ppp拨号ADSL突然不能用的问题？

garfy

这些天一直使用正常的ppp拨号adsl共享上网，今天一早不能拨了，可气的是在winxp下正常：
日志如下：
pppoe# ppp -nat -ddial adsl ;tail -f /var/log/ppp.log
Working in ddial mode
Using interface: tun0
Jun 10 11:50:27 pppoe ppp[288]: Phase: Using interface: tun0
Jun 10 11:50:27 pppoe ppp[288]: Phase: deflink: Created in closed state
Jun 10 11:50:27 pppoe ppp[288]: tun0: Command: default: nat enable yes
Jun 10 11:50:27 pppoe ppp[288]: tun0: Command: default: nat same_ports yes
Jun 10 11:50:27 pppoe ppp[288]: tun0: Command: default: nat use_sockets yes
Jun 10 11:50:27 pppoe ppp[288]: tun0: Command: default: set redial 15 128800
Jun 10 11:50:27 pppoe ppp[288]: tun0: Command: default: set reconnect 15 128800
Jun 10 11:50:27 pppoe ppp[288]: tun0: Command: adsl: set device PPPoE:rl1:
Jun 10 11:50:27 pppoe ppp[288]: tun0: Command: adsl: set mru 1492
Jun 10 11:50:27 pppoe ppp[288]: tun0: Command: adsl: set mtu 1492
Jun 10 11:50:27 pppoe ppp[288]: tun0: Command: adsl: set speed sync
Jun 10 11:50:27 pppoe ppp[288]: tun0: Command: adsl: enable lqr
Jun 10 11:50:27 pppoe ppp[288]: tun0: Command: adsl: nat enable yes
Jun 10 11:50:27 pppoe ppp[288]: tun0: Command: adsl: set lqrperiod 600
Jun 10 11:50:27 pppoe ppp[288]: tun0: Command: adsl: set cd 5
Jun 10 11:50:27 pppoe ppp[288]: tun0: Command: adsl: set dial
Jun 10 11:50:27 pppoe ppp[288]: tun0: Command: adsl: set login
Jun 10 11:50:27 pppoe ppp[288]: tun0: Command: adsl: set timeout 15
Jun 10 11:50:27 pppoe ppp[288]: tun0: Command: adsl: set authname 100123365368
Jun 10 11:50:27 pppoe ppp[288]: tun0: Command: adsl: set authkey ********
Jun 10 11:50:27 pppoe ppp[288]: tun0: Command: adsl: add default HISADDR
Jun 10 11:50:27 pppoe ppp[288]: tun0: Command: adsl: enable dns
Jun 10 11:50:27 pppoe ppp[289]: tun0: Phase: PPP Started (ddial mode).
Jun 10 11:50:27 pppoe ppp[289]: tun0: Phase: bundle: Establish
Jun 10 11:50:27 pppoe ppp[289]: tun0: Phase: deflink: closed ->; opening
Jun 10 11:50:27 pppoe ppp[289]: tun0: Phase: deflink: Connected!
Jun 10 11:50:27 pppoe ppp[289]: tun0: Phase: deflink: opening ->; dial
Jun 10 11:50:27 pppoe ppp[289]: tun0: Phase: deflink: dial ->; carrier
Jun 10 11:50:28 pppoe ppp[289]: tun0: Phase: Received NGM_PPPOE_ACNAME (hook "6610BPTZ01"
Jun 10 11:50:28 pppoe ppp[289]: tun0: Phase: Received NGM_PPPOE_SESSIONID
Jun 10 11:50:28 pppoe ppp[289]: tun0: Phase: Received NGM_PPPOE_SUCCESS
Jun 10 11:50:28 pppoe ppp[289]: tun0: Phase: deflink: carrier ->; login
Jun 10 11:50:28 pppoe ppp[289]: tun0: Phase: deflink: login ->; lcp
Jun 10 11:50:28 pppoe ppp[289]: tun0: LCP: FSM: Using "deflink" as a transport
Jun 10 11:50:28 pppoe ppp[289]: tun0: LCP: deflink: State change Initial -->; Closed
Jun 10 11:50:28 pppoe ppp[289]: tun0: LCP: deflink: State change Closed -->; Stopped
Jun 10 11:50:28 pppoe ppp[289]: tun0: LCP: deflink: RecvConfigReq(1) state = Stopped
Jun 10 11:50:28 pppoe ppp[289]: tun0: LCP:  MAGICNUM[6] 0x26a84f0d
Jun 10 11:50:28 pppoe ppp[289]: tun0: LCP:  AUTHPROTO[4] 0xc023 (PAP)
Jun 10 11:50:28 pppoe ppp[289]: tun0: LCP: deflink: SendConfigReq(1) state = Stopped
Jun 10 11:50:28 pppoe ppp[289]: tun0: LCP:  MRU[4] 1492
Jun 10 11:50:28 pppoe ppp[289]: tun0: LCP:  MAGICNUM[6] 0x0c2b149f
Jun 10 11:50:28 pppoe ppp[289]: tun0: LCP:  QUALPROTO[8] proto c025, interval 600000ms
Jun 10 11:50:28 pppoe ppp[289]: tun0: LCP: deflink: SendConfigNak(1) state = Stopped
Jun 10 11:50:28 pppoe ppp[289]: tun0: LCP:  MRU[4] 1492
Jun 10 11:50:28 pppoe ppp[289]: tun0: LCP: deflink: LayerStart
Jun 10 11:50:28 pppoe ppp[289]: tun0: LCP: deflink: State change Stopped -->; Req-Sent
Jun 10 11:50:31 pppoe ppp[289]: tun0: LCP: deflink: SendConfigReq(1) state = Req-Sent
Jun 10 11:50:31 pppoe ppp[289]: tun0: LCP:  MRU[4] 1492
Jun 10 11:50:31 pppoe ppp[289]: tun0: LCP:  MAGICNUM[6] 0x0c2b149f
Jun 10 11:50:31 pppoe ppp[289]: tun0: LCP:  QUALPROTO[8] proto c025, interval 600000ms
Jun 10 11:50:34 pppoe ppp[289]: tun0: LCP: deflink: SendConfigReq(1) state = Req-Sent
Jun 10 11:50:34 pppoe ppp[289]: tun0: LCP:  MRU[4] 1492
Jun 10 11:50:34 pppoe ppp[289]: tun0: LCP:  MAGICNUM[6] 0x0c2b149f
Jun 10 11:50:34 pppoe ppp[289]: tun0: LCP:  QUALPROTO[8] proto c025, interval 600000ms
Jun 10 11:50:37 pppoe ppp[289]: tun0: LCP: deflink: SendConfigReq(1) state = Req-Sent
Jun 10 11:50:37 pppoe ppp[289]: tun0: LCP:  MRU[4] 1492
Jun 10 11:50:37 pppoe ppp[289]: tun0: LCP:  MAGICNUM[6] 0x0c2b149f
Jun 10 11:50:37 pppoe ppp[289]: tun0: LCP:  QUALPROTO[8] proto c025, interval 600000ms
Jun 10 11:50:40 pppoe ppp[289]: tun0: LCP: deflink: SendConfigReq(1) state = Req-Sent
Jun 10 11:50:40 pppoe ppp[289]: tun0: LCP:  MRU[4] 1492
Jun 10 11:50:40 pppoe ppp[289]: tun0: LCP:  MAGICNUM[6] 0x0c2b149f
Jun 10 11:50:40 pppoe ppp[289]: tun0: LCP:  QUALPROTO[8] proto c025, interval 600000ms
Jun 10 11:50:43 pppoe ppp[289]: tun0: LCP: deflink: LayerFinish
Jun 10 11:50:43 pppoe ppp[289]: tun0: LCP: deflink: State change Req-Sent -->; Stopped
Jun 10 11:50:43 pppoe ppp[289]: tun0: LCP: deflink: State change Stopped -->; Closed
Jun 10 11:50:43 pppoe ppp[289]: tun0: LCP: deflink: State change Closed -->; Initial
Jun 10 11:50:43 pppoe ppp[289]: tun0: Phase: deflink: Disconnected!
Jun 10 11:50:43 pppoe ppp[289]: tun0: Phase: deflink: lcp ->; logout
Jun 10 11:50:43 pppoe ppp[289]: tun0: Phase: deflink: logout ->; hangup
Jun 10 11:50:43 pppoe ppp[289]: tun0: Phase: deflink: Disconnected!
Jun 10 11:50:43 pppoe ppp[289]: tun0: Phase: deflink: Connect time: 16 secs: 16 octets in, 130 octets out
Jun 10 11:50:43 pppoe ppp[289]: tun0: Phase: deflink: 1 packets in, 6 packets out
Jun 10 11:50:43 pppoe ppp[289]: tun0: Phase:  total 9 bytes/sec, peak 16 bytes/sec on Tue Jun 10 11:50:29 2003
Jun 10 11:50:43 pppoe ppp[289]: tun0: Phase: deflink: hangup ->; opening
Jun 10 11:50:43 pppoe ppp[289]: tun0: Phase: deflink: Enter pause (15) for redialing.
Jun 10 11:50:43 pppoe ppp[289]: tun0: Chat: deflink: Reconnect try 1 of 128800

其中这几行好像以前没有见过：
Jun 10 11:50:28 pppoe ppp[289]: tun0: LCP:  MAGICNUM[6] 0x26a84f0d
Jun 10 11:50:28 pppoe ppp[289]: tun0: LCP:  AUTHPROTO[4] 0xc023 (PAP)
Jun 10 11:50:28 pppoe ppp[289]: tun0: LCP: deflink: SendConfigReq(1) state = Stopped
Jun 10 11:50:28 pppoe ppp[289]: tun0: LCP:  MRU[4] 1492
Jun 10 11:50:28 pppoe ppp[289]: tun0: LCP:  MAGICNUM[6] 0x0c2b149f
Jun 10 11:50:28 pppoe ppp[289]: tun0: LCP:  QUALPROTO[8] proto c025, interval 600000ms

garfy

内核中相关设置如下：
# ADSL PPPOE Setup
options                NETGRAPH
options                NETGRAPH_PPPOE
options                NETGRAPH_SOCKET
options                NETGRAPH_ETHER
options                NETGRAPH_IFACE

# Firewall Setup
options IPFIREWALL
options IPFIREWALL_VERBOSE
options IPFIREWALL_VERBOSE_LIMIT=100
options IPDIVERT
options IPFIREWALL_DEFAULT_TO_ACCEPT
options IPSTEALTH
options ACCEPT_FILTER_DATA
options ACCEPT_FILTER_HTTP
options ICMP_BANDLIM

/etc/rc.conf:
defaultrouter="10.13.1.254"
gateway_enable="YES"
hostname="pppoe.test.com.cn"
network_interfaces="rl0 rl1 lo0 tun0 ppp0"
ifconfig_rl0="inet 10.13.0.5  netmask 255.255.0.0"
kern_securelevel_enable="NO"
ifconfig_rl1="inet up"
firewall_enable="YES"
firewall_script="/etc/rc.firewall"
#firewall_type="open"
firewall_type="/etc/ipfw.conf"
nfs_reserved_port_only="YES"
natd_enable="YES"
natd_interface="tun0"
natd_flags="-m -s -f /etc/natd.conf"
sendmail_enable="NO"
sshd_enable="YES"
usbd_enable="YES"

/etc/ppp/ppp.conf
default:
  set log Phase Chat LCP IPCP CCP tun command
  nat enable yes
  nat same_ports yes
  nat use_sockets yes
  set redial 15 128800
  set reconnect 15 128800

adsl:
  set device PPPoE:rl1:
  set mru 1492
  set mtu 1492
  set speed sync
  enable lqr
  nat enable yes
  set lqrperiod 600
  set cd 5
  set dial
  set login
  set timeout 15
  set authname 101022365368
  set authkey 00000000
# set ifaddr 10.0.0.1/0 10.0.0.2/0 255.255.255.255 0.0.0.0
  add default HISADDR
  enable dns

garfy

反复出现这样的错误，不知何故？

Jun 10 14:04:41 pppoe ppp[200]: tun0: LCP:  MAGICNUM[6] 0x26a84f0d
Jun 10 14:04:41 pppoe ppp[200]: tun0: LCP: deflink: RecvConfigReq(7) state = Ack-Rcvd
Jun 10 14:04:41 pppoe ppp[200]: tun0: LCP:  MAGICNUM[6] 0x26a84f0d
Jun 10 14:04:41 pppoe ppp[200]: tun0: LCP:  AUTHPROTO[4] 0xc023 (PAP)
Jun 10 14:04:41 pppoe ppp[200]: tun0: LCP: deflink: SendConfigRej(7) state = Ack-Rcvd
Jun 10 14:04:41 pppoe ppp[200]: tun0: LCP:  MAGICNUM[6] 0x26a84f0d
Jun 10 14:04:41 pppoe ppp[200]: tun0: LCP: deflink: RecvConfigReq( state = Ack-Rcvd
Jun 10 14:04:41 pppoe ppp[200]: tun0: LCP:  MAGICNUM[6] 0x26a84f0d
Jun 10 14:04:41 pppoe ppp[200]: tun0: LCP:  AUTHPROTO[4] 0xc023 (PAP)
Jun 10 14:04:41 pppoe ppp[200]: tun0: LCP: deflink: SendConfigRej( state = Ack-Rcvd
Jun 10 14:04:41 pppoe ppp[200]: tun0: LCP:  MAGICNUM[6] 0x26a84f0d
Jun 10 14:04:41 pppoe ppp[200]: tun0: LCP: deflink: RecvConfigReq(9) state = Ack-Rcvd
Jun 10 14:04:41 pppoe ppp[200]: tun0: LCP:  MAGICNUM[6] 0x26a84f0d