From: David Anderson (dma@xxxxxxxxx)
Date: Tue Jun 12 2001 - 20:37:54 GMT-3
Just for reference....
Here is a debug (debug ppp negotiation, debug ppp authentication, debug
dialer) that shows a successfull ISDN callback. R5 is calling R3, the call
is established and then dropped and then R3 calls R5 back. I thought
someone could possibly use it.
David
Type escape sequence to abort.
Sending 5, 100-byte ICMP Echos to 133.1.100.6, timeout is 2 seconds:
07:05:08: BR0/0 DDR: Dialing cause ip (s=133.1.100.5, d=133.1.100.6)
07:05:08: BR0/0 DDR: Attempting to dial 5552221
07:05:34359738368: %LINK-3-UPDOWN: Interface BRI0/0:1, changed state to up
07:05:34359738432: %ISDN-6-CONNECT: Interface BRI0/0:1 is now connected to
55522
21
07:05:34359738375: BR0/0:1 PPP: Treating connection as a callout
07:05:36525315220: BR0/0:1 PPP: Phase is ESTABLISHING, Active Open
07:05:34359738400: BR0/0:1 LCP: O CONFREQ [Closed] id 166 len 32
07:05:38654705663: BR0/0:1 LCP: AuthProto CHAP (0x0305C22305)
07:05:34359738368: BR0/0:1 LCP: MagicNumber 0x321A14B3 (0x0506321A14B3)
07:05:34359738368: BR0/0:1 LCP: Callback 0 (0x0D0300)
07:05:34359738368: BR0/0:1 LCP: MRRU 1524 (0x110405F4)
07:05:34359738368: BR0/0:1 LCP: EndpointDisc 1 Local
(0x130A01726F7574657235)
07:05:08: BR0/0:1 LCP: I CONFREQ [REQsent] id 94 len 29
07:05:08: BR0/0:1 LCP: AuthProto CHAP (0x0305C22305)
07:05:08: BR0/0:1 LCP: MagicNumber 0x061FF2C8 (0x0506061FF2C8)
.7:05:08: BR0/0:1 LCP: MRRU 1524 (0x110405F4)
07:05:08: BR0/0:1 LCP: EndpointDisc 1 Local (0x130A01726F7574657233)
07:05:08: BR0/0:1 LCP: O CONFACK [REQsent] id 94 len 29
07:05:08: BR0/0:1 LCP: AuthProto CHAP (0x0305C22305)
07:05:08: BR0/0:1 LCP: MagicNumber 0x061FF2C8 (0x0506061FF2C8)
07:05:08: BR0/0:1 LCP: MRRU 1524 (0x110405F4)
07:05:08: BR0/0:1 LCP: EndpointDisc 1 Local (0x130A01726F7574657233)
07:05:08: BR0/0:1 LCP: I CONFACK [ACKsent] id 166 len 32
07:05:08: BR0/0:1 LCP: AuthProto CHAP (0x0305C22305)
07:05:08: BR0/0:1 LCP: MagicNumber 0x321A14B3 (0x0506321A14B3)
07:05:08: BR0/0:1 LCP: Callback 0 (0x0D0300)
07:05:08: BR0/0:1 LCP: MRRU 1524 (0x110405F4)
07:05:08: BR0/0:1 LCP: EndpointDisc 1 Local (0x130A01726F7574657235)
07:05:08: BR0/0:1 LCP: State is Open
07:05:08: BR0/0:1 PPP: Phase is AUTHENTICATING, by both
07:05:08: BR0/0:1 CHAP: O CHALLENGE id 67 len 28 from "router5"
07:05:08: BR0/0:1 CHAP: I CHALLENGE id 67 len 28 from "router3"
07:05:08: BR0/0:1 CHAP: O RESPONSE id 67 len 28 from "router5"
07:05:08: BR0/0:1 CHAP: I SUCCE.SS id 67 len 4
07:05:08: BR0/0:1 CHAP: I RESPONSE id 67 len 28 from "router3"
07:05:08: BR0/0:1 CHAP: O SUCCESS id 67 len 4
07:05:08: BR0/0:1 DDR: Callback negotiated - waiting for server disconnect
07:05:08: BR0/0:1 PPP: Phase is VIRTUALIZED
07:05:08: Vi1 PPP: Phase is DOWN, Setup
07:05:08: %LINK-3-UPDOWN: Interface Virtual-Access1, changed state to
upDialer s
tatechange to up Virtual-Access1Dialer call has been placed Virtual-Access1
07:05:08: Vi1 PPP: Treating connection as a callout
07:05:08: Vi1 PPP: Phase is ESTABLISHING, Active Open
07:05:08: Vi1 LCP: O CONFREQ [Closed] id 1 len 32
07:05:08: Vi1 LCP: AuthProto CHAP (0x0305C22305)
07:05:08: Vi1 LCP: MagicNumber 0x321A1509 (0x0506321A1509)
07:05:08: Vi1 LCP: Callback 0 (0x0D0300)
07:05:08: Vi1 LCP: MRRU 1524 (0x110405F4)
07:05:08: Vi1 LCP: EndpointDisc 1 Local (0x130A01726F7574657235)
07:05:08: Vi1 PPP: Phase is UP
07:05:08: Vi1 IPCP: O CONFREQ [Closed] id 1 len 10
07:05:08: Vi1 IPCP: Address 133.1.100.5 (0x030685016405)
07:05:08: Vi1 CDPCP: O CONF.REQ [Closed] id 1 len 4
07:05:08: BR0/0:1 MLP: router3, multilink up, first link
07:05:34359738368: %LINK-3-UPDOWN: Interface BRI0/0:1, changed state to down
07:05:34359738368: DDR: Callback client for router3 5552221 created
07:05:36532277176: BR0/0:1 PPP: Phase is TERMINATING
07:05:34359738368: BR0/0:1 LCP: State is Closed
07:05:36532276924: BR0/0:1 PPP: Phase is DOWN
07:05:36525315220: BR0/0:1 DDR: disconnecting call
07:05:08: Vi1 IPCP: State is Closed
07:05:08: Vi1 CDPCP: State is Closed
07:05:10: Vi1 LCP: Missed link down notification
07:05:10: Vi1 PPP: Phase is TERMINATING
07:05:10: Vi1 LCP: State is Closed
07:05:10: Vi1 PPP: Phase is DOWN..
Success rate is 0 percent (0/5)
router5#
07:05:23: %LINK-3-UPDOWN: Interface BRI0/0:1, changed state to up
07:05:23: BR0/0:1 PPP: Treating connection as a callin
07:05:23: BR0/0:1 PPP: Phase is ESTABLISHING, Passive Open
07:05:23: BR0/0:1 LCP: State is Listen
07:05:25: BR0/0:1 LCP: TIMEout: State Listen
07:05:25: BR0/0:1 LCP: O CONFREQ [Listen] id 167 len 29
07:05:25: BR0/0:1 LCP: AuthProto CHAP (0x0305C22305)
07:05:25: BR0/0:1 LCP: MagicNumber 0x321A57AB (0x0506321A57AB)
07:05:25: BR0/0:1 LCP: MRRU 1524 (0x110405F4)
07:05:25: BR0/0:1 LCP: EndpointDisc 1 Local (0x130A01726F7574657235)
07:05:25: BR0/0:1 LCP: I CONFACK [REQsent] id 167 len 29
07:05:25: BR0/0:1 LCP: AuthProto CHAP (0x0305C22305)
07:05:25: BR0/0:1 LCP: MagicNumber 0x321A57AB (0x0506321A57AB)
07:05:25: BR0/0:1 LCP: MRRU 1524 (0x110405F4)
07:05:25: BR0/0:1 LCP: EndpointDisc 1 Local (0x130A01726F7574657235)
07:05:25: BR0/0:1 LCP: I CONFREQ [ACKrcvd] id 96 len 29
07:05:25: BR0/0:1 LCP: AuthProto CHAP (0x0305C22305)
07:05:25: BR0/0:1 LCP: MagicNumber 0x06202F2E (0x050606202F2E)
07:05:25: BR0/0:1 LCP: MRRU 1524 (0x110405F4)
07:05:25: BR0/0:1 LCP: EndpointDisc 1 Local (0x130A01726F7574657233)
07:05:25: BR0/0:1 LCP: O CONFACK [ACKrcvd] id 96 len 29
07:05:25: BR0/0:1 LCP: AuthProto CHAP (0x0305C22305)
07:05:25: BR0/0:1 LCP: MagicNumber 0x06202F2E (0x050606202F2E)
07:05:25: BR0/0:1 LCP: MRRU 1524 (0x110405F4)
07:05:25: BR0/0:1 LCP: EndpointDisc 1 Local (0x130A01726F7574657233)
07:05:25: BR0/0:1 LCP: State is Open
07:05:25: BR0/0:1 PPP: Phase is AUTHENTICATING, by both
07:05:25: BR0/0:1 CHAP: O CHALLENGE id 68 len 28 from "router5"
07:05:25: BR0/0:1 CHAP: I CHALLENGE id 68 len 28 from "router3"
07:05:25: BR0/0:1 CHAP: Waiting for peer to authenticate first
07:05:25: BR0/0:1 CHAP: I RESPONSE id 68 len 28 from "router3"
07:05:25: BR0/0:1 CHAP: O SUCCESS id 68 len 4
07:05:25: BR0/0:1 CHAP: Processing saved Challenge, id 68
07:05:25: BR0/0:1 CHAP: O RESPONSE id 68 len 28 from "router5"
07:05:25: BR0/0:1 CHAP: I SUCCESS id 68 len 4
07:05:25: BR0/0:1 PPP: Phase is VIRTUALIZED
07:05:25: Vi1 PPP: Phase is DOWN, Setup
07:05:25: %LINK-3-UPDOWN: Interface Virtual-Access1, changed state to
upDialer s
tatechange to up Virtual-Access1
07:05:25: Vi1 PPP: Treating connection as a callin
07:05:25: Vi1 PPP: Phase is ESTABLISHING, Passive Open
07:05:25: Vi1 LCP: State is Listen
07:05:25: BR0/0:1 IPCP: Packet buffered while building MLP bundle interface
07:05:25: BR0/0:1 CDPCP: Packet buffered while building MLP bundle interface
07:05:25: Vi1 PPP: Phase is UP
07:05:25: Vi1 IPCP: O CONFREQ [Closed] id 1 len 10
07:05:25: Vi1 IPCP: Address 133.1.100.5 (0x030685016405)
07:05:25: Vi1 CDPCP: O CONFREQ [Closed] id 1 len 4
07:05:25: BR0/0:1 MLP: router3, multilink up, first link
07:05:25: Vi1 PPP: Pending ncpQ size is 2
07:05:25: BR0/0:1 IPCP: Redirect packet to Vi1
07:05:25: Vi1 IPCP: I CONFREQ [REQsent] id 1 len 10
07:05:25: Vi1 IPCP: Address 133.1.100.6 (0x030685016406)
07:05:25: Vi1 IPCP: O CONFACK [REQsent] id 1 len 10
07:05:25: Vi1 IPCP: Address 133.1.100.6 (0x030685016406)
07:05:25: BR0/0:1 CDPCP: Redirect packet to Vi1
07:05:25: Vi1 CDPCP: I CONFREQ [REQsent] id 1 len 4
07:05:25: Vi1 CDPCP: O CONFACK [REQsent] id 1 len 4
07:05:26: Vi1 IPCP: I CONFACK [ACKsent] id 1 len 10
07:05:26: Vi1 IPCP: Address 133.1.100.5 (0x030685016405)
07:05:26: Vi1 IPCP: State is Open
07:05:26: Vi1 CDPCP: I CONFACK [ACKsent] id 1 len 4
07:05:26: Vi1 CDPCP: State is Open
07:05:26: Vi1 DDR: dialer protocol up
07:05:26: Virtual-Access1 DDR: Callback received from router3 5552221
07:05:26: DDR: Freeing callback to router3 5552221
07:05:26: %LINEPROTO-5-UPDOWN: Line protocol on Interface BRI0/0:1, changed
stat
e to up
07:05:26: %LINEPROTO-5-UPDOWN: Line protocol on Interface Virtual-Access1,
chang
ed state to up
07:05:29: %ISDN-6-CONNECT: Interface BRI0/0:1 is now connected to 5552221
router
3
router5#ping 133.1.100.6
Type escape sequence to abort.
Sending 5, 100-byte ICMP Echos to 133.1.100.6, timeout is 2 seconds:
!!!!!
Success rate is 100 percent (5/5), round-trip min/avg/max = 32/34/36 ms
**Please read:http://www.groupstudy.com/list/posting.html
This archive was generated by hypermail 2.1.4 : Thu Jun 13 2002 - 10:31:23 GMT-3