Re: VXR drops connection every 120 secs

thoppays · ‎01-17-2002

Hi,

The ISDN is dialing out to PRI line in 7206VXR. The VXR is dropping the line at approx every 120 secs. Then the ISDN is dialling out and gets connected to VXR. Again the VXR is dropping after every 120 secs. I am running Version 12.1(6.4)in C7206 VXR.

I am using the same config in 7206 running 12.1(7) which is prefectly alright. Is this a bug or config problem? See if debug (from the originating router) help u to troubleshoot.

*Feb 28 19:31:55: ISDN BR0/0: TX -> RRp sapi = 0 tei = 104 nr = 28

*Feb 28 19:31:55: ISDN BR0/0: RX <- RRf sapi = 0 tei = 104 nr = 21

*Feb 28 19:31:55: BR0/0:1 LCP: I TERMREQ [Open] id 52 len 4

*Feb 28 19:31:55: BR0/0:1 LCP: O TERMACK [Open] id 52 len 4

*Feb 28 19:31:55: BR0/0:1 PPP: Phase is TERMINATING

*Feb 28 19:31:55: BR0/0:2 LCP: I TERMREQ [Open] id 52 len 4

*Feb 28 19:31:55: BR0/0:2 LCP: O TERMACK [Open] id 52 len 4

*Feb 28 19:31:55: BR0/0:2 PPP: Phase is TERMINATING

*Feb 28 19:31:55: Vi1 IPCP: State is Closed

*Feb 28 19:31:55: Vi1 CDPCP: State is Closed

*Feb 28 19:31:55: Vi1 DDR: disconnecting call

*Feb 28 19:31:55: Di0 IPCP: Remove route to 10.119.119.119

*Feb 28 19:31:55: %LINK-3-UPDOWN: Interface Virtual-Access1, changed state to do

wn

*Feb 28 19:31:55: Vi1 PPP: Phase is TERMINATING

*Feb 28 19:31:55: Vi1 LCP: State is Closed

*Feb 28 19:31:55: Vi1 PPP: Phase is DOWN

*Feb 28 19:31:55: ISDN BR0/0: RX <- INFOc sapi = 0 tei = 104 ns = 28 nr = 21

i = 0x08018E4508028090

*Feb 28 19:31:55: DISCONNECT pd = 8 callref = 0x8E

*Feb 28 19:31:55: Cause i = 0x8090 - Normal call clearing

*Feb 28 19:31:55: ISDN BR0/0: TX -> RRr sapi = 0 tei = 104 nr = 29

*Feb 28 19:31:55: ISDN BR0/0: TX -> INFOc sapi = 0 tei = 104 ns = 21 nr = 29

i = 0x08010E4D

*Feb 28 19:31:55: RELEASE pd = 8 callref = 0x0E

*Feb 28 19:31:55: %ISDN-6-DISCONNECT: Interface BRI0/0:1 disconnected from 1212

6076500 C7206VXR_BroadSt, call lasted 120 seconds

*Feb 28 19:31:55: %LINK-3-UPDOWN: Interface BRI0/0:1, changed state to down

*Feb 28 19:31:55: BR0/0:1 LCP: State is Closed

*Feb 28 19:31:55: BR0/0:1 PPP: Phase is DOWN

*Feb 28 19:31:55: BR0/0:1 DDR: disconnecting call

*Feb 28 19:31:55: ISDN BR0/0: RX <- RRr sapi = 0 tei = 104 nr = 22

*Feb 28 19:31:55: ISDN BR0/0: RX <- INFOc sapi = 0 tei = 113 ns = 27 nr = 20

i = 0x08018F4508028090

*Feb 28 19:31:55: DISCONNECT pd = 8 callref = 0x8F

*Feb 28 19:31:55: Cause i = 0x8090 - Normal call clearing

*Feb 28 19:31:55: ISDN BR0/0: TX -> RRr sapi = 0 tei = 113 nr = 28

*Feb 28 19:31:55: ISDN BR0/0: TX -> INFOc sapi = 0 tei = 113 ns = 20 nr = 28

i = 0x08010F4D

*Feb 28 19:31:55: RELEASE pd = 8 callref = 0x0F

*Feb 28 19:31:55: %ISDN-6-DISCONNECT: Interface BRI0/0:2 disconnected from 1212

6076500 C7206VXR_BroadSt, call lasted 118 seconds

*Feb 28 19:31:55: %LINK-3-UPDOWN: Interface BRI0/0:2, changed state to down

*Feb 28 19:31:55: BR0/0:2 LCP: State is Closed

*Feb 28 19:31:55: BR0/0:2 PPP: Phase is DOWN

*Feb 28 19:31:55: BR0/0:2 DDR: disconnecting call

*Feb 28 19:31:55: ISDN BR0/0: RX <- INFOc sapi = 0 tei = 104 ns = 29 nr = 22

i = 0x08018E5A

*Feb 28 19:31:55: RELEASE_COMP pd = 8 callref = 0x8E

*Feb 28 19:31:55: ISDN BR0/0: TX -> RRr sapi = 0 tei = 104 nr = 30

*Feb 28 19:31:55: ISDN BR0/0: RX <- RRr sapi = 0 tei = 113 nr = 21

*Feb 28 19:31:55: ISDN BR0/0: RX <- INFOc sapi = 0 tei = 113 ns = 28 nr = 21

i = 0x08018F5A

*Feb 28 19:31:55: RELEASE_COMP pd = 8 callref = 0x8F

*Feb 28 19:31:55: ISDN BR0/0: TX -> RRr sapi = 0 tei = 113 nr = 29

*Feb 28 19:31:56: %LINEPROTO-5-UPDOWN: Line protocol on Interface BRI0/0:1, chan

ged state to down

*Feb 28 19:31:56: %LINEPROTO-5-UPDOWN: Line protocol on Interface BRI0/0:2, chan

ged state to down

*Feb 28 19:31:56: %LINEPROTO-5-UPDOWN: Line protocol on Interface Virtual-Access

1, changed state to down

*Feb 28 19:31:57: BR0/0 DDR: rotor dialout [best] least recent failure is also m

ost recent failure

*Feb 28 19:31:57: BR0/0 DDR: rotor dialout [best] also has most recent failure

*Feb 28 19:31:57: BR0/0 DDR: rotor dialout [best]

*Feb 28 19:31:57: BR0/0 DDR: Dialing cause ip (s=10.8.113.1, d=10.119.119.119)

*Feb 28 19:31:57: BR0/0 DDR: Attempting to dial 12126076500

*Feb 28 19:31:57: ISDN BR0/0: TX -> INFOc sapi = 0 tei = 104 ns = 22 nr = 30

i = 0x08011005040288901801832C0B3132313236303736353030

*Feb 28 19:31:57: SETUP pd = 8 callref = 0x10

*Feb 28 19:31:57: Bearer Capability i = 0x8890

*Feb 28 19:31:57: Channel ID i = 0x83

*Feb 28 19:31:57: Keypad Facility i = '12126076500'

*Feb 28 19:31:57: ISDN BR0/0: RX <- RRr sapi = 0 tei = 104 nr = 23

*Feb 28 19:31:58: ISDN BR0/0: RX <- INFOc sapi = 0 tei = 104 ns = 30 nr = 23

i = 0x08019002180189

jduffek · ‎01-17-2002

Thanks for posting the debugs. Here is one instance of the disconnect:

*Feb 28 19:31:55: ISDN BR0/0: RX <- RRf sapi = 0 tei = 104 nr = 21

*Feb 28 19:31:55: BR0/0:1 LCP: I TERMREQ [Open] id 52 len 4

You can see that we are receiving a terminate request at the ppp layer from the remote peer. Since you said it happens every 120 seconds, it sounds like the peer is dropping due to idle timeout...is it a cisco box? I would look at how you have interesting traffic setup. 120 is cisco's default idle-timeout on a ddr interface so look to see if you see no idle-timeout configured...if so it is 120(verify with "sh dialer").

Can you post the relevent config for dial stuff from the peer? Also get a "sh ver".

Josh

thoppays · ‎01-24-2002

Josh,

I fixed the problem on the same day I posted the query. I found a diference betweem two releases. The version 12.1(7) doesn't need the command dialer idle-timeout 0. But the ver 12.1(6.4) need it. So I just added dialer in-band & dialer idle-timeout 0, as you suggested.

Thanks,

TVS Kumar