LinuxQuestions.org
Review your favorite Linux distribution.
Go Back   LinuxQuestions.org > Forums > Linux Forums > Linux - Networking
User Name
Password
Linux - Networking This forum is for any issue related to networks or networking.
Routing, network cards, OSI, etc. Anything is fair game.

Notices


Reply
  Search this Thread
Old 02-20-2009, 10:57 AM   #1
Fredde87
Member
 
Registered: Aug 2005
Posts: 158

Rep: Reputation: 30
PPP problems


Hi,

I am having problems getting my PPP to work. I am trying to dial to my ISP without any luck. I tried a different RAS server as well but still got the same issues.

I use WvDial with pppd to connect. If I dont use Stupid Mode then I get stuck on the "Carrier detected. Waiting for prompt." line, this is my log then,

Quote:
Using interface ppp0
local IP address 10.64.64.64
remote IP address 10.112.112.112
Starting link
--> WvDial: Internet dialer version 1.60
--> Initializing modem.
--> Sending: AT
AT
OK
--> Sending: AT&F1 %V2 %P3
AT&F1 %V2 %P3
OK
--> Modem initialized.
--> Idle Seconds = 120, disabling automatic reconnect.
--> Sending: ATDT28#
--> Waiting for carrier.
ATDT28#
CONNECT 115200
--> Carrier detected. Waiting for prompt.
~[7f][03]@![01]7 ![03][04]@#[05][06]\VI+[11][04][05]t[13][0f][01]SNET-NY-AS01[15]5~~[7f][03]@![01]8 ![03][04]@#[05][06]\VI+[11][04][05]t[13][0f][01]SNET-NY-AS01 Z~~[7f][03]@![01]9 ![03][04]@#[05][06]\VI+[11][04][05]t[13][0f][01]SNET-NY-AS01k-~~[7f][03]@![01]: ![03][04]@#[05][06]\VI+[11][04][05]t[13][0f][01]SNET-NY-AS01M4~~[7f][03]@![01]; ![03][04]@#[05][06]\VI+[11][04][05]t[13][0f][01]SNET-NY-AS01/C~~[7f][03]@![01]< ![03][04]@#[05][06]\VI+[11][04][05]t[13][0f][01]SNET-NY-AS01[10][0f]~~[7f][03]@![01]= ![03][04]@#[05][06]\VI+[11][04][05]t[13][0f][01]SNET-NY-AS01rx~~[7f][03]@![01]> ![03][04]@#[05][06]\VI+[11][04][05]t[13][0f][01]SNET-NY-AS01Ta~~[7f][03]@![01]? ![03][04]@#[05][06]\VI+[11][04][05]t[13][0f][01]SNET-NY-AS016[16]~~[7f][03]@![01]@ ![03][04]@#[05][06]\VI+[11][04][05]t[13][0f][01]SNET-NY-AS01[1e][1a]~
--> Don't know what to do! Starting pppd and hoping for the best.
Serial connection established.
using channel 71
Connect: ppp0 <--> /dev/ttyS0
sent [LCP ConfReq id=0x1 <asyncmap 0x0> <magic 0xd997ea52> <pcomp> <accomp>]
Hangup (SIGHUP)
Modem hangup
Connection terminated.

If I turn Stupid Mode on then the pppd will start and I can se my machine sending ConfReq as below,

Quote:
Using interface ppp0
local IP address 10.64.64.64
remote IP address 10.112.112.112
Starting link
--> WvDial: Internet dialer version 1.60
--> Initializing modem.
--> Sending: AT
ERROR
--> Bad init string.
Caught signal 15: Attempting to exit gracefully...
Connect script failed
Using interface ppp0
local IP address 10.64.64.64
remote IP address 10.112.112.112
Starting link
--> WvDial: Internet dialer version 1.60
--> Initializing modem.
--> Sending: AT
AT
OK
--> Sending: AT&F1 %V2 %P3
AT&F1 %V2 %P3
OK
--> Modem initialized.
--> Idle Seconds = 120, disabling automatic reconnect.
--> Sending: ATDT28#
--> Waiting for carrier.
ATDT28#
CONNECT 115200
--> Carrier detected. Chatmode finished.
Serial connection established.
using channel 69
Connect: ppp0 <--> /dev/ttyS0
sent [LCP ConfReq id=0x1 <asyncmap 0x0> <magic 0x62f90f68> <pcomp> <accomp>]
sent [LCP ConfReq id=0x1 <asyncmap 0x0> <magic 0x62f90f68> <pcomp> <accomp>]
sent [LCP ConfReq id=0x1 <asyncmap 0x0> <magic 0x62f90f68> <pcomp> <accomp>]
sent [LCP ConfReq id=0x1 <asyncmap 0x0> <magic 0x62f90f68> <pcomp> <accomp>]
sent [LCP ConfReq id=0x1 <asyncmap 0x0> <magic 0x62f90f68> <pcomp> <accomp>]
sent [LCP ConfReq id=0x1 <asyncmap 0x0> <magic 0x62f90f68> <pcomp> <accomp>]
sent [LCP ConfReq id=0x1 <asyncmap 0x0> <magic 0x62f90f68> <pcomp> <accomp>]
sent [LCP ConfReq id=0x1 <asyncmap 0x0> <magic 0x62f90f68> <pcomp> <accomp>]
sent [LCP ConfReq id=0x1 <asyncmap 0x0> <magic 0x62f90f68> <pcomp> <accomp>]
sent [LCP ConfReq id=0x1 <asyncmap 0x0> <magic 0x62f90f68> <pcomp> <accomp>]
LCP: timeout sending Config-Requests
Connection terminated.
Hangup (SIGHUP)

