FreeBSD 8.2 and MPD5 stability issues - update

Adrian Minta gygy at stsnet.ro
Tue Jul 5 10:10:59 UTC 2011


A deeper debug of a failure looks like this:

# grep "L28-6225" /var/log/mpd.log
Jul  5 13:06:39 lns mpd: [L28-6225] L2TP: Incoming call #70 via control 
connection 0x80b7bfc10 accepted
Jul  5 13:06:39 lns mpd: [L28-6225] Link: OPEN event
Jul  5 13:06:39 lns mpd: [L28-6225] LCP: Open event
Jul  5 13:06:39 lns mpd: [L28-6225] LCP: state change Initial --> Starting
Jul  5 13:06:39 lns mpd: [L28-6225] LCP: LayerStart
Jul  5 13:06:40 lns mpd: [L28-6225] L2TP: Call #70 connected
Jul  5 13:06:40 lns mpd: [L28-6225] Link: UP event
Jul  5 13:06:40 lns mpd: [L28-6225] LCP: Up event
Jul  5 13:06:40 lns mpd: [L28-6225] LCP: state change Starting --> Req-Sent
Jul  5 13:06:40 lns mpd: [L28-6225] LCP: SendConfigReq #1
Jul  5 13:06:42 lns mpd: [L28-6225] LCP: rec'd Configure Request #1 
(Req-Sent)
Jul  5 13:06:42 lns mpd: [L28-6225] LCP: SendConfigAck #1
Jul  5 13:06:42 lns mpd: [L28-6225] LCP: state change Req-Sent --> Ack-Sent
Jul  5 13:06:42 lns mpd: [L28-6225] LCP: SendConfigReq #2
Jul  5 13:06:43 lns mpd: [L28-6225] LCP: rec'd Configure Reject #4 
(Ack-Sent)
Jul  5 13:06:43 lns mpd: [L28-6225]   Wrong id#, expecting 2
Jul  5 13:06:44 lns mpd: [L28-6225] LCP: SendConfigReq #3
Jul  5 13:06:46 lns mpd: [L28-6225] LCP: SendConfigReq #4
Jul  5 13:06:48 lns mpd: [L28-6225] LCP: SendConfigReq #5
Jul  5 13:06:48 lns mpd: [L28-6225] LCP: rec'd Configure Reject #5 
(Ack-Sent)
Jul  5 13:06:48 lns mpd: [L28-6225] LCP: SendConfigReq #6
Jul  5 13:06:49 lns mpd: [L28-6225] LCP: rec'd Configure Request #1 
(Ack-Sent)
Jul  5 13:06:49 lns mpd: [L28-6225] LCP: SendConfigAck #1
Jul  5 13:06:50 lns mpd: [L28-6225] LCP: SendConfigReq #7
Jul  5 13:06:52 lns mpd: [L28-6225] LCP: SendConfigReq #8
Jul  5 13:06:52 lns mpd: [L28-6225] LCP: rec'd Configure Reject #6 
(Ack-Sent)
Jul  5 13:06:52 lns mpd: [L28-6225]   Wrong id#, expecting 8
Jul  5 13:06:54 lns mpd: [L28-6225] LCP: SendConfigReq #9
Jul  5 13:06:55 lns mpd: [L28-6225] LCP: rec'd Configure Request #1 
(Ack-Sent)
Jul  5 13:06:55 lns mpd: [L28-6225] LCP: SendConfigAck #1
Jul  5 13:06:56 lns mpd: [L28-6225] LCP: SendConfigReq #10
Jul  5 13:06:57 lns mpd: [L28-6225] LCP: rec'd Configure Reject #7 
(Ack-Sent)
Jul  5 13:06:57 lns mpd: [L28-6225]   Wrong id#, expecting 10
Jul  5 13:06:58 lns mpd: [L28-6225] LCP: SendConfigReq #11
Jul  5 13:07:00 lns mpd: [L28-6225] LCP: SendConfigReq #12
Jul  5 13:07:02 lns mpd: [L28-6225] LCP: rec'd Configure Request #1 
(Ack-Sent)
Jul  5 13:07:02 lns mpd: [L28-6225] LCP: SendConfigAck #1
Jul  5 13:07:02 lns mpd: [L28-6225] LCP: rec'd Configure Reject #8 
(Ack-Sent)
Jul  5 13:07:02 lns mpd: [L28-6225]   Wrong id#, expecting 12
Jul  5 13:07:02 lns mpd: [L28-6225] LCP: SendConfigReq #13
Jul  5 13:07:04 lns mpd: [L28-6225] LCP: SendConfigReq #14
Jul  5 13:07:07 lns mpd: [L28-6225] LCP: SendConfigReq #15
Jul  5 13:07:07 lns mpd: [L28-6225] LCP: rec'd Configure Reject #9 
(Ack-Sent)
Jul  5 13:07:07 lns mpd: [L28-6225]   Wrong id#, expecting 15
Jul  5 13:07:09 lns mpd: [L28-6225] LCP: parameter negotiation failed
Jul  5 13:07:09 lns mpd: [L28-6225] LCP: state change Ack-Sent --> Stopped
Jul  5 13:07:09 lns mpd: [L28-6225] LCP: LayerFinish
Jul  5 13:07:09 lns mpd: [L28-6225] L2TP: Call #70 terminated locally
Jul  5 13:07:09 lns mpd: [L28-6225] Link: DOWN event
Jul  5 13:07:09 lns mpd: [L28-6225] LCP: Close event
Jul  5 13:07:09 lns mpd: [L28-6225] LCP: state change Stopped --> Closed
Jul  5 13:07:09 lns mpd: [L28-6225] LCP: Down event
Jul  5 13:07:09 lns mpd: [L28-6225] LCP: state change Closed --> Initial
Jul  5 13:07:09 lns mpd: [L28-6225] Link: SHUTDOWN event
Jul  5 13:07:09 lns mpd: [L28-6225] Link: Shutdown


-- 
Best regards,





More information about the freebsd-net mailing list