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

    PPPOE regression in 2.5.1

    Scheduled Pinned Locked Moved General pfSense Questions
    5 Posts 2 Posters 738 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.
    • M
      mgiammarco2
      last edited by

      Hello,
      I have three pfsense 2.4.4/2.4.5 firewalls: different hardware, different providers but wan on pppoe.
      They worked flawlessy.
      Now I have upgraded them to 2.5.1 and they have the same problem: pppoe connection goes up after several hours.
      I attach part of the log of one of them where you can see that, after many wrong attempts at a certain point it starts working.

      Apr 18 11:11:12	ppp	84311	[wan_link0] Link: reconnection attempt 305
Apr 18 11:11:12	ppp	84311	[wan_link0] PPPoE: Connecting to ''
Apr 18 11:11:12	ppp	84311	PPPoE: rec'd ACNAME "r-rn899"
Apr 18 11:11:12	ppp	84311	[wan_link0] PPPoE: connection successful
Apr 18 11:11:12	ppp	84311	[wan_link0] Link: UP event
Apr 18 11:11:12	ppp	84311	[wan_link0] LCP: Up event
Apr 18 11:11:12	ppp	84311	[wan_link0] LCP: state change Starting --> Req-Sent
Apr 18 11:11:12	ppp	84311	[wan_link0] LCP: SendConfigReq #36
Apr 18 11:11:12	ppp	84311	[wan_link0] PROTOCOMP
Apr 18 11:11:12	ppp	84311	[wan_link0] MRU 1492
Apr 18 11:11:12	ppp	84311	[wan_link0] MAGICNUM 0x124453f6
Apr 18 11:11:13	ppp	84311	[wan_link0] LCP: rec'd Configure Request #136 (Req-Sent)
Apr 18 11:11:13	ppp	84311	[wan_link0] MRU 1492
Apr 18 11:11:13	ppp	84311	[wan_link0] AUTHPROTO PAP
Apr 18 11:11:13	ppp	84311	[wan_link0] MAGICNUM 0x2eb0ce8f
Apr 18 11:11:13	ppp	84311	[wan_link0] LCP: SendConfigAck #136
Apr 18 11:11:13	ppp	84311	[wan_link0] MRU 1492
Apr 18 11:11:13	ppp	84311	[wan_link0] AUTHPROTO PAP
Apr 18 11:11:13	ppp	84311	[wan_link0] MAGICNUM 0x2eb0ce8f
Apr 18 11:11:13	ppp	84311	[wan_link0] LCP: state change Req-Sent --> Ack-Sent
Apr 18 11:11:13	ppp	84311	[wan_link0] LCP: rec'd Configure Ack #36 (Ack-Sent)
Apr 18 11:11:13	ppp	84311	[wan_link0] PROTOCOMP
Apr 18 11:11:13	ppp	84311	[wan_link0] MRU 1492
Apr 18 11:11:13	ppp	84311	[wan_link0] MAGICNUM 0x124453f6
Apr 18 11:11:13	ppp	84311	[wan_link0] LCP: state change Ack-Sent --> Opened
Apr 18 11:11:13	ppp	84311	[wan_link0] LCP: auth: peer wants PAP, I want nothing
Apr 18 11:11:13	ppp	84311	[wan_link0] PAP: using authname "giammar.limfa@cheapnet.it"
Apr 18 11:11:13	ppp	84311	[wan_link0] PAP: sending REQUEST #1 len: 45
Apr 18 11:11:13	ppp	84311	[wan_link0] LCP: LayerUp
Apr 18 11:11:13	ppp	84311	[wan_link0] PAP: rec'd NAK #1 len: 37
Apr 18 11:11:13	ppp	84311	[wan_link0] MESG: REASON013 - MULTISESSION CONTROL
Apr 18 11:11:13	ppp	84311	[wan_link0] LCP: authorization failed
Apr 18 11:11:13	ppp	84311	[wan_link0] LCP: parameter negotiation failed
Apr 18 11:11:13	ppp	84311	[wan_link0] LCP: state change Opened --> Stopping
Apr 18 11:11:13	ppp	84311	[wan_link0] LCP: SendTerminateReq #37lte
Apr 18 11:11:13	ppp	84311	[wan_link0] LCP: LayerDown
Apr 18 11:11:13	ppp	84311	[wan_link0] LCP: rec'd Terminate Request #137 (Stopping)
Apr 18 11:11:13	ppp	84311	[wan_link0] LCP: SendTerminateAck #38
Apr 18 11:11:13	ppp	84311	[wan_link0] PPPoE: connecltetion closed
Apr 18 11:11:13	ppp	84311	[wan_link0] Link: DOWN event
Apr 18 11:11:13	ppp	84311	[wan_link0] LCP: Down event
Apr 18 11:11:13	ppp	84311	[wan_link0] LCP: state change Stopping --> Starting
Apr 18 11:11:13	ppp	84311	[wan_link0] Link: reconnection attempt 306 in 1 seconds
Apr 18 11:11:14	ppp	84311	[wan_link0] Link: reconnection attempt 306
Apr 18 11:11:14	ppp	84311	[wan_link0] PPPoE: Connecting to ''
Apr 18 11:11:14	ppp	84311	PPPoE: rec'd ACNAME "r-rn899"
Apr 18 11:11:14	ppp	84311	[wan_link0] PPPoE: connection successful
Apr 18 11:11:14	ppp	84311	[wan_link0] Link: UP event
Apr 18 11:11:14	ppp	84311	[wan_link0] LCP: Up event
Apr 18 11:11:14	ppp	84311	[wan_link0] LCP: state change Starting --> Req-Sent
Apr 18 11:11:14	ppp	84311	[wan_link0] LCP: SendConfigReq #39
Apr 18 11:11:14	ppp	84311	[wan_link0] PROTOCOMP
Apr 18 11:11:14	ppp	84311	[wan_link0] MRU 1492
Apr 18 11:11:14	ppp	84311	[wan_link0] MAGICNUM 0xe98c9f0d
Apr 18 11:11:14	ppp	84311	[wan_link0] LCP: rec'd Configure Request #189 (Req-Sent)
Apr 18 11:11:14	ppp	84311	[wan_link0] MRU 1492
Apr 18 11:11:14	ppp	84311	[wan_link0] AUTHPROTO PAP
Apr 18 11:11:14	ppp	84311	[wan_link0] MAGICNUM 0x63604b94
Apr 18 11:11:14	ppp	84311	[wan_link0] LCP: SendConfigAck #189
Apr 18 11:11:14	ppp	84311	[wan_link0] MRU 1492
Apr 18 11:11:14	ppp	84311	[wan_link0] AUTHPROTO PAP
Apr 18 11:11:14	ppp	84311	[wan_link0] MAGICNUM 0x63604b94
Apr 18 11:11:14	ppp	84311	[wan_link0] LCP: state change Req-Sent --> Ack-Sent
Apr 18 11:11:14	ppp	84311	[wan_link0] LCP: rec'd Configure Ack #39 (Ack-Sent)
Apr 18 11:11:14	ppp	84311	[wan_link0] PROTOCOMP
Apr 18 11:11:14	ppp	84311	[wan_link0] MRU 1492
Apr 18 11:11:14	ppp	84311	[wan_link0] MAGICNUM 0xe98c9f0d
Apr 18 11:11:14	ppp	84311	[wan_link0] LCP: state change Ack-Sent --> Opened
Apr 18 11:11:14	ppp	84311	[wan_link0] LCP: auth: peer wants PAP, I want nothing
Apr 18 11:11:14	ppp	84311	[wan_link0] PAP: using authname "giammar.limfa@cheapnet.it"
Apr 18 11:11:14	ppp	84311	[wan_link0] PAP: sending REQUEST #1 len: 45
Apr 18 11:11:14	ppp	84311	[wan_link0] LCP: LayerUp
Apr 18 11:11:14	ppp	84311	[wan_link0] PAP: rec'd NAK #1 len: 37
Apr 18 11:11:14	ppp	84311	[wan_link0] MESG: REASON013 - MULTISESSION CONTROL
Apr 18 11:11:14	ppp	84311	[wan_link0] LCP: authorization failed
Apr 18 11:11:14	ppp	84311	[wan_link0] LCP: parameter negotiation failed
Apr 18 11:11:14	ppp	84311	[wan_link0] LCP: state change Opened --> Stopping
Apr 18 11:11:14	ppp	84311	[wan_link0] LCP: SendTerminateReq #40
Apr 18 11:11:14	ppp	84311	[wan_link0] LCP: LayerDown
Apr 18 11:11:14	ppp	84311	[wan_link0] LCP: rec'd Terminate Request #190 (Stopping)
Apr 18 11:11:14	ppp	84311	[wan_link0] LCP: SendTerminateAck #41
Apr 18 11:11:14	ppp	84311	[wan_link0] PPPoE: connection closed
Apr 18 11:11:14	ppp	84311	[wan_link0] Link: DOWN event
Apr 18 11:11:14	ppp	84311	[wan_link0] LCP: Down event
Apr 18 11:11:14	ppp	84311	[wan_link0] LCP: state change Stopping --> Starting
Apr 18 11:11:14	ppp	84311	[wan_link0] Link: reconnection attempt 307 in 2 seconds
Apr 18 11:11:16	ppp	84311	[wan_link0] Link: reconnection attempt 307
Apr 18 11:11:16	ppp	84311	[wan_link0] PPPoE: Connecting to ''
Apr 18 11:11:16	ppp	84311	PPPoE: rec'd ACNAME "r-rn899"
Apr 18 11:11:16	ppp	84311	[wan_link0] PPPoE: connection successful
Apr 18 11:11:16	ppp	84311	[wan_link0] Link: UP event
Apr 18 11:11:16	ppp	84311	[wan_link0] LCP: Up event
Apr 18 11:11:16	ppp	84311	[wan_link0] LCP: state change Starting --> Req-Sent
Apr 18 11:11:16	ppp	84311	[wan_link0] LCP: SendConfigReq #42
Apr 18 11:11:16	ppp	84311	[wan_link0] PROTOCOMP
Apr 18 11:11:16	ppp	84311	[wan_link0] MRU 1492
Apr 18 11:11:16	ppp	84311	[wan_link0] MAGICNUM 0x99b86112
Apr 18 11:11:16	ppp	84311	[wan_link0] LCP: rec'd Configure Request #246 (Req-Sent)
Apr 18 11:11:16	ppp	84311	[wan_link0] MRU 1492
Apr 18 11:11:16	ppp	84311	[wan_link0] AUTHPROTO PAP
Apr 18 11:11:16	ppp	84311	[wan_link0] MAGICNUM 0x4f2d9db6
Apr 18 11:11:16	ppp	84311	[wan_link0] LCP: SendConfigAck #246
Apr 18 11:11:16	ppp	84311	[wan_link0] MRU 1492
Apr 18 11:11:16	ppp	84311	[wan_link0] AUTHPROTO PAP
Apr 18 11:11:16	ppp	84311	[wan_link0] MAGICNUM 0x4f2d9db6
Apr 18 11:11:16	ppp	84311	[wan_link0] LCP: state change Req-Sent --> Ack-Sent
Apr 18 11:11:16	ppp	84311	[wan_link0] LCP: rec'd Configure Ack #42 (Ack-Sent)
Apr 18 11:11:16	ppp	84311	[wan_link0] PROTOCOMP
Apr 18 11:11:16	ppp	84311	[wan_link0] MRU 1492
Apr 18 11:11:16	ppp	84311	[wan_link0] MAGICNUM 0x99b86112
Apr 18 11:11:16	ppp	84311	[wan_link0] LCP: state change Ack-Sent --> Opened
Apr 18 11:11:16	ppp	84311	[wan_link0] LCP: auth: peer wants PAP, I want nothing
Apr 18 11:11:16	ppp	84311	[wan_link0] PAP: using authname "giammar.limfa@cheapnet.it"
Apr 18 11:11:16	ppp	84311	[wan_link0] PAP: sending REQUEST #1 len: 45
Apr 18 11:11:16	ppp	84311	[wan_link0] LCP: LayerUp
Apr 18 11:11:17	ppp	84311	[wan_link0] PAP: rec'd NAK #1 len: 37
Apr 18 11:11:17	ppp	84311	[wan_link0] MESG: REASON013 - MULTISESSION CONTROL
Apr 18 11:11:17	ppp	84311	[wan_link0] LCP: authorization failed
Apr 18 11:11:17	ppp	84311	[wan_link0] LCP: parameter negotiation failed
Apr 18 11:11:17	ppp	84311	[wan_link0] LCP: state change Opened --> Stopping
Apr 18 11:11:17	ppp	84311	[wan_link0] LCP: SendTerminateReq #43
Apr 18 11:11:17	ppp	84311	[wan_link0] LCP: LayerDown
Apr 18 11:11:17	ppp	84311	[wan_link0] LCP: rec'd Terminate Request #247 (Stopping)
Apr 18 11:11:17	ppp	84311	[wan_link0] LCP: SendTerminateAck #44
Apr 18 11:11:17	ppp	84311	[wan_link0] PPPoE: connection closed
Apr 18 11:11:17	ppp	84311	[wan_link0] Link: DOWN event
Apr 18 11:11:17	ppp	84311	[wan_link0] LCP: Down event
Apr 18 11:11:17	ppp	84311	[wan_link0] LCP: state change Stopping --> Starting
Apr 18 11:11:17	ppp	84311	[wan_link0] Link: reconnection attempt 308 in 4 seconds
Apr 18 11:11:21	ppp	84311	[wan_link0] Link: reconnection attempt 308
Apr 18 11:11:21	ppp	84311	[wan_link0] PPPoE: Connecting to ''
Apr 18 11:11:21	ppp	84311	PPPoE: rec'd ACNAME "r-rn899"
Apr 18 11:11:21	ppp	84311	[wan_link0] PPPoE: connection successful
Apr 18 11:11:21	ppp	84311	[wan_link0] Link: UP event
Apr 18 11:11:21	ppp	84311	[wan_link0] LCP: Up event
Apr 18 11:11:21	ppp	84311	[wan_link0] LCP: state change Starting --> Req-Sent
Apr 18 11:11:21	ppp	84311	[wan_link0] LCP: SendConfigReq #45
Apr 18 11:11:21	ppp	84311	[wan_link0] PROTOCOMP
Apr 18 11:11:21	ppp	84311	[wan_link0] MRU 1492
Apr 18 11:11:21	ppp	84311	[wan_link0] MAGICNUM 0xedf5424f
Apr 18 11:11:21	ppp	84311	[wan_link0] LCP: rec'd Configure Request #28 (Req-Sent)
Apr 18 11:11:21	ppp	84311	[wan_link0] MRU 1492
Apr 18 11:11:21	ppp	84311	[wan_link0] AUTHPROTO PAP
Apr 18 11:11:21	ppp	84311	[wan_link0] MAGICNUM 0x6cdc7b5d
Apr 18 11:11:21	ppp	84311	[wan_link0] LCP: SendConfigAck #28
Apr 18 11:11:21	ppp	84311	[wan_link0] MRU 1492
Apr 18 11:11:21	ppp	84311	[wan_link0] AUTHPROTO PAP
Apr 18 11:11:21	ppp	84311	[wan_link0] MAGICNUM 0x6cdc7b5d
Apr 18 11:11:21	ppp	84311	[wan_link0] LCP: state change Req-Sent --> Ack-Sent
Apr 18 11:11:21	ppp	84311	[wan_link0] LCP: rec'd Configure Ack #45 (Ack-Sent)
Apr 18 11:11:21	ppp	84311	[wan_link0] PROTOCOMP
Apr 18 11:11:21	ppp	84311	[wan_link0] MRU 1492
Apr 18 11:11:21	ppp	84311	[wan_link0] MAGICNUM 0xedf5424f
Apr 18 11:11:21	ppp	84311	[wan_link0] LCP: state chlteange Ack-Sent --> Opened
Apr 18 11:11:21	ppp	84311	[wan_link0] LCP: auth: peer wants PAP, I want nothing
Apr 18 11:11:21	ppp	84311	[wan_link0] PAP: using authname "giammar.limfa@cheapnet.it"
Apr 18 11:11:21	ppp	84311	[wan_link0] PAP: sending REQUEST #1 len: 45
Apr 18 11:11:21	ppp	84311	[wan_link0] LCP: LayerUp
Apr 18 11:11:21	ppp	84311	[wan_link0] PAP: rec'd NAK #1 len: 37
Apr 18 11:11:21	ppp	84311	[wan_link0] MESG: REASON013 - MULTISESSION CONTROL
Apr 18 11:11:21	ppp	84311	[wan_link0] LCP: authorization failed
Apr 18 11:11:21	ppp	84311	[wan_link0] LCP: parameter negotiation failed
Apr 18 11:11:21	ppp	84311	[wan_link0] LCP: state change Opened --> Stopping
Apr 18 11:11:21	ppp	84311	[wan_link0] LCP: SendTerminateReq #46
Apr 18 11:11:21	ppp	84311	[wan_link0] LCP: LayerDown
Apr 18 11:11:21	ppp	84311	[wan_link0] LCP: rec'd Terminate Request #29 (Stopping)
Apr 18 11:11:21	ppp	84311	[wan_link0] LCP: SendTerminateAck #47
Apr 18 11:11:21	ppp	84311	[wan_link0] PPPoE: connection closed
Apr 18 11:11:21	ppp	84311	[wan_link0] Link: DOWN event
Apr 18 11:11:21	ppp	84311	[wan_link0] LCP: Down event
Apr 18 11:11:21	ppp	84311	[wan_link0] LCP: state change Stopping --> Starting
Apr 18 11:11:21	ppp	84311	[wan_link0] Link: reconnection attempt 309 in 4 seconds
Apr 18 11:11:26	ppp	84311	[wan_link0] Link: reconnection attempt 309
Apr 18 11:11:26	ppp	84311	[wan_link0] PPPoE: Connecting to ''
Apr 18 11:11:26	ppp	84311	PPPoE: rec'd ACNAME "r-rn899"
Apr 18 11:11:26	ppp	84311	[wan_link0] PPPoE: connection successful
Apr 18 11:11:26	ppp	84311	[wan_link0] Link: UP event
Apr 18 11:11:26	ppp	84311	[wan_link0] LCP: Up event
Apr 18 11:11:26	ppp	84311	[wan_link0] LCP: state change Starting --> Req-Sent
Apr 18 11:11:26	ppp	84311	[wan_link0] LCP: SendConfigReq #48
Apr 18 11:11:26	ppp	84311	[wan_link0] PROTOCOMP
Apr 18 11:11:26	ppp	84311	[wan_link0] MRU 1492
Apr 18 11:11:26	ppp	84311	[wan_link0] MAGICNUM 0xc6c1f564
Apr 18 11:11:26	ppp	84311	[wan_link0] LCP: rec'd Configure Request #113 (Req-Sent)
Apr 18 11:11:26	ppp	84311	[wan_link0] MRU 1492
Apr 18 11:11:26	ppp	84311	[wan_link0] AUTHPROTO PAP
Apr 18 11:11:26	ppp	84311	[wan_link0] MAGICNUM 0x56696b12
Apr 18 11:11:26	ppp	84311	[wan_link0] LCP: SendConfigAck #113
Apr 18 11:11:26	ppp	84311	[wan_link0] MRU 1492
Apr 18 11:11:26	ppp	84311	[wan_link0] AUTHPROTO PAP
Apr 18 11:11:26	ppp	84311	[wan_link0] MAGICNUM 0x56696b12
Apr 18 11:11:26	ppp	84311	[wan_link0] LCP: state change Req-Sent --> Ack-Sent
Apr 18 11:11:26	ppp	84311	[wan_link0] LCP: rec'd Configure Ack #48 (Ack-Sent)
Apr 18 11:11:26	ppp	84311	[wan_link0] PROTOCOMP
Apr 18 11:11:26	ppp	84311	[wan_link0] MRU 1492
Apr 18 11:11:26	ppp	84311	[wan_link0] MAGICNUM 0xc6c1f564
Apr 18 11:11:26	ppp	84311	[wan_link0] LCP: state change Ack-Sent --> Opened
Apr 18 11:11:26	ppp	84311	[wan_link0] LCP: auth: peer wants PAP, I want nothing
Apr 18 11:11:26	ppp	84311	[wan_link0] PAP: using authname "giammar.limfa@cheapnet.it"
Apr 18 11:11:26	ppp	84311	[wan_link0] PAP: sending REQUEST #1 len: 45
Apr 18 11:11:26	ppp	84311	[wan_link0] LCP: LayerUp
Apr 18 11:11:26	ppp	84311	[wan_link0] PAP: rec'd NAK #1 len: 37
Apr 18 11:11:26	ppp	84311	[wan_link0] MESG: REASON013 - MULTISESSION CONTROL
Apr 18 11:11:26	ppp	84311	[wan_link0] LCP: authorization failed
Apr 18 11:11:26	ppp	84311	[wan_link0] LCP: parameter negotiation failed
Apr 18 11:11:26	ppp	84311	[wan_link0] LCP: state change Opened --> Stopping
Apr 18 11:11:26	ppp	84311	[wan_link0] LCP: SendTerminateReq #49
Apr 18 11:11:26	ppp	84311	[wan_link0] LCP: LayerDown
Apr 18 11:11:26	ppp	84311	[wan_link0] LCP: rec'd Terminate Request #114 (Stopping)
Apr 18 11:11:26	ppp	84311	[wan_link0] LCP: SendTerminateAck #50
Apr 18 11:11:26	ppp	84311	[wan_link0] PPPoE: connection closed
Apr 18 11:11:26	ppp	84311	[wan_link0] Link: DOWN event
Apr 18 11:11:26	ppp	84311	[wan_link0] LCP: Down event
Apr 18 11:11:26	ppp	84311	[wan_link0] LCP: state change Stopping --> Starting
Apr 18 11:11:26	ppp	84311	[wan_link0] Link: reconnection attempt 310 in 4 seconds
Apr 18 11:11:30	ppp	84311	[wan_link0] Link: reconnection attempt 310
Apr 18 11:11:30	ppp	84311	[wan_link0] PPPoE: Connecting to ''
Apr 18 11:11:30	ppp	84311	PPPoE: rec'd ACNAME "r-rn899"
Apr 18 11:11:30	ppp	84311	[wan_link0] PPPoE: connection successful
Apr 18 11:11:30	ppp	84311	[wan_link0] Link: UP event
Apr 18 11:11:30	ppp	84311	[wan_link0] LCP: Up event
Apr 18 11:11:30	ppp	84311	[wan_link0] LCP: state change Starting --> Req-Sent
Apr 18 11:11:30	ppp	84311	[wan_link0] LCP: SendConfigReq #51
Apr 18 11:11:30	ppp	84311	[wan_link0] PROTOCOMP
Apr 18 11:11:30	ppp	84311	[wan_link0] MRU 1492
Apr 18 11:11:30	ppp	84311	[wan_link0] MAGICNUM 0x30ef756d
Apr 18 11:11:30	ppp	84311	[wan_link0] LCP: rec'd Configure Request #228 (Req-Sent)
Apr 18 11:11:30	ppp	84311	[wan_link0] MRU 1492
Apr 18 11:11:30	ppp	84311	[wan_link0] AUTHPROTO PAP
Apr 18 11:11:30	ppp	84311	[wan_link0] MAGICNUM 0x02e9f865
Apr 18 11:11:30	ppp	84311	[wan_link0] LCP: SendConfigAck #228
Apr 18 11:11:30	ppp	84311	[wan_link0] MRU 1492
Apr 18 11:11:30	ppp	84311	[wan_link0] AUTHPROTO PAP
Apr 18 11:11:30	ppp	84311	[wan_link0] MAGICNUM 0x02e9f865
Apr 18 11:11:30	ppp	84311	[wan_link0] LCP: state change Req-Sent --> Ack-Sent
Apr 18 11:11:30	ppp	84311	[wan_link0] LCP: rec'd Configure Ack #51 (Ack-Sent)
Apr 18 11:11:30	ppp	84311	[wan_link0] PROTOCOMP
Apr 18 11:11:30	ppp	84311	[wan_link0] MRU 1492
Apr 18 11:11:30	ppp	84311	[wan_link0] MAGICNUM 0x30ef756d
Apr 18 11:11:30	ppp	84311	[wan_link0] LCP: state change Ack-Sent --> Opened
Apr 18 11:11:30	ppp	84311	[wan_link0] LCP: auth: peer wants PAP, I want nothing
Apr 18 11:11:30	ppp	84311	[wan_link0] PAP: using authname "giammar.limfa@cheapnet.it"
Apr 18 11:11:30	ppp	84311	[wan_link0] PAP: sending REQUEST #1 len: 45
Apr 18 11:11:30	ppp	84311	[wan_link0] LCP: LayerUp
Apr 18 11:11:30	ppp	84311	[wan_link0] PAP: rec'd NAK #1 len: 37
Apr 18 11:11:30	ppp	84311	[wan_link0] MESG: REASON013 - MULTISESSION CONTROL
Apr 18 11:11:30	ppp	84311	[wan_link0] LCP: authorization failed
Apr 18 11:11:30	ppp	84311	[wan_link0] LCP: parameter negotiation failed
Apr 18 11:11:30	ppp	84311	[wan_link0] LCP: state change Opened --> Stopping
Apr 18 11:11:30	ppp	84311	[wan_link0] LCP: SendTerminateReq #52
Apr 18 11:11:30	ppp	84311	[wan_link0] LCP: LayerDown
Apr 18 11:11:30	ppp	84311	[wan_link0] LCP: rec'd Terminate Request #229 (Stopping)
Apr 18 11:11:30	ppp	84311	[wan_link0] LCP: SendTerminateAck #53
Apr 18 11:11:30	ppp	84311	[wan_link0] PPPoE: connection closed
Apr 18 11:11:30	ppp	84311	[wan_link0] Link: DOWN event
Apr 18 11:11:30	ppp	84311	[wan_link0] LCP: Down event
Apr 18 11:11:30	ppp	84311	[wan_link0] LCP: state change Stopping --> Starting
Apr 18 11:11:30	ppp	84311	[wan_link0] Link: reconnection attempt 311 in 3 seconds
Apr 18 11:11:33	ppp	84311	[wan_link0] Link: reconnection attempt 311
Apr 18 11:11:33	ppp	84311	[wan_link0] PPPoE: Connecting to ''
Apr 18 11:11:34	ppp	84311	PPPoE: rec'd ACNAME "r-rn899"
Apr 18 11:11:34	ppp	84311	[wan_link0] PPPoE: connection successful
Apr 18 11:11:34	ppp	84311	[wan_link0] Link: UP event
Apr 18 11:11:34	ppp	84311	[wan_link0] LCP: Up event
Apr 18 11:11:34	ppp	84311	[wan_link0] LCP: state change Starting --> Req-Sent
Apr 18 11:11:34	ppp	84311	[wan_link0] LCP: SendConfigReq #54
Apr 18 11:11:34	ppp	84311	[wan_link0] PROTOCOMP
Apr 18 11:11:34	ppp	84311	[wan_link0] MRU 1492
Apr 18 11:11:34	ppp	84311	[wan_link0] MAGICNUM 0xa44df010
Apr 18 11:11:34	ppp	84311	[wan_link0] LCP: rec'd Configure Request #189 (Req-Sent)
Apr 18 11:11:34	ppp	84311	[wan_link0] MRU 1492
Apr 18 11:11:34	ppp	84311	[wan_link0] AUTHPROTO PAP
Apr 18 11:11:34	ppp	84311	[wan_link0] MAGICNUM 0x4b18e687
Apr 18 11:11:34	ppp	84311	[wan_link0] LCP: SendConfigAck #189
Apr 18 11:11:34	ppp	84311	[wan_link0] MRU 1492
Apr 18 11:11:34	ppp	84311	[wan_link0] AUTHPROTO PAP
Apr 18 11:11:34	ppp	84311	[wan_link0] MAGICNUM 0x4b18e687
Apr 18 11:11:34	ppp	84311	[wan_link0] LCP: state change Req-Sent --> Ack-Sent
Apr 18 11:11:34	ppp	84311	[wan_link0] LCP: rec'd Configure Ack #54 (Ack-Sent)
Apr 18 11:11:34	ppp	84311	[wan_link0] PROTOCOMP
Apr 18 11:11:34	ppp	84311	[wan_link0] MRU 1492
Apr 18 11:11:34	ppp	84311	[wan_link0] MAGICNUM 0xa44df010
Apr 18 11:11:34	ppp	84311	[wan_link0] LCP: state change Ack-Sent --> Opened
Apr 18 11:11:34	ppp	84311	[wan_link0] LCP: auth: peer wants PAP, I want nothing
Apr 18 11:11:34	ppp	84311	[wan_link0] PAP: using authname "giammar.limfa@cheapnet.it"
Apr 18 11:11:34	ppp	84311	[wan_link0] PAP: sending REQUEST #1 len: 45
Apr 18 11:11:34	ppp	84311	[wan_link0] LCP: LayerUp
Apr 18 11:11:34	ppp	84311	[wan_link0] PAP: rec'd NAK #1 len: 37
Apr 18 11:11:34	ppp	84311	[wan_link0] MESG: REASON013 - MULTISESSION CONTROL
Apr 18 11:11:34	ppp	84311	[wan_link0] LCP: authorization failed
Apr 18 11:11:34	ppp	84311	[wan_link0] LCP: parameter negotiation failed
Apr 18 11:11:34	ppp	84311	[wan_link0] LCP: state change Opened --> Stopping
Apr 18 11:11:34	ppp	84311	[wan_link0] LCP: SendTerminateReq #55
Apr 18 11:11:34	ppp	84311	[wan_link0] LCP: LayerDown
Apr 18 11:11:34	ppp	84311	[wan_link0] LCP: rec'd Terminate Request #190 (Stopping)
Apr 18 11:11:34	ppp	84311	[wan_link0] LCP: SendTerminateAck #56
Apr 18 11:11:34	ppp	84311	[wan_link0] PPPoE: connection closed
Apr 18 11:11:34	ppp	84311	[wan_link0] Link: DOWN event
Apr 18 11:11:34	ppp	84311	[wan_link0] LCP: Down event
Apr 18 11:11:34	ppp	84311	[wan_link0] LCP: state change Stopping --> Starting
Apr 18 11:11:34	ppp	84311	[wan_link0] Link: reconnection attempt 312 in 2 seconds
Apr 18 11:11:36	ppp	84311	[wan_link0] Link: reconnection attempt 312
Apr 18 11:11:36	ppp	84311	[wan_link0] PPPoE: Connecting to ''
Apr 18 11:11:36	ppp	84311	PPPoE: rec'd ACNAME "r-rn899"
Apr 18 11:11:36	ppp	84311	[wan_link0] PPPoE: connection successful
Apr 18 11:11:36	ppp	84311	[wan_link0] Link: UP event
Apr 18 11:11:36	ppp	84311	[wan_link0] LCP: Up event
Apr 18 11:11:36	ppp	84311	[wan_link0] LCP: state change Starting --> Req-Sent
Apr 18 11:11:36	ppp	84311	[wan_link0] LCP: SendConfigReq #57
Apr 18 11:11:36	ppp	84311	[wan_link0] PROTOCOMP
Apr 18 11:11:36	ppp	84311	[wan_link0] MRU 1492
Apr 18 11:11:36	ppp	84311	[wan_link0] MAGICNUM 0x5cd50fec
Apr 18 11:11:36	ppp	84311	[wan_link0] LCP: rec'd Configure Ack #57 (Req-Sent)
Apr 18 11:11:36	ppp	84311	[wan_link0] PROTOCOMP
Apr 18 11:11:36	ppp	84311	[wan_link0] MRU 1492
Apr 18 11:11:36	ppp	84311	[wan_link0] MAGICNUM 0x5cd50fec
Apr 18 11:11:36	ppp	84311	[wan_link0] LCP: state change Req-Sent --> Ack-Rcvd
Apr 18 11:11:38	ppp	84311	[wan_link0] LCP: state change Ack-Rcvd --> Req-Sent
Apr 18 11:11:38	ppp	84311	[wan_link0] LCP: SendConfigReq #58
Apr 18 11:11:38	ppp	84311	[wan_link0] PROTOCOMP
Apr 18 11:11:38	ppp	84311	[wan_link0] MRU 1492
Apr 18 11:11:38	ppp	84311	[wan_link0] MAGICNUM 0x5cd50fec
Apr 18 11:11:38	ppp	84311	[wan_link0] LCP: rec'd Configure Ack #58 (Req-Sent)
Apr 18 11:11:38	ppp	84311	[wan_link0] PROTOCOMP
Apr 18 11:11:38	ppp	84311	[wan_link0] MRU 1492
Apr 18 11:11:38	ppp	84311	[wan_link0] MAGICNUM 0x5cd50fec
Apr 18 11:11:38	ppp	84311	[wan_link0] LCP: state change Req-Sent --> Ack-Rcvd
Apr 18 11:11:39	ppp	84311	[wan_link0] LCP: rec'd Configure Request #188 (Ack-Rcvd)
Apr 18 11:11:39	ppp	84311	[wan_link0] MRU 1492
Apr 18 11:11:39	ppp	84311	[wan_link0] AUTHPROTO PAP
Apr 18 11:11:39	ppp	84311	[wan_link0] MAGICNUM 0x54be6419
Apr 18 11:11:39	ppp	84311	[wan_link0] LCP: SendConfigAck #188
Apr 18 11:11:39	ppp	84311	[wan_link0] MRU 1492
Apr 18 11:11:39	ppp	84311	[wan_link0] AUTHPROTO PAP
Apr 18 11:11:39	ppp	84311	[wan_link0] MAGICNUM 0x54be6419
Apr 18 11:11:39	ppp	84311	[wan_link0] LCP: state change Ack-Rcvd --> Opened
Apr 18 11:11:39	ppp	84311	[wan_link0] LCP: auth: peer wants PAP, I want nothing
Apr 18 11:11:39	ppp	84311	[wan_link0] PAP: using authname "giammar.limfa@cheapnet.it"
Apr 18 11:11:39	ppp	84311	[wan_link0] PAP: sending REQUEST #1 len: 45
Apr 18 11:11:39	ppp	84311	[wan_link0] LCP: LayerUp
Apr 18 11:11:39	ppp	84311	[wan_link0] PAP: rec'd NAK #1 len: 37
Apr 18 11:11:39	ppp	84311	[wan_link0] MESG: REASON013 - MULTISESSION CONTROL
Apr 18 11:11:39	ppp	84311	[wan_link0] LCP: authorization failed
Apr 18 11:11:39	ppp	84311	[wan_link0] LCP: parameter negotiation failed
Apr 18 11:11:39	ppp	84311	[wan_link0] LCP: state change Opened --> Stopping
Apr 18 11:11:39	ppp	84311	[wan_link0] LCP: SendTerminateReq #59
Apr 18 11:11:39	ppp	84311	[wan_link0] LCP: LayerDown
Apr 18 11:11:39	ppp	84311	[wan_link0] LCP: rec'd Terminate Request #189 (Stopping)
Apr 18 11:11:39	ppp	84311	[wan_link0] LCP: SendTerminateAck #60
Apr 18 11:11:40	ppp	84311	[wan_link0] LCP: rec'd Configure Request #116 (Stopping)
Apr 18 11:11:41	ppp	84311	[wan_link0] LCP: SendTerminateReq #61
Apr 18 11:11:41	ppp	84311	[wan_link0] LCP: rec'd Terminate Ack #61 (Stopping)
Apr 18 11:11:41	ppp	84311	[wan_link0] LCP: state change Stopping --> Stopped
Apr 18 11:11:41	ppp	84311	[wan_link0] LCP: LayerFinish
Apr 18 11:11:41	ppp	84311	[wan_link0] PPPoE: connection closed
Apr 18 11:11:41	ppp	84311	[wan_link0] Link: DOWN event
Apr 18 11:11:41	ppp	84311	[wan_link0] LCP: Down event
Apr 18 11:11:41	ppp	84311	[wan_link0] LCP: state change Stopped --> Starting
Apr 18 11:11:41	ppp	84311	[wan_link0] LCP: LayerStart
Apr 18 11:11:41	ppp	84311	[wan_link0] Link: reconnection attempt 313 in 2 seconds
Apr 18 11:11:43	ppp	84311	[wan_link0] Link: reconnection attempt 313
Apr 18 11:11:43	ppp	84311	[wan_link0] PPPoE: Connecting to ''
Apr 18 11:11:43	ppp	84311	PPPoE: rec'd ACNAME "r-rn899"
Apr 18 11:11:43	ppp	84311	[wan_link0] PPPoE: connection successful
Apr 18 11:11:43	ppp	84311	[wan_link0] Link: UP event
Apr 18 11:11:43	ppp	84311	[wan_link0] LCP: Up event
Apr 18 11:11:43	ppp	84311	[wan_link0] LCP: state change Starting --> Req-Sent
Apr 18 11:11:43	ppp	84311	[wan_link0] LCP: SendConfigReq #62
Apr 18 11:11:43	ppp	84311	[wan_link0] PROTOCOMP
Apr 18 11:11:43	ppp	84311	[wan_link0] MRU 1492
Apr 18 11:11:43	ppp	84311	[wan_link0] MAGICNUM 0x120693a6
Apr 18 11:11:44	ppp	84311	[wan_link0] LCP: rec'd Configure Request #99 (Req-Sent)
Apr 18 11:11:44	ppp	84311	[wan_link0] MRU 1492
Apr 18 11:11:44	ppp	84311	[wan_link0] AUTHPROTO PAP
Apr 18 11:11:44	ppp	84311	[wan_link0] MAGICNUM 0x45f329e3
Apr 18 11:11:44	ppp	84311	[wan_link0] LCP: SendConfigAck #99
Apr 18 11:11:44	ppp	84311	[wan_link0] MRU 1492
Apr 18 11:11:44	ppp	84311	[wan_link0] AUTHPROTO PAP
Apr 18 11:11:44	ppp	84311	[wan_link0] MAGICNUM 0x45f329e3
Apr 18 11:11:44	ppp	84311	[wan_link0] LCP: state change Req-Sent --> Ack-Sent
Apr 18 11:11:44	ppp	84311	[wan_link0] LCP: rec'd Configure Ack #62 (Ack-Sent)
Apr 18 11:11:44	ppp	84311	[wan_link0] PROTOCOMP
Apr 18 11:11:44	ppp	84311	[wan_link0] MRU 1492
Apr 18 11:11:44	ppp	84311	[wan_link0] MAGICNUM 0x120693a6
Apr 18 11:11:44	ppp	84311	[wan_link0] LCP: state change Ack-Sent --> Opened
Apr 18 11:11:44	ppp	84311	[wan_link0] LCP: auth: peer wants PAP, I want nothing
Apr 18 11:11:44	ppp	84311	[wan_link0] PAP: using authname "giammar.limfa@cheapnet.it"
Apr 18 11:11:44	ppp	84311	[wan_link0] PAP: sending REQUEST #1 len: 45
Apr 18 11:11:44	ppp	84311	[wan_link0] LCP: LayerUp
Apr 18 11:11:44	ppp	84311	[wan_link0] PAP: rec'd NAK #1 len: 37
Apr 18 11:11:44	ppp	84311	[wan_link0] MESG: REASON013 - MULTISESSION CONTROL
Apr 18 11:11:44	ppp	84311	[wan_link0] LCP: authorization failed
Apr 18 11:11:44	ppp	84311	[wan_link0] LCP: parameter negotiation failed
Apr 18 11:11:44	ppp	84311	[wan_link0] LCP: state change Opened --> Stopping
Apr 18 11:11:44	ppp	84311	[wan_link0] LCP: SendTerminateReq #63
Apr 18 11:11:44	ppp	84311	[wan_link0] LCP: LayerDown
Apr 18 11:11:44	ppp	84311	[wan_link0] LCP: rec'd Terminate Request #100 (Stopping)
Apr 18 11:11:44	ppp	84311	[wan_link0] LCP: SendTerminateAck #64
Apr 18 11:11:44	ppp	84311	[wan_link0] PPPoE: connection closed
Apr 18 11:11:44	ppp	84311	[wan_link0] Link: DOWN event
Apr 18 11:11:44	ppp	84311	[wan_link0] LCP: Down event
Apr 18 11:11:44	ppp	84311	[wan_link0] LCP: state change Stopping --> Starting
Apr 18 11:11:44	ppp	84311	[wan_link0] Link: reconnection attempt 314 in 3 seconds
Apr 18 11:11:47	ppp	84311	[wan_link0] Link: reconnection attempt 314
Apr 18 11:11:47	ppp	84311	[wan_link0] PPPoE: Connecting to ''
Apr 18 11:11:48	ppp	84311	PPPoE: rec'd ACNAME "sodoma"
Apr 18 11:11:48	ppp	84311	[wan_link0] PPPoE: connection successful
Apr 18 11:11:48	ppp	84311	[wan_link0] Link: UP event
Apr 18 11:11:48	ppp	84311	[wan_link0] LCP: Up event
Apr 18 11:11:48	ppp	84311	[wan_link0] LCP: state change Starting --> Req-Sent
Apr 18 11:11:48	ppp	84311	[wan_link0] LCP: SendConfigReq #65
Apr 18 11:11:48	ppp	84311	[wan_link0] PROTOCOMP
Apr 18 11:11:48	ppp	84311	[wan_link0] MRU 1492
Apr 18 11:11:48	ppp	84311	[wan_link0] MAGICNUM 0xa51f777f
Apr 18 11:11:48	ppp	84311	[wan_link0] LCP: rec'd Configure Request #1 (Req-Sent)
Apr 18 11:11:48	ppp	84311	[wan_link0] MRU 1492
Apr 18 11:11:48	ppp	84311	[wan_link0] AUTHPROTO PAP
Apr 18 11:11:48	ppp	84311	[wan_link0] MAGICNUM 0x086c8b3d
Apr 18 11:11:48	ppp	84311	[wan_link0] LCP: SendConfigAck #1
Apr 18 11:11:48	ppp	84311	[wan_link0] MRU 1492
Apr 18 11:11:48	ppp	84311	[wan_link0] AUTHPROTO PAP
Apr 18 11:11:48	ppp	84311	[wan_link0] MAGICNUM 0x086c8b3d
Apr 18 11:11:48	ppp	84311	[wan_link0] LCP: state change Req-Sent --> Ack-Sent
Apr 18 11:11:48	ppp	84311	[wan_link0] LCP: rec'd Configure Ack #65 (Ack-Sent)
Apr 18 11:11:48	ppp	84311	[wan_link0] PROTOCOMP
Apr 18 11:11:48	ppp	84311	[wan_link0] MRU 1492
Apr 18 11:11:48	ppp	84311	[wan_link0] MAGICNUM 0xa51f777f
Apr 18 11:11:48	ppp	84311	[wan_link0] LCP: state change Ack-Sent --> Opened
Apr 18 11:11:48	ppp	84311	[wan_link0] LCP: auth: peer wants PAP, I want nothing
Apr 18 11:11:48	ppp	84311	[wan_link0] PAP: using authname "giammar.limfa@cheapnet.it"
Apr 18 11:11:48	ppp	84311	[wan_link0] PAP: sending REQUEST #1 len: 45
Apr 18 11:11:48	ppp	84311	[wan_link0] LCP: LayerUp
Apr 18 11:11:48	ppp	84311	[wan_link0] LCP: rec'd Configure Request #1 (Opened)
Apr 18 11:11:48	ppp	84311	[wan_link0] AUTHPROTO CHAP MD5
Apr 18 11:11:48	ppp	84311	[wan_link0] MAGICNUM 0x4c707e2a
Apr 18 11:11:48	ppp	84311	[wan_link0] LCP: LayerDown
Apr 18 11:11:48	ppp	84311	[wan_link0] LCP: SendConfigReq #66
Apr 18 11:11:48	ppp	84311	[wan_link0] PROTOCOMP
Apr 18 11:11:48	ppp	84311	[wan_link0] MRU 1492
Apr 18 11:11:48	ppp	84311	[wan_link0] MAGICNUM 0xa51f777f
Apr 18 11:11:48	ppp	84311	[wan_link0] LCP: SendConfigAck #1
Apr 18 11:11:48	ppp	84311	[wan_link0] AUTHPROTO CHAP MD5
Apr 18 11:11:48	ppp	84311	[wan_link0] MAGICNUM 0x4c707e2a
Apr 18 11:11:48	ppp	84311	[wan_link0] LCP: state change Opened --> Ack-Sent
Apr 18 11:11:48	ppp	84311	[wan_link0] LCP: rec'd Configure Ack #66 (Ack-Sent)
Apr 18 11:11:48	ppp	84311	[wan_link0] PROTOCOMP
Apr 18 11:11:48	ppp	84311	[wan_link0] MRU 1492
Apr 18 11:11:48	ppp	84311	[wan_link0] MAGICNUM 0xa51f777f
Apr 18 11:11:48	ppp	84311	[wan_link0] LCP: state change Ack-Sent --> Opened
Apr 18 11:11:48	ppp	84311	[wan_link0] LCP: auth: peer wants CHAP, I want nothing
Apr 18 11:11:48	ppp	84311	[wan_link0] LCP: LayerUp
Apr 18 11:11:48	ppp	84311	[wan_link0] CHAP: rec'd CHALLENGE #1 len: 25
Apr 18 11:11:48	ppp	84311	[wan_link0] Name: "BNG1"
Apr 18 11:11:48	ppp	84311	[wan_link0] CHAP: Using authname "giammar.limfa@cheapnet.it"
Apr 18 11:11:48	ppp	84311	[wan_link0] CHAP: sending RESPONSE #1 len: 46
Apr 18 11:11:48	ppp	84311	[wan_link0] CHAP: rec'd SUCCESS #1 len: 4
Apr 18 11:11:48	ppp	84311	[wan_link0] LCP: authorization successful
Apr 18 11:11:48	ppp	84311	[wan_link0] Link: Matched action 'bundle "wan" ""'
Apr 18 11:11:48	ppp	84311	[wan_link0] Link: Join bundle "wan"
Apr 18 11:11:48	ppp	84311	[wan] Bundle: Status update: up 1 link, total bandwidth 64000 bps
Apr 18 11:11:48	ppp	84311	[wan] IPCP: Open event
Apr 18 11:11:48	ppp	84311	[wan] IPCP: state change Initial --> Starting
Apr 18 11:11:48	ppp	84311	[wan] IPCP: LayerStart
Apr 18 11:11:48	ppp	84311	[wan] IPCP: Up event
Apr 18 11:11:48	ppp	84311	[wan] IPCP: state change Starting --> Req-Sent
Apr 18 11:11:48	ppp	84311	[wan] IPCP: SendConfigReq #1
Apr 18 11:11:48	ppp	84311	[wan] IPADDR 0.0.0.0
Apr 18 11:11:48	ppp	84311	[wan] COMPPROTO VJCOMP, 16 comp. channels, no comp-cid
Apr 18 11:11:48	ppp	84311	[wan] PRIDNS 0.0.0.0
Apr 18 11:11:48	ppp	84311	[wan] SECDNS 0.0.0.0
Apr 18 11:11:48	ppp	84311	[wan] IPCP: rec'd Configure Request #1 (Req-Sent)
Apr 18 11:11:48	ppp	84311	[wan] IPADDR 80.249.32.96
Apr 18 11:11:48	ppp	84311	[wan] 80.249.32.96 is OK
Apr 18 11:11:48	ppp	84311	[wan] IPCP: SendConfigAck #1
Apr 18 11:11:48	ppp	84311	[wan] IPADDR 80.249.32.96
Apr 18 11:11:48	ppp	84311	[wan] IPCP: state change Req-Sent --> Ack-Sent
Apr 18 11:11:48	ppp	84311	[wan] IPCP: rec'd Configure Reject #1 (Ack-Sent)
Apr 18 11:11:48	ppp	84311	[wan] COMPPROTO VJCOMP, 16 comp. channels, no comp-cid
Apr 18 11:11:48	ppp	84311	[wan] IPCP: SendConfigReq #2
Apr 18 11:11:48	ppp	84311	[wan] IPADDR 0.0.0.0
Apr 18 11:11:48	ppp	84311	[wan] PRIDNS 0.0.0.0
Apr 18 11:11:48	ppp	84311	[wan] SECDNS 0.0.0.0
Apr 18 11:11:48	ppp	84311	[wan] IPCP: rec'd Configure Nak #2 (Ack-Sent)
Apr 18 11:11:48	ppp	84311	[wan] IPADDR 87.238.16.141
Apr 18 11:11:48	ppp	84311	[wan] 87.238.16.141 is OK
Apr 18 11:11:48	ppp	84311	[wan] PRIDNS 80.249.32.30
Apr 18 11:11:48	ppp	84311	[wan] SECDNS 87.238.28.111
Apr 18 11:11:48	ppp	84311	[wan] IPCP: SendConfigReq #3
Apr 18 11:11:48	ppp	84311	[wan] IPADDR 87.238.16.141
Apr 18 11:11:48	ppp	84311	[wan] PRIDNS 80.249.32.30
Apr 18 11:11:48	ppp	84311	[wan] SECDNS 87.238.28.111
Apr 18 11:11:48	ppp	84311	[wan] IPCP: rec'd Configure Ack #3 (Ack-Sent)
Apr 18 11:11:48	ppp	84311	[wan] IPADDR 87.238.16.141
Apr 18 11:11:48	ppp	84311	[wan] PRIDNS 80.249.32.30
Apr 18 11:11:48	ppp	84311	[wan] SECDNS 87.238.28.111
Apr 18 11:11:48	ppp	84311	[wan] IPCP: state change Ack-Sent --> Opened
Apr 18 11:11:48	ppp	84311	[wan] IPCP: LayerUp
Apr 18 11:11:48	ppp	84311	[wan] 87.238.16.141 -> 80.249.32.96
Apr 18 11:11:49	ppp	84311	[wan] IFACE: Up event
Apr 18 11:11:49	ppp	84311	[wan] IFACE: Rename interface ng0 to pppoe0
pfSense is developed and maintained by Netgate. © ESF 2004 - 2021 View license.
      1 Reply Last reply Reply Quote 0
      • N
        netblues
        last edited by

        Seems like your configuration requests multilink and or additional auth.
        Check ppp settings advanced
        Especially this
        a10f8cdb-62fe-4344-8473-0447a3c8bd13-image.png

        As a last resort, try recreating the pppoe connection

        Also, by any chance, do you have some other equipment using the same username/pass for ppp active at the same time?

        M 1 Reply Last reply Reply Quote 0
        • M
          mgiammarco2 @netblues
          last edited by

          @netblues
          Thanks for reply.
          I repeat what I have said: three different firewalls in three different cities with different hardware, different switches and so on.
          All worked perfectly on 2.4.5. On 2.5.1 you must wait some hours before they stabilize.
          It is impossible that someone has gone in three different cities to put another equipment with pppoe.
          Connection deleted and recreated from scratch double checking password. Infact after some hours spontaneuosly begin to work.

          N 1 Reply Last reply Reply Quote 0
          • N
            netblues @mgiammarco2
            last edited by

            @mgiammarco2 We have to believe what the logs say.
            MESG: REASON013 - MULTISESSION CONTROL
            Apr 18 11:11:13 ppp 84311 [wan_link0] LCP: authorization failed
            Apr 18 11:11:13 ppp 84311 [wan_link0] LCP: parameter negotiation failed

            Obviously something triggers this.
            What I can say is that since is a plain straight forward pppoe connection, there are plenty that do work with no issues under 2.5.1.

            Next step is to see logs with pppoe establishin with previous versions and seeing if the multisession appears in logs.

            Might give us pointers to something.
            Apart from that, doing a pcap capture of pppoe negotiaton and compaing raw cable information would also reveal any differences.
            But this isn't exactly trivial too.

            Regards.

            M 1 Reply Last reply Reply Quote 0
            • M
              mgiammarco2 @netblues
              last edited by

              @netblues
              I have done other tests: I plug a mikrotik or a linux netbook and I get immediate pppoe working connection.
              With PFSense some days I get immediate connection even if I restart the box several times. Other days starts again in an infinite loop but after several hours it "repairs" itself. In this cases if I put a mikrotik/linux I get immediate connection so it is not a pppoe server fault.
              I will try a pcap but I need some hints.

              1 Reply Last reply Reply Quote 0
              • First post
                Last post
              Copyright 2025 Rubicon Communications LLC (Netgate). All rights reserved.