PPPoE reconenction fix - mpd fix ($100)
-
here r some of the results, below logs r from ppp
unplug cable and reconnect after 30seconds, wan ip changes on reconnect and auto reconeccts fine
Sep 22 13:02:52 ppp: [wan_link0] Link: DOWN event Sep 22 13:02:52 ppp: [wan_link0] LCP: Down event Sep 22 13:02:52 ppp: [wan_link0] Link: reconnection attempt 12 in 4 seconds Sep 22 13:02:56 ppp: [wan_link0] Link: reconnection attempt 12 Sep 22 13:02:56 ppp: [wan_link0] PPPoE: Connecting to '' Sep 22 13:02:56 ppp: PPPoE: rec'd ACNAME "WE1" Sep 22 13:03:03 ppp: Multi-link PPP daemon for FreeBSD Sep 22 13:03:03 ppp: Sep 22 13:03:03 ppp: process 39410 started, version 5.5 (root@FreeBSD_8.0_pfSense_2.0-snaps.pfsense.org 13:56 11-Aug-2011) Sep 22 13:03:03 ppp: caught fatal signal term Sep 22 13:03:03 ppp: [wan] IFACE: Close event Sep 22 13:03:03 ppp: [wan] IPCP: Close event Sep 22 13:03:03 ppp: waiting for process 8830 to die... Sep 22 13:03:05 ppp: [wan_link0] PPPoE connection timeout after 9 seconds Sep 22 13:03:05 ppp: [wan_link0] Link: DOWN event Sep 22 13:03:05 ppp: [wan_link0] Link: giving up after 12 reconnection attempts Sep 22 13:03:05 ppp: [wan_link0] LCP: Close event Sep 22 13:03:05 ppp: [wan_link0] LCP: state change Starting --> Initial Sep 22 13:03:05 ppp: [wan_link0] LCP: LayerFinish Sep 22 13:03:05 ppp: [wan_link0] LCP: Down event Sep 22 13:03:05 ppp: [wan] Bundle: Shutdown Sep 22 13:03:05 ppp: [wan_link0] Link: Shutdown Sep 22 13:03:05 ppp: process 8830 terminated Sep 22 13:03:05 ppp: waiting for process 8830 to die... Sep 22 13:03:05 ppp: web: web is not running Sep 22 13:03:05 ppp: [wan] Bundle: Interface ng0 created Sep 22 13:03:05 ppp: [wan_link0] Link: OPEN event Sep 22 13:03:05 ppp: [wan_link0] LCP: Open event Sep 22 13:03:05 ppp: [wan_link0] LCP: state change Initial --> Starting Sep 22 13:03:05 ppp: [wan_link0] LCP: LayerStart Sep 22 13:03:05 ppp: [wan_link0] PPPoE: Connecting to '' Sep 22 13:03:06 ppp: PPPoE: rec'd ACNAME "WE1" Sep 22 13:03:15 ppp: [wan_link0] PPPoE connection timeout after 9 seconds Sep 22 13:03:15 ppp: [wan_link0] Link: DOWN event Sep 22 13:03:15 ppp: [wan_link0] LCP: Down event Sep 22 13:03:15 ppp: [wan_link0] Link: reconnection attempt 1 in 1 seconds Sep 22 13:03:16 ppp: [wan_link0] Link: reconnection attempt 1 Sep 22 13:03:16 ppp: [wan_link0] PPPoE: Connecting to '' Sep 22 13:03:16 ppp: PPPoE: rec'd ACNAME "WE1" Sep 22 13:03:25 ppp: [wan_link0] PPPoE connection timeout after 9 seconds Sep 22 13:03:25 ppp: [wan_link0] Link: DOWN event Sep 22 13:03:25 ppp: [wan_link0] LCP: Down event Sep 22 13:03:25 ppp: [wan_link0] Link: reconnection attempt 2 in 3 seconds Sep 22 13:03:28 ppp: [wan_link0] Link: reconnection attempt 2 Sep 22 13:03:28 ppp: [wan_link0] PPPoE: Connecting to '' Sep 22 13:03:28 ppp: PPPoE: rec'd ACNAME "WE1" Sep 22 13:03:37 ppp: [wan_link0] PPPoE connection timeout after 9 seconds Sep 22 13:03:37 ppp: [wan_link0] Link: DOWN event Sep 22 13:03:37 ppp: [wan_link0] LCP: Down event Sep 22 13:03:37 ppp: [wan_link0] Link: reconnection attempt 3 in 3 seconds .... Sep 22 13:06:52 ppp: [wan_link0] PPPoE: Connecting to '' Sep 22 13:07:01 ppp: [wan_link0] PPPoE connection timeout after 9 seconds Sep 22 13:07:01 ppp: [wan_link0] Link: DOWN event Sep 22 13:07:01 ppp: [wan_link0] LCP: Down event Sep 22 13:07:01 ppp: [wan_link0] Link: reconnection attempt 4 in 2 seconds Sep 22 13:07:03 ppp: [wan_link0] Link: reconnection attempt 4 Sep 22 13:07:03 ppp: [wan_link0] PPPoE: Connecting to '' Sep 22 13:07:12 ppp: [wan_link0] PPPoE connection timeout after 9 seconds Sep 22 13:07:12 ppp: [wan_link0] Link: DOWN event Sep 22 13:07:12 ppp: [wan_link0] LCP: Down event Sep 22 13:07:12 ppp: [wan_link0] Link: reconnection attempt 5 in 1 seconds Sep 22 13:07:13 ppp: [wan_link0] Link: reconnection attempt 5 Sep 22 13:07:13 ppp: [wan_link0] PPPoE: Connecting to '' Sep 22 13:07:22 ppp: [wan_link0] PPPoE connection timeout after 9 seconds Sep 22 13:07:22 ppp: [wan_link0] Link: DOWN event Sep 22 13:07:22 ppp: [wan_link0] LCP: Down event Sep 22 13:07:22 ppp: [wan_link0] Link: reconnection attempt 6 in 1 seconds Sep 22 13:07:23 ppp: [wan_link0] Link: reconnection attempt 6 Sep 22 13:07:23 ppp: [wan_link0] PPPoE: Connecting to '' Sep 22 13:07:32 ppp: [wan_link0] PPPoE connection timeout after 9 seconds Sep 22 13:07:32 ppp: [wan_link0] Link: DOWN event Sep 22 13:07:32 ppp: [wan_link0] LCP: Down event Sep 22 13:07:32 ppp: [wan_link0] Link: reconnection attempt 7 in 1 seconds Sep 22 13:07:33 ppp: [wan_link0] Link: reconnection attempt 7 Sep 22 13:07:33 ppp: [wan_link0] PPPoE: Connecting to '' Sep 22 13:07:42 ppp: [wan_link0] PPPoE connection timeout after 9 seconds Sep 22 13:07:42 ppp: [wan_link0] Link: DOWN event Sep 22 13:07:42 ppp: [wan_link0] LCP: Down event Sep 22 13:07:42 ppp: [wan_link0] Link: reconnection attempt 8 in 4 seconds Sep 22 13:07:46 ppp: [wan_link0] Link: reconnection attempt 8 Sep 22 13:07:46 ppp: [wan_link0] PPPoE: Connecting to '' Sep 22 13:07:46 ppp: PPPoE: rec'd ACNAME "WE1" Sep 22 13:07:55 ppp: [wan_link0] PPPoE connection timeout after 9 seconds Sep 22 13:07:55 ppp: [wan_link0] Link: DOWN event Sep 22 13:07:55 ppp: [wan_link0] LCP: Down event Sep 22 13:07:55 ppp: [wan_link0] Link: reconnection attempt 9 in 1 seconds Sep 22 13:07:56 ppp: [wan_link0] Link: reconnection attempt 9 Sep 22 13:07:56 ppp: [wan_link0] PPPoE: Connecting to '' Sep 22 13:07:56 ppp: PPPoE: rec'd ACNAME "WE1" Sep 22 13:08:05 ppp: [wan_link0] PPPoE connection timeout after 9 seconds Sep 22 13:08:05 ppp: [wan_link0] Link: DOWN event Sep 22 13:08:05 ppp: [wan_link0] LCP: Down event Sep 22 13:08:05 ppp: [wan_link0] Link: reconnection attempt 10 in 2 seconds Sep 22 13:08:07 ppp: [wan_link0] Link: reconnection attempt 10 Sep 22 13:08:07 ppp: [wan_link0] PPPoE: Connecting to '' Sep 22 13:08:07 ppp: PPPoE: rec'd ACNAME "WE1" Sep 22 13:08:53 ppp: [wan_link0] PPPoE: connection successful Sep 22 13:08:53 ppp: [wan_link0] Link: UP event Sep 22 13:08:53 ppp: [wan_link0] LCP: Up event Sep 22 13:08:53 ppp: [wan_link0] LCP: state change Starting --> Req-Sent Sep 22 13:08:53 ppp: [wan_link0] LCP: SendConfigReq #4 Sep 22 13:08:53 ppp: [wan_link0] PROTOCOMP Sep 22 13:08:53 ppp: [wan_link0] MRU 1492 Sep 22 13:08:53 ppp: [wan_link0] MAGICNUM 9ecd1a58 Sep 22 13:08:53 ppp: [wan_link0] LCP: rec'd Configure Request #88 (Req-Sent) Sep 22 13:08:53 ppp: [wan_link0] MRU 1492 Sep 22 13:08:53 ppp: [wan_link0] AUTHPROTO PAP Sep 22 13:08:53 ppp: [wan_link0] MAGICNUM 6fd061fb Sep 22 13:08:53 ppp: [wan_link0] LCP: SendConfigAck #88 Sep 22 13:08:53 ppp: [wan_link0] MRU 1492 Sep 22 13:08:53 ppp: [wan_link0] AUTHPROTO PAP Sep 22 13:08:53 ppp: [wan_link0] MAGICNUM 6fd061fb Sep 22 13:08:53 ppp: [wan_link0] LCP: state change Req-Sent --> Ack-Sent Sep 22 13:08:53 ppp: [wan_link0] LCP: rec'd Configure Ack #4 (Ack-Sent) Sep 22 13:08:53 ppp: [wan_link0] PROTOCOMP Sep 22 13:08:53 ppp: [wan_link0] MRU 1492 Sep 22 13:08:53 ppp: [wan_link0] MAGICNUM 9ecd1a58 Sep 22 13:08:53 ppp: [wan_link0] LCP: state change Ack-Sent --> Opened Sep 22 13:08:53 ppp: [wan_link0] LCP: auth: peer wants PAP, I want nothing Sep 22 13:08:53 ppp: [wan_link0] PAP: using authname "xbipin" Sep 22 13:08:53 ppp: [wan_link0] PAP: sending REQUEST #1 len: 20 Sep 22 13:08:53 ppp: [wan_link0] LCP: LayerUp Sep 22 13:08:55 ppp: [wan_link0] PAP: using authname "xbipin" Sep 22 13:08:55 ppp: [wan_link0] PAP: sending REQUEST #2 len: 20 Sep 22 13:08:59 ppp: [wan_link0] PAP: using authname "xbipin" Sep 22 13:08:59 ppp: [wan_link0] PAP: sending REQUEST #4 len: 20 Sep 22 13:09:01 ppp: [wan_link0] PAP: rec'd ACK #4 len: 5 Sep 22 13:09:01 ppp: [wan_link0] LCP: authorization successful Sep 22 13:09:01 ppp: [wan_link0] Link: Matched action 'bundle "wan" ""' Sep 22 13:09:01 ppp: [wan_link0] Link: Join bundle "wan" Sep 22 13:09:01 ppp: [wan] Bundle: Status update: up 1 link, total bandwidth 64000 bps Sep 22 13:09:01 ppp: [wan] IPCP: Open event Sep 22 13:09:01 ppp: [wan] IPCP: state change Initial --> Starting Sep 22 13:09:01 ppp: [wan] IPCP: LayerStart Sep 22 13:09:01 ppp: [wan] IPCP: Up event Sep 22 13:09:01 ppp: [wan] IPCP: state change Starting --> Req-Sent Sep 22 13:09:01 ppp: [wan] IPCP: SendConfigReq #4 Sep 22 13:09:01 ppp: [wan] IPADDR 0.0.0.0 Sep 22 13:09:01 ppp: [wan] IPCP: rec'd Configure Nak #4 (Req-Sent) Sep 22 13:09:01 ppp: [wan] IPADDR 92.99.131.139 Sep 22 13:09:01 ppp: [wan] 92.99.131.139 is OK Sep 22 13:09:01 ppp: [wan] IPCP: SendConfigReq #5 Sep 22 13:09:01 ppp: [wan] IPADDR 92.99.131.139 Sep 22 13:09:01 ppp: [wan] IPCP: rec'd Configure Ack #5 (Req-Sent) Sep 22 13:09:01 ppp: [wan] IPADDR 92.99.131.139 Sep 22 13:09:01 ppp: [wan] IPCP: state change Req-Sent --> Ack-Rcvd Sep 22 13:09:01 ppp: [wan] IPCP: rec'd Configure Request #210 (Ack-Rcvd) Sep 22 13:09:01 ppp: [wan] IPADDR 195.229.252.27 Sep 22 13:09:01 ppp: [wan] 195.229.252.27 is OK Sep 22 13:09:01 ppp: [wan] IPCP: SendConfigAck #210 Sep 22 13:09:01 ppp: [wan] IPADDR 195.229.252.27 Sep 22 13:09:01 ppp: [wan] IPCP: state change Ack-Rcvd --> Opened Sep 22 13:09:01 ppp: [wan] IPCP: LayerUp Sep 22 13:09:01 ppp: [wan] 92.99.131.139 -> 195.229.252.27 Sep 22 13:09:01 ppp: [wan] IFACE: Up event
unplug cable and reconnect in less than 30seconds, wan ip remains same at first then later changes and reconnects fine
Sep 22 13:20:35 ppp: [wan_link0] LCP: no reply to 1 echo request(s) Sep 22 13:21:45 ppp: [wan_link0] LCP: no reply to 1 echo request(s) Sep 22 13:21:45 ppp: [wan_link0] LCP: no reply to 2 echo request(s) Sep 22 13:21:55 ppp: [wan_link0] LCP: no reply to 3 echo request(s) ... Sep 22 13:48:20 ppp: [wan_link0] PROTOCOMP Sep 22 13:48:20 ppp: [wan_link0] MRU 1492 Sep 22 13:48:20 ppp: [wan_link0] MAGICNUM a59b33b8 Sep 22 13:48:21 ppp: [wan_link0] LCP: rec'd Configure Request #67 (Req-Sent) Sep 22 13:48:21 ppp: [wan_link0] MRU 1492 Sep 22 13:48:21 ppp: [wan_link0] AUTHPROTO PAP Sep 22 13:48:21 ppp: [wan_link0] MAGICNUM 35150c1e Sep 22 13:48:21 ppp: [wan_link0] LCP: SendConfigAck #67 Sep 22 13:48:21 ppp: [wan_link0] MRU 1492 Sep 22 13:48:21 ppp: [wan_link0] AUTHPROTO PAP Sep 22 13:48:21 ppp: [wan_link0] MAGICNUM 35150c1e Sep 22 13:48:21 ppp: [wan_link0] LCP: state change Req-Sent --> Ack-Sent Sep 22 13:48:21 ppp: [wan_link0] LCP: rec'd Configure Ack #7 (Ack-Sent) Sep 22 13:48:21 ppp: [wan_link0] PROTOCOMP Sep 22 13:48:21 ppp: [wan_link0] MRU 1492 Sep 22 13:48:21 ppp: [wan_link0] MAGICNUM a59b33b8 Sep 22 13:48:21 ppp: [wan_link0] LCP: state change Ack-Sent --> Opened Sep 22 13:48:21 ppp: [wan_link0] LCP: auth: peer wants PAP, I want nothing Sep 22 13:48:21 ppp: [wan_link0] PAP: using authname "xbipin" Sep 22 13:48:21 ppp: [wan_link0] PAP: sending REQUEST #1 len: 20 Sep 22 13:48:21 ppp: [wan_link0] LCP: LayerUp Sep 22 13:48:21 ppp: [wan_link0] PAP: rec'd ACK #1 len: 5 Sep 22 13:48:21 ppp: [wan_link0] LCP: authorization successful Sep 22 13:48:21 ppp: [wan_link0] Link: Matched action 'bundle "wan" ""' Sep 22 13:48:21 ppp: [wan_link0] Link: Join bundle "wan" Sep 22 13:48:21 ppp: [wan] Bundle: Status update: up 1 link, total bandwidth 64000 bps Sep 22 13:48:21 ppp: [wan] IPCP: Open event Sep 22 13:48:21 ppp: [wan] IPCP: state change Initial --> Starting Sep 22 13:48:21 ppp: [wan] IPCP: LayerStart Sep 22 13:48:21 ppp: [wan] IPCP: Up event Sep 22 13:48:21 ppp: [wan] IPCP: state change Starting --> Req-Sent Sep 22 13:48:21 ppp: [wan] IPCP: SendConfigReq #7 Sep 22 13:48:21 ppp: [wan] IPADDR 0.0.0.0 Sep 22 13:48:21 ppp: [wan] IPCP: rec'd Configure Nak #7 (Req-Sent) Sep 22 13:48:21 ppp: [wan] IPADDR 92.99.205.85 Sep 22 13:48:21 ppp: [wan] 92.99.205.85 is OK Sep 22 13:48:21 ppp: [wan] IPCP: SendConfigReq #8 Sep 22 13:48:21 ppp: [wan] IPADDR 92.99.205.85 Sep 22 13:48:21 ppp: [wan] IPCP: rec'd Configure Ack #8 (Req-Sent) Sep 22 13:48:21 ppp: [wan] IPADDR 92.99.205.85 Sep 22 13:48:21 ppp: [wan] IPCP: state change Req-Sent --> Ack-Rcvd Sep 22 13:48:21 ppp: [wan] IPCP: rec'd Configure Request #245 (Ack-Rcvd) Sep 22 13:48:21 ppp: [wan] IPADDR 195.229.252.27 Sep 22 13:48:21 ppp: [wan] 195.229.252.27 is OK Sep 22 13:48:21 ppp: [wan] IPCP: SendConfigAck #245 Sep 22 13:48:21 ppp: [wan] IPADDR 195.229.252.27 Sep 22 13:48:21 ppp: [wan] IPCP: state change Ack-Rcvd --> Opened Sep 22 13:48:21 ppp: [wan] IPCP: LayerUp Sep 22 13:48:21 ppp: [wan] 92.99.205.85 -> 195.229.252.27 Sep 22 13:48:21 ppp: [wan] IFACE: Up event
fibre optic modem from isp reset or power plug pulled and then after some time repowered but pf doesnt reconnect, log below
Sep 22 13:52:31 ppp: [wan_link0] LCP: no reply to 1 echo request(s) Sep 22 13:52:41 ppp: [wan_link0] LCP: no reply to 2 echo request(s) Sep 22 13:52:51 ppp: [wan_link0] LCP: no reply to 3 echo request(s) Sep 22 13:53:01 ppp: [wan_link0] LCP: no reply to 4 echo request(s) Sep 22 13:53:11 ppp: [wan_link0] LCP: no reply to 5 echo request(s) Sep 22 13:53:11 ppp: [wan_link0] LCP: peer not responding to echo requests Sep 22 13:53:11 ppp: [wan_link0] LCP: state change Opened --> Stopping Sep 22 13:53:11 ppp: [wan_link0] Link: Leave bundle "wan" Sep 22 13:53:11 ppp: [wan] Bundle: Status update: up 0 links, total bandwidth 9600 bps Sep 22 13:53:11 ppp: [wan] IPCP: Close event Sep 22 13:53:11 ppp: [wan] IPCP: state change Opened --> Closing Sep 22 13:53:11 ppp: [wan] IPCP: SendTerminateReq #9 Sep 22 13:53:11 ppp: [wan] IPCP: LayerDown Sep 22 13:53:11 ppp: [wan] IFACE: Down event Sep 22 13:53:11 ppp: [wan] IPCP: Down event Sep 22 13:53:11 ppp: [wan] IPCP: LayerFinish Sep 22 13:53:11 ppp: [wan] Bundle: No NCPs left. Closing links... Sep 22 13:53:11 ppp: [wan] IPCP: state change Closing --> Initial Sep 22 13:53:11 ppp: [wan_link0] LCP: SendTerminateReq #8 Sep 22 13:53:11 ppp: [wan_link0] LCP: LayerDown Sep 22 13:53:13 ppp: [wan_link0] LCP: SendTerminateReq #9 Sep 22 13:53:15 ppp: [wan_link0] LCP: state change Stopping --> Stopped Sep 22 13:53:15 ppp: [wan_link0] LCP: LayerFinish Sep 22 13:53:15 ppp: [wan_link0] PPPoE: connection closed Sep 22 13:53:15 ppp: [wan_link0] Link: DOWN event Sep 22 13:53:15 ppp: [wan_link0] LCP: Down event Sep 22 13:53:15 ppp: [wan_link0] LCP: state change Stopped --> Starting Sep 22 13:53:15 ppp: [wan_link0] LCP: LayerStart Sep 22 13:53:15 ppp: [wan_link0] Link: reconnection attempt 1 in 1 seconds Sep 22 13:53:16 ppp: [wan_link0] Link: reconnection attempt 1 Sep 22 13:53:16 ppp: [wan_link0] PPPoE: Connecting to '' Sep 22 13:53:25 ppp: [wan_link0] PPPoE connection timeout after 9 seconds Sep 22 13:53:25 ppp: [wan_link0] Link: DOWN event Sep 22 13:53:25 ppp: [wan_link0] LCP: Down event Sep 22 13:53:25 ppp: [wan_link0] Link: reconnection attempt 2 in 2 seconds Sep 22 13:53:27 ppp: [wan_link0] Link: reconnection attempt 2 Sep 22 13:53:27 ppp: [wan_link0] PPPoE: Connecting to '' Sep 22 13:53:36 ppp: [wan_link0] PPPoE connection timeout after 9 seconds Sep 22 13:53:36 ppp: [wan_link0] Link: DOWN event Sep 22 13:53:36 ppp: [wan_link0] LCP: Down event Sep 22 13:53:36 ppp: [wan_link0] Link: reconnection attempt 3 in 3 seconds Sep 22 13:53:39 ppp: [wan_link0] Link: reconnection attempt 3 Sep 22 13:53:39 ppp: [wan_link0] PPPoE: Connecting to '' Sep 22 13:53:48 ppp: [wan_link0] PPPoE connection timeout after 9 seconds Sep 22 13:53:48 ppp: [wan_link0] Link: DOWN event Sep 22 13:53:48 ppp: [wan_link0] LCP: Down event Sep 22 13:53:48 ppp: [wan_link0] Link: reconnection attempt 4 in 2 seconds Sep 22 13:53:50 ppp: [wan_link0] Link: reconnection attempt 4 Sep 22 13:53:50 ppp: [wan_link0] PPPoE: Connecting to '' Sep 22 13:53:59 ppp: [wan_link0] PPPoE connection timeout after 9 seconds Sep 22 13:53:59 ppp: [wan_link0] Link: DOWN event Sep 22 13:53:59 ppp: [wan_link0] LCP: Down event Sep 22 13:53:59 ppp: [wan_link0] Link: reconnection attempt 5 in 1 seconds Sep 22 13:54:00 ppp: [wan_link0] Link: reconnection attempt 5 Sep 22 13:54:00 ppp: [wan_link0] PPPoE: Connecting to '' Sep 22 13:54:09 ppp: [wan_link0] PPPoE connection timeout after 9 seconds Sep 22 13:54:09 ppp: [wan_link0] Link: DOWN event Sep 22 13:54:09 ppp: [wan_link0] LCP: Down event Sep 22 13:54:09 ppp: [wan_link0] Link: reconnection attempt 6 in 3 seconds Sep 22 13:54:12 ppp: [wan_link0] Link: reconnection attempt 6 Sep 22 13:54:12 ppp: [wan_link0] PPPoE: Connecting to ''
-
in summary, resetting isp modem doesnt make pppoe reconnect, problem still persists
-
any luck?
-
The logs displayed a couple of replies back suggest the remote PPP is not responding. Since this seems to be fairly easily reproduced I suggests you make it happen while you have a packet trace running so you can see if there is response from the ISP. Is there any response from the ISP's end? If not, call their technical support to report the problem.
-
do i run the below command with itnerface as pppoe0 or vr1 ?
tcpdump -i $interface -s 0 -vvvX -w /tmp/pcap.capture
-
command run with interface as pppoe0 and replicated a isp modem reset and complete endless loop for a while for pf reconnection attempt
file name - pcap.capture1command run with interface as vr1 and replicated a isp modem reset and complete endless loop for a while for pf reconnection attempt
file name - pcap.capture2the cable from the isp modem to pf if i put in my PC then the LAN status always shows limited connectivity and no IP from DHCP untill a pppoe connection is dialed out
all standard routers such as dlink, aztec etc sold in this region work fine when u replicate the same situation so i wonder how do they reconnect fine even if u reset or unplug and replug the isp modem
-
the strange thing is, suppose i remove the wan cable going from my isp modem to pfsense and reboot pfsense then once its done it doesnt have any internet connection and no wan ip but as soon as i plug the cable from my isp modem to pfsense, in just one attempt it connects and remains connected.
so i guess the issue is mpd would need the vr1 used for wan to do down and then replugging it would get it up and then mpd would dial out perfectly fine but if the isp modem was just reset then the port has the power on so i guess it doesn't go down completely and then reconnection attempt keeps failing. i mayb wrong on the above but at least on a pfsense reboot everything works fine and even on a cable unplug and replug also works fine but on a modem reset only it doesn't work or mayb if the isp modem hanged or dropped the connection then also it would connect but i havent been able to do that.
-
can anything be done to solve this?
-
Sorry, I haven't had a lot of time to look into this.
I have looked at your packet captures. Unfortunately they don't show the PPP control packets. Can you provide another set with the capture interface being the physical device used for the PPP link rather than the PPP link? For example, if pppoe0 uses physical interface vr1 I would like the capture on interface vr1 rather than pppoe0.
capture1 initially shows pings and replies then just pings (no replies). No ppp control packets.
capture2 just looks like "normal" traffic: no PPP control packets shown and no obvious sign of a "down" link. (I expected to see repeated PPP initalisation attempts.) Capture2 timestamps go from 18:57:31.x to 18:57:42.x, about 11 seconds. Your previously posted log of a failed reinitialisation covers a time span of nearly two minutes. Are you sure you provided a capture taken when mpd was reporting repeated initialisation attempts?
Your previous posts have repeated mentioned a modem reset. What is a modem reset and (since it appears to cause so much grief) why do you do it?
-
i just ran the command given to me for both pppoe0 and vr1 and when i said mpd going in reconenct loop, that actually i see from the web gui but i also fail to understand y no pppoe control packets r seen on the trace related to vr1, i hope its the right command im running.
the issue is just not modem reset but suppose if its goes down or drops an active connection or it has a firmware update and reboots or even in pfsense i set periodic reset for pppoe, in all these situations it never reconnects untill i reboot pfsense so.
ill again run a trace for vr1 and send it
-
here is another capture, its the same, once the isp modem is reset the packet count never goes ahead inspite of mpd retrying to conect, correct me if im wrong, below is the command i run
tcpdump -i vr1 -s 0 -vvvX -w /tmp/pcap.capture
capture can be downloaded from
http://www.mediafire.com/?41s858ze4bri7c9 -
correct me if im wrong, below is the command i run
tcpdump -i vr1 -s 0 -vvvX -w /tmp/pcap.capture
Looks fine to me though -vvvX seems to apply just to decoding and displaying captured data.
here is another capture, its the same, once the isp modem is reset the packet count never goes ahead inspite of mpd retrying to conect
Capture ran from 16:46:56.457199 to 16:47:16.647419 and shows pings and responses for the whole duration (about 20 seconds). Perhaps you ran the capture for much longer than 20 seconds and there was no traffic after the last entry. This doesn't seem consistent with mpd's claim to be making reconnection attempts.
-
the capture was running for more than 2-3mins and when i say no traffic after last entry, i meant once i reset the modem, the last captured packet was before that and after that inspite of mpd showing reconenct attempts under logs, no packets control or any other appear in the trace so mayb mpd just keeps saying its reconnecting but no actual attempt is made or mayb the capture doesnt take the ppoe control packets in the trace at all.
anyways ill run the trace again for about 5mins now but im sure the capture wont have any packets in them related to reconnect attempts
-
i ran the trace and its the same, it takes about 20secs for me to start the trace and then reset the modem and once done, for the next 10mins also no new packets in the capture
-
for al alternative approach, i took the wan wire and plugged it into my windows PC and started wireshark and then first created a pppoe connection and dialed it and all fine and then reset the modem and windows too wont redial at all till the LAN card is disabled and enabled again and then the same connection redialed, i hope this trace will help as it lists pppoe control packets as well
http://www.mediafire.com/?sp6n1weermra3y8
-
what i noticed from the trace was after modem reset the PC sends a PADI and the server replies with PADO then PC sends PADR but then the server for some reason doesnt send the PADS and to only make this work, the LAN card needs to be disabled and reenabled so guess one solution between reconnection request sent by mpd would be to actually disable the port first then enable it and then dialout, no idea how but the older mpd v4 used to and still does work like a charm but for that i would have to revert back to pfsense 1.2.3
-
any suggestions?
-
Ermal is probably away, since according to this, both he and cmb will be doing a presentation at EuroBSDCon11 on 6-Oct-2011.
Have you contacted mpd's developers at http://sourceforge.net/projects/mpd/ about this?
-
no i havent checked with the mpd developers, it would be like repeating a year long story from start :)
-
no progress yet