Netgate Discussion Forum
    • Categories
    • Recent
    • Tags
    • Popular
    • Users
    • Search
    • Register
    • Login

    PPPoE Disconnects

    Scheduled Pinned Locked Moved General pfSense Questions
    1 Posts 1 Posters 527 Views
    Loading More Posts
    • Oldest to Newest
    • Newest to Oldest
    • Most Votes
    Reply
    • Reply as topic
    Log in to reply
    This topic has been deleted. Only users with topic management privileges can see it.
    • B
      breakaway
      last edited by

      Hello Everyone

      I'm trying to get to the bottom of some PPPoE micro disconnects. The internet connection is a PPPoE GPON. The log is below. I've got probably 30-40 pfSense out there and I have two connections that are experiencing this issue. The hardware is one of those cheap machines from Alibaba (One is an Intel J1900, the other is an Intel N3100). The boxes themselves are fine. I verified these by testing them on our office connection which is also by the same ISP and it works just fine.

      So to summarise, I have tried

      • New pfSense hardware (I've been through 4 different physical boxes)
      • Various version of pfSense (2.3.2, 2.3.3, 2.3.3_1)
      • Even tried changing patch cables.

      I told the ISP about this but they maintain nothing is wrong at their end… and they're not being too helpful with diagnosis because they say pfSense is an "unsupported" configuration (They would rather you use their terrible Huawei modem).

      You can see the log below. I replaced the pfSense system at 10:37 AM. Then, at 14:08, 14:20, 14:27, 14:29 and 14:30 there are micro disconnects (PPPoE drops for a few minutes then comes back).

      I would REALLY appreciate some assistance in diagnosing this!

      Apr 5 10:37:32	ppp		Multi-link PPP daemon for FreeBSD
Apr 5 10:37:32	ppp		process 7141 started, version 5.8 (root@pfSense_v2_3_3_amd64-pfSense_v2_3_3-job-16 03:21 11-Feb-2017)
Apr 5 10:37:32	ppp		web: web is not running
Apr 5 10:37:32	ppp		[opt2] Bundle: Interface ng0 created
Apr 5 10:37:32	ppp		[opt2_link0] Link: OPEN event
Apr 5 10:37:32	ppp		[opt2_link0] LCP: Open event
Apr 5 10:37:32	ppp		[opt2_link0] LCP: state change Initial --> Starting
Apr 5 10:37:32	ppp		[opt2_link0] LCP: LayerStart
Apr 5 10:37:32	ppp		[opt2_link0] PPPoE: Connecting to ''
Apr 5 10:37:41	ppp		[opt2_link0] PPPoE connection timeout after 9 seconds
Apr 5 10:37:41	ppp		[opt2_link0] Link: DOWN event
Apr 5 10:37:41	ppp		[opt2_link0] LCP: Down event
Apr 5 10:37:41	ppp		[opt2_link0] Link: reconnection attempt 1 in 3 seconds
Apr 5 10:37:44	ppp		[opt2_link0] Link: reconnection attempt 1
Apr 5 10:37:44	ppp		[opt2_link0] PPPoE: Connecting to ''
Apr 5 10:37:44	ppp		PPPoE: rec'd ACNAME "Air-PER-01"
Apr 5 10:37:44	ppp		[opt2_link0] PPPoE: connection successful
Apr 5 10:37:44	ppp		[opt2_link0] Link: UP event
Apr 5 10:37:44	ppp		[opt2_link0] LCP: Up event
Apr 5 10:37:44	ppp		[opt2_link0] LCP: state change Starting --> Req-Sent
Apr 5 10:37:44	ppp		[opt2_link0] LCP: SendConfigReq #1
Apr 5 10:37:44	ppp		[opt2_link0] PROTOCOMP
Apr 5 10:37:44	ppp		[opt2_link0] MRU 1492
Apr 5 10:37:44	ppp		[opt2_link0] MAGICNUM 0x069f7cf3
Apr 5 10:37:44	ppp		[opt2_link0] LCP: rec'd Configure Request #1 (Req-Sent)
Apr 5 10:37:44	ppp		[opt2_link0] MRU 1492
Apr 5 10:37:44	ppp		[opt2_link0] AUTHPROTO PAP
Apr 5 10:37:44	ppp		[opt2_link0] MAGICNUM 0x454e5b97
Apr 5 10:37:44	ppp		[opt2_link0] LCP: SendConfigAck #1
Apr 5 10:37:44	ppp		[opt2_link0] MRU 1492
Apr 5 10:37:44	ppp		[opt2_link0] AUTHPROTO PAP
Apr 5 10:37:44	ppp		[opt2_link0] MAGICNUM 0x454e5b97
Apr 5 10:37:44	ppp		[opt2_link0] LCP: state change Req-Sent --> Ack-Sent
Apr 5 10:37:44	ppp		[opt2_link0] LCP: rec'd Configure Ack #1 (Ack-Sent)
Apr 5 10:37:44	ppp		[opt2_link0] PROTOCOMP
Apr 5 10:37:44	ppp		[opt2_link0] MRU 1492
Apr 5 10:37:44	ppp		[opt2_link0] MAGICNUM 0x069f7cf3
Apr 5 10:37:44	ppp		[opt2_link0] LCP: state change Ack-Sent --> Opened
Apr 5 10:37:44	ppp		[opt2_link0] LCP: auth: peer wants PAP, I want nothing
Apr 5 10:37:44	ppp		[opt2_link0] PAP: using authname "pppoeuser@theisp.net"
Apr 5 10:37:44	ppp		[opt2_link0] PAP: sending REQUEST #1 len: 37
Apr 5 10:37:44	ppp		[opt2_link0] LCP: LayerUp
Apr 5 10:37:46	ppp		[opt2_link0] PAP: using authname "pppoeuser@theisp.net"
Apr 5 10:37:46	ppp		[opt2_link0] PAP: sending REQUEST #2 len: 37
Apr 5 10:37:47	ppp		[opt2_link0] PAP: rec'd ACK #2 len: 5
Apr 5 10:37:47	ppp		[opt2_link0] LCP: authorization successful
Apr 5 10:37:47	ppp		[opt2_link0] Link: Matched action 'bundle "opt2" ""'
Apr 5 10:37:47	ppp		[opt2_link0] Link: Join bundle "opt2"
Apr 5 10:37:47	ppp		[opt2] Bundle: Status update: up 1 link, total bandwidth 64000 bps
Apr 5 10:37:47	ppp		[opt2] IPCP: Open event
Apr 5 10:37:47	ppp		[opt2] IPCP: state change Initial --> Starting
Apr 5 10:37:47	ppp		[opt2] IPCP: LayerStart
Apr 5 10:37:47	ppp		[opt2] IPV6CP: Open event
Apr 5 10:37:47	ppp		[opt2] IPV6CP: state change Initial --> Starting
Apr 5 10:37:47	ppp		[opt2] IPV6CP: LayerStart
Apr 5 10:37:47	ppp		[opt2] IPCP: Up event
Apr 5 10:37:47	ppp		[opt2] IPCP: state change Starting --> Req-Sent
Apr 5 10:37:47	ppp		[opt2] IPCP: SendConfigReq #1
Apr 5 10:37:47	ppp		[opt2] IPADDR 0.0.0.0
Apr 5 10:37:47	ppp		[opt2] COMPPROTO VJCOMP, 16 comp. channels, no comp-cid
Apr 5 10:37:47	ppp		[opt2] PRIDNS 0.0.0.0
Apr 5 10:37:47	ppp		[opt2] SECDNS 0.0.0.0
Apr 5 10:37:47	ppp		[opt2] IPV6CP: Up event
Apr 5 10:37:47	ppp		[opt2] IPV6CP: state change Starting --> Req-Sent
Apr 5 10:37:47	ppp		[opt2] IPV6CP: SendConfigReq #1
Apr 5 10:37:47	ppp		[opt2] IPCP: rec'd Configure Request #1 (Req-Sent)
Apr 5 10:37:47	ppp		[opt2] IPADDR 210.48.12.66
Apr 5 10:37:47	ppp		[opt2] 210.48.12.66 is OK
Apr 5 10:37:47	ppp		[opt2] IPCP: SendConfigAck #1
Apr 5 10:37:47	ppp		[opt2] IPADDR 210.48.12.66
Apr 5 10:37:47	ppp		[opt2] IPCP: state change Req-Sent --> Ack-Sent
Apr 5 10:37:47	ppp		[opt2] IPV6CP: rec'd Configure Request #1 (Req-Sent)
Apr 5 10:37:47	ppp		[opt2] IPV6CP: SendConfigAck #1
Apr 5 10:37:47	ppp		[opt2] IPV6CP: state change Req-Sent --> Ack-Sent
Apr 5 10:37:47	ppp		[opt2] IPCP: rec'd Configure Reject #1 (Ack-Sent)
Apr 5 10:37:47	ppp		[opt2] COMPPROTO VJCOMP, 16 comp. channels, no comp-cid
Apr 5 10:37:47	ppp		[opt2] IPCP: SendConfigReq #2
Apr 5 10:37:47	ppp		[opt2] IPADDR 0.0.0.0
Apr 5 10:37:47	ppp		[opt2] PRIDNS 0.0.0.0
Apr 5 10:37:47	ppp		[opt2] SECDNS 0.0.0.0
Apr 5 10:37:47	ppp		[opt2] IPV6CP: rec'd Configure Ack #1 (Ack-Sent)
Apr 5 10:37:47	ppp		[opt2] IPV6CP: state change Ack-Sent --> Opened
Apr 5 10:37:47	ppp		[opt2] IPV6CP: LayerUp
Apr 5 10:37:47	ppp		[opt2] 0230:18ff:fe0a:ebf4 -> ba38:61ff:fef5:df00
Apr 5 10:37:48	ppp		[opt2] IFACE: Up event
Apr 5 10:37:48	ppp		[opt2] IFACE: Rename interface ng0 to pppoe1
Apr 5 10:37:48	ppp		[opt2] IPCP: rec'd Configure Nak #2 (Ack-Sent)
Apr 5 10:37:48	ppp		[opt2] IPADDR 125.126.0.42
Apr 5 10:37:48	ppp		[opt2] 125.126.0.42 is OK
Apr 5 10:37:48	ppp		[opt2] PRIDNS 125.126.65.1
Apr 5 10:37:48	ppp		[opt2] SECDNS 125.126.66.1
Apr 5 10:37:48	ppp		[opt2] IPCP: SendConfigReq #3
Apr 5 10:37:48	ppp		[opt2] IPADDR 125.126.0.42
Apr 5 10:37:48	ppp		[opt2] PRIDNS 125.126.65.1
Apr 5 10:37:48	ppp		[opt2] SECDNS 125.126.66.1
Apr 5 10:37:48	ppp		[opt2] IPCP: rec'd Configure Ack #3 (Ack-Sent)
Apr 5 10:37:48	ppp		[opt2] IPADDR 125.126.0.42
Apr 5 10:37:48	ppp		[opt2] PRIDNS 125.126.65.1
Apr 5 10:37:48	ppp		[opt2] SECDNS 125.126.66.1
Apr 5 10:37:48	ppp		[opt2] IPCP: state change Ack-Sent --> Opened
Apr 5 10:37:48	ppp		[opt2] IPCP: LayerUp
Apr 5 10:37:48	ppp		[opt2] 125.126.0.42 -> 210.48.12.66
Apr 5 14:08:06	ppp		Multi-link PPP daemon for FreeBSD
Apr 5 14:08:06	ppp		process 53404 started, version 5.8 (root@pfSense_v2_3_3_amd64-pfSense_v2_3_3-job-16 03:21 11-Feb-2017)
Apr 5 14:08:06	ppp		waiting for process 7141 to die...
Apr 5 14:08:06	ppp		caught fatal signal TERM
Apr 5 14:08:06	ppp		[opt2] IFACE: Close event
Apr 5 14:08:06	ppp		[opt2] IPCP: Close event
Apr 5 14:08:06	ppp		[opt2] IPCP: state change Opened --> Closing
Apr 5 14:08:06	ppp		[opt2] IPCP: SendTerminateReq #4
Apr 5 14:08:06	ppp		[opt2] IPCP: LayerDown
Apr 5 14:08:06	ppp		[opt2] IFACE: Delete route 0.0.0.0/0 210.48.12.66 failed: No such process
Apr 5 14:08:06	ppp		[opt2] IFACE: Removing IPv4 address from pppoe1 failed(IGNORING for now. This should be only for PPPoE friendly!): Can't assign requested address
Apr 5 14:08:06	ppp		[opt2] IPV6CP: Close event
Apr 5 14:08:06	ppp		[opt2] IPV6CP: state change Opened --> Closing
Apr 5 14:08:06	ppp		[opt2] IPV6CP: SendTerminateReq #2
Apr 5 14:08:06	ppp		[opt2] IPV6CP: LayerDown
Apr 5 14:08:07	ppp		[opt2] IFACE: Down event
Apr 5 14:08:07	ppp		[opt2] IFACE: Rename interface pppoe1 to pppoe1
Apr 5 14:08:07	ppp		waiting for process 7141 to die...
Apr 5 14:08:08	ppp		waiting for process 7141 to die...
Apr 5 14:08:09	ppp		[opt2] Bundle: Shutdown
Apr 5 14:08:09	ppp		[opt2_link0] Link: Shutdown
Apr 5 14:08:09	ppp		process 7141 terminated
Apr 5 14:08:09	ppp		web: web is not running
Apr 5 14:08:09	ppp		[opt2] Bundle: Interface ng0 created
Apr 5 14:08:09	ppp		[opt2_link0] Link: OPEN event
Apr 5 14:08:09	ppp		[opt2_link0] LCP: Open event
Apr 5 14:08:09	ppp		[opt2_link0] LCP: state change Initial --> Starting
Apr 5 14:08:09	ppp		[opt2_link0] LCP: LayerStart
Apr 5 14:08:09	ppp		[opt2_link0] PPPoE: Connecting to ''
Apr 5 14:08:09	ppp		PPPoE: rec'd ACNAME "Air-PER-01"
Apr 5 14:08:09	ppp		[opt2_link0] PPPoE: connection successful
Apr 5 14:08:09	ppp		[opt2_link0] Link: UP event
Apr 5 14:08:09	ppp		[opt2_link0] LCP: Up event
Apr 5 14:08:09	ppp		[opt2_link0] LCP: state change Starting --> Req-Sent
Apr 5 14:08:09	ppp		[opt2_link0] LCP: SendConfigReq #1
Apr 5 14:08:09	ppp		[opt2_link0] PROTOCOMP
Apr 5 14:08:09	ppp		[opt2_link0] MRU 1492
Apr 5 14:08:09	ppp		[opt2_link0] MAGICNUM 0xd077174c
Apr 5 14:08:09	ppp		[opt2_link0] LCP: rec'd Configure Request #1 (Req-Sent)
Apr 5 14:08:09	ppp		[opt2_link0] MRU 1492
Apr 5 14:08:09	ppp		[opt2_link0] AUTHPROTO PAP
Apr 5 14:08:09	ppp		[opt2_link0] MAGICNUM 0x460f0af7
Apr 5 14:08:09	ppp		[opt2_link0] LCP: SendConfigAck #1
Apr 5 14:08:09	ppp		[opt2_link0] MRU 1492
Apr 5 14:08:09	ppp		[opt2_link0] AUTHPROTO PAP
Apr 5 14:08:09	ppp		[opt2_link0] MAGICNUM 0x460f0af7
Apr 5 14:08:09	ppp		[opt2_link0] LCP: state change Req-Sent --> Ack-Sent
Apr 5 14:08:09	ppp		[opt2_link0] LCP: rec'd Configure Ack #1 (Ack-Sent)
Apr 5 14:08:09	ppp		[opt2_link0] PROTOCOMP
Apr 5 14:08:09	ppp		[opt2_link0] MRU 1492
Apr 5 14:08:09	ppp		[opt2_link0] MAGICNUM 0xd077174c
Apr 5 14:08:09	ppp		[opt2_link0] LCP: state change Ack-Sent --> Opened
Apr 5 14:08:09	ppp		[opt2_link0] LCP: auth: peer wants PAP, I want nothing
Apr 5 14:08:09	ppp		[opt2_link0] PAP: using authname "pppoeuser@theisp.net"
Apr 5 14:08:09	ppp		[opt2_link0] PAP: sending REQUEST #1 len: 37
Apr 5 14:08:09	ppp		[opt2_link0] LCP: LayerUp
Apr 5 14:08:11	ppp		[opt2_link0] PAP: using authname "pppoeuser@theisp.net"
Apr 5 14:08:11	ppp		[opt2_link0] PAP: sending REQUEST #2 len: 37
Apr 5 14:08:12	ppp		[opt2_link0] PAP: rec'd ACK #2 len: 5
Apr 5 14:08:12	ppp		[opt2_link0] LCP: authorization successful
Apr 5 14:08:12	ppp		[opt2_link0] Link: Matched action 'bundle "opt2" ""'
Apr 5 14:08:12	ppp		[opt2_link0] Link: Join bundle "opt2"
Apr 5 14:08:12	ppp		[opt2] Bundle: Status update: up 1 link, total bandwidth 64000 bps
Apr 5 14:08:12	ppp		[opt2] IPCP: Open event
Apr 5 14:08:12	ppp		[opt2] IPCP: state change Initial --> Starting
Apr 5 14:08:12	ppp		[opt2] IPCP: LayerStart
Apr 5 14:08:12	ppp		[opt2] IPV6CP: Open event
Apr 5 14:08:12	ppp		[opt2] IPV6CP: state change Initial --> Starting
Apr 5 14:08:12	ppp		[opt2] IPV6CP: LayerStart
Apr 5 14:08:12	ppp		[opt2] IPCP: Up event
Apr 5 14:08:12	ppp		[opt2] IPCP: state change Starting --> Req-Sent
Apr 5 14:08:12	ppp		[opt2] IPCP: SendConfigReq #1
Apr 5 14:08:12	ppp		[opt2] IPADDR 0.0.0.0
Apr 5 14:08:12	ppp		[opt2] COMPPROTO VJCOMP, 16 comp. channels, no comp-cid
Apr 5 14:08:12	ppp		[opt2] PRIDNS 0.0.0.0
Apr 5 14:08:12	ppp		[opt2] SECDNS 0.0.0.0
Apr 5 14:08:12	ppp		[opt2] IPV6CP: Up event
Apr 5 14:08:12	ppp		[opt2] IPV6CP: state change Starting --> Req-Sent
Apr 5 14:08:12	ppp		[opt2] IPV6CP: SendConfigReq #1
Apr 5 14:08:12	ppp		[opt2] IPCP: rec'd Configure Request #1 (Req-Sent)
Apr 5 14:08:12	ppp		[opt2] IPADDR 210.48.12.66
Apr 5 14:08:12	ppp		[opt2] 210.48.12.66 is OK
Apr 5 14:08:12	ppp		[opt2] IPCP: SendConfigAck #1
Apr 5 14:08:12	ppp		[opt2] IPADDR 210.48.12.66
Apr 5 14:08:12	ppp		[opt2] IPCP: state change Req-Sent --> Ack-Sent
Apr 5 14:08:12	ppp		[opt2] IPV6CP: rec'd Configure Request #1 (Req-Sent)
Apr 5 14:08:12	ppp		[opt2] IPV6CP: SendConfigAck #1
Apr 5 14:08:12	ppp		[opt2] IPV6CP: state change Req-Sent --> Ack-Sent
Apr 5 14:08:12	ppp		[opt2] IPCP: rec'd Configure Reject #1 (Ack-Sent)
Apr 5 14:08:12	ppp		[opt2] COMPPROTO VJCOMP, 16 comp. channels, no comp-cid
Apr 5 14:08:12	ppp		[opt2] IPCP: SendConfigReq #2
Apr 5 14:08:12	ppp		[opt2] IPADDR 0.0.0.0
Apr 5 14:08:12	ppp		[opt2] PRIDNS 0.0.0.0
Apr 5 14:08:12	ppp		[opt2] SECDNS 0.0.0.0
Apr 5 14:08:12	ppp		[opt2] IPV6CP: rec'd Configure Ack #1 (Ack-Sent)
Apr 5 14:08:12	ppp		[opt2] IPV6CP: state change Ack-Sent --> Opened
Apr 5 14:08:12	ppp		[opt2] IPV6CP: LayerUp
Apr 5 14:08:12	ppp		[opt2] 0230:18ff:fe0a:ebf4 -> ba38:61ff:fef5:df00
Apr 5 14:08:13	ppp		[opt2] IFACE: Up event
Apr 5 14:08:13	ppp		[opt2] IFACE: Rename interface ng0 to pppoe1
Apr 5 14:08:13	ppp		[opt2] IPCP: rec'd Configure Nak #2 (Ack-Sent)
Apr 5 14:08:13	ppp		[opt2] IPADDR 125.126.0.42
Apr 5 14:08:13	ppp		[opt2] 125.126.0.42 is OK
Apr 5 14:08:13	ppp		[opt2] PRIDNS 125.126.65.1
Apr 5 14:08:13	ppp		[opt2] SECDNS 125.126.66.1
Apr 5 14:08:13	ppp		[opt2] IPCP: SendConfigReq #3
Apr 5 14:08:13	ppp		[opt2] IPADDR 125.126.0.42
Apr 5 14:08:13	ppp		[opt2] PRIDNS 125.126.65.1
Apr 5 14:08:13	ppp		[opt2] SECDNS 125.126.66.1
Apr 5 14:08:13	ppp		[opt2] IPCP: rec'd Configure Ack #3 (Ack-Sent)
Apr 5 14:08:13	ppp		[opt2] IPADDR 125.126.0.42
Apr 5 14:08:13	ppp		[opt2] PRIDNS 125.126.65.1
Apr 5 14:08:13	ppp		[opt2] SECDNS 125.126.66.1
Apr 5 14:08:13	ppp		[opt2] IPCP: state change Ack-Sent --> Opened
Apr 5 14:08:13	ppp		[opt2] IPCP: LayerUp
Apr 5 14:08:13	ppp		[opt2] 125.126.0.42 -> 210.48.12.66
Apr 5 14:20:24	ppp		Multi-link PPP daemon for FreeBSD
Apr 5 14:20:24	ppp		process 91047 started, version 5.8 (root@pfSense_v2_3_3_amd64-pfSense_v2_3_3-job-16 03:21 11-Feb-2017)
Apr 5 14:20:24	ppp		waiting for process 53404 to die...
Apr 5 14:20:24	ppp		caught fatal signal TERM
Apr 5 14:20:24	ppp		[opt2] IFACE: Close event
Apr 5 14:20:24	ppp		[opt2] IPCP: Close event
Apr 5 14:20:24	ppp		[opt2] IPCP: state change Opened --> Closing
Apr 5 14:20:24	ppp		[opt2] IPCP: SendTerminateReq #4
Apr 5 14:20:24	ppp		[opt2] IPCP: LayerDown
Apr 5 14:20:24	ppp		[opt2] IFACE: Delete route 0.0.0.0/0 210.48.12.66 failed: No such process
Apr 5 14:20:24	ppp		[opt2] IFACE: Removing IPv4 address from pppoe1 failed(IGNORING for now. This should be only for PPPoE friendly!): Can't assign requested address
Apr 5 14:20:24	ppp		[opt2] IPV6CP: Close event
Apr 5 14:20:24	ppp		[opt2] IPV6CP: state change Opened --> Closing
Apr 5 14:20:24	ppp		[opt2] IPV6CP: SendTerminateReq #2
Apr 5 14:20:24	ppp		[opt2] IPV6CP: LayerDown
Apr 5 14:20:25	ppp		[opt2] IFACE: Down event
Apr 5 14:20:25	ppp		[opt2] IFACE: Rename interface pppoe1 to pppoe1
Apr 5 14:20:25	ppp		waiting for process 53404 to die...
Apr 5 14:20:26	ppp		waiting for process 53404 to die...
Apr 5 14:20:27	ppp		[opt2] Bundle: Shutdown
Apr 5 14:20:27	ppp		[opt2_link0] Link: Shutdown
Apr 5 14:20:27	ppp		process 53404 terminated
Apr 5 14:20:27	ppp		web: web is not running
Apr 5 14:20:27	ppp		[opt2] Bundle: Interface ng0 created
Apr 5 14:20:27	ppp		[opt2_link0] Link: OPEN event
Apr 5 14:20:27	ppp		[opt2_link0] LCP: Open event
Apr 5 14:20:27	ppp		[opt2_link0] LCP: state change Initial --> Starting
Apr 5 14:20:27	ppp		[opt2_link0] LCP: LayerStart
Apr 5 14:20:27	ppp		[opt2_link0] PPPoE: Connecting to ''
Apr 5 14:20:29	ppp		PPPoE: rec'd ACNAME "Air-PER-01"
Apr 5 14:20:29	ppp		[opt2_link0] PPPoE: connection successful
Apr 5 14:20:29	ppp		[opt2_link0] Link: UP event
Apr 5 14:20:29	ppp		[opt2_link0] LCP: Up event
Apr 5 14:20:29	ppp		[opt2_link0] LCP: state change Starting --> Req-Sent
Apr 5 14:20:29	ppp		[opt2_link0] LCP: SendConfigReq #1
Apr 5 14:20:29	ppp		[opt2_link0] PROTOCOMP
Apr 5 14:20:29	ppp		[opt2_link0] MRU 1492
Apr 5 14:20:29	ppp		[opt2_link0] MAGICNUM 0xce052cee
Apr 5 14:20:29	ppp		[opt2_link0] LCP: rec'd Configure Request #1 (Req-Sent)
Apr 5 14:20:29	ppp		[opt2_link0] MRU 1492
Apr 5 14:20:29	ppp		[opt2_link0] AUTHPROTO PAP
Apr 5 14:20:29	ppp		[opt2_link0] MAGICNUM 0x461a5726
Apr 5 14:20:29	ppp		[opt2_link0] LCP: SendConfigAck #1
Apr 5 14:20:29	ppp		[opt2_link0] MRU 1492
Apr 5 14:20:29	ppp		[opt2_link0] AUTHPROTO PAP
Apr 5 14:20:29	ppp		[opt2_link0] MAGICNUM 0x461a5726
Apr 5 14:20:29	ppp		[opt2_link0] LCP: state change Req-Sent --> Ack-Sent
Apr 5 14:20:29	ppp		[opt2_link0] LCP: rec'd Configure Ack #1 (Ack-Sent)
Apr 5 14:20:29	ppp		[opt2_link0] PROTOCOMP
Apr 5 14:20:29	ppp		[opt2_link0] MRU 1492
Apr 5 14:20:29	ppp		[opt2_link0] MAGICNUM 0xce052cee
Apr 5 14:20:29	ppp		[opt2_link0] LCP: state change Ack-Sent --> Opened
Apr 5 14:20:29	ppp		[opt2_link0] LCP: auth: peer wants PAP, I want nothing
Apr 5 14:20:29	ppp		[opt2_link0] PAP: using authname "pppoeuser@theisp.net"
Apr 5 14:20:29	ppp		[opt2_link0] PAP: sending REQUEST #1 len: 37
Apr 5 14:20:29	ppp		[opt2_link0] LCP: LayerUp
Apr 5 14:20:31	ppp		[opt2_link0] PAP: using authname "pppoeuser@theisp.net"
Apr 5 14:20:31	ppp		[opt2_link0] PAP: sending REQUEST #2 len: 37
Apr 5 14:20:32	ppp		[opt2_link0] PAP: rec'd ACK #2 len: 5
Apr 5 14:20:32	ppp		[opt2_link0] LCP: authorization successful
Apr 5 14:20:32	ppp		[opt2_link0] Link: Matched action 'bundle "opt2" ""'
Apr 5 14:20:32	ppp		[opt2_link0] Link: Join bundle "opt2"
Apr 5 14:20:32	ppp		[opt2] Bundle: Status update: up 1 link, total bandwidth 64000 bps
Apr 5 14:20:32	ppp		[opt2] IPCP: Open event
Apr 5 14:20:32	ppp		[opt2] IPCP: state change Initial --> Starting
Apr 5 14:20:32	ppp		[opt2] IPCP: LayerStart
Apr 5 14:20:32	ppp		[opt2] IPV6CP: Open event
Apr 5 14:20:32	ppp		[opt2] IPV6CP: state change Initial --> Starting
Apr 5 14:20:32	ppp		[opt2] IPV6CP: LayerStart
Apr 5 14:20:32	ppp		[opt2] IPCP: Up event
Apr 5 14:20:32	ppp		[opt2] IPCP: state change Starting --> Req-Sent
Apr 5 14:20:32	ppp		[opt2] IPCP: SendConfigReq #1
Apr 5 14:20:32	ppp		[opt2] IPADDR 0.0.0.0
Apr 5 14:20:32	ppp		[opt2] COMPPROTO VJCOMP, 16 comp. channels, no comp-cid
Apr 5 14:20:32	ppp		[opt2] PRIDNS 0.0.0.0
Apr 5 14:20:32	ppp		[opt2] SECDNS 0.0.0.0
Apr 5 14:20:32	ppp		[opt2] IPV6CP: Up event
Apr 5 14:20:32	ppp		[opt2] IPV6CP: state change Starting --> Req-Sent
Apr 5 14:20:32	ppp		[opt2] IPV6CP: SendConfigReq #1
Apr 5 14:20:32	ppp		[opt2] IPCP: rec'd Configure Request #1 (Req-Sent)
Apr 5 14:20:32	ppp		[opt2] IPADDR 210.48.12.66
Apr 5 14:20:32	ppp		[opt2] 210.48.12.66 is OK
Apr 5 14:20:32	ppp		[opt2] IPCP: SendConfigAck #1
Apr 5 14:20:32	ppp		[opt2] IPADDR 210.48.12.66
Apr 5 14:20:32	ppp		[opt2] IPCP: state change Req-Sent --> Ack-Sent
Apr 5 14:20:32	ppp		[opt2] IPV6CP: rec'd Configure Request #1 (Req-Sent)
Apr 5 14:20:32	ppp		[opt2] IPV6CP: SendConfigAck #1
Apr 5 14:20:32	ppp		[opt2] IPV6CP: state change Req-Sent --> Ack-Sent
Apr 5 14:20:32	ppp		[opt2] IPCP: rec'd Configure Reject #1 (Ack-Sent)
Apr 5 14:20:32	ppp		[opt2] COMPPROTO VJCOMP, 16 comp. channels, no comp-cid
Apr 5 14:20:32	ppp		[opt2] IPCP: SendConfigReq #2
Apr 5 14:20:32	ppp		[opt2] IPADDR 0.0.0.0
Apr 5 14:20:32	ppp		[opt2] PRIDNS 0.0.0.0
Apr 5 14:20:32	ppp		[opt2] SECDNS 0.0.0.0
Apr 5 14:20:32	ppp		[opt2] IPV6CP: rec'd Configure Ack #1 (Ack-Sent)
Apr 5 14:20:32	ppp		[opt2] IPV6CP: state change Ack-Sent --> Opened
Apr 5 14:20:32	ppp		[opt2] IPV6CP: LayerUp
Apr 5 14:20:32	ppp		[opt2] 0230:18ff:fe0a:ebf4 -> ba38:61ff:fef5:df00
Apr 5 14:20:33	ppp		[opt2] IFACE: Up event
Apr 5 14:20:33	ppp		[opt2] IFACE: Rename interface ng0 to pppoe1
Apr 5 14:20:33	ppp		[opt2] IPCP: rec'd Configure Nak #2 (Ack-Sent)
Apr 5 14:20:33	ppp		[opt2] IPADDR 125.126.0.42
Apr 5 14:20:33	ppp		[opt2] 125.126.0.42 is OK
Apr 5 14:20:33	ppp		[opt2] PRIDNS 125.126.65.1
Apr 5 14:20:33	ppp		[opt2] SECDNS 125.126.66.1
Apr 5 14:20:33	ppp		[opt2] IPCP: SendConfigReq #3
Apr 5 14:20:33	ppp		[opt2] IPADDR 125.126.0.42
Apr 5 14:20:33	ppp		[opt2] PRIDNS 125.126.65.1
Apr 5 14:20:33	ppp		[opt2] SECDNS 125.126.66.1
Apr 5 14:20:33	ppp		[opt2] IPCP: rec'd Configure Ack #3 (Ack-Sent)
Apr 5 14:20:33	ppp		[opt2] IPADDR 125.126.0.42
Apr 5 14:20:33	ppp		[opt2] PRIDNS 125.126.65.1
Apr 5 14:20:33	ppp		[opt2] SECDNS 125.126.66.1
Apr 5 14:20:33	ppp		[opt2] IPCP: state change Ack-Sent --> Opened
Apr 5 14:20:33	ppp		[opt2] IPCP: LayerUp
Apr 5 14:20:33	ppp		[opt2] 125.126.0.42 -> 210.48.12.66
Apr 5 14:27:13	ppp		Multi-link PPP daemon for FreeBSD
Apr 5 14:27:13	ppp		process 54406 started, version 5.8 (root@pfSense_v2_3_3_amd64-pfSense_v2_3_3-job-16 03:21 11-Feb-2017)
Apr 5 14:27:13	ppp		waiting for process 91047 to die...
Apr 5 14:27:13	ppp		caught fatal signal TERM
Apr 5 14:27:13	ppp		[opt2] IFACE: Close event
Apr 5 14:27:13	ppp		[opt2] IPCP: Close event
Apr 5 14:27:13	ppp		[opt2] IPCP: state change Opened --> Closing
Apr 5 14:27:13	ppp		[opt2] IPCP: SendTerminateReq #4
Apr 5 14:27:13	ppp		[opt2] IPCP: LayerDown
Apr 5 14:27:13	ppp		[opt2] IFACE: Delete route 0.0.0.0/0 210.48.12.66 failed: No such process
Apr 5 14:27:13	ppp		[opt2] IFACE: Removing IPv4 address from pppoe1 failed(IGNORING for now. This should be only for PPPoE friendly!): Can't assign requested address
Apr 5 14:27:13	ppp		[opt2] IPV6CP: Close event
Apr 5 14:27:13	ppp		[opt2] IPV6CP: state change Opened --> Closing
Apr 5 14:27:13	ppp		[opt2] IPV6CP: SendTerminateReq #2
Apr 5 14:27:13	ppp		[opt2] IPV6CP: LayerDown
Apr 5 14:27:14	ppp		[opt2] IFACE: Down event
Apr 5 14:27:14	ppp		[opt2] IFACE: Rename interface pppoe1 to pppoe1
Apr 5 14:27:14	ppp		waiting for process 91047 to die...
Apr 5 14:27:15	ppp		waiting for process 91047 to die...
Apr 5 14:27:16	ppp		[opt2] Bundle: Shutdown
Apr 5 14:27:16	ppp		[opt2_link0] Link: Shutdown
Apr 5 14:27:16	ppp		process 91047 terminated
Apr 5 14:27:16	ppp		web: web is not running
Apr 5 14:27:16	ppp		[opt2] Bundle: Interface ng0 created
Apr 5 14:27:16	ppp		[opt2_link0] Link: OPEN event
Apr 5 14:27:16	ppp		[opt2_link0] LCP: Open event
Apr 5 14:27:16	ppp		[opt2_link0] LCP: state change Initial --> Starting
Apr 5 14:27:16	ppp		[opt2_link0] LCP: LayerStart
Apr 5 14:27:16	ppp		[opt2_link0] PPPoE: Connecting to ''
Apr 5 14:27:18	ppp		PPPoE: rec'd ACNAME "Air-PER-01"
Apr 5 14:27:18	ppp		[opt2_link0] PPPoE: connection successful
Apr 5 14:27:18	ppp		[opt2_link0] Link: UP event
Apr 5 14:27:18	ppp		[opt2_link0] LCP: Up event
Apr 5 14:27:18	ppp		[opt2_link0] LCP: state change Starting --> Req-Sent
Apr 5 14:27:18	ppp		[opt2_link0] LCP: SendConfigReq #1
Apr 5 14:27:18	ppp		[opt2_link0] PROTOCOMP
Apr 5 14:27:18	ppp		[opt2_link0] MRU 1492
Apr 5 14:27:18	ppp		[opt2_link0] MAGICNUM 0x9a56af6e
Apr 5 14:27:18	ppp		[opt2_link0] LCP: rec'd Configure Request #1 (Req-Sent)
Apr 5 14:27:18	ppp		[opt2_link0] MRU 1492
Apr 5 14:27:18	ppp		[opt2_link0] AUTHPROTO PAP
Apr 5 14:27:18	ppp		[opt2_link0] MAGICNUM 0x46209609
Apr 5 14:27:18	ppp		[opt2_link0] LCP: SendConfigAck #1
Apr 5 14:27:18	ppp		[opt2_link0] MRU 1492
Apr 5 14:27:18	ppp		[opt2_link0] AUTHPROTO PAP
Apr 5 14:27:18	ppp		[opt2_link0] MAGICNUM 0x46209609
Apr 5 14:27:18	ppp		[opt2_link0] LCP: state change Req-Sent --> Ack-Sent
Apr 5 14:27:18	ppp		[opt2_link0] LCP: rec'd Configure Ack #1 (Ack-Sent)
Apr 5 14:27:18	ppp		[opt2_link0] PROTOCOMP
Apr 5 14:27:18	ppp		[opt2_link0] MRU 1492
Apr 5 14:27:18	ppp		[opt2_link0] MAGICNUM 0x9a56af6e
Apr 5 14:27:18	ppp		[opt2_link0] LCP: state change Ack-Sent --> Opened
Apr 5 14:27:18	ppp		[opt2_link0] LCP: auth: peer wants PAP, I want nothing
Apr 5 14:27:18	ppp		[opt2_link0] PAP: using authname "pppoeuser@theisp.net"
Apr 5 14:27:18	ppp		[opt2_link0] PAP: sending REQUEST #1 len: 37
Apr 5 14:27:18	ppp		[opt2_link0] LCP: LayerUp
Apr 5 14:27:20	ppp		[opt2_link0] PAP: using authname "pppoeuser@theisp.net"
Apr 5 14:27:20	ppp		[opt2_link0] PAP: sending REQUEST #2 len: 37
Apr 5 14:27:21	ppp		[opt2_link0] PAP: rec'd ACK #2 len: 5
Apr 5 14:27:21	ppp		[opt2_link0] LCP: authorization successful
Apr 5 14:27:21	ppp		[opt2_link0] Link: Matched action 'bundle "opt2" ""'
Apr 5 14:27:21	ppp		[opt2_link0] Link: Join bundle "opt2"
Apr 5 14:27:21	ppp		[opt2] Bundle: Status update: up 1 link, total bandwidth 64000 bps
Apr 5 14:27:21	ppp		[opt2] IPCP: Open event
Apr 5 14:27:21	ppp		[opt2] IPCP: state change Initial --> Starting
Apr 5 14:27:21	ppp		[opt2] IPCP: LayerStart
Apr 5 14:27:21	ppp		[opt2] IPV6CP: Open event
Apr 5 14:27:21	ppp		[opt2] IPV6CP: state change Initial --> Starting
Apr 5 14:27:21	ppp		[opt2] IPV6CP: LayerStart
Apr 5 14:27:21	ppp		[opt2] IPCP: Up event
Apr 5 14:27:21	ppp		[opt2] IPCP: state change Starting --> Req-Sent
Apr 5 14:27:21	ppp		[opt2] IPCP: SendConfigReq #1
Apr 5 14:27:21	ppp		[opt2] IPADDR 0.0.0.0
Apr 5 14:27:21	ppp		[opt2] COMPPROTO VJCOMP, 16 comp. channels, no comp-cid
Apr 5 14:27:21	ppp		[opt2] PRIDNS 0.0.0.0
Apr 5 14:27:21	ppp		[opt2] SECDNS 0.0.0.0
Apr 5 14:27:21	ppp		[opt2] IPV6CP: Up event
Apr 5 14:27:21	ppp		[opt2] IPV6CP: state change Starting --> Req-Sent
Apr 5 14:27:21	ppp		[opt2] IPV6CP: SendConfigReq #1
Apr 5 14:27:21	ppp		[opt2] IPCP: rec'd Configure Request #1 (Req-Sent)
Apr 5 14:27:21	ppp		[opt2] IPADDR 210.48.12.66
Apr 5 14:27:21	ppp		[opt2] 210.48.12.66 is OK
Apr 5 14:27:21	ppp		[opt2] IPCP: SendConfigAck #1
Apr 5 14:27:21	ppp		[opt2] IPADDR 210.48.12.66
Apr 5 14:27:21	ppp		[opt2] IPCP: state change Req-Sent --> Ack-Sent
Apr 5 14:27:21	ppp		[opt2] IPV6CP: rec'd Configure Request #1 (Req-Sent)
Apr 5 14:27:21	ppp		[opt2] IPV6CP: SendConfigAck #1
Apr 5 14:27:21	ppp		[opt2] IPV6CP: state change Req-Sent --> Ack-Sent
Apr 5 14:27:21	ppp		[opt2] IPCP: rec'd Configure Reject #1 (Ack-Sent)
Apr 5 14:27:21	ppp		[opt2] COMPPROTO VJCOMP, 16 comp. channels, no comp-cid
Apr 5 14:27:21	ppp		[opt2] IPCP: SendConfigReq #2
Apr 5 14:27:21	ppp		[opt2] IPADDR 0.0.0.0
Apr 5 14:27:21	ppp		[opt2] PRIDNS 0.0.0.0
Apr 5 14:27:21	ppp		[opt2] SECDNS 0.0.0.0
Apr 5 14:27:21	ppp		[opt2] IPV6CP: rec'd Configure Ack #1 (Ack-Sent)
Apr 5 14:27:21	ppp		[opt2] IPV6CP: state change Ack-Sent --> Opened
Apr 5 14:27:21	ppp		[opt2] IPV6CP: LayerUp
Apr 5 14:27:21	ppp		[opt2] 0230:18ff:fe0a:ebf4 -> ba38:61ff:fef5:df00
Apr 5 14:27:22	ppp		[opt2] IFACE: Up event
Apr 5 14:27:22	ppp		[opt2] IFACE: Rename interface ng0 to pppoe1
Apr 5 14:27:22	ppp		[opt2] IPCP: rec'd Configure Nak #2 (Ack-Sent)
Apr 5 14:27:22	ppp		[opt2] IPADDR 125.126.0.42
Apr 5 14:27:22	ppp		[opt2] 125.126.0.42 is OK
Apr 5 14:27:22	ppp		[opt2] PRIDNS 125.126.65.1
Apr 5 14:27:22	ppp		[opt2] SECDNS 125.126.66.1
Apr 5 14:27:22	ppp		[opt2] IPCP: SendConfigReq #3
Apr 5 14:27:22	ppp		[opt2] IPADDR 125.126.0.42
Apr 5 14:27:22	ppp		[opt2] PRIDNS 125.126.65.1
Apr 5 14:27:22	ppp		[opt2] SECDNS 125.126.66.1
Apr 5 14:27:22	ppp		[opt2] IPCP: rec'd Configure Ack #3 (Ack-Sent)
Apr 5 14:27:22	ppp		[opt2] IPADDR 125.126.0.42
Apr 5 14:27:22	ppp		[opt2] PRIDNS 125.126.65.1
Apr 5 14:27:22	ppp		[opt2] SECDNS 125.126.66.1
Apr 5 14:27:22	ppp		[opt2] IPCP: state change Ack-Sent --> Opened
Apr 5 14:27:22	ppp		[opt2] IPCP: LayerUp
Apr 5 14:27:22	ppp		[opt2] 125.126.0.42 -> 210.48.12.66
Apr 5 14:29:57	ppp		Multi-link PPP daemon for FreeBSD
Apr 5 14:29:57	ppp		process 4959 started, version 5.8 (root@pfSense_v2_3_3_amd64-pfSense_v2_3_3-job-16 03:21 11-Feb-2017)
Apr 5 14:29:57	ppp		waiting for process 54406 to die...
Apr 5 14:29:57	ppp		caught fatal signal TERM
Apr 5 14:29:57	ppp		[opt2] IFACE: Close event
Apr 5 14:29:57	ppp		[opt2] IPCP: Close event
Apr 5 14:29:57	ppp		[opt2] IPCP: state change Opened --> Closing
Apr 5 14:29:57	ppp		[opt2] IPCP: SendTerminateReq #4
Apr 5 14:29:57	ppp		[opt2] IPCP: LayerDown
Apr 5 14:29:57	ppp		[opt2] IFACE: Delete route 0.0.0.0/0 210.48.12.66 failed: No such process
Apr 5 14:29:57	ppp		[opt2] IFACE: Removing IPv4 address from pppoe1 failed(IGNORING for now. This should be only for PPPoE friendly!): Can't assign requested address
Apr 5 14:29:57	ppp		[opt2] IPV6CP: Close event
Apr 5 14:29:57	ppp		[opt2] IPV6CP: state change Opened --> Closing
Apr 5 14:29:57	ppp		[opt2] IPV6CP: SendTerminateReq #2
Apr 5 14:29:57	ppp		[opt2] IPV6CP: LayerDown
Apr 5 14:29:58	ppp		[opt2] IFACE: Down event
Apr 5 14:29:58	ppp		[opt2] IFACE: Rename interface pppoe1 to pppoe1
Apr 5 14:29:58	ppp		waiting for process 54406 to die...
Apr 5 14:29:59	ppp		waiting for process 54406 to die...
Apr 5 14:30:00	ppp		[opt2] Bundle: Shutdown
Apr 5 14:30:00	ppp		[opt2_link0] Link: Shutdown
Apr 5 14:30:00	ppp		process 54406 terminated
Apr 5 14:30:00	ppp		web: web is not running
Apr 5 14:30:00	ppp		[opt2] Bundle: Interface ng0 created
Apr 5 14:30:00	ppp		[opt2_link0] Link: OPEN event
Apr 5 14:30:00	ppp		[opt2_link0] LCP: Open event
Apr 5 14:30:00	ppp		[opt2_link0] LCP: state change Initial --> Starting
Apr 5 14:30:00	ppp		[opt2_link0] LCP: LayerStart
Apr 5 14:30:00	ppp		[opt2_link0] PPPoE: Connecting to ''
Apr 5 14:30:00	ppp		PPPoE: rec'd ACNAME "Air-PER-01"
Apr 5 14:30:00	ppp		[opt2_link0] PPPoE: connection successful
Apr 5 14:30:00	ppp		[opt2_link0] Link: UP event
Apr 5 14:30:00	ppp		[opt2_link0] LCP: Up event
Apr 5 14:30:00	ppp		[opt2_link0] LCP: state change Starting --> Req-Sent
Apr 5 14:30:00	ppp		[opt2_link0] LCP: SendConfigReq #1
Apr 5 14:30:00	ppp		[opt2_link0] PROTOCOMP
Apr 5 14:30:00	ppp		[opt2_link0] MRU 1492
Apr 5 14:30:00	ppp		[opt2_link0] MAGICNUM 0xce2655ef
Apr 5 14:30:00	ppp		[opt2_link0] LCP: rec'd Configure Request #1 (Req-Sent)
Apr 5 14:30:00	ppp		[opt2_link0] MRU 1492
Apr 5 14:30:00	ppp		[opt2_link0] AUTHPROTO PAP
Apr 5 14:30:00	ppp		[opt2_link0] MAGICNUM 0x46230f4a
Apr 5 14:30:00	ppp		[opt2_link0] LCP: SendConfigAck #1
Apr 5 14:30:00	ppp		[opt2_link0] MRU 1492
Apr 5 14:30:00	ppp		[opt2_link0] AUTHPROTO PAP
Apr 5 14:30:00	ppp		[opt2_link0] MAGICNUM 0x46230f4a
Apr 5 14:30:00	ppp		[opt2_link0] LCP: state change Req-Sent --> Ack-Sent
Apr 5 14:30:00	ppp		[opt2_link0] LCP: rec'd Configure Ack #1 (Ack-Sent)
Apr 5 14:30:00	ppp		[opt2_link0] PROTOCOMP
Apr 5 14:30:00	ppp		[opt2_link0] MRU 1492
Apr 5 14:30:00	ppp		[opt2_link0] MAGICNUM 0xce2655ef
Apr 5 14:30:00	ppp		[opt2_link0] LCP: state change Ack-Sent --> Opened
Apr 5 14:30:00	ppp		[opt2_link0] LCP: auth: peer wants PAP, I want nothing
Apr 5 14:30:00	ppp		[opt2_link0] PAP: using authname "pppoeuser@theisp.net"
Apr 5 14:30:00	ppp		[opt2_link0] PAP: sending REQUEST #1 len: 37
Apr 5 14:30:00	ppp		[opt2_link0] LCP: LayerUp
Apr 5 14:30:02	ppp		[opt2_link0] PAP: using authname "pppoeuser@theisp.net"
Apr 5 14:30:02	ppp		[opt2_link0] PAP: sending REQUEST #2 len: 37
Apr 5 14:30:03	ppp		[opt2_link0] PAP: rec'd ACK #2 len: 5
Apr 5 14:30:03	ppp		[opt2_link0] LCP: authorization successful
Apr 5 14:30:03	ppp		[opt2_link0] Link: Matched action 'bundle "opt2" ""'
Apr 5 14:30:03	ppp		[opt2_link0] Link: Join bundle "opt2"
Apr 5 14:30:03	ppp		[opt2] Bundle: Status update: up 1 link, total bandwidth 64000 bps
Apr 5 14:30:03	ppp		[opt2] IPCP: Open event
Apr 5 14:30:03	ppp		[opt2] IPCP: state change Initial --> Starting
Apr 5 14:30:03	ppp		[opt2] IPCP: LayerStart
Apr 5 14:30:03	ppp		[opt2] IPV6CP: Open event
Apr 5 14:30:03	ppp		[opt2] IPV6CP: state change Initial --> Starting
Apr 5 14:30:03	ppp		[opt2] IPV6CP: LayerStart
Apr 5 14:30:03	ppp		[opt2] IPCP: Up event
Apr 5 14:30:03	ppp		[opt2] IPCP: state change Starting --> Req-Sent
Apr 5 14:30:03	ppp		[opt2] IPCP: SendConfigReq #1
Apr 5 14:30:03	ppp		[opt2] IPADDR 0.0.0.0
Apr 5 14:30:03	ppp		[opt2] COMPPROTO VJCOMP, 16 comp. channels, no comp-cid
Apr 5 14:30:03	ppp		[opt2] PRIDNS 0.0.0.0
Apr 5 14:30:03	ppp		[opt2] SECDNS 0.0.0.0
Apr 5 14:30:03	ppp		[opt2] IPV6CP: Up event
Apr 5 14:30:03	ppp		[opt2] IPV6CP: state change Starting --> Req-Sent
Apr 5 14:30:03	ppp		[opt2] IPV6CP: SendConfigReq #1
Apr 5 14:30:03	ppp		[opt2] IPCP: rec'd Configure Request #1 (Req-Sent)
Apr 5 14:30:03	ppp		[opt2] IPADDR 210.48.12.66
Apr 5 14:30:03	ppp		[opt2] 210.48.12.66 is OK
Apr 5 14:30:03	ppp		[opt2] IPCP: SendConfigAck #1
Apr 5 14:30:03	ppp		[opt2] IPADDR 210.48.12.66
Apr 5 14:30:03	ppp		[opt2] IPCP: state change Req-Sent --> Ack-Sent
Apr 5 14:30:03	ppp		[opt2] IPV6CP: rec'd Configure Request #1 (Req-Sent)
Apr 5 14:30:03	ppp		[opt2] IPV6CP: SendConfigAck #1
Apr 5 14:30:03	ppp		[opt2] IPV6CP: state change Req-Sent --> Ack-Sent
Apr 5 14:30:03	ppp		[opt2] IPCP: rec'd Configure Reject #1 (Ack-Sent)
Apr 5 14:30:03	ppp		[opt2] COMPPROTO VJCOMP, 16 comp. channels, no comp-cid
Apr 5 14:30:03	ppp		[opt2] IPCP: SendConfigReq #2
Apr 5 14:30:03	ppp		[opt2] IPADDR 0.0.0.0
Apr 5 14:30:03	ppp		[opt2] PRIDNS 0.0.0.0
Apr 5 14:30:03	ppp		[opt2] SECDNS 0.0.0.0
Apr 5 14:30:03	ppp		[opt2] IPV6CP: rec'd Configure Ack #1 (Ack-Sent)
Apr 5 14:30:03	ppp		[opt2] IPV6CP: state change Ack-Sent --> Opened
Apr 5 14:30:03	ppp		[opt2] IPV6CP: LayerUp
Apr 5 14:30:03	ppp		[opt2] 0230:18ff:fe0a:ebf4 -> ba38:61ff:fef5:df00
Apr 5 14:30:04	ppp		[opt2] IFACE: Up event
Apr 5 14:30:04	ppp		[opt2] IFACE: Rename interface ng0 to pppoe1
Apr 5 14:30:04	ppp		[opt2] IPCP: rec'd Configure Nak #2 (Ack-Sent)
Apr 5 14:30:04	ppp		[opt2] IPADDR 125.126.0.42
Apr 5 14:30:04	ppp		[opt2] 125.126.0.42 is OK
Apr 5 14:30:04	ppp		[opt2] PRIDNS 125.126.65.1
Apr 5 14:30:04	ppp		[opt2] SECDNS 125.126.66.1
Apr 5 14:30:04	ppp		[opt2] IPCP: SendConfigReq #3
Apr 5 14:30:04	ppp		[opt2] IPADDR 125.126.0.42
Apr 5 14:30:04	ppp		[opt2] PRIDNS 125.126.65.1
Apr 5 14:30:04	ppp		[opt2] SECDNS 125.126.66.1
Apr 5 14:30:04	ppp		[opt2] IPCP: rec'd Configure Ack #3 (Ack-Sent)
Apr 5 14:30:04	ppp		[opt2] IPADDR 125.126.0.42
Apr 5 14:30:04	ppp		[opt2] PRIDNS 125.126.65.1
Apr 5 14:30:04	ppp		[opt2] SECDNS 125.126.66.1
Apr 5 14:30:04	ppp		[opt2] IPCP: state change Ack-Sent --> Opened
Apr 5 14:30:04	ppp		[opt2] IPCP: LayerUp
Apr 5 14:30:04	ppp		[opt2] 125.126.0.42 -> 210.48.12.66
      1 Reply Last reply Reply Quote 0
      • First post
        Last post
      Copyright 2025 Rubicon Communications LLC (Netgate). All rights reserved.