If I add "sync" to my PPP config (I can change into HDLC mode on my modem by sending %P2 rather then %P3) then I get the following,

Quote:
Using interface ppp0
local IP address 10.64.64.64
remote IP address 10.112.112.112
Starting link
--> WvDial: Internet dialer version 1.60
--> Initializing modem.
--> Sending: AT
AT
OK
--> Sending: AT&F1 %V2 %P2
AT&F1 %V2 %P2
OK
--> Modem initialized.
--> Idle Seconds = 120, disabling automatic reconnect.
--> Sending: ATDT28#
--> Waiting for carrier.
ATDT28#
CONNECT 115200
--> Carrier detected. Chatmode finished.
Serial connection established.
using channel 72
Connect: ppp0 <--> /dev/ttyS0
sent [LCP ConfReq id=0x1 <asyncmap 0x0> <magic 0x6eb8a57f> <pcomp> <accomp>]
rcvd [LCP] 01 c3 00 21 03 04 c0 23 05 06 5c 59 b9 f2 11 04 05 f4 13 0f
rcvd [proto=0x1] 53 4e 45 54 2d 4e 59 2d 41 53 30 31
Discarded non-LCP packet when LCP not open
rcvd [LCP ConfAck id=0x1 <asyncmap 0x0> <magic 0x6eb8a57f> <pcomp> <accomp>]
sent [LCP ConfReq id=0x1 <asyncmap 0x0> <magic 0x6eb8a57f> <pcomp> <accomp>]
rcvd [LCP] 02 01 00 14
rcvd [proto=0x206] 00 00 00 00 05 06 6e b8 a5 7f 07 02 08 02
Discarded non-LCP packet when LCP not open
sent [LCP ConfReq id=0x1 <asyncmap 0x0> <magic 0x6eb8a57f> <pcomp> <accomp>]
rcvd [LCP] 02 01 00 14
rcvd [proto=0x206] 00 00 00 00 05 06 6e b8 a5 7f 07 02 08 02
Discarded non-LCP packet when LCP not open
sent [LCP ConfReq id=0x1 <asyncmap 0x0> <magic 0x6eb8a57f> <pcomp> <accomp>]
rcvd [LCP ConfAck id=0x1 <asyncmap 0x0> <magic 0x6eb8a57f> <pcomp> <accomp>]
rcvd [LCP] 01 c4 00 21 03 04 c0 23 05 06 5c 59
rcvd [proto=0xb9] f2 11 04 05 f4 13 0f 01 53 4e 45 54 2d 4e 59 2d 41 53 30 31
Discarded non-LCP packet when LCP not open
sent [LCP ConfReq id=0x1 <asyncmap 0x0> <magic 0x6eb8a57f> <pcomp> <accomp>]
sent [LCP ConfReq id=0x1 <asyncmap 0x0> <magic 0x6eb8a57f> <pcomp> <accomp>]
rcvd [LCP] 02 01 00 14
rcvd [proto=0x206] 00 00 00 00 05 06 6e b8 a5 7f 07 02 08 02
Discarded non-LCP packet when LCP not open
sent [LCP ConfReq id=0x1 <asyncmap 0x0> <magic 0x6eb8a57f> <pcomp> <accomp>]
rcvd [LCP] 01 c5 00 21 03 04 c0 23 05 06 5c 59
rcvd [proto=0xb9] f2 11 04 05 f4 13 0f 01 53 4e 45 54 2d 4e 59 2d 41 53 30 31
Discarded non-LCP packet when LCP not open
sent [LCP ConfReq id=0x1 <asyncmap 0x0> <magic 0x6eb8a57f> <pcomp> <accomp>]
sent [LCP ConfReq id=0x1 <asyncmap 0x0> <magic 0x6eb8a57f> <pcomp> <accomp>]
rcvd [LCP] 02 01 00 14
rcvd [proto=0x206] 00 00 00 00 05 06 6e b8 a5 7f 07 02 08 02
Discarded non-LCP packet when LCP not open
sent [LCP ConfReq id=0x1 <asyncmap 0x0> <magic 0x6eb8a57f> <pcomp> <accomp>]
sent [LCP ConfReq id=0x1 <asyncmap 0x0> <magic 0x6eb8a57f> <pcomp> <accomp>]
rcvd [LCP] 01 c6 00 21
rcvd [proto=0x3] 04 c0 23 05 06 5c 59 b9 f2 11 04 05 f4 13 0f 01 53 4e 45 54 2d 4e 59 2d 41 53 30 31
Discarded non-LCP packet when LCP not open
sent [LCP ConfReq id=0x1 <asyncmap 0x0> <magic 0x6eb8a57f> <pcomp> <accomp>]
sent [LCP ConfReq id=0x1 <asyncmap 0x0> <magic 0x6eb8a57f> <pcomp> <accomp>]
rcvd [LCP] 02 01 00 14
rcvd [proto=0x206] 00 00 00 00 05 06 6e b8 a5 7f 07 02 08 02
Discarded non-LCP packet when LCP not open
sent [LCP ConfReq id=0x1 <asyncmap 0x0> <magic 0x6eb8a57f> <pcomp> <accomp>]
rcvd [LCP] 02 01 00 14
rcvd [proto=0x206] 00 00 00 00 05 06 6e b8 a5 7f 07 02 08 02
Discarded non-LCP packet when LCP not open
rcvd [LCP] 01 c7 00 21 03 04 c0 23 05 06 5c 59 b9 f2 11 04 05 f4 13 0f 01 53 4e 45 54 2d 4e 59
LCP: timeout sending Config-Requests
Connection terminated.
Hangup (SIGHUP)

Here are the pppd options I am using

debug usepeerdns usehostname crtscts modem defaultroute noipdefault idle 120 user ***** password ***** demand


It seems that in HLDC I atleast get back ConfAcks but my pppd seems to ignore them and send out a new exact same ConfReq.

Any ideas why?


Edit: Forgot to mention that it dials fine (in PPP mode, not HLDC) in Windows. Here is some of the trace I got from my Windows XP machine.

Quote:
[172] 15:44:49:562: PPPEMSG_Start recvd, d=, hPort=10,callback=0,mask=830348,IfType=-1
[2016] 15:44:49:562: Line up event occurred on port 10
[2016] 15:44:49:562: Local identification = MSRAS-0-LWC-IBM-01
[2016] 15:44:49:562: PortName: COM5
[2016] 15:44:49:562: Starting PPP on link with IfType=0xffffffff,IPIf=0xffffffff,IPXIf=0xffffffff
[2016] 15:44:49:562: RasGetBuffer returned 3838fc8 for SendBuf
[2016] 15:44:49:562: FsmInit called for protocol = c021, port = 10
[2016] 15:44:49:562: ConfigInfo = 830348
[2016] 15:44:49:562: APs available = 5e
[2016] 15:44:49:562: FsmReset called for protocol = c021, port = 10
[2016] 15:44:49:562: Inserting port in bucket # 0
[2016] 15:44:49:562: Inserting bundle in bucket # 3
[2016] 15:44:49:562: FsmOpen event received for protocol c021 on port 10
[2016] 15:44:49:562: FsmThisLayerStarted called for protocol = c021, port = 10
[2016] 15:44:49:562: FsmUp event received for protocol c021 on port 10
[2016] 15:44:49:562: <PPP packet sent at 02/17/2009 15:44:49:562
[2016] 15:44:49:562: <Protocol = LCP, Type = Configure-Req, Length = 0x19, Id = 0x0, Port = 10
[2016] 15:44:49:562: <C0 21 01 00 00 17 02 06 00 00 00 00 05 06 60 DF |.!............`.|
[2016] 15:44:49:562: <42 80 07 02 08 02 0D 03 06 00 00 00 00 00 00 00 |B...............|
[2016] 15:44:49:562:
[2016] 15:44:49:562: InsertInTimerQ called portid=4,Id=0,Protocol=c021,EventType=0,fAuth=0
[2016] 15:44:49:562: InsertInTimerQ called portid=4,Id=0,Protocol=0,EventType=3,fAuth=0
[1248] 15:44:50:343: Packet received (35 bytes) for hPort 10
[2016] 15:44:50:343: >PPP packet received at 02/17/2009 15:44:50:343
[2016] 15:44:50:343: >Protocol = LCP, Type = Configure-Req, Length = 0x23, Id = 0x41, Port = 10
[2016] 15:44:50:343: >C0 21 01 41 00 21 03 04 C0 23 05 06 4C A7 C7 B2 |.!.A.!...#..L...|
[2016] 15:44:50:343: >11 04 05 F4 13 0F 01 53 4E 45 54 2D 4E 59 2D 41 |.......SNET-NY-A|
[2016] 15:44:50:343: >53 30 31 00 00 00 00 00 00 00 00 00 00 00 00 00 |S01.............|
[2016] 15:44:50:343:
[2016] 15:44:50:343: <PPP packet sent at 02/17/2009 15:44:50:343
[2016] 15:44:50:343: <Protocol = LCP, Type = Configure-Reject, Length = 0x19, Id = 0x41, Port = 10
[2016] 15:44:50:343: <C0 21 04 41 00 17 11 04 05 F4 13 0F 01 53 4E 45 |.!.A.........SNE|
[2016] 15:44:50:343: <54 2D 4E 59 2D 41 53 30 31 00 00 00 00 00 00 00 |T-NY-AS01.......|
[2016] 15:44:50:343:
[1248] 15:44:50:343: Packet received (9 bytes) for hPort 10
[2016] 15:44:50:343: >PPP packet received at 02/17/2009 15:44:50:343
[2016] 15:44:50:343: >Protocol = LCP, Type = Configure-Reject, Length = 0x9, Id = 0x0, Port = 10
[2016] 15:44:50:343: >C0 21 04 00 00 07 0D 03 06 00 00 00 00 00 00 00 |.!..............|
[2016] 15:44:50:343:
[2016] 15:44:50:343: RemoveFromTimerQ called portid=4,Id=0,Protocol=c021,EventType=0,fAuth=0
[2016] 15:44:50:343: <PPP packet sent at 02/17/2009 15:44:50:343
[2016] 15:44:50:343: <Protocol = LCP, Type = Configure-Req, Length = 0x16, Id = 0x1, Port = 10
[2016] 15:44:50:343: <C0 21 01 01 00 14 02 06 00 00 00 00 05 06 60 DF |.!............`.|
[2016] 15:44:50:343: <42 80 07 02 08 02 00 00 00 00 00 00 00 00 00 00 |B...............|
[2016] 15:44:50:343:
[2016] 15:44:50:343: InsertInTimerQ called portid=4,Id=1,Protocol=c021,EventType=0,fAuth=0
[1248] 15:44:51:125: Packet received (16 bytes) for hPort 10
[2016] 15:44:51:125: >PPP packet received at 02/17/2009 15:44:51:125
[2016] 15:44:51:125: >Protocol = LCP, Type = Configure-Req, Length = 0x10, Id = 0x42, Port = 10
[2016] 15:44:51:125: >C0 21 01 42 00 0E 03 04 C0 23 05 06 4C A7 C7 B2 |.!.B.....#..L...|
[2016] 15:44:51:125:
[2016] 15:44:51:125: <PPP packet sent at 02/17/2009 15:44:51:125
[2016] 15:44:51:125: <Protocol = LCP, Type = Configure-Ack, Length = 0x10, Id = 0x42, Port = 10
[2016] 15:44:51:125: <C0 21 02 42 00 0E 03 04 C0 23 05 06 4C A7 C7 B2 |.!.B.....#..L...|
[2016] 15:44:51:125:
[1248] 15:44:51:125: Packet received (22 bytes) for hPort 10
[2016] 15:44:51:125: >PPP packet received at 02/17/2009 15:44:51:125
[2016] 15:44:51:125: >Protocol = LCP, Type = Configure-Ack, Length = 0x16, Id = 0x1, Port = 10
[2016] 15:44:51:125: >C0 21 02 01 00 14 02 06 00 00 00 00 05 06 60 DF |.!............`.|
[2016] 15:44:51:125: >42 80 07 02 08 02 00 00 00 00 00 00 00 00 00 00 |B...............|
[2016] 15:44:51:125:
[2016] 15:44:51:125: RemoveFromTimerQ called portid=4,Id=1,Protocol=c021,EventType=0,fAuth=0
[2016] 15:44:51:125: FsmThisLayerUp called for protocol = c021, port = 10
[2016] 15:44:51:125: LCP Local Options-------------
[2016] 15:44:51:125: MRU=1500,ACCM=0,Auth=0,MagicNumber=1625244288,PFC=ON,ACFC=ON
[2016] 15:44:51:125: Recv Framing = PPP,SSHF=OFF,MRRU=1500,LinkDiscrim=0,BAP=OFF
[2016] 15:44:51:125: LCP Remote Options-------------
[2016] 15:44:51:125: MRU=1500,ACCM=-1,Auth=c023,MagicNumber=1286064050,PFC=OFF,ACFC=OFF
[2016] 15:44:51:125: Send Framing = PPP,SSHF=OFF,MRRU=1500,LinkDiscrim=0
[2016] 15:44:51:125: LCP Configured successfully
[2016] 15:44:51:125: <PPP packet sent at 02/17/2009 15:44:51:125
[2016] 15:44:51:125: <Protocol = LCP, Type = Identification, Length = 0x14, Id = 0x2, Port = 10
[2016] 15:44:51:125: <C0 21 0C 02 00 12 60 DF 42 80 4D 53 52 41 53 56 |.!....`.B.MSRASV|
[2016] 15:44:51:125: <35 2E 31 30 00 00 00 00 00 00 00 00 00 00 00 00 |5.10............|
[2016] 15:44:51:125:
[2016] 15:44:51:125: <PPP packet sent at 02/17/2009 15:44:51:125
[2016] 15:44:51:125: <Protocol = LCP, Type = Identification, Length = 0x1c, Id = 0x3, Port = 10
[2016] 15:44:51:125: <C0 21 0C 03 00 1A 60 DF 42 80 4D 53 52 41 53 2D |.!....`.B.MSRAS-|
[2016] 15:44:51:125: <30 2D 4C 57 43 2D 49 42 4D 2D 30 31 00 00 00 00 |0-LWC-IBM-01....|
[2016] 15:44:51:125:
[2016] 15:44:51:125: Authenticating phase started
[2016] 15:44:51:125: Calling APWork in APStart
[2016] 15:44:51:125: <PPP packet sent at 02/17/2009 15:44:51:125
[2016] 15:44:51:125: <Protocol = PAP, Type = Protocol specific, Length = 0x16, Id = 0x2, Port = 10
[2016] 15:44:51:125:
[2016] 15:44:51:125: InsertInTimerQ called portid=4,Id=2,Protocol=c023,EventType=0,fAuth=0
[1248] 15:44:52:000: Packet received (18 bytes) for hPort 10
[2016] 15:44:52:000: >PPP packet received at 02/17/2009 15:44:52:000
[2016] 15:44:52:000: >Protocol = IPCP, Type = Configure-Req, Length = 0x12, Id = 0x1, Port = 10
[2016] 15:44:52:000: >80 21 01 01 00 10 02 06 00 2D 0F 01 03 06 D8 81 |.!.......-......|
[2016] 15:44:52:000: >AA 08 00 00 00 00 00 00 00 00 00 00 00 00 00 00 |................|
[2016] 15:44:52:000:
[2016] 15:44:52:000: Non-LCP packet received when LCP is not opened
[2016] 15:44:52:000: Packet being silently discarded
[2016] 15:44:52:578: Recv timeout event received for portid=4,Id=2,Protocol=c023,fAuth=0
[2016] 15:44:52:578: <PPP packet sent at 02/17/2009 15:44:52:578
[2016] 15:44:52:578: <Protocol = PAP, Type = Protocol specific, Length = 0x16, Id = 0x3, Port = 10
[2016] 15:44:52:578:
[2016] 15:44:52:578: InsertInTimerQ called portid=4,Id=3,Protocol=c023,EventType=0,fAuth=0
[1248] 15:44:53:343: Packet received (7 bytes) for hPort 10
[2016] 15:44:53:343: >PPP packet received at 02/17/2009 15:44:53:343
[2016] 15:44:53:343: >Protocol = PAP, Type = Protocol specific, Length = 0x7, Id = 0x3, Port = 10
[2016] 15:44:53:343:
[2016] 15:44:53:343: RemoveFromTimerQ called portid=4,Id=3,Protocol=c023,EventType=0,fAuth=0
[2016] 15:44:53:343: FsmThisLayerUp called for protocol = c023, port = 10
[2016] 15:44:53:343: NotifyCaller(hPort=10, dwMsgId=17)
[2016] 15:44:53:343: NotifyCaller(hPort=10, dwMsgId=3)
[2016] 15:44:53:343: Will not initialize CP 8029
[2016] 15:44:53:343: Will not initialize CP 802b
[2016] 15:44:53:343: FsmInit called for protocol = 80fd, port = 10
[2016] 15:44:53:343: FsmInit for protocol = 80fd failed with error 731
[2016] 15:44:53:343: Will not initialize CP 8021
[2016] 15:44:53:343: NotifyCaller(hPort=10, dwMsgId=1)
[172] 15:44:53:359: PppStop

[172] 15:44:53:359: PPPEMSG_Stop recvd

[2016] 15:44:53:359: FsmClose event received for protocol c021 on port 10
[2016] 15:44:53:359: RemoveFromTimerQ called portid=4,Id=1,Protocol=c021,EventType=0,fAuth=0
[2016] 15:44:53:359: FsmThisLayerDown called for protocol = c021, port = 10
[2016] 15:44:53:359: RemoveFromTimerQ called portid=4,Id=3,Protocol=c023,EventType=0,fAuth=0
[2016] 15:44:53:359: RemoveFromTimerQ called portid=4,Id=0,Protocol=c029,EventType=0,fAuth=0
[2016] 15:44:53:359: <PPP packet sent at 02/17/2009 15:44:53:359
[2016] 15:44:53:359: <Protocol = LCP, Type = Terminate-Req, Length = 0x12, Id = 0x4, Port = 10
[2016] 15:44:53:359: <C0 21 05 04 00 10 60 DF 42 80 00 3C CD 74 00 00 |.!....`.B..<.t..|
[2016] 15:44:53:359: <02 D0 00 00 00 00 00 00 00 00 00 00 00 00 00 00 |................|
[2016] 15:44:53:359:
[2016] 15:44:53:359: InsertInTimerQ called portid=4,Id=4,Protocol=c021,EventType=0,fAuth=0
[1248] 15:44:54:140: Packet received (6 bytes) for hPort 10
[2016] 15:44:54:140: >PPP packet received at 02/17/2009 15:44:54:140
[2016] 15:44:54:140: >Protocol = LCP, Type = Terminate-Ack, Length = 0x6, Id = 0x4, Port = 10
[2016] 15:44:54:140: >C0 21 06 04 00 04 00 00 00 00 00 00 00 00 00 00 |.!..............|
[2016] 15:44:54:140:
[2016] 15:44:54:140: RemoveFromTimerQ called portid=4,Id=4,Protocol=c021,EventType=0,fAuth=0
[2016] 15:44:54:140: FsmThisLayerFinished called for protocol = c021, port = 10
[2016] 15:44:54:140: NotifyCaller(hPort=10, dwMsgId=10)
[1248] 15:44:55:250: PPPEMSG_LineDown recvd, hPort=10

[2016] 15:44:55:250: Line down event occurred on port 10
[2016] 15:44:55:312: FsmDown event received for protocol c021 on port 10
[2016] 15:44:55:312: RemoveFromTimerQ called portid=4,Id=4,Protocol=c021,EventType=0,fAuth=0
[2016] 15:44:55:312: FsmReset called for protocol = c021, port = 10
[2016] 15:44:55:312: RemoveFromTimerQ called portid=4,Id=0,Protocol=0,EventType=3,fAuth=0
[2016] 15:44:55:312: RemoveFromTimerQ called portid=4,Id=0,Protocol=0,EventType=7,fAuth=0
[2016] 15:44:55:312: RemoveFromTimerQ called portid=4,Id=0,Protocol=0,EventType=2,fAuth=0
[2016] 15:44:55:312: RemoveFromTimerQ called portid=4,Id=0,Protocol=0,EventType=1,fAuth=0
[2016] 15:44:55:312: RemoveFromTimerQ called portid=4,Id=0,Protocol=c029,EventType=0,fAuth=0
[2016] 15:44:55:312: LcpEnd
[2016] 15:44:55:312: Post line down event occurred on port 10
[2016] 15:44:55:312: NotifyCaller(hPort=10, dwMsgId=23)
[1352] 15:13:05:937: PPPEMSG_Start recvd, d=, hPort=6,callback=0,mask=830348,IfType=-1
[3932] 15:13:05:953: Line up event occurred on port 6
[3932] 15:13:05:953: Local identification = MSRAS-0-LWC-IBM-01
[3932] 15:13:05:953: PortName: COM2
[3932] 15:13:05:953: Starting PPP on link with IfType=0xffffffff,IPIf=0xffffffff,IPXIf=0xffffffff
[3932] 15:13:05:953: RasGetBuffer returned 38791f0 for SendBuf
[3932] 15:13:05:953: FsmInit called for protocol = c021, port = 6
[3932] 15:13:05:953: ConfigInfo = 830348
[3932] 15:13:05:953: APs available = 5e
[3932] 15:13:05:953: FsmReset called for protocol = c021, port = 6
[3932] 15:13:05:953: Inserting port in bucket # 6
[3932] 15:13:05:953: Inserting bundle in bucket # 0
[3932] 15:13:05:953: FsmOpen event received for protocol c021 on port 6
[3932] 15:13:05:953: FsmThisLayerStarted called for protocol = c021, port = 6
[3932] 15:13:05:953: FsmUp event received for protocol c021 on port 6
[3932] 15:13:05:968: <PPP packet sent at 02/20/2009 15:13:05:953
[3932] 15:13:05:968: <Protocol = LCP, Type = Configure-Req, Length = 0x19, Id = 0x0, Port = 6
[3932] 15:13:05:968: <C0 21 01 00 00 17 02 06 00 00 00 00 05 06 12 48 |.!.............H|
[3932] 15:13:05:968: <49 BD 07 02 08 02 0D 03 06 00 00 00 00 00 00 00 |I...............|
[3932] 15:13:05:968:
[3932] 15:13:05:968: InsertInTimerQ called portid=0,Id=0,Protocol=c021,EventType=0,fAuth=0
[3932] 15:13:05:968: InsertInTimerQ called portid=0,Id=0,Protocol=0,EventType=3,fAuth=0
[3776] 15:13:06:750: Packet received (35 bytes) for hPort 6
[3776] 15:13:06:750: Packet received (9 bytes) for hPort 6
[3932] 15:13:06:750: >PPP packet received at 02/20/2009 15:13:06:750
[3932] 15:13:06:750: >Protocol = LCP, Type = Configure-Req, Length = 0x23, Id = 0x80, Port = 6
[3932] 15:13:06:750: >C0 21 01 80 00 21 03 04 C0 23 05 06 5B FD F1 B2 |.!...!...#..[...|
[3932] 15:13:06:750: >11 04 05 F4 13 0F 01 53 4E 45 54 2D 4E 59 2D 41 |.......SNET-NY-A|
[3932] 15:13:06:750: >53 30 31 00 00 00 00 00 00 00 00 00 00 00 00 00 |S01.............|
[3932] 15:13:06:750:
[3932] 15:13:06:750: <PPP packet sent at 02/20/2009 15:13:06:750
[3932] 15:13:06:750: <Protocol = LCP, Type = Configure-Reject, Length = 0x19, Id = 0x80, Port = 6
[3932] 15:13:06:750: <C0 21 04 80 00 17 11 04 05 F4 13 0F 01 53 4E 45 |.!...........SNE|
[3932] 15:13:06:750: <54 2D 4E 59 2D 41 53 30 31 00 00 00 00 00 00 00 |T-NY-AS01.......|
[3932] 15:13:06:750:
[3932] 15:13:06:750: >PPP packet received at 02/20/2009 15:13:06:750
[3932] 15:13:06:750: >Protocol = LCP, Type = Configure-Reject, Length = 0x9, Id = 0x0, Port = 6
[3932] 15:13:06:750: >C0 21 04 00 00 07 0D 03 06 00 00 00 00 00 00 00 |.!..............|
[3932] 15:13:06:750:
[3932] 15:13:06:750: RemoveFromTimerQ called portid=0,Id=0,Protocol=c021,EventType=0,fAuth=0
[3932] 15:13:06:750: <PPP packet sent at 02/20/2009 15:13:06:750
[3932] 15:13:06:750: <Protocol = LCP, Type = Configure-Req, Length = 0x16, Id = 0x1, Port = 6
[3932] 15:13:06:750: <C0 21 01 01 00 14 02 06 00 00 00 00 05 06 12 48 |.!.............H|
[3932] 15:13:06:750: <49 BD 07 02 08 02 00 00 00 00 00 00 00 00 00 00 |I...............|
[3932] 15:13:06:750:
[3932] 15:13:06:750: InsertInTimerQ called portid=0,Id=1,Protocol=c021,EventType=0,fAuth=0
[3776] 15:13:07:531: Packet received (16 bytes) for hPort 6
[3932] 15:13:07:531: >PPP packet received at 02/20/2009 15:13:07:531
[3932] 15:13:07:531: >Protocol = LCP, Type = Configure-Req, Length = 0x10, Id = 0x81, Port = 6
[3932] 15:13:07:531: >C0 21 01 81 00 0E 03 04 C0 23 05 06 5B FD F1 B2 |.!.......#..[...|
[3932] 15:13:07:531:
[3932] 15:13:07:531: <PPP packet sent at 02/20/2009 15:13:07:531
[3932] 15:13:07:531: <Protocol = LCP, Type = Configure-Ack, Length = 0x10, Id = 0x81, Port = 6
[3932] 15:13:07:531: <C0 21 02 81 00 0E 03 04 C0 23 05 06 5B FD F1 B2 |.!.......#..[...|
[3932] 15:13:07:531:
[3776] 15:13:07:531: Packet received (22 bytes) for hPort 6
[3932] 15:13:07:531: >PPP packet received at 02/20/2009 15:13:07:531
[3932] 15:13:07:531: >Protocol = LCP, Type = Configure-Ack, Length = 0x16, Id = 0x1, Port = 6
[3932] 15:13:07:531: >C0 21 02 01 00 14 02 06 00 00 00 00 05 06 12 48 |.!.............H|
[3932] 15:13:07:531: >49 BD 07 02 08 02 00 00 00 00 00 00 00 00 00 00 |I...............|
[3932] 15:13:07:531:
[3932] 15:13:07:531: RemoveFromTimerQ called portid=0,Id=1,Protocol=c021,EventType=0,fAuth=0
[3932] 15:13:07:531: FsmThisLayerUp called for protocol = c021, port = 6
[3932] 15:13:07:531: LCP Local Options-------------
[3932] 15:13:07:531: MRU=1500,ACCM=0,Auth=0,MagicNumber=306727357,PFC=ON,ACFC=ON
[3932] 15:13:07:531: Recv Framing = PPP,SSHF=OFF,MRRU=1500,LinkDiscrim=0,BAP=OFF
[3932] 15:13:07:531: LCP Remote Options-------------
[3932] 15:13:07:531: MRU=1500,ACCM=-1,Auth=c023,MagicNumber=1543369138,PFC=OFF,ACFC=OFF
[3932] 15:13:07:531: Send Framing = PPP,SSHF=OFF,MRRU=1500,LinkDiscrim=0
[3932] 15:13:07:531: LCP Configured successfully
[3932] 15:13:07:531: <PPP packet sent at 02/20/2009 15:13:07:531
[3932] 15:13:07:531: <Protocol = LCP, Type = Identification, Length = 0x14, Id = 0x2, Port = 6
[3932] 15:13:07:531: <C0 21 0C 02 00 12 12 48 49 BD 4D 53 52 41 53 56 |.!.....HI.MSRASV|
[3932] 15:13:07:531: <35 2E 31 30 00 00 00 00 00 00 00 00 00 00 00 00 |5.10............|
[3932] 15:13:07:531:
[3932] 15:13:07:531: <PPP packet sent at 02/20/2009 15:13:07:531
[3932] 15:13:07:531: <Protocol = LCP, Type = Identification, Length = 0x1c, Id = 0x3, Port = 6
[3932] 15:13:07:531: <C0 21 0C 03 00 1A 12 48 49 BD 4D 53 52 41 53 2D |.!.....HI.MSRAS-|
[3932] 15:13:07:531: <30 2D 4C 57 43 2D 49 42 4D 2D 30 31 00 00 00 00 |0-LWC-IBM-01....|
[3932] 15:13:07:531:
[3932] 15:13:07:531: Authenticating phase started
[3932] 15:13:07:531: Calling APWork in APStart
[3932] 15:13:07:531: <PPP packet sent at 02/20/2009 15:13:07:531
[3932] 15:13:07:531: <Protocol = PAP, Type = Protocol specific, Length = 0x16, Id = 0x0, Port = 6

Last edited by Fredde87; 02-20-2009 at 11:02 AM.
 
Old 02-21-2009, 07:38 AM   #2
rossonieri#1
Member
 
Registered: Jun 2007
Posts: 359

Rep: Reputation: 34
hi fredde,

what is the problem actually?
have you got your PPP setting from your ISP?
have you tried to configure your PPP using wvdialconf command?
 
Old 02-23-2009, 03:19 AM   #3
Fredde87
Member
 
Registered: Aug 2005
Posts: 158

Original Poster
Rep: Reputation: 30
Quote:
Originally Posted by rossonieri#1 View Post
hi fredde,

what is the problem actually?
have you got your PPP setting from your ISP?
have you tried to configure your PPP using wvdialconf command?
Hi, my ISP does not offer any linux support. I have got all the username, passwords and the telephone number from them but that is about it.

Using wvdialconf doesnt do anything differently. It detects the modem on the correct port and that the speed is 115200 but that is about it.

I cant seem to get PPP talking to the RAS. Using HDLC seems to be the best option but by the looks of it the PPP client is getting stuck in a loop.

Quote:
sent [LCP ConfReq id=0x1 <asyncmap 0x0> <magic 0x6eb8a57f> <pcomp> <accomp>]
rcvd [LCP ConfAck id=0x1 <asyncmap 0x0> <magic 0x6eb8a57f> <pcomp> <accomp>]
Shouldnt we move on to the next step after the RAS has acknowledge our ConfReq? But we seem to just send a new ConfReq after we receive their ConfAck.
 
  


Reply


Thread Tools Search this Thread
Search this Thread:

Advanced Search

Posting Rules
You may not post new threads
You may not post replies
You may not post attachments
You may not edit your posts

BB code is On
Smilies are On
[IMG] code is Off
HTML code is Off



Similar Threads
Thread Thread Starter Forum Replies Last Post
PPP problems krisrao Linux - Networking 3 05-13-2004 02:44 PM
PPP problems Obelus Slackware 1 01-17-2004 04:59 AM
ppp problems mohapi Linux - General 1 05-27-2003 12:18 PM
problems with PPP wrjt Linux - Newbie 1 12-24-2001 01:48 AM
ppp problems n71fl Linux - Newbie 2 11-18-2001 12:07 PM

LinuxQuestions.org > Forums > Linux Forums > Linux - Networking

All times are GMT -5. The time now is 02:51 AM.

Main Menu
Advertisement
My LQ
Write for LQ
LinuxQuestions.org is looking for people interested in writing Editorials, Articles, Reviews, and more. If you'd like to contribute content, let us know.
Main Menu
Syndicate
RSS1  Latest Threads
RSS1  LQ News
Twitter: @linuxquestions
Open Source Consulting | Domain Registration