Cisco 1721 as PPTP Client
in [Cisco]
|
From: E. S. on 25 Nov 2006 05:23 "Dan Lanciani" <ddl(a)danlan.*com> ha scritto nel messaggio news:1334753(a)news1.IPSWITCHS.CMM... > In article <MYidnQsPj5ZcU_rYnZ2dnUVZ8qSdnZ2d(a)kpnqwest.it>, > admin(a)NOSPAMspadhausen.com (E. S.) writes: > > | IT WORKED. > > What did you change to fix the previous two problems you posted about? Well I had to put the entry dialer string 123, that I missed to insert. And then the router dialed out and worked. > | The only problem wich lasts now is that the connection stays up and then > | drops every minute or two. > > Are you sure that it is working correctly when it is up? That kind of > cycling is a typical symptom of the routing loop issue I mentioned. -Many PPTP servers use their primary address (i.e., the address that you might use in the vpdn-group's "initiate-to ip" command) for their end of the ppp connection. This is a problem because IOS will install a /32 route to that address through the dialer interface thus creating a loop that chokes the connection (and possibly even crashes the router). If you can't find an alternate address for the server you will need to use policy routing to work around the problem as it appears that nothing can compete with a /32 "directly" connected interface route. Is there any way to resolve this? When the dialer interface is up, I browse the internet with the dialer0 ip that the router negotiated via the pptp link. Everything is fast and ok, but after 30~60secs the connection drops, then reconnects. > | How can I configure the vpn to keepalive, or to stay connected all the > time? > | I tried with no shutdown but It doesnt work. > > Keepalive (in the sense of LCP echo) is on by default. You need to turn > on debugging to see exactly why the connection is being shut down. Try > "debug ppp negotiation" and "debug ppp errors" for a start. I start logging it now and then i post the results here. I absolutely need this configuration working :) I put an mty of 1500, because i received this warning: 25-11-2006 04:28:05 Syslog.Warning 192.168.1.254 32: 000028: Nov 25 05:27:43.791 CET: %DIALER-4-MTU_WARNING: Current MTU setting of 1500 on Virtual-Access1 is being overwritten by setting of 1450 defined by Dialer0. > Dan Lanciani > ddl(a)danlan.*com
From: E. S. on 25 Nov 2006 05:33 This is the log : it started when i put "no shutdown" to the dial0 and ends when I put "shutdown" on dial0 The auth to the pptp should be MSCHAP-V2 also this is what i added to the previously released config: ------------------------------------------ service internal ! no ip gratuitous-arps ! recommended ! ip multicast-routing ! vpdn enable ! vpdn-group 1 request-dialin protocol pptp rotary-group 0 initiate-to ip 111111 initiate-to ip 222222 initiate-to ip 333333 ! interface Dialer0 description VPN Tunnel to PPTP Accentrator ip address negotiated ip pim dense-mode encapsulation ppp dialer in-band dialer idle-timeout 0 dialer string 123 dialer vpdn dialer-group 1 no cdp enable ppp pfc local request ppp pfc remote apply ppp encrypt mppe auto ppp chap hostname xxxxxxxxx ppp chap password 0 xxxxxxxxxxx ! dialer-list 1 protocol ip permit 25-11-2006 11:18:49 Syslog.Notice 192.168.1.254 168: 000164: Nov 25 12:18:27.107 CET: %SYS-5-CONFIG_I: Configured from console by maggiore on vty0 (192.168.1.11) 25-11-2006 11:29:11 Syslog.Debug 192.168.1.254 169: 000165: Nov 25 12:28:50.308 CET: Vi1 PPP: Phase is DOWN, Setup 25-11-2006 11:29:11 Syslog.Error 192.168.1.254 170: 000166: Nov 25 12:28:50.524 CET: %LINK-3-UPDOWN: Interface Virtual-Access1, changed state to up 25-11-2006 11:29:11 Syslog.Debug 192.168.1.254 171: 000167: Nov 25 12:28:50.548 CET: Vi1 PPP: Using dialer call direction 25-11-2006 11:29:11 Syslog.Debug 192.168.1.254 172: 000168: Nov 25 12:28:50.552 CET: Vi1 PPP: Treating connection as a callout 25-11-2006 11:29:11 Syslog.Debug 192.168.1.254 173: 000169: Nov 25 12:28:50.552 CET: Vi1 PPP: Session handle[76000089] Session id[43] 25-11-2006 11:29:11 Syslog.Debug 192.168.1.254 174: 000170: Nov 25 12:28:50.552 CET: Vi1 PPP: Phase is ESTABLISHING, Active Open 25-11-2006 11:29:11 Syslog.Debug 192.168.1.254 175: 000171: Nov 25 12:28:50.552 CET: Vi1 PPP: No remote authentication for call-out 25-11-2006 11:29:11 Syslog.Debug 192.168.1.254 176: 000172: Nov 25 12:28:50.552 CET: Vi1 LCP: O CONFREQ [Closed] id 1 len 12 25-11-2006 11:29:11 Syslog.Debug 192.168.1.254 177: 000173: Nov 25 12:28:50.552 CET: Vi1 LCP: MagicNumber 0x062FC9F5 (0x0506062FC9F5) 25-11-2006 11:29:11 Syslog.Debug 192.168.1.254 178: 000174: Nov 25 12:28:50.552 CET: Vi1 LCP: PFC (0x0702) 25-11-2006 11:29:11 Syslog.Debug 192.168.1.254 179: 000175: Nov 25 12:28:50.612 CET: Vi1 LCP: I CONFACK [REQsent] id 1 len 12 25-11-2006 11:29:12 Syslog.Debug 192.168.1.254 180: 000176: Nov 25 12:28:50.612 CET: Vi1 LCP: MagicNumber 0x062FC9F5 (0x0506062FC9F5) 25-11-2006 11:29:12 Syslog.Debug 192.168.1.254 181: 000177: Nov 25 12:28:50.612 CET: Vi1 LCP: PFC (0x0702) 25-11-2006 11:29:13 Syslog.Error 192.168.1.254 182: 000178: Nov 25 12:28:52.296 CET: %LINK-3-UPDOWN: Interface Dialer0, changed state to up 25-11-2006 11:29:14 Syslog.Debug 192.168.1.254 183: 000179: Nov 25 12:28:52.516 CET: Vi1 LCP: Timeout: State ACKrcvd 25-11-2006 11:29:14 Syslog.Debug 192.168.1.254 184: 000180: Nov 25 12:28:52.516 CET: Vi1 LCP: O CONFREQ [ACKrcvd] id 2 len 12 25-11-2006 11:29:14 Syslog.Debug 192.168.1.254 185: 000181: Nov 25 12:28:52.516 CET: Vi1 LCP: MagicNumber 0x062FC9F5 (0x0506062FC9F5) 25-11-2006 11:29:14 Syslog.Debug 192.168.1.254 186: 000182: Nov 25 12:28:52.516 CET: Vi1 LCP: PFC (0x0702) 25-11-2006 11:29:14 Syslog.Debug 192.168.1.254 187: 000183: Nov 25 12:28:52.572 CET: Vi1 LCP: I CONFACK [REQsent] id 2 len 12 25-11-2006 11:29:14 Syslog.Debug 192.168.1.254 188: 000184: Nov 25 12:28:52.576 CET: Vi1 LCP: MagicNumber 0x062FC9F5 (0x0506062FC9F5) 25-11-2006 11:29:14 Syslog.Debug 192.168.1.254 189: 000185: Nov 25 12:28:52.576 CET: Vi1 LCP: PFC (0x0702) 25-11-2006 11:29:14 Syslog.Debug 192.168.1.254 190: 000186: Nov 25 12:28:53.512 CET: Vi1 LCP: I CONFREQ [ACKrcvd] id 1 len 25 25-11-2006 11:29:14 Syslog.Debug 192.168.1.254 191: 000187: Nov 25 12:28:53.512 CET: Vi1 LCP: ACCM 0x00000000 (0x020600000000) 25-11-2006 11:29:14 Syslog.Debug 192.168.1.254 192: 000188: Nov 25 12:28:53.512 CET: Vi1 LCP: AuthProto MS-CHAP-V2 (0x0305C22381) 25-11-2006 11:29:14 Syslog.Debug 192.168.1.254 193: 000189: Nov 25 12:28:53.512 CET: Vi1 LCP: MagicNumber 0x8F04A680 (0x05068F04A680) 25-11-2006 11:29:14 Syslog.Debug 192.168.1.254 194: 000190: Nov 25 12:28:53.516 CET: Vi1 LCP: PFC (0x0702) 25-11-2006 11:29:14 Syslog.Debug 192.168.1.254 195: 000191: Nov 25 12:28:53.516 CET: Vi1 LCP: ACFC (0x0802) 25-11-2006 11:29:14 Syslog.Debug 192.168.1.254 196: 000192: Nov 25 12:28:53.516 CET: Vi1 LCP: O CONFACK [ACKrcvd] id 1 len 25 25-11-2006 11:29:14 Syslog.Debug 192.168.1.254 197: 000193: Nov 25 12:28:53.516 CET: Vi1 LCP: ACCM 0x00000000 (0x020600000000) 25-11-2006 11:29:14 Syslog.Debug 192.168.1.254 198: 000194: Nov 25 12:28:53.516 CET: Vi1 LCP: AuthProto MS-CHAP-V2 (0x0305C22381) 25-11-2006 11:29:14 Syslog.Debug 192.168.1.254 199: 000195: Nov 25 12:28:53.516 CET: Vi1 LCP: MagicNumber 0x8F04A680 (0x05068F04A680) 25-11-2006 11:29:14 Syslog.Debug 192.168.1.254 200: 000196: Nov 25 12:28:53.520 CET: Vi1 LCP: PFC (0x0702) 25-11-2006 11:29:15 Syslog.Debug 192.168.1.254 201: 000197: Nov 25 12:28:53.520 CET: Vi1 LCP: ACFC (0x0802) 25-11-2006 11:29:15 Syslog.Debug 192.168.1.254 202: 000198: Nov 25 12:28:53.520 CET: Vi1 LCP: State is Open 25-11-2006 11:29:15 Syslog.Debug 192.168.1.254 203: 000199: Nov 25 12:28:53.520 CET: Vi1 PPP: Phase is AUTHENTICATING, by the peer 25-11-2006 11:29:15 Syslog.Debug 192.168.1.254 204: 000200: Nov 25 12:28:53.584 CET: Vi1 MS-CHAP-V2: I CHALLENGE id 217 len 26 from "pptpd" 25-11-2006 11:29:15 Syslog.Debug 192.168.1.254 205: 000201: Nov 25 12:28:53.620 CET: Vi1 MS CHAP V2: Using hostname from interface CHAP 25-11-2006 11:29:15 Syslog.Debug 192.168.1.254 206: 000202: Nov 25 12:28:53.620 CET: Vi1 MS CHAP V2: Using password from interface CHAP 25-11-2006 11:29:15 Syslog.Debug 192.168.1.254 207: 000203: Nov 25 12:28:53.620 CET: Vi1 MS-CHAP-V2: O RESPONSE id 217 len 62 from "maggiore" 25-11-2006 11:29:15 Syslog.Debug 192.168.1.254 208: 000204: Nov 25 12:28:53.688 CET: Vi1 MS-CHAP-V2: I SUCCESS id 217 len 46 msg is "S=2A9FBD98828DD49FB738F4CD2D5C57C1053D4AC8" 25-11-2006 11:29:15 Syslog.Debug 192.168.1.254 209: 000205: Nov 25 12:28:53.692 CET: Vi1 MS CHAP V2 No Password found for : pptpd 25-11-2006 11:29:15 Syslog.Debug 192.168.1.254 210: 000206: Nov 25 12:28:53.692 CET: Vi1 MS CHAP V2 No Password found for : pptpd 25-11-2006 11:29:15 Syslog.Debug 192.168.1.254 211: 000207: Nov 25 12:28:53.692 CET: Vi1 MS CHAP V2 Check AuthenticatorResponse Success for : maggiore 25-11-2006 11:29:15 Syslog.Debug 192.168.1.254 212: 000208: Nov 25 12:28:53.692 CET: Vi1 PPP: Phase is FORWARDING, Attempting Forward 25-11-2006 11:29:15 Syslog.Debug 192.168.1.254 213: 000209: Nov 25 12:28:53.692 CET: Vi1 PPP: Queue CCP code[1] id[1] 25-11-2006 11:29:15 Syslog.Debug 192.168.1.254 214: 000210: Nov 25 12:28:53.696 CET: Vi1 PPP SSS: Receive SSS-Mgr Connect-Local 25-11-2006 11:29:15 Syslog.Debug 192.168.1.254 215: 000211: Nov 25 12:28:53.696 CET: Vi1 PPP: Phase is ESTABLISHING, Finish LCP 25-11-2006 11:29:15 Syslog.Debug 192.168.1.254 216: 000212: Nov 25 12:28:53.700 CET: Vi1 PPP: Phase is UP 25-11-2006 11:29:15 Syslog.Debug 192.168.1.254 217: 000213: Nov 25 12:28:53.700 CET: Vi1 IPCP: O CONFREQ [Closed] id 1 len 10 25-11-2006 11:29:15 Syslog.Debug 192.168.1.254 218: 000214: Nov 25 12:28:53.700 CET: Vi1 IPCP: Address 0.0.0.0 (0x030600000000) 25-11-2006 11:29:15 Syslog.Debug 192.168.1.254 219: 000215: Nov 25 12:28:53.700 CET: Vi1 CCP: O CONFREQ [Closed] id 1 len 10 25-11-2006 11:29:15 Syslog.Debug 192.168.1.254 220: 000216: Nov 25 12:28:53.700 CET: Vi1 CCP: MS-PPC supported bits 0x01000060 (0x120601000060) 25-11-2006 11:29:15 Syslog.Debug 192.168.1.254 221: 000217: Nov 25 12:28:53.704 CET: Vi1 PPP: Process pending ncp packets 25-11-2006 11:29:15 Syslog.Debug 192.168.1.254 222: 000218: Nov 25 12:28:53.704 CET: Vi1 CCP: Redirect packet to Vi1 25-11-2006 11:29:15 Syslog.Debug 192.168.1.254 223: 000219: Nov 25 12:28:53.704 CET: Vi1 CCP: I CONFREQ [REQsent] id 1 len 10 25-11-2006 11:29:15 Syslog.Debug 192.168.1.254 224: 000220: Nov 25 12:28:53.704 CET: Vi1 CCP: MS-PPC supported bits 0x01000040 (0x120601000040) 25-11-2006 11:29:15 Syslog.Debug 192.168.1.254 225: 000221: Nov 25 12:28:53.704 CET: Vi1 CCP: O CONFACK [REQsent] id 1 len 10 25-11-2006 11:29:15 Syslog.Debug 192.168.1.254 226: 000222: Nov 25 12:28:53.708 CET: Vi1 CCP: MS-PPC supported bits 0x01000040 (0x120601000040) 25-11-2006 11:29:15 Syslog.Debug 192.168.1.254 227: 000223: Nov 25 12:28:53.764 CET: Vi1 IPCP: I TERMACK [REQsent] id 1 len 4 25-11-2006 11:29:15 Syslog.Debug 192.168.1.254 228: 000224: Nov 25 12:28:53.768 CET: Vi1 CCP: I CONFNAK [ACKsent] id 1 len 10 25-11-2006 11:29:15 Syslog.Debug 192.168.1.254 229: 000225: Nov 25 12:28:53.768 CET: Vi1 CCP: MS-PPC supported bits 0x01000040 (0x120601000040) 25-11-2006 11:29:15 Syslog.Debug 192.168.1.254 230: 000226: Nov 25 12:28:53.768 CET: Vi1 CCP: O CONFREQ [ACKsent] id 2 len 10 25-11-2006 11:29:15 Syslog.Debug 192.168.1.254 231: 000227: Nov 25 12:28:53.772 CET: Vi1 CCP: MS-PPC supported bits 0x01000040 (0x120601000040) 25-11-2006 11:29:15 Syslog.Debug 192.168.1.254 232: 000228: Nov 25 12:28:53.828 CET: Vi1 CCP: I CONFACK [ACKsent] id 2 len 10 25-11-2006 11:29:15 Syslog.Debug 192.168.1.254 233: 000229: Nov 25 12:28:53.828 CET: Vi1 CCP: MS-PPC supported bits 0x01000040 (0x120601000040) 25-11-2006 11:29:16 Syslog.Debug 192.168.1.254 234: 000230: Nov 25 12:28:53.828 CET: Vi1 CCP: State is Open 25-11-2006 11:29:16 Syslog.Debug 192.168.1.254 235: 000231: Nov 25 12:28:53.836 CET: Vi1 IPCP: I CONFREQ [REQsent] id 1 len 10 25-11-2006 11:29:16 Syslog.Debug 192.168.1.254 236: 000232: Nov 25 12:28:53.836 CET: Vi1 IPCP: Address 83.233.168.2 (0x030653E9A802) 25-11-2006 11:29:16 Syslog.Debug 192.168.1.254 237: 000233: Nov 25 12:28:53.836 CET: Vi1 IPCP: O CONFACK [REQsent] id 1 len 10 25-11-2006 11:29:16 Syslog.Debug 192.168.1.254 238: 000234: Nov 25 12:28:53.836 CET: Vi1 IPCP: Address 83.233.168.2 (0x030653E9A802) 25-11-2006 11:29:17 Syslog.Notice 192.168.1.254 239: 000235: Nov 25 12:28:54.700 CET: %LINEPROTO-5-UPDOWN: Line protocol on Interface Virtual-Access1, changed state to up 25-11-2006 11:29:17 Syslog.Debug 192.168.1.254 240: 000236: Nov 25 12:28:55.684 CET: Vi1 IPCP: Timeout: State ACKsent 25-11-2006 11:29:17 Syslog.Debug 192.168.1.254 241: 000237: Nov 25 12:28:55.684 CET: Vi1 IPCP: O CONFREQ [ACKsent] id 2 len 10 25-11-2006 11:29:17 Syslog.Debug 192.168.1.254 242: 000238: Nov 25 12:28:55.684 CET: Vi1 IPCP: Address 0.0.0.0 (0x030600000000) 25-11-2006 11:29:17 Syslog.Debug 192.168.1.254 243: 000239: Nov 25 12:28:55.740 CET: Vi1 IPCP: I CONFNAK [ACKsent] id 2 len 10 25-11-2006 11:29:17 Syslog.Debug 192.168.1.254 244: 000240: Nov 25 12:28:55.740 CET: Vi1 IPCP: Address 83.233.168.28 (0x030653E9A81C) 25-11-2006 11:29:17 Syslog.Debug 192.168.1.254 245: 000241: Nov 25 12:28:55.740 CET: Vi1 IPCP: O CONFREQ [ACKsent] id 3 len 10 25-11-2006 11:29:17 Syslog.Debug 192.168.1.254 246: 000242: Nov 25 12:28:55.744 CET: Vi1 IPCP: Address 83.233.168.28 (0x030653E9A81C) 25-11-2006 11:29:17 Syslog.Debug 192.168.1.254 247: 000243: Nov 25 12:28:55.800 CET: Vi1 IPCP: I CONFACK [ACKsent] id 3 len 10 25-11-2006 11:29:18 Syslog.Debug 192.168.1.254 248: 000244: Nov 25 12:28:55.800 CET: Vi1 IPCP: Address 83.233.168.28 (0x030653E9A81C) 25-11-2006 11:29:18 Syslog.Debug 192.168.1.254 249: 000245: Nov 25 12:28:55.800 CET: Vi1 IPCP: State is Open 25-11-2006 11:29:18 Syslog.Debug 192.168.1.254 250: 000246: Nov 25 12:28:55.804 CET: Di0 IPCP: Install negotiated IP interface address 83.233.168.28 25-11-2006 11:29:18 Syslog.Debug 192.168.1.254 251: 000247: Nov 25 12:28:55.812 CET: Di0 IPCP: Install route to 83.233.168.2 25-11-2006 11:29:18 Syslog.Debug 192.168.1.254 252: 000248: Nov 25 12:28:55.816 CET: Vi1 IPCP: Add link info for cef entry 83.233.168.2 25-11-2006 11:29:57 Syslog.Debug 192.168.1.254 253: 000249: Nov 25 12:29:35.671 CET: Vi1 PPP: Missed 3 keepalives, taking LCP down 25-11-2006 11:29:57 Syslog.Debug 192.168.1.254 254: 000250: Nov 25 12:29:35.671 CET: Vi1 PPP: Sending Acct Event[Down] id[2F] 25-11-2006 11:29:57 Syslog.Debug 192.168.1.254 255: 000251: Nov 25 12:29:35.671 CET: Vi1 LCP: State is Closed 25-11-2006 11:29:57 Syslog.Debug 192.168.1.254 256: 000252: Nov 25 12:29:35.671 CET: Vi1 PPP: Phase is DOWN 25-11-2006 11:29:57 Syslog.Debug 192.168.1.254 257: 000253: Nov 25 12:29:35.671 CET: Vi1 CCP: State is Closed 25-11-2006 11:29:57 Syslog.Debug 192.168.1.254 258: 000254: Nov 25 12:29:35.675 CET: Vi1 IPCP: State is Closed 25-11-2006 11:29:57 Syslog.Debug 192.168.1.254 259: 000255: Nov 25 12:29:35.675 CET: Vi1 IPCP: Remove link info for cef entry 83.233.168.2 25-11-2006 11:29:57 Syslog.Debug 192.168.1.254 260: 000256: Nov 25 12:29:35.675 CET: Vi1 PPP SSS: Send DISCONNECT to mgr_hdl[4E00004B] 25-11-2006 11:29:57 Syslog.Debug 192.168.1.254 261: 000257: Nov 25 12:29:35.679 CET: Vi1 PPP: Phase is ESTABLISHING, Passive Open 25-11-2006 11:29:57 Syslog.Debug 192.168.1.254 262: 000258: Nov 25 12:29:35.679 CET: Vi1 LCP: State is Listen 25-11-2006 11:29:57 Syslog.Debug 192.168.1.254 263: 000259: Nov 25 12:29:35.695 CET: Di0 IPCP: Remove route to 83.233.168.2 25-11-2006 11:29:58 Syslog.Notice 192.168.1.254 264: 000260: Nov 25 12:29:36.672 CET: %LINEPROTO-5-UPDOWN: Line protocol on Interface Virtual-Access1, changed state to down 25-11-2006 11:29:59 Syslog.Debug 192.168.1.254 265: 000261: Nov 25 12:29:37.688 CET: Vi1 LCP: Timeout: State Listen 25-11-2006 11:29:59 Syslog.Debug 192.168.1.254 266: 000262: Nov 25 12:29:37.688 CET: Vi1 PPP: No remote authentication for call-out 25-11-2006 11:29:59 Syslog.Debug 192.168.1.254 267: 000263: Nov 25 12:29:37.688 CET: Vi1 LCP: O CONFREQ [Listen] id 3 len 12 25-11-2006 11:29:59 Syslog.Debug 192.168.1.254 268: 000264: Nov 25 12:29:37.688 CET: Vi1 LCP: MagicNumber 0x06308229 (0x050606308229) 25-11-2006 11:29:59 Syslog.Debug 192.168.1.254 269: 000265: Nov 25 12:29:37.688 CET: Vi1 LCP: PFC (0x0702) 25-11-2006 11:29:59 Syslog.Debug 192.168.1.254 270: 000266: Nov 25 12:29:37.820 CET: Vi1 LCP: I TERMREQ [REQsent] id 2 len 17 (0x4D5050452064697361626C6564) 25-11-2006 11:29:59 Syslog.Debug 192.168.1.254 271: 000267: Nov 25 12:29:37.824 CET: Vi1 LCP: O TERMACK [REQsent] id 2 len 4 25-11-2006 11:29:59 Syslog.Debug 192.168.1.254 272: 000268: Nov 25 12:29:37.824 CET: Vi1 LCP: I CONFREQ [REQsent] id 3 len 25 25-11-2006 11:29:59 Syslog.Debug 192.168.1.254 273: 000269: Nov 25 12:29:37.824 CET: Vi1 LCP: ACCM 0x00000000 (0x020600000000) 25-11-2006 11:29:59 Syslog.Debug 192.168.1.254 274: 000270: Nov 25 12:29:37.824 CET: Vi1 LCP: AuthProto MS-CHAP-V2 (0x0305C22381) 25-11-2006 11:29:59 Syslog.Debug 192.168.1.254 275: 000271: Nov 25 12:29:37.824 CET: Vi1 LCP: MagicNumber 0x0B45D881 (0x05060B45D881) 25-11-2006 11:29:59 Syslog.Debug 192.168.1.254 276: 000272: Nov 25 12:29:37.824 CET: Vi1 LCP: PFC (0x0702) 25-11-2006 11:29:59 Syslog.Debug 192.168.1.254 277: 000273: Nov 25 12:29:37.824 CET: Vi1 LCP: ACFC (0x0802) 25-11-2006 11:29:59 Syslog.Debug 192.168.1.254 278: 000274: Nov 25 12:29:37.828 CET: Vi1 LCP: O CONFACK [REQsent] id 3 len 25 25-11-2006 11:29:59 Syslog.Debug 192.168.1.254 279: 000275: Nov 25 12:29:37.828 CET: Vi1 LCP: ACCM 0x00000000 (0x020600000000) 25-11-2006 11:29:59 Syslog.Debug 192.168.1.254 280: 000276: Nov 25 12:29:37.828 CET: Vi1 LCP: AuthProto MS-CHAP-V2 (0x0305C22381) 25-11-2006 11:29:59 Syslog.Debug 192.168.1.254 281: 000277: Nov 25 12:29:37.828 CET: Vi1 LCP: MagicNumber 0x0B45D881 (0x05060B45D881) 25-11-2006 11:29:59 Syslog.Debug 192.168.1.254 282: 000278: Nov 25 12:29:37.828 CET: Vi1 LCP: PFC (0x0702) 25-11-2006 11:29:59 Syslog.Debug 192.168.1.254 283: 000279: Nov 25 12:29:37.828 CET: Vi1 LCP: ACFC (0x0802) 25-11-2006 11:29:59 Syslog.Debug 192.168.1.254 284: 000280: Nov 25 12:29:37.828 CET: Vi1 LCP: I CONFACK [ACKsent] id 3 len 12 25-11-2006 11:29:59 Syslog.Debug 192.168.1.254 285: 000281: Nov 25 12:29:37.828 CET: Vi1 LCP: MagicNumber 0x06308229 (0x050606308229) 25-11-2006 11:29:59 Syslog.Debug 192.168.1.254 286: 000282: Nov 25 12:29:37.832 CET: Vi1 LCP: PFC (0x0702) 25-11-2006 11:29:59 Syslog.Debug 192.168.1.254 287: 000283: Nov 25 12:29:37.832 CET: Vi1 LCP: State is Open 25-11-2006 11:29:59 Syslog.Debug 192.168.1.254 288: 000284: Nov 25 12:29:37.832 CET: Vi1 PPP: Phase is AUTHENTICATING, by the peer 25-11-2006 11:29:59 Syslog.Debug 192.168.1.254 289: 000285: Nov 25 12:29:37.896 CET: Vi1 MS-CHAP-V2: I CHALLENGE id 222 len 26 from "pptpd" 25-11-2006 11:29:59 Syslog.Debug 192.168.1.254 290: 000286: Nov 25 12:29:37.932 CET: Vi1 MS CHAP V2: Using hostname from interface CHAP 25-11-2006 11:29:59 Syslog.Debug 192.168.1.254 291: 000287: Nov 25 12:29:37.932 CET: Vi1 MS CHAP V2: Using password from interface CHAP 25-11-2006 11:29:59 Syslog.Debug 192.168.1.254 292: 000288: Nov 25 12:29:37.932 CET: Vi1 MS-CHAP-V2: O RESPONSE id 222 len 62 from "maggiore" 25-11-2006 11:29:59 Syslog.Debug 192.168.1.254 293: 000289: Nov 25 12:29:37.996 CET: Vi1 MS-CHAP-V2: I SUCCESS id 222 len 4 25-11-2006 11:29:59 Syslog.Debug 192.168.1.254 294: 000290: Nov 25 12:29:38.000 CET: Vi1 MS CHAP V2 No Password found for : pptpd 25-11-2006 11:29:59 Syslog.Debug 192.168.1.254 295: 000291: Nov 25 12:29:38.000 CET: Vi1 MS CHAP V2 No Password found for : pptpd 25-11-2006 11:29:59 Syslog.Debug 192.168.1.254 296: 000292: Nov 25 12:29:38.000 CET: Vi1 MS CHAP V2 CheckAuthenticatorResponse Failed for : maggiore 25-11-2006 11:29:59 Syslog.Debug 192.168.1.254 297: 000293: Nov 25 12:29:38.000 CET: Vi1 PPP: Phase is FORWARDING, Attempting Forward 25-11-2006 11:29:59 Syslog.Debug 192.168.1.254 298: 000294: Nov 25 12:29:38.004 CET: Vi1 PPP: Sending Acct Event[Down] id[30] 25-11-2006 11:29:59 Syslog.Debug 192.168.1.254 299: 000295: Nov 25 12:29:38.004 CET: Vi1 PPP: Phase is TERMINATING 25-11-2006 11:29:59 Syslog.Debug 192.168.1.254 300: 000296: Nov 25 12:29:38.004 CET: Vi1 LCP: O TERMREQ [Open] id 4 len 4 25-11-2006 11:29:59 Syslog.Debug 192.168.1.254 301: 000297: Nov 25 12:29:38.008 CET: Vi1 PPP SSS: Receive SSS-Mgr Connect-Local 25-11-2006 11:29:59 Syslog.Debug 192.168.1.254 302: 000298: Nov 25 12:29:38.012 CET: Vi1 PPP: Phase is ESTABLISHING, Finish LCP 25-11-2006 11:29:59 Syslog.Debug 192.168.1.254 303: 000299: Nov 25 12:29:38.064 CET: Vi1 LCP: I TERMACK [TERMsent] id 4 len 4 25-11-2006 11:29:59 Syslog.Debug 192.168.1.254 304: 000300: Nov 25 12:29:38.064 CET: Vi1 LCP: State is Closed 25-11-2006 11:29:59 Syslog.Debug 192.168.1.254 305: 000301: Nov 25 12:29:38.064 CET: Vi1 PPP: Phase is DOWN 25-11-2006 11:29:59 Syslog.Debug 192.168.1.254 306: 000302: Nov 25 12:29:38.068 CET: Vi1 PPP SSS: Send DISCONNECT to mgr_hdl[8300004D] 25-11-2006 11:29:59 Syslog.Debug 192.168.1.254 307: 000303: Nov 25 12:29:38.068 CET: Vi1 PPP: Phase is ESTABLISHING, Passive Open 25-11-2006 11:30:00 Syslog.Debug 192.168.1.254 308: 000304: Nov 25 12:29:38.068 CET: Vi1 LCP: State is Listen 25-11-2006 11:30:02 Syslog.Debug 192.168.1.254 309: 000305: Nov 25 12:29:40.057 CET: Vi1 LCP: Timeout: State Listen 25-11-2006 11:30:02 Syslog.Debug 192.168.1.254 310: 000306: Nov 25 12:29:40.057 CET: Vi1 PPP: No remote authentication for call-out 25-11-2006 11:30:02 Syslog.Debug 192.168.1.254 311: 000307: Nov 25 12:29:40.057 CET: Vi1 LCP: O CONFREQ [Listen] id 5 len 12 25-11-2006 11:30:02 Syslog.Debug 192.168.1.254 312: 000308: Nov 25 12:29:40.057 CET: Vi1 LCP: MagicNumber 0x06308B6B (0x050606308B6B) 25-11-2006 11:30:02 Syslog.Debug 192.168.1.254 313: 000309: Nov 25 12:29:40.057 CET: Vi1 LCP: PFC (0x0702) 25-11-2006 11:30:03 Syslog.Error 192.168.1.254 314: 000310: Nov 25 12:29:40.854 CET: %LINK-3-UPDOWN: Interface Virtual-Access1, changed state to down 25-11-2006 11:30:16 Syslog.Debug 192.168.1.254 315: 000311: Nov 25 12:29:54.487 CET: Vi1 PPP: Phase is DOWN, Setup 25-11-2006 11:30:16 Syslog.Error 192.168.1.254 316: 000312: Nov 25 12:29:54.703 CET: %LINK-3-UPDOWN: Interface Virtual-Access1, changed state to up 25-11-2006 11:30:16 Syslog.Debug 192.168.1.254 317: 000313: Nov 25 12:29:54.727 CET: Vi1 PPP: Using dialer call direction 25-11-2006 11:30:16 Syslog.Debug 192.168.1.254 318: 000314: Nov 25 12:29:54.731 CET: Vi1 PPP: Treating connection as a callout 25-11-2006 11:30:16 Syslog.Debug 192.168.1.254 319: 000315: Nov 25 12:29:54.731 CET: Vi1 PPP: Session handle[D00008D] Session id[46] 25-11-2006 11:30:16 Syslog.Debug 192.168.1.254 320: 000316: Nov 25 12:29:54.731 CET: Vi1 PPP: Phase is ESTABLISHING, Active Open 25-11-2006 11:30:16 Syslog.Debug 192.168.1.254 321: 000317: Nov 25 12:29:54.731 CET: Vi1 PPP: No remote authentication for call-out 25-11-2006 11:30:16 Syslog.Debug 192.168.1.254 322: 000318: Nov 25 12:29:54.731 CET: Vi1 LCP: O CONFREQ [Closed] id 1 len 12 25-11-2006 11:30:16 Syslog.Debug 192.168.1.254 323: 000319: Nov 25 12:29:54.731 CET: Vi1 LCP: MagicNumber 0x0630C4B8 (0x05060630C4B8) 25-11-2006 11:30:16 Syslog.Debug 192.168.1.254 324: 000320: Nov 25 12:29:54.731 CET: Vi1 LCP: PFC (0x0702) 25-11-2006 11:30:16 Syslog.Debug 192.168.1.254 325: 000321: Nov 25 12:29:54.791 CET: Vi1 LCP: I CONFACK [REQsent] id 1 len 12 25-11-2006 11:30:17 Syslog.Debug 192.168.1.254 326: 000322: Nov 25 12:29:54.791 CET: Vi1 LCP: MagicNumber 0x0630C4B8 (0x05060630C4B8) 25-11-2006 11:30:17 Syslog.Debug 192.168.1.254 327: 000323: Nov 25 12:29:54.791 CET: Vi1 LCP: PFC (0x0702) 25-11-2006 11:30:19 Syslog.Debug 192.168.1.254 328: 000324: Nov 25 12:29:56.703 CET: Vi1 LCP: Timeout: State ACKrcvd 25-11-2006 11:30:19 Syslog.Debug 192.168.1.254 329: 000325: Nov 25 12:29:56.703 CET: Vi1 LCP: O CONFREQ [ACKrcvd] id 2 len 12 25-11-2006 11:30:19 Syslog.Debug 192.168.1.254 330: 000326: Nov 25 12:29:56.703 CET: Vi1 LCP: MagicNumber 0x0630C4B8 (0x05060630C4B8) 25-11-2006 11:30:19 Syslog.Debug 192.168.1.254 331: 000327: Nov 25 12:29:56.703 CET: Vi1 LCP: PFC (0x0702) 25-11-2006 11:30:19 Syslog.Debug 192.168.1.254 332: 000328: Nov 25 12:29:56.763 CET: Vi1 LCP: I CONFACK [REQsent] id 2 len 12 25-11-2006 11:30:19 Syslog.Debug 192.168.1.254 333: 000329: Nov 25 12:29:56.767 CET: Vi1 LCP: MagicNumber 0x0630C4B8 (0x05060630C4B8) 25-11-2006 11:30:19 Syslog.Debug 192.168.1.254 334: 000330: Nov 25 12:29:56.767 CET: Vi1 LCP: PFC (0x0702) 25-11-2006 11:30:19 Syslog.Debug 192.168.1.254 335: 000331: Nov 25 12:29:57.695 CET: Vi1 LCP: I CONFREQ [ACKrcvd] id 1 len 25 25-11-2006 11:30:19 Syslog.Debug 192.168.1.254 336: 000332: Nov 25 12:29:57.695 CET: Vi1 LCP: ACCM 0x00000000 (0x020600000000) 25-11-2006 11:30:19 Syslog.Debug 192.168.1.254 337: 000333: Nov 25 12:29:57.695 CET: Vi1 LCP: AuthProto MS-CHAP-V2 (0x0305C22381) 25-11-2006 11:30:19 Syslog.Debug 192.168.1.254 338: 000334: Nov 25 12:29:57.695 CET: Vi1 LCP: MagicNumber 0x403C8590 (0x0506403C8590) 25-11-2006 11:30:19 Syslog.Debug 192.168.1.254 339: 000335: Nov 25 12:29:57.695 CET: Vi1 LCP: PFC (0x0702) 25-11-2006 11:30:19 Syslog.Debug 192.168.1.254 340: 000336: Nov 25 12:29:57.695 CET: Vi1 LCP: ACFC (0x0802) 25-11-2006 11:30:19 Syslog.Debug 192.168.1.254 341: 000337: Nov 25 12:29:57.695 CET: Vi1 LCP: O CONFACK [ACKrcvd] id 1 len 25 25-11-2006 11:30:19 Syslog.Debug 192.168.1.254 342: 000338: Nov 25 12:29:57.699 CET: Vi1 LCP: ACCM 0x00000000 (0x020600000000) 25-11-2006 11:30:19 Syslog.Debug 192.168.1.254 343: 000339: Nov 25 12:29:57.699 CET: Vi1 LCP: AuthProto MS-CHAP-V2 (0x0305C22381) 25-11-2006 11:30:19 Syslog.Debug 192.168.1.254 344: 000340: Nov 25 12:29:57.699 CET: Vi1 LCP: MagicNumber 0x403C8590 (0x0506403C8590) 25-11-2006 11:30:19 Syslog.Debug 192.168.1.254 345: 000341: Nov 25 12:29:57.699 CET: Vi1 LCP: PFC (0x0702) 25-11-2006 11:30:19 Syslog.Debug 192.168.1.254 346: 000342: Nov 25 12:29:57.699 CET: Vi1 LCP: ACFC (0x0802) 25-11-2006 11:30:19 Syslog.Debug 192.168.1.254 347: 000343: Nov 25 12:29:57.699 CET: Vi1 LCP: State is Open 25-11-2006 11:30:19 Syslog.Debug 192.168.1.254 348: 000344: Nov 25 12:29:57.699 CET: Vi1 PPP: Phase is AUTHENTICATING, by the peer 25-11-2006 11:30:19 Syslog.Debug 192.168.1.254 349: 000345: Nov 25 12:29:57.763 CET: Vi1 MS-CHAP-V2: I CHALLENGE id 3 len 26 from "pptpd" 25-11-2006 11:30:19 Syslog.Debug 192.168.1.254 350: 000346: Nov 25 12:29:57.799 CET: Vi1 MS CHAP V2: Using hostname from interface CHAP 25-11-2006 11:30:19 Syslog.Debug 192.168.1.254 351: 000347: Nov 25 12:29:57.799 CET: Vi1 MS CHAP V2: Using password from interface CHAP 25-11-2006 11:30:19 Syslog.Debug 192.168.1.254 352: 000348: Nov 25 12:29:57.803 CET: Vi1 MS-CHAP-V2: O RESPONSE id 3 len 62 from "maggiore" 25-11-2006 11:30:19 Syslog.Debug 192.168.1.254 353: 000349: Nov 25 12:29:57.867 CET: Vi1 MS-CHAP-V2: I SUCCESS id 3 len 46 msg is "S=F8CE9D998998E78AA852350AE3B56EA2132D0510" 25-11-2006 11:30:19 Syslog.Debug 192.168.1.254 354: 000350: Nov 25 12:29:57.867 CET: Vi1 MS CHAP V2 No Password found for : pptpd 25-11-2006 11:30:19 Syslog.Debug 192.168.1.254 355: 000351: Nov 25 12:29:57.867 CET: Vi1 MS CHAP V2 No Password found for : pptpd 25-11-2006 11:30:19 Syslog.Debug 192.168.1.254 356: 000352: Nov 25 12:29:57.871 CET: Vi1 MS CHAP V2 Check AuthenticatorResponse Success for : maggiore 25-11-2006 11:30:19 Syslog.Debug 192.168.1.254 357: 000353: Nov 25 12:29:57.871 CET: Vi1 PPP: Phase is FORWARDING, Attempting Forward 25-11-2006 11:30:19 Syslog.Debug 192.168.1.254 358: 000354: Nov 25 12:29:57.871 CET: Vi1 PPP: Queue CCP code[1] id[1] 25-11-2006 11:30:19 Syslog.Debug 192.168.1.254 359: 000355: Nov 25 12:29:57.871 CET: Vi1 PPP SSS: Receive SSS-Mgr Connect-Local 25-11-2006 11:30:19 Syslog.Debug 192.168.1.254 360: 000356: Nov 25 12:29:57.875 CET: Vi1 PPP: Phase is ESTABLISHING, Finish LCP 25-11-2006 11:30:19 Syslog.Debug 192.168.1.254 361: 000357: Nov 25 12:29:57.875 CET: Vi1 PPP: Phase is UP 25-11-2006 11:30:19 Syslog.Debug 192.168.1.254 362: 000358: Nov 25 12:29:57.875 CET: Vi1 IPCP: O CONFREQ [Closed] id 1 len 10 25-11-2006 11:30:19 Syslog.Debug 192.168.1.254 363: 000359: Nov 25 12:29:57.875 CET: Vi1 IPCP: Address 0.0.0.0 (0x030600000000) 25-11-2006 11:30:19 Syslog.Debug 192.168.1.254 364: 000360: Nov 25 12:29:57.879 CET: Vi1 CCP: O CONFREQ [Closed] id 1 len 10 25-11-2006 11:30:19 Syslog.Debug 192.168.1.254 365: 000361: Nov 25 12:29:57.879 CET: Vi1 CCP: MS-PPC supported bits 0x01000060 (0x120601000060) 25-11-2006 11:30:19 Syslog.Debug 192.168.1.254 366: 000362: Nov 25 12:29:57.879 CET: Vi1 PPP: Process pending ncp packets 25-11-2006 11:30:19 Syslog.Debug 192.168.1.254 367: 000363: Nov 25 12:29:57.879 CET: Vi1 CCP: Redirect packet to Vi1 25-11-2006 11:30:19 Syslog.Debug 192.168.1.254 368: 000364: Nov 25 12:29:57.879 CET: Vi1 CCP: I CONFREQ [REQsent] id 1 len 10 25-11-2006 11:30:19 Syslog.Debug 192.168.1.254 369: 000365: Nov 25 12:29:57.879 CET: Vi1 CCP: MS-PPC supported bits 0x01000040 (0x120601000040) 25-11-2006 11:30:19 Syslog.Debug 192.168.1.254 370: 000366: Nov 25 12:29:57.879 CET: Vi1 CCP: O CONFACK [REQsent] id 1 len 10 25-11-2006 11:30:19 Syslog.Debug 192.168.1.254 371: 000367: Nov 25 12:29:57.883 CET: Vi1 CCP: MS-PPC supported bits 0x01000040 (0x120601000040) 25-11-2006 11:30:19 Syslog.Debug 192.168.1.254 372: 000368: Nov 25 12:29:57.939 CET: Vi1 IPCP: I TERMACK [REQsent] id 1 len 4 25-11-2006 11:30:19 Syslog.Debug 192.168.1.254 373: 000369: Nov 25 12:29:57.943 CET: Vi1 CCP: I CONFNAK [ACKsent] id 1 len 10 25-11-2006 11:30:19 Syslog.Debug 192.168.1.254 374: 000370: Nov 25 12:29:57.943 CET: Vi1 CCP: MS-PPC supported bits 0x01000040 (0x120601000040) 25-11-2006 11:30:19 Syslog.Debug 192.168.1.254 375: 000371: Nov 25 12:29:57.947 CET: Vi1 CCP: O CONFREQ [ACKsent] id 2 len 10 25-11-2006 11:30:19 Syslog.Debug 192.168.1.254 376: 000372: Nov 25 12:29:57.947 CET: Vi1 CCP: MS-PPC supported bits 0x01000040 (0x120601000040) 25-11-2006 11:30:19 Syslog.Debug 192.168.1.254 377: 000373: Nov 25 12:29:58.003 CET: Vi1 CCP: I CONFACK [ACKsent] id 2 len 10 25-11-2006 11:30:19 Syslog.Debug 192.168.1.254 378: 000374: Nov 25 12:29:58.003 CET: Vi1 CCP: MS-PPC supported bits 0x01000040 (0x120601000040) 25-11-2006 11:30:20 Syslog.Debug 192.168.1.254 379: 000375: Nov 25 12:29:58.007 CET: Vi1 CCP: State is Open 25-11-2006 11:30:20 Syslog.Debug 192.168.1.254 380: 000376: Nov 25 12:29:58.011 CET: Vi1 IPCP: I CONFREQ [REQsent] id 1 len 10 25-11-2006 11:30:20 Syslog.Debug 192.168.1.254 381: 000377: Nov 25 12:29:58.011 CET: Vi1 IPCP: Address 83.233.168.2 (0x030653E9A802) 25-11-2006 11:30:20 Syslog.Debug 192.168.1.254 382: 000378: Nov 25 12:29:58.011 CET: Vi1 IPCP: O CONFACK [REQsent] id 1 len 10 25-11-2006 11:30:20 Syslog.Debug 192.168.1.254 383: 000379: Nov 25 12:29:58.011 CET: Vi1 IPCP: Address 83.233.168.2 (0x030653E9A802) 25-11-2006 11:30:21 Syslog.Notice 192.168.1.254 384: 000380: Nov 25 12:29:58.875 CET: %LINEPROTO-5-UPDOWN: Line protocol on Interface Virtual-Access1, changed state to up 25-11-2006 11:30:21 Syslog.Debug 192.168.1.254 385: 000381: Nov 25 12:29:59.871 CET: Vi1 IPCP: Timeout: State ACKsent 25-11-2006 11:30:21 Syslog.Debug 192.168.1.254 386: 000382: Nov 25 12:29:59.871 CET: Vi1 IPCP: O CONFREQ [ACKsent] id 2 len 10 25-11-2006 11:30:21 Syslog.Debug 192.168.1.254 387: 000383: Nov 25 12:29:59.871 CET: Vi1 IPCP: Address 0.0.0.0 (0x030600000000) 25-11-2006 11:30:21 Syslog.Debug 192.168.1.254 388: 000384: Nov 25 12:29:59.927 CET: Vi1 IPCP: I CONFNAK [ACKsent] id 2 len 10 25-11-2006 11:30:21 Syslog.Debug 192.168.1.254 389: 000385: Nov 25 12:29:59.927 CET: Vi1 IPCP: Address 83.233.168.28 (0x030653E9A81C) 25-11-2006 11:30:21 Syslog.Debug 192.168.1.254 390: 000386: Nov 25 12:29:59.931 CET: Vi1 IPCP: O CONFREQ [ACKsent] id 3 len 10 25-11-2006 11:30:21 Syslog.Debug 192.168.1.254 391: 000387: Nov 25 12:29:59.931 CET: Vi1 IPCP: Address 83.233.168.28 (0x030653E9A81C) 25-11-2006 11:30:21 Syslog.Debug 192.168.1.254 392: 000388: Nov 25 12:29:59.991 CET: Vi1 IPCP: I CONFACK [ACKsent] id 3 len 10 25-11-2006 11:30:22 Syslog.Debug 192.168.1.254 393: 000389: Nov 25 12:29:59.991 CET: Vi1 IPCP: Address 83.233.168.28 (0x030653E9A81C) 25-11-2006 11:30:22 Syslog.Debug 192.168.1.254 394: 000390: Nov 25 12:29:59.991 CET: Vi1 IPCP: State is Open 25-11-2006 11:30:22 Syslog.Debug 192.168.1.254 395: 000391: Nov 25 12:29:59.991 CET: Di0 IPCP: Install negotiated IP interface address 83.233.168.28 25-11-2006 11:30:22 Syslog.Debug 192.168.1.254 396: 000392: Nov 25 12:30:00.003 CET: Di0 IPCP: Install route to 83.233.168.2 25-11-2006 11:30:22 Syslog.Debug 192.168.1.254 397: 000393: Nov 25 12:30:00.007 CET: Vi1 IPCP: Add link info for cef entry 83.233.168.2 25-11-2006 11:30:38 Syslog.Debug 192.168.1.254 398: 000394: Nov 25 12:30:17.459 CET: Vi1 PPP: Block vaccess from being freed [0x11] 25-11-2006 11:30:38 Syslog.Error 192.168.1.254 399: 000395: Nov 25 12:30:17.475 CET: %LINK-3-UPDOWN: Interface Virtual-Access1, changed state to down 25-11-2006 11:30:38 Syslog.Debug 192.168.1.254 400: 000396: Nov 25 12:30:17.507 CET: Vi1 PPP: Sending Acct Event[Down] id[32] 25-11-2006 11:30:38 Syslog.Debug 192.168.1.254 401: 000397: Nov 25 12:30:17.511 CET: Vi1 CCP: State is Closed 25-11-2006 11:30:38 Syslog.Debug 192.168.1.254 402: 000398: Nov 25 12:30:17.511 CET: Vi1 IPCP: State is Closed 25-11-2006 11:30:38 Syslog.Debug 192.168.1.254 403: 000399: Nov 25 12:30:17.511 CET: Vi1 IPCP: Remove link info for cef entry 83.233.168.2 25-11-2006 11:30:38 Syslog.Debug 192.168.1.254 404: 000400: Nov 25 12:30:17.515 CET: Vi1 PPP: Unlocked by [0x1] Still Locked by [0x12] 25-11-2006 11:30:38 Syslog.Debug 192.168.1.254 405: 000401: Nov 25 12:30:17.515 CET: Vi1 PPP: Unlocked by [0x10] Still Locked by [0x2] 25-11-2006 11:30:38 Syslog.Debug 192.168.1.254 406: 000402: Nov 25 12:30:17.515 CET: Vi1 PPP: Phase is TERMINATING 25-11-2006 11:30:38 Syslog.Debug 192.168.1.254 407: 000403: Nov 25 12:30:17.515 CET: Vi1 LCP: State is Closed 25-11-2006 11:30:38 Syslog.Debug 192.168.1.254 408: 000404: Nov 25 12:30:17.515 CET: Vi1 PPP: Phase is DOWN 25-11-2006 11:30:39 Syslog.Debug 192.168.1.254 409: 000405: Nov 25 12:30:17.515 CET: Vi1 PPP SSS: Send DISCONNECT to mgr_hdl[A100004F] 25-11-2006 11:30:39 Syslog.Debug 192.168.1.254 410: 000406: Nov 25 12:30:17.515 CET: Vi1 PPP: Unlocked by [0x2] Still Locked by [0x0] 25-11-2006 11:30:39 Syslog.Debug 192.168.1.254 411: 000407: Nov 25 12:30:17.515 CET: Vi1 PPP: Free previously blocked vaccess 25-11-2006 11:30:39 Syslog.Debug 192.168.1.254 412: 000408: Nov 25 12:30:17.527 CET: Di0 IPCP: Remove route to 83.233.168.2 25-11-2006 11:30:40 Syslog.Notice 192.168.1.254 413: 000409: Nov 25 12:30:18.475 CET: %LINEPROTO-5-UPDOWN: Line protocol on Interface Virtual-Access1, changed state to down 25-11-2006 11:30:40 Syslog.Notice 192.168.1.254 414: 000410: Nov 25 12:30:19.458 CET: %LINK-5-CHANGED: Interface Dialer0, changed state to administratively down
From: E. S. on 25 Nov 2006 05:59 I browsed some forums, I disabled the keepalive i now have this TERMSENT error and the line goes down. 25-11-2006 11:53:04 Syslog.Error 192.168.1.254 546: 000542: Nov 25 12:52:43.553 CET: %LINK-3-UPDOWN: Interface Virtual-Access1, changed state to up 25-11-2006 11:53:04 Syslog.Debug 192.168.1.254 547: 000543: Nov 25 12:52:43.577 CET: Vi1 PPP: Using dialer call direction 25-11-2006 11:53:04 Syslog.Debug 192.168.1.254 548: 000544: Nov 25 12:52:43.581 CET: Vi1 PPP: Treating connection as a callout 25-11-2006 11:53:04 Syslog.Debug 192.168.1.254 549: 000545: Nov 25 12:52:43.581 CET: Vi1 PPP: Session handle[90000096] Session id[51] 25-11-2006 11:53:04 Syslog.Debug 192.168.1.254 550: 000546: Nov 25 12:52:43.581 CET: Vi1 PPP: Phase is ESTABLISHING, Active Open 25-11-2006 11:53:04 Syslog.Debug 192.168.1.254 551: 000547: Nov 25 12:52:43.581 CET: Vi1 PPP: No remote authentication for call-out 25-11-2006 11:53:04 Syslog.Debug 192.168.1.254 552: 000548: Nov 25 12:52:43.581 CET: Vi1 LCP: O CONFREQ [Closed] id 1 len 12 25-11-2006 11:53:04 Syslog.Debug 192.168.1.254 553: 000549: Nov 25 12:52:43.581 CET: Vi1 LCP: MagicNumber 0x0645A9EB (0x05060645A9EB) 25-11-2006 11:53:04 Syslog.Debug 192.168.1.254 554: 000550: Nov 25 12:52:43.581 CET: Vi1 LCP: PFC (0x0702) 25-11-2006 11:53:04 Syslog.Debug 192.168.1.254 555: 000551: Nov 25 12:52:43.641 CET: Vi1 LCP: I CONFACK [REQsent] id 1 len 12 25-11-2006 11:53:05 Syslog.Debug 192.168.1.254 556: 000552: Nov 25 12:52:43.641 CET: Vi1 LCP: MagicNumber 0x0645A9EB (0x05060645A9EB) 25-11-2006 11:53:05 Syslog.Debug 192.168.1.254 557: 000553: Nov 25 12:52:43.645 CET: Vi1 LCP: PFC (0x0702) 25-11-2006 11:53:07 Syslog.Debug 192.168.1.254 558: 000554: Nov 25 12:52:45.557 CET: Vi1 LCP: Timeout: State ACKrcvd 25-11-2006 11:53:07 Syslog.Debug 192.168.1.254 559: 000555: Nov 25 12:52:45.557 CET: Vi1 LCP: O CONFREQ [ACKrcvd] id 2 len 12 25-11-2006 11:53:07 Syslog.Debug 192.168.1.254 560: 000556: Nov 25 12:52:45.557 CET: Vi1 LCP: MagicNumber 0x0645A9EB (0x05060645A9EB) 25-11-2006 11:53:07 Syslog.Debug 192.168.1.254 561: 000557: Nov 25 12:52:45.557 CET: Vi1 LCP: PFC (0x0702) 25-11-2006 11:53:07 Syslog.Debug 192.168.1.254 562: 000558: Nov 25 12:52:45.617 CET: Vi1 LCP: I CONFACK [REQsent] id 2 len 12 25-11-2006 11:53:07 Syslog.Debug 192.168.1.254 563: 000559: Nov 25 12:52:45.617 CET: Vi1 LCP: MagicNumber 0x0645A9EB (0x05060645A9EB) 25-11-2006 11:53:07 Syslog.Debug 192.168.1.254 564: 000560: Nov 25 12:52:45.617 CET: Vi1 LCP: PFC (0x0702) 25-11-2006 11:53:07 Syslog.Debug 192.168.1.254 565: 000561: Nov 25 12:52:46.545 CET: Vi1 LCP: I CONFREQ [ACKrcvd] id 1 len 25 25-11-2006 11:53:07 Syslog.Debug 192.168.1.254 566: 000562: Nov 25 12:52:46.549 CET: Vi1 LCP: ACCM 0x00000000 (0x020600000000) 25-11-2006 11:53:07 Syslog.Debug 192.168.1.254 567: 000563: Nov 25 12:52:46.549 CET: Vi1 LCP: AuthProto MS-CHAP-V2 (0x0305C22381) 25-11-2006 11:53:07 Syslog.Debug 192.168.1.254 568: 000564: Nov 25 12:52:46.549 CET: Vi1 LCP: MagicNumber 0x679A59F7 (0x0506679A59F7) 25-11-2006 11:53:07 Syslog.Debug 192.168.1.254 569: 000565: Nov 25 12:52:46.549 CET: Vi1 LCP: PFC (0x0702) 25-11-2006 11:53:07 Syslog.Debug 192.168.1.254 570: 000566: Nov 25 12:52:46.549 CET: Vi1 LCP: ACFC (0x0802) 25-11-2006 11:53:07 Syslog.Debug 192.168.1.254 571: 000567: Nov 25 12:52:46.549 CET: Vi1 LCP: O CONFACK [ACKrcvd] id 1 len 25 25-11-2006 11:53:07 Syslog.Debug 192.168.1.254 572: 000568: Nov 25 12:52:46.549 CET: Vi1 LCP: ACCM 0x00000000 (0x020600000000) 25-11-2006 11:53:07 Syslog.Debug 192.168.1.254 573: 000569: Nov 25 12:52:46.549 CET: Vi1 LCP: AuthProto MS-CHAP-V2 (0x0305C22381) 25-11-2006 11:53:07 Syslog.Debug 192.168.1.254 574: 000570: Nov 25 12:52:46.553 CET: Vi1 LCP: MagicNumber 0x679A59F7 (0x0506679A59F7) 25-11-2006 11:53:07 Syslog.Debug 192.168.1.254 575: 000571: Nov 25 12:52:46.553 CET: Vi1 LCP: PFC (0x0702) 25-11-2006 11:53:08 Syslog.Debug 192.168.1.254 576: 000572: Nov 25 12:52:46.553 CET: Vi1 LCP: ACFC (0x0802) 25-11-2006 11:53:08 Syslog.Debug 192.168.1.254 577: 000573: Nov 25 12:52:46.553 CET: Vi1 LCP: State is Open 25-11-2006 11:53:08 Syslog.Debug 192.168.1.254 578: 000574: Nov 25 12:52:46.553 CET: Vi1 PPP: Phase is AUTHENTICATING, by the peer 25-11-2006 11:53:08 Syslog.Debug 192.168.1.254 579: 000575: Nov 25 12:52:46.613 CET: Vi1 MS-CHAP-V2: I CHALLENGE id 52 len 26 from "pptpd" 25-11-2006 11:53:08 Syslog.Debug 192.168.1.254 580: 000576: Nov 25 12:52:46.649 CET: Vi1 MS CHAP V2: Using hostname from interface CHAP 25-11-2006 11:53:08 Syslog.Debug 192.168.1.254 581: 000577: Nov 25 12:52:46.649 CET: Vi1 MS CHAP V2: Using password from interface CHAP 25-11-2006 11:53:08 Syslog.Debug 192.168.1.254 582: 000578: Nov 25 12:52:46.649 CET: Vi1 MS-CHAP-V2: O RESPONSE id 52 len 62 from "maggiore" 25-11-2006 11:53:08 Syslog.Debug 192.168.1.254 583: 000579: Nov 25 12:52:46.713 CET: Vi1 MS-CHAP-V2: I SUCCESS id 52 len 46 msg is "S=3FAC4702528299820E4994BBE6793090F74DCCB6" 25-11-2006 11:53:08 Syslog.Debug 192.168.1.254 584: 000580: Nov 25 12:52:46.717 CET: Vi1 MS CHAP V2 No Password found for : pptpd 25-11-2006 11:53:08 Syslog.Debug 192.168.1.254 585: 000581: Nov 25 12:52:46.717 CET: Vi1 MS CHAP V2 No Password found for : pptpd 25-11-2006 11:53:08 Syslog.Debug 192.168.1.254 586: 000582: Nov 25 12:52:46.717 CET: Vi1 MS CHAP V2 Check AuthenticatorResponse Success for : maggiore 25-11-2006 11:53:08 Syslog.Debug 192.168.1.254 587: 000583: Nov 25 12:52:46.717 CET: Vi1 PPP: Phase is FORWARDING, Attempting Forward 25-11-2006 11:53:08 Syslog.Debug 192.168.1.254 588: 000584: Nov 25 12:52:46.717 CET: Vi1 PPP: Queue CCP code[1] id[1] 25-11-2006 11:53:08 Syslog.Debug 192.168.1.254 589: 000585: Nov 25 12:52:46.721 CET: Vi1 PPP SSS: Receive SSS-Mgr Connect-Local 25-11-2006 11:53:08 Syslog.Debug 192.168.1.254 590: 000586: Nov 25 12:52:46.721 CET: Vi1 PPP: Phase is ESTABLISHING, Finish LCP 25-11-2006 11:53:08 Syslog.Debug 192.168.1.254 591: 000587: Nov 25 12:52:46.725 CET: Vi1 PPP: Phase is UP 25-11-2006 11:53:08 Syslog.Debug 192.168.1.254 592: 000588: Nov 25 12:52:46.725 CET: Vi1 IPCP: O CONFREQ [Closed] id 1 len 10 25-11-2006 11:53:08 Syslog.Debug 192.168.1.254 593: 000589: Nov 25 12:52:46.725 CET: Vi1 IPCP: Address 0.0.0.0 (0x030600000000) 25-11-2006 11:53:08 Syslog.Debug 192.168.1.254 594: 000590: Nov 25 12:52:46.725 CET: Vi1 CCP: O CONFREQ [Closed] id 1 len 10 25-11-2006 11:53:08 Syslog.Debug 192.168.1.254 595: 000591: Nov 25 12:52:46.725 CET: Vi1 CCP: MS-PPC supported bits 0x01000060 (0x120601000060) 25-11-2006 11:53:08 Syslog.Debug 192.168.1.254 596: 000592: Nov 25 12:52:46.725 CET: Vi1 PPP: Process pending ncp packets 25-11-2006 11:53:08 Syslog.Debug 192.168.1.254 597: 000593: Nov 25 12:52:46.729 CET: Vi1 CCP: Redirect packet to Vi1 25-11-2006 11:53:08 Syslog.Debug 192.168.1.254 598: 000594: Nov 25 12:52:46.729 CET: Vi1 CCP: I CONFREQ [REQsent] id 1 len 10 25-11-2006 11:53:08 Syslog.Debug 192.168.1.254 599: 000595: Nov 25 12:52:46.729 CET: Vi1 CCP: MS-PPC supported bits 0x01000040 (0x120601000040) 25-11-2006 11:53:08 Syslog.Debug 192.168.1.254 600: 000596: Nov 25 12:52:46.729 CET: Vi1 CCP: O CONFACK [REQsent] id 1 len 10 25-11-2006 11:53:08 Syslog.Debug 192.168.1.254 601: 000597: Nov 25 12:52:46.729 CET: Vi1 CCP: MS-PPC supported bits 0x01000040 (0x120601000040) 25-11-2006 11:53:08 Syslog.Debug 192.168.1.254 602: 000598: Nov 25 12:52:46.789 CET: Vi1 IPCP: I TERMACK [REQsent] id 1 len 4 25-11-2006 11:53:08 Syslog.Debug 192.168.1.254 603: 000599: Nov 25 12:52:46.793 CET: Vi1 CCP: I CONFNAK [ACKsent] id 1 len 10 25-11-2006 11:53:08 Syslog.Debug 192.168.1.254 604: 000600: Nov 25 12:52:46.793 CET: Vi1 CCP: MS-PPC supported bits 0x01000040 (0x120601000040) 25-11-2006 11:53:08 Syslog.Debug 192.168.1.254 605: 000601: Nov 25 12:52:46.793 CET: Vi1 CCP: O CONFREQ [ACKsent] id 2 len 10 25-11-2006 11:53:08 Syslog.Debug 192.168.1.254 606: 000602: Nov 25 12:52:46.793 CET: Vi1 CCP: MS-PPC supported bits 0x01000040 (0x120601000040) 25-11-2006 11:53:08 Syslog.Debug 192.168.1.254 607: 000603: Nov 25 12:52:46.853 CET: Vi1 CCP: I CONFACK [ACKsent] id 2 len 10 25-11-2006 11:53:08 Syslog.Debug 192.168.1.254 608: 000604: Nov 25 12:52:46.853 CET: Vi1 CCP: MS-PPC supported bits 0x01000040 (0x120601000040) 25-11-2006 11:53:09 Syslog.Debug 192.168.1.254 609: 000605: Nov 25 12:52:46.853 CET: Vi1 CCP: State is Open 25-11-2006 11:53:09 Syslog.Debug 192.168.1.254 610: 000606: Nov 25 12:52:46.857 CET: Vi1 IPCP: I CONFREQ [REQsent] id 1 len 10 25-11-2006 11:53:09 Syslog.Debug 192.168.1.254 611: 000607: Nov 25 12:52:46.857 CET: Vi1 IPCP: Address 83.233.168.2 (0x030653E9A802) 25-11-2006 11:53:09 Syslog.Debug 192.168.1.254 612: 000608: Nov 25 12:52:46.861 CET: Vi1 IPCP: O CONFACK [REQsent] id 1 len 10 25-11-2006 11:53:09 Syslog.Debug 192.168.1.254 613: 000609: Nov 25 12:52:46.861 CET: Vi1 IPCP: Address 83.233.168.2 (0x030653E9A802) 25-11-2006 11:53:10 Syslog.Notice 192.168.1.254 614: 000610: Nov 25 12:52:47.721 CET: %LINEPROTO-5-UPDOWN: Line protocol on Interface Virtual-Access1, changed state to up 25-11-2006 11:53:10 Syslog.Debug 192.168.1.254 615: 000611: Nov 25 12:52:48.725 CET: Vi1 IPCP: Timeout: State ACKsent 25-11-2006 11:53:10 Syslog.Debug 192.168.1.254 616: 000612: Nov 25 12:52:48.725 CET: Vi1 IPCP: O CONFREQ [ACKsent] id 2 len 10 25-11-2006 11:53:10 Syslog.Debug 192.168.1.254 617: 000613: Nov 25 12:52:48.725 CET: Vi1 IPCP: Address 0.0.0.0 (0x030600000000) 25-11-2006 11:53:10 Syslog.Debug 192.168.1.254 618: 000614: Nov 25 12:52:48.785 CET: Vi1 IPCP: I CONFNAK [ACKsent] id 2 len 10 25-11-2006 11:53:10 Syslog.Debug 192.168.1.254 619: 000615: Nov 25 12:52:48.785 CET: Vi1 IPCP: Address 83.233.168.28 (0x030653E9A81C) 25-11-2006 11:53:10 Syslog.Debug 192.168.1.254 620: 000616: Nov 25 12:52:48.789 CET: Vi1 IPCP: O CONFREQ [ACKsent] id 3 len 10 25-11-2006 11:53:10 Syslog.Debug 192.168.1.254 621: 000617: Nov 25 12:52:48.789 CET: Vi1 IPCP: Address 83.233.168.28 (0x030653E9A81C) 25-11-2006 11:53:10 Syslog.Debug 192.168.1.254 622: 000618: Nov 25 12:52:48.845 CET: Vi1 IPCP: I CONFACK [ACKsent] id 3 len 10 25-11-2006 11:53:11 Syslog.Debug 192.168.1.254 623: 000619: Nov 25 12:52:48.845 CET: Vi1 IPCP: Address 83.233.168.28 (0x030653E9A81C) 25-11-2006 11:53:11 Syslog.Debug 192.168.1.254 624: 000620: Nov 25 12:52:48.849 CET: Vi1 IPCP: State is Open 25-11-2006 11:53:11 Syslog.Debug 192.168.1.254 625: 000621: Nov 25 12:52:48.849 CET: Di0 IPCP: Install negotiated IP interface address 83.233.168.28 25-11-2006 11:53:11 Syslog.Debug 192.168.1.254 626: 000622: Nov 25 12:52:48.857 CET: Di0 IPCP: Install route to 83.233.168.2 25-11-2006 11:53:11 Syslog.Debug 192.168.1.254 627: 000623: Nov 25 12:52:48.861 CET: Vi1 IPCP: Add link info for cef entry 83.233.168.2 25-11-2006 11:55:44 Syslog.Debug 192.168.1.254 628: 000624: Nov 25 12:55:21.702 CET: Vi1 LCP: I TERMREQ [Open] id 3 len 17 (0x4D5050452064697361626C6564) 25-11-2006 11:55:44 Syslog.Debug 192.168.1.254 629: 000625: Nov 25 12:55:21.706 CET: Vi1 LCP: O TERMACK [Open] id 3 len 4 25-11-2006 11:55:44 Syslog.Debug 192.168.1.254 630: 000626: Nov 25 12:55:21.706 CET: Vi1 PPP: Sending Acct Event[Down] id[38] 25-11-2006 11:55:44 Syslog.Debug 192.168.1.254 631: 000627: Nov 25 12:55:21.706 CET: Vi1 PPP: Phase is TERMINATING 25-11-2006 11:55:46 Syslog.Debug 192.168.1.254 632: 000628: Nov 25 12:55:23.702 CET: Vi1 LCP: Timeout: State TERMsent 25-11-2006 11:55:46 Syslog.Debug 192.168.1.254 633: 000629: Nov 25 12:55:23.702 CET: Vi1 LCP: State is Closed 25-11-2006 11:55:46 Syslog.Debug 192.168.1.254 634: 000630: Nov 25 12:55:23.702 CET: Vi1 PPP: Phase is DOWN 25-11-2006 11:55:46 Syslog.Debug 192.168.1.254 635: 000631: Nov 25 12:55:23.702 CET: Vi1 CCP: State is Closed 25-11-2006 11:55:46 Syslog.Debug 192.168.1.254 636: 000632: Nov 25 12:55:23.706 CET: Vi1 IPCP: State is Closed 25-11-2006 11:55:46 Syslog.Debug 192.168.1.254 637: 000633: Nov 25 12:55:23.706 CET: Vi1 IPCP: Remove link info for cef entry 83.233.168.2 25-11-2006 11:55:46 Syslog.Debug 192.168.1.254 638: 000634: Nov 25 12:55:23.706 CET: Vi1 PPP SSS: Send DISCONNECT to mgr_hdl[40000055] 25-11-2006 11:55:46 Syslog.Debug 192.168.1.254 639: 000635: Nov 25 12:55:23.706 CET: Vi1 PPP: Phase is ESTABLISHING, Passive Open 25-11-2006 11:55:46 Syslog.Debug 192.168.1.254 640: 000636: Nov 25 12:55:23.706 CET: Vi1 LCP: State is Listen 25-11-2006 11:55:46 Syslog.Debug 192.168.1.254 641: 000637: Nov 25 12:55:23.718 CET: Di0 IPCP: Remove route to 83.233.168.2 25-11-2006 11:55:46 Syslog.Notice 192.168.1.254 642: 000638: Nov 25 12:55:24.702 CET: %LINEPROTO-5-UPDOWN: Line protocol on Interface Virtual-Access1, changed state to down 25-11-2006 11:55:47 Syslog.Error 192.168.1.254 643: 000639: Nov 25 12:55:24.734 CET: %LINK-3-UPDOWN: Interface Virtual-Access1, changed state to down 25-11-2006 11:55:52 Syslog.Debug 192.168.1.254 644: 000640: Nov 25 12:55:30.890 CET: Vi1 PPP: Phase is DOWN, Setup 25-11-2006 11:55:52 Syslog.Error 192.168.1.254 645: 000641: Nov 25 12:55:31.102 CET: %LINK-3-UPDOWN: Interface Virtual-Access1, changed state to up 25-11-2006 11:55:52 Syslog.Debug 192.168.1.254 646: 000642: Nov 25 12:55:31.130 CET: Vi1 PPP: Using dialer call direction 25-11-2006 11:55:52 Syslog.Debug 192.168.1.254 647: 000643: Nov 25 12:55:31.130 CET: Vi1 PPP: Treating connection as a callout 25-11-2006 11:55:52 Syslog.Debug 192.168.1.254 648: 000644: Nov 25 12:55:31.130 CET: Vi1 PPP: Session handle[D2000099] Session id[52] 25-11-2006 11:55:52 Syslog.Debug 192.168.1.254 649: 000645: Nov 25 12:55:31.130 CET: Vi1 PPP: Phase is ESTABLISHING, Active Open 25-11-2006 11:55:52 Syslog.Debug 192.168.1.254 650: 000646: Nov 25 12:55:31.130 CET: Vi1 PPP: No remote authentication for call-out 25-11-2006 11:55:52 Syslog.Debug 192.168.1.254 651: 000647: Nov 25 12:55:31.130 CET: Vi1 LCP: O CONFREQ [Closed] id 1 len 12 25-11-2006 11:55:52 Syslog.Debug 192.168.1.254 652: 000648: Nov 25 12:55:31.130 CET: Vi1 LCP: MagicNumber 0x0648391E (0x05060648391E) 25-11-2006 11:55:52 Syslog.Debug 192.168.1.254 653: 000649: Nov 25 12:55:31.130 CET: Vi1 LCP: PFC (0x0702) 25-11-2006 11:55:52 Syslog.Debug 192.168.1.254 654: 000650: Nov 25 12:55:31.190 CET: Vi1 LCP: I CONFACK [REQsent] id 1 len 12 25-11-2006 11:55:53 Syslog.Debug 192.168.1.254 655: 000651: Nov 25 12:55:31.190 CET: Vi1 LCP: MagicNumber 0x0648391E (0x05060648391E) 25-11-2006 11:55:53 Syslog.Debug 192.168.1.254 656: 000652: Nov 25 12:55:31.190 CET: Vi1 LCP: PFC (0x0702) 25-11-2006 11:55:55 Syslog.Debug 192.168.1.254 657: 000653: Nov 25 12:55:33.110 CET: Vi1 LCP: Timeout: State ACKrcvd 25-11-2006 11:55:55 Syslog.Debug 192.168.1.254 658: 000654: Nov 25 12:55:33.110 CET: Vi1 LCP: O CONFREQ [ACKrcvd] id 2 len 12 25-11-2006 11:55:55 Syslog.Debug 192.168.1.254 659: 000655: Nov 25 12:55:33.110 CET: Vi1 LCP: MagicNumber 0x0648391E (0x05060648391E) 25-11-2006 11:55:55 Syslog.Debug 192.168.1.254 660: 000656: Nov 25 12:55:33.110 CET: Vi1 LCP: PFC (0x0702) 25-11-2006 11:55:55 Syslog.Debug 192.168.1.254 661: 000657: Nov 25 12:55:33.170 CET: Vi1 LCP: I CONFACK [REQsent] id 2 len 12 25-11-2006 11:55:55 Syslog.Debug 192.168.1.254 662: 000658: Nov 25 12:55:33.170 CET: Vi1 LCP: MagicNumber 0x0648391E (0x05060648391E) 25-11-2006 11:55:55 Syslog.Debug 192.168.1.254 663: 000659: Nov 25 12:55:33.170 CET: Vi1 LCP: PFC (0x0702) 25-11-2006 11:55:55 Syslog.Debug 192.168.1.254 664: 000660: Nov 25 12:55:34.090 CET: Vi1 LCP: I CONFREQ [ACKrcvd] id 1 len 25 25-11-2006 11:55:55 Syslog.Debug 192.168.1.254 665: 000661: Nov 25 12:55:34.090 CET: Vi1 LCP: ACCM 0x00000000 (0x020600000000) 25-11-2006 11:55:55 Syslog.Debug 192.168.1.254 666: 000662: Nov 25 12:55:34.090 CET: Vi1 LCP: AuthProto MS-CHAP-V2 (0x0305C22381) 25-11-2006 11:55:55 Syslog.Debug 192.168.1.254 667: 000663: Nov 25 12:55:34.090 CET: Vi1 LCP: MagicNumber 0xD8B9902B (0x0506D8B9902B) 25-11-2006 11:55:55 Syslog.Debug 192.168.1.254 668: 000664: Nov 25 12:55:34.094 CET: Vi1 LCP: PFC (0x0702) 25-11-2006 11:55:55 Syslog.Debug 192.168.1.254 669: 000665: Nov 25 12:55:34.094 CET: Vi1 LCP: ACFC (0x0802) 25-11-2006 11:55:55 Syslog.Debug 192.168.1.254 670: 000666: Nov 25 12:55:34.094 CET: Vi1 LCP: O CONFACK [ACKrcvd] id 1 len 25 25-11-2006 11:55:55 Syslog.Debug 192.168.1.254 671: 000667: Nov 25 12:55:34.094 CET: Vi1 LCP: ACCM 0x00000000 (0x020600000000) 25-11-2006 11:55:55 Syslog.Debug 192.168.1.254 672: 000668: Nov 25 12:55:34.094 CET: Vi1 LCP: AuthProto MS-CHAP-V2 (0x0305C22381) 25-11-2006 11:55:55 Syslog.Debug 192.168.1.254 673: 000669: Nov 25 12:55:34.094 CET: Vi1 LCP: MagicNumber 0xD8B9902B (0x0506D8B9902B) 25-11-2006 11:55:55 Syslog.Debug 192.168.1.254 674: 000670: Nov 25 12:55:34.094 CET: Vi1 LCP: PFC (0x0702) 25-11-2006 11:55:55 Syslog.Debug 192.168.1.254 675: 000671: Nov 25 12:55:34.094 CET: Vi1 LCP: ACFC (0x0802) 25-11-2006 11:55:55 Syslog.Debug 192.168.1.254 676: 000672: Nov 25 12:55:34.098 CET: Vi1 LCP: State is Open 25-11-2006 11:55:55 Syslog.Debug 192.168.1.254 677: 000673: Nov 25 12:55:34.098 CET: Vi1 PPP: Phase is AUTHENTICATING, by the peer 25-11-2006 11:55:55 Syslog.Debug 192.168.1.254 678: 000674: Nov 25 12:55:34.158 CET: Vi1 MS-CHAP-V2: I CHALLENGE id 121 len 26 from "pptpd" 25-11-2006 11:55:55 Syslog.Debug 192.168.1.254 679: 000675: Nov 25 12:55:34.194 CET: Vi1 MS CHAP V2: Using hostname from interface CHAP 25-11-2006 11:55:55 Syslog.Debug 192.168.1.254 680: 000676: Nov 25 12:55:34.198 CET: Vi1 MS CHAP V2: Using password from interface CHAP 25-11-2006 11:55:55 Syslog.Debug 192.168.1.254 681: 000677: Nov 25 12:55:34.198 CET: Vi1 MS-CHAP-V2: O RESPONSE id 121 len 62 from "maggiore" 25-11-2006 11:55:55 Syslog.Debug 192.168.1.254 682: 000678: Nov 25 12:55:34.262 CET: Vi1 MS-CHAP-V2: I SUCCESS id 121 len 46 msg is "S=A85B9B7951B09A530E865CB78AAF6306FBD95D4C" 25-11-2006 11:55:55 Syslog.Debug 192.168.1.254 683: 000679: Nov 25 12:55:34.262 CET: Vi1 MS CHAP V2 No Password found for : pptpd 25-11-2006 11:55:55 Syslog.Debug 192.168.1.254 684: 000680: Nov 25 12:55:34.266 CET: Vi1 MS CHAP V2 No Password found for : pptpd 25-11-2006 11:55:55 Syslog.Debug 192.168.1.254 685: 000681: Nov 25 12:55:34.266 CET: Vi1 MS CHAP V2 Check AuthenticatorResponse Success for : maggiore 25-11-2006 11:55:55 Syslog.Debug 192.168.1.254 686: 000682: Nov 25 12:55:34.266 CET: Vi1 PPP: Phase is FORWARDING, Attempting Forward 25-11-2006 11:55:55 Syslog.Debug 192.168.1.254 687: 000683: Nov 25 12:55:34.266 CET: Vi1 PPP: Queue CCP code[1] id[1] 25-11-2006 11:55:55 Syslog.Debug 192.168.1.254 688: 000684: Nov 25 12:55:34.270 CET: Vi1 PPP SSS: Receive SSS-Mgr Connect-Local 25-11-2006 11:55:55 Syslog.Debug 192.168.1.254 689: 000685: Nov 25 12:55:34.270 CET: Vi1 PPP: Phase is ESTABLISHING, Finish LCP 25-11-2006 11:55:55 Syslog.Debug 192.168.1.254 690: 000686: Nov 25 12:55:34.274 CET: Vi1 PPP: Phase is UP 25-11-2006 11:55:55 Syslog.Debug 192.168.1.254 691: 000687: Nov 25 12:55:34.274 CET: Vi1 IPCP: O CONFREQ [Closed] id 1 len 10 25-11-2006 11:55:55 Syslog.Debug 192.168.1.254 692: 000688: Nov 25 12:55:34.274 CET: Vi1 IPCP: Address 0.0.0.0 (0x030600000000) 25-11-2006 11:55:55 Syslog.Debug 192.168.1.254 693: 000689: Nov 25 12:55:34.274 CET: Vi1 CCP: O CONFREQ [Closed] id 1 len 10 25-11-2006 11:55:55 Syslog.Debug 192.168.1.254 694: 000690: Nov 25 12:55:34.274 CET: Vi1 CCP: MS-PPC supported bits 0x01000060 (0x120601000060) 25-11-2006 11:55:55 Syslog.Debug 192.168.1.254 695: 000691: Nov 25 12:55:34.274 CET: Vi1 PPP: Process pending ncp packets 25-11-2006 11:55:55 Syslog.Debug 192.168.1.254 696: 000692: Nov 25 12:55:34.274 CET: Vi1 CCP: Redirect packet to Vi1 25-11-2006 11:55:55 Syslog.Debug 192.168.1.254 697: 000693: Nov 25 12:55:34.274 CET: Vi1 CCP: I CONFREQ [REQsent] id 1 len 10 25-11-2006 11:55:55 Syslog.Debug 192.168.1.254 698: 000694: Nov 25 12:55:34.278 CET: Vi1 CCP: MS-PPC supported bits 0x01000040 (0x120601000040) 25-11-2006 11:55:55 Syslog.Debug 192.168.1.254 699: 000695: Nov 25 12:55:34.278 CET: Vi1 CCP: O CONFACK [REQsent] id 1 len 10 25-11-2006 11:55:55 Syslog.Debug 192.168.1.254 700: 000696: Nov 25 12:55:34.278 CET: Vi1 CCP: MS-PPC supported bits 0x01000040 (0x120601000040) 25-11-2006 11:55:55 Syslog.Debug 192.168.1.254 701: 000697: Nov 25 12:55:34.338 CET: Vi1 IPCP: I TERMACK [REQsent] id 1 len 4 25-11-2006 11:55:55 Syslog.Debug 192.168.1.254 702: 000698: Nov 25 12:55:34.338 CET: Vi1 CCP: I CONFNAK [ACKsent] id 1 len 10 25-11-2006 11:55:55 Syslog.Debug 192.168.1.254 703: 000699: Nov 25 12:55:34.338 CET: Vi1 CCP: MS-PPC supported bits 0x01000040 (0x120601000040) 25-11-2006 11:55:55 Syslog.Debug 192.168.1.254 704: 000700: Nov 25 12:55:34.342 CET: Vi1 CCP: O CONFREQ [ACKsent] id 2 len 10 25-11-2006 11:55:55 Syslog.Debug 192.168.1.254 705: 000701: Nov 25 12:55:34.342 CET: Vi1 CCP: MS-PPC supported bits 0x01000040 (0x120601000040) 25-11-2006 11:55:55 Syslog.Debug 192.168.1.254 706: 000702: Nov 25 12:55:34.402 CET: Vi1 CCP: I CONFACK [ACKsent] id 2 len 10 25-11-2006 11:55:55 Syslog.Debug 192.168.1.254 707: 000703: Nov 25 12:55:34.402 CET: Vi1 CCP: MS-PPC supported bits 0x01000040 (0x120601000040) 25-11-2006 11:55:56 Syslog.Debug 192.168.1.254 708: 000704: Nov 25 12:55:34.402 CET: Vi1 CCP: State is Open 25-11-2006 11:55:56 Syslog.Debug 192.168.1.254 709: 000705: Nov 25 12:55:34.410 CET: Vi1 IPCP: I CONFREQ [REQsent] id 1 len 10 25-11-2006 11:55:56 Syslog.Debug 192.168.1.254 710: 000706: Nov 25 12:55:34.410 CET: Vi1 IPCP: Address 83.233.168.2 (0x030653E9A802) 25-11-2006 11:55:56 Syslog.Debug 192.168.1.254 711: 000707: Nov 25 12:55:34.410 CET: Vi1 IPCP: O CONFACK [REQsent] id 1 len 10 25-11-2006 11:55:56 Syslog.Debug 192.168.1.254 712: 000708: Nov 25 12:55:34.410 CET: Vi1 IPCP: Address 83.233.168.2 (0x030653E9A802) 25-11-2006 11:55:57 Syslog.Notice 192.168.1.254 713: 000709: Nov 25 12:55:35.270 CET: %LINEPROTO-5-UPDOWN: Line protocol on Interface Virtual-Access1, changed state to up 25-11-2006 11:55:57 Syslog.Debug 192.168.1.254 714: 000710: Nov 25 12:55:36.278 CET: Vi1 IPCP: Timeout: State ACKsent 25-11-2006 11:55:57 Syslog.Debug 192.168.1.254 715: 000711: Nov 25 12:55:36.278 CET: Vi1 IPCP: O CONFREQ [ACKsent] id 2 len 10 25-11-2006 11:55:57 Syslog.Debug 192.168.1.254 716: 000712: Nov 25 12:55:36.278 CET: Vi1 IPCP: Address 0.0.0.0 (0x030600000000) 25-11-2006 11:55:57 Syslog.Debug 192.168.1.254 717: 000713: Nov 25 12:55:36.342 CET: Vi1 IPCP: I CONFNAK [ACKsent] id 2 len 10 25-11-2006 11:55:57 Syslog.Debug 192.168.1.254 718: 000714: Nov 25 12:55:36.342 CET: Vi1 IPCP: Address 83.233.168.28 (0x030653E9A81C) 25-11-2006 11:55:57 Syslog.Debug 192.168.1.254 719: 000715: Nov 25 12:55:36.342 CET: Vi1 IPCP: O CONFREQ [ACKsent] id 3 len 10 25-11-2006 11:55:57 Syslog.Debug 192.168.1.254 720: 000716: Nov 25 12:55:36.342 CET: Vi1 IPCP: Address 83.233.168.28 (0x030653E9A81C) 25-11-2006 11:55:57 Syslog.Debug 192.168.1.254 721: 000717: Nov 25 12:55:36.406 CET: Vi1 IPCP: I CONFACK [ACKsent] id 3 len 10 25-11-2006 11:55:58 Syslog.Debug 192.168.1.254 722: 000718: Nov 25 12:55:36.406 CET: Vi1 IPCP: Address 83.233.168.28 (0x030653E9A81C) 25-11-2006 11:55:58 Syslog.Debug 192.168.1.254 723: 000719: Nov 25 12:55:36.406 CET: Vi1 IPCP: State is Open 25-11-2006 11:55:58 Syslog.Debug 192.168.1.254 724: 000720: Nov 25 12:55:36.406 CET: Di0 IPCP: Install negotiated IP interface address 83.233.168.28 25-11-2006 11:55:58 Syslog.Debug 192.168.1.254 725: 000721: Nov 25 12:55:36.414 CET: Di0 IPCP: Install route to 83.233.168.2 25-11-2006 11:55:58 Syslog.Debug 192.168.1.254 726: 000722: Nov 25 12:55:36.418 CET: Vi1 IPCP: Add link info for cef entry 83.233.168.2 25-11-2006 11:58:31 Syslog.Debug 192.168.1.254 727: 000723: Nov 25 12:58:09.232 CET: Vi1 LCP: I TERMREQ [Open] id 3 len 17 (0x4D5050452064697361626C6564) 25-11-2006 11:58:31 Syslog.Debug 192.168.1.254 728: 000724: Nov 25 12:58:09.232 CET: Vi1 LCP: O TERMACK [Open] id 3 len 4 25-11-2006 11:58:31 Syslog.Debug 192.168.1.254 729: 000725: Nov 25 12:58:09.232 CET: Vi1 PPP: Sending Acct Event[Down] id[39] 25-11-2006 11:58:31 Syslog.Debug 192.168.1.254 730: 000726: Nov 25 12:58:09.232 CET: Vi1 PPP: Phase is TERMINATING 25-11-2006 11:58:33 Syslog.Debug 192.168.1.254 731: 000727: Nov 25 12:58:11.224 CET: Vi1 LCP: Timeout: State TERMsent 25-11-2006 11:58:33 Syslog.Debug 192.168.1.254 732: 000728: Nov 25 12:58:11.224 CET: Vi1 LCP: State is Closed 25-11-2006 11:58:33 Syslog.Debug 192.168.1.254 733: 000729: Nov 25 12:58:11.224 CET: Vi1 PPP: Phase is DOWN 25-11-2006 11:58:33 Syslog.Debug 192.168.1.254 734: 000730: Nov 25 12:58:11.224 CET: Vi1 CCP: State is Closed 25-11-2006 11:58:33 Syslog.Debug 192.168.1.254 735: 000731: Nov 25 12:58:11.228 CET: Vi1 IPCP: State is Closed 25-11-2006 11:58:33 Syslog.Debug 192.168.1.254 736: 000732: Nov 25 12:58:11.228 CET: Vi1 IPCP: Remove link info for cef entry 83.233.168.2 25-11-2006 11:58:33 Syslog.Debug 192.168.1.254 737: 000733: Nov 25 12:58:11.228 CET: Vi1 PPP SSS: Send DISCONNECT to mgr_hdl[1F000057] 25-11-2006 11:58:33 Syslog.Debug 192.168.1.254 738: 000734: Nov 25 12:58:11.228 CET: Vi1 PPP: Phase is ESTABLISHING, Passive Open 25-11-2006 11:58:33 Syslog.Debug 192.168.1.254 739: 000735: Nov 25 12:58:11.228 CET: Vi1 LCP: State is Listen 25-11-2006 11:58:33 Syslog.Debug 192.168.1.254 740: 000736: Nov 25 12:58:11.244 CET: Di0 IPCP: Remove route to 83.233.168.2 25-11-2006 11:58:33 Syslog.Notice 192.168.1.254 741: 000737: Nov 25 12:58:12.224 CET: %LINEPROTO-5-UPDOWN: Line protocol on Interface Virtual-Access1, changed state to down 25-11-2006 11:58:34 Syslog.Error 192.168.1.254 742: 000738: Nov 25 12:58:12.264 CET: %LINK-3-UPDOWN: Interface Virtual-Access1, changed state to down 25-11-2006 11:58:53 Syslog.Debug 192.168.1.254 743: 000739: Nov 25 12:58:31.892 CET: Vi1 PPP: Phase is DOWN, Setup 25-11-2006 11:58:53 Syslog.Error 192.168.1.254 744: 000740: Nov 25 12:58:32.100 CET: %LINK-3-UPDOWN: Interface Virtual-Access1, changed state to up 25-11-2006 11:58:53 Syslog.Debug 192.168.1.254 745: 000741: Nov 25 12:58:32.124 CET: Vi1 PPP: Using dialer call direction 25-11-2006 11:58:53 Syslog.Debug 192.168.1.254 746: 000742: Nov 25 12:58:32.128 CET: Vi1 PPP: Treating connection as a callout 25-11-2006 11:58:53 Syslog.Debug 192.168.1.254 747: 000743: Nov 25 12:58:32.128 CET: Vi1 PPP: Session handle[C700009C] Session id[53] 25-11-2006 11:58:53 Syslog.Debug 192.168.1.254 748: 000744: Nov 25 12:58:32.128 CET: Vi1 PPP: Phase is ESTABLISHING, Active Open 25-11-2006 11:58:53 Syslog.Debug 192.168.1.254 749: 000745: Nov 25 12:58:32.128 CET: Vi1 PPP: No remote authentication for call-out 25-11-2006 11:58:53 Syslog.Debug 192.168.1.254 750: 000746: Nov 25 12:58:32.128 CET: Vi1 LCP: O CONFREQ [Closed] id 1 len 12 25-11-2006 11:58:53 Syslog.Debug 192.168.1.254 751: 000747: Nov 25 12:58:32.128 CET: Vi1 LCP: MagicNumber 0x064AFD21 (0x0506064AFD21) 25-11-2006 11:58:53 Syslog.Debug 192.168.1.254 752: 000748: Nov 25 12:58:32.128 CET: Vi1 LCP: PFC (0x0702) 25-11-2006 11:58:53 Syslog.Debug 192.168.1.254 753: 000749: Nov 25 12:58:32.188 CET: Vi1 LCP: I CONFACK [REQsent] id 1 len 12 25-11-2006 11:58:54 Syslog.Debug 192.168.1.254 754: 000750: Nov 25 12:58:32.188 CET: Vi1 LCP: MagicNumber 0x064AFD21 (0x0506064AFD21) 25-11-2006 11:58:54 Syslog.Debug 192.168.1.254 755: 000751: Nov 25 12:58:32.188 CET: Vi1 LCP: PFC (0x0702) 25-11-2006 11:58:56 Syslog.Debug 192.168.1.254 756: 000752: Nov 25 12:58:34.104 CET: Vi1 LCP: Timeout: State ACKrcvd 25-11-2006 11:58:56 Syslog.Debug 192.168.1.254 757: 000753: Nov 25 12:58:34.104 CET: Vi1 LCP: O CONFREQ [ACKrcvd] id 2 len 12 25-11-2006 11:58:56 Syslog.Debug 192.168.1.254 758: 000754: Nov 25 12:58:34.104 CET: Vi1 LCP: MagicNumber 0x064AFD21 (0x0506064AFD21) 25-11-2006 11:58:56 Syslog.Debug 192.168.1.254 759: 000755: Nov 25 12:58:34.104 CET: Vi1 LCP: PFC (0x0702) 25-11-2006 11:58:56 Syslog.Debug 192.168.1.254 760: 000756: Nov 25 12:58:34.160 CET: Vi1 LCP: I CONFACK [REQsent] id 2 len 12 25-11-2006 11:58:56 Syslog.Debug 192.168.1.254 761: 000757: Nov 25 12:58:34.164 CET: Vi1 LCP: MagicNumber 0x064AFD21 (0x0506064AFD21) 25-11-2006 11:58:56 Syslog.Debug 192.168.1.254 762: 000758: Nov 25 12:58:34.164 CET: Vi1 LCP: PFC (0x0702) 25-11-2006 11:58:56 Syslog.Debug 192.168.1.254 763: 000759: Nov 25 12:58:35.088 CET: Vi1 LCP: I CONFREQ [ACKrcvd] id 1 len 25 25-11-2006 11:58:56 Syslog.Debug 192.168.1.254 764: 000760: Nov 25 12:58:35.092 CET: Vi1 LCP: ACCM 0x00000000 (0x020600000000) 25-11-2006 11:58:56 Syslog.Debug 192.168.1.254 765: 000761: Nov 25 12:58:35.092 CET: Vi1 LCP: AuthProto MS-CHAP-V2 (0x0305C22381) 25-11-2006 11:58:56 Syslog.Debug 192.168.1.254 766: 000762: Nov 25 12:58:35.092 CET: Vi1 LCP: MagicNumber 0x0633EE04 (0x05060633EE04) 25-11-2006 11:58:56 Syslog.Debug 192.168.1.254 767: 000763: Nov 25 12:58:35.092 CET: Vi1 LCP: PFC (0x0702) 25-11-2006 11:58:56 Syslog.Debug 192.168.1.254 768: 000764: Nov 25 12:58:35.092 CET: Vi1 LCP: ACFC (0x0802) 25-11-2006 11:58:56 Syslog.Debug 192.168.1.254 769: 000765: Nov 25 12:58:35.092 CET: Vi1 LCP: O CONFACK [ACKrcvd] id 1 len 25 25-11-2006 11:58:56 Syslog.Debug 192.168.1.254 770: 000766: Nov 25 12:58:35.092 CET: Vi1 LCP: ACCM 0x00000000 (0x020600000000) 25-11-2006 11:58:56 Syslog.Debug 192.168.1.254 771: 000767: Nov 25 12:58:35.096 CET: Vi1 LCP: AuthProto MS-CHAP-V2 (0x0305C22381) 25-11-2006 11:58:56 Syslog.Debug 192.168.1.254 772: 000768: Nov 25 12:58:35.096 CET: Vi1 LCP: MagicNumber 0x0633EE04 (0x05060633EE04) 25-11-2006 11:58:56 Syslog.Debug 192.168.1.254 773: 000769: Nov 25 12:58:35.096 CET: Vi1 LCP: PFC (0x0702) 25-11-2006 11:58:56 Syslog.Debug 192.168.1.254 774: 000770: Nov 25 12:58:35.096 CET: Vi1 LCP: ACFC (0x0802) 25-11-2006 11:58:56 Syslog.Debug 192.168.1.254 775: 000771: Nov 25 12:58:35.096 CET: Vi1 LCP: State is Open 25-11-2006 11:58:56 Syslog.Debug 192.168.1.254 776: 000772: Nov 25 12:58:35.096 CET: Vi1 PPP: Phase is AUTHENTICATING, by the peer 25-11-2006 11:58:56 Syslog.Debug 192.168.1.254 777: 000773: Nov 25 12:58:35.156 CET: Vi1 MS-CHAP-V2: I CHALLENGE id 120 len 26 from "pptpd" 25-11-2006 11:58:56 Syslog.Debug 192.168.1.254 778: 000774: Nov 25 12:58:35.192 CET: Vi1 MS CHAP V2: Using hostname from interface CHAP 25-11-2006 11:58:56 Syslog.Debug 192.168.1.254 779: 000775: Nov 25 12:58:35.196 CET: Vi1 MS CHAP V2: Using password from interface CHAP 25-11-2006 11:58:56 Syslog.Debug 192.168.1.254 780: 000776: Nov 25 12:58:35.196 CET: Vi1 MS-CHAP-V2: O RESPONSE id 120 len 62 from "maggiore" 25-11-2006 11:58:56 Syslog.Debug 192.168.1.254 781: 000777: Nov 25 12:58:35.260 CET: Vi1 MS-CHAP-V2: I SUCCESS id 120 len 46 msg is "S=70624F72201B468D304224C06F4BCD1454162EFE" 25-11-2006 11:58:56 Syslog.Debug 192.168.1.254 782: 000778: Nov 25 12:58:35.260 CET: Vi1 MS CHAP V2 No Password found for : pptpd 25-11-2006 11:58:56 Syslog.Debug 192.168.1.254 783: 000779: Nov 25 12:58:35.260 CET: Vi1 MS CHAP V2 No Password found for : pptpd 25-11-2006 11:58:56 Syslog.Debug 192.168.1.254 784: 000780: Nov 25 12:58:35.264 CET: Vi1 MS CHAP V2 Check AuthenticatorResponse Success for : maggiore 25-11-2006 11:58:56 Syslog.Debug 192.168.1.254 785: 000781: Nov 25 12:58:35.264 CET: Vi1 PPP: Phase is FORWARDING, Attempting Forward 25-11-2006 11:58:56 Syslog.Debug 192.168.1.254 786: 000782: Nov 25 12:58:35.264 CET: Vi1 PPP: Queue CCP code[1] id[1] 25-11-2006 11:58:56 Syslog.Debug 192.168.1.254 787: 000783: Nov 25 12:58:35.268 CET: Vi1 PPP SSS: Receive SSS-Mgr Connect-Local 25-11-2006 11:58:56 Syslog.Debug 192.168.1.254 788: 000784: Nov 25 12:58:35.268 CET: Vi1 PPP: Phase is ESTABLISHING, Finish LCP 25-11-2006 11:58:56 Syslog.Debug 192.168.1.254 789: 000785: Nov 25 12:58:35.268 CET: Vi1 PPP: Phase is UP 25-11-2006 11:58:56 Syslog.Debug 192.168.1.254 790: 000786: Nov 25 12:58:35.268 CET: Vi1 IPCP: O CONFREQ [Closed] id 1 len 10 25-11-2006 11:58:56 Syslog.Debug 192.168.1.254 791: 000787: Nov 25 12:58:35.272 CET: Vi1 IPCP: Address 0.0.0.0 (0x030600000000) 25-11-2006 11:58:56 Syslog.Debug 192.168.1.254 792: 000788: Nov 25 12:58:35.272 CET: Vi1 CCP: O CONFREQ [Closed] id 1 len 10 25-11-2006 11:58:56 Syslog.Debug 192.168.1.254 793: 000789: Nov 25 12:58:35.272 CET: Vi1 CCP: MS-PPC supported bits 0x01000060 (0x120601000060) 25-11-2006 11:58:56 Syslog.Debug 192.168.1.254 794: 000790: Nov 25 12:58:35.272 CET: Vi1 PPP: Process pending ncp packets 25-11-2006 11:58:56 Syslog.Debug 192.168.1.254 795: 000791: Nov 25 12:58:35.272 CET: Vi1 CCP: Redirect packet to Vi1 25-11-2006 11:58:56 Syslog.Debug 192.168.1.254 796: 000792: Nov 25 12:58:35.272 CET: Vi1 CCP: I CONFREQ [REQsent] id 1 len 10 25-11-2006 11:58:57 Syslog.Debug 192.168.1.254 797: 000793: Nov 25 12:58:35.272 CET: Vi1 CCP: MS-PPC supported bits 0x01000040 (0x120601000040) 25-11-2006 11:58:57 Syslog.Debug 192.168.1.254 798: 000794: Nov 25 12:58:35.276 CET: Vi1 CCP: O CONFACK [REQsent] id 1 len 10 25-11-2006 11:58:57 Syslog.Debug 192.168.1.254 799: 000795: Nov 25 12:58:35.276 CET: Vi1 CCP: MS-PPC supported bits 0x01000040 (0x120601000040) 25-11-2006 11:58:57 Syslog.Debug 192.168.1.254 800: 000796: Nov 25 12:58:35.332 CET: Vi1 IPCP: I TERMACK [REQsent] id 1 len 4 25-11-2006 11:58:57 Syslog.Debug 192.168.1.254 801: 000797: Nov 25 12:58:35.336 CET: Vi1 CCP: I CONFNAK [ACKsent] id 1 len 10 25-11-2006 11:58:57 Syslog.Debug 192.168.1.254 802: 000798: Nov 25 12:58:35.336 CET: Vi1 CCP: MS-PPC supported bits 0x01000040 (0x120601000040) 25-11-2006 11:58:57 Syslog.Debug 192.168.1.254 803: 000799: Nov 25 12:58:35.336 CET: Vi1 CCP: O CONFREQ [ACKsent] id 2 len 10 25-11-2006 11:58:57 Syslog.Debug 192.168.1.254 804: 000800: Nov 25 12:58:35.336 CET: Vi1 CCP: MS-PPC supported bits 0x01000040 (0x120601000040) 25-11-2006 11:58:57 Syslog.Debug 192.168.1.254 805: 000801: Nov 25 12:58:35.396 CET: Vi1 CCP: I CONFACK [ACKsent] id 2 len 10 25-11-2006 11:58:57 Syslog.Debug 192.168.1.254 806: 000802: Nov 25 12:58:35.396 CET: Vi1 CCP: MS-PPC supported bits 0x01000040 (0x120601000040) 25-11-2006 11:58:57 Syslog.Debug 192.168.1.254 807: 000803: Nov 25 12:58:35.396 CET: Vi1 CCP: State is Open 25-11-2006 11:58:57 Syslog.Debug 192.168.1.254 808: 000804: Nov 25 12:58:35.404 CET: Vi1 IPCP: I CONFREQ [REQsent] id 1 len 10 25-11-2006 11:58:57 Syslog.Debug 192.168.1.254 809: 000805: Nov 25 12:58:35.404 CET: Vi1 IPCP: Address 83.233.168.2 (0x030653E9A802) 25-11-2006 11:58:57 Syslog.Debug 192.168.1.254 810: 000806: Nov 25 12:58:35.404 CET: Vi1 IPCP: O CONFACK [REQsent] id 1 len 10 25-11-2006 11:58:57 Syslog.Debug 192.168.1.254 811: 000807: Nov 25 12:58:35.404 CET: Vi1 IPCP: Address 83.233.168.2 (0x030653E9A802) 25-11-2006 11:58:58 Syslog.Notice 192.168.1.254 812: 000808: Nov 25 12:58:36.268 CET: %LINEPROTO-5-UPDOWN: Line protocol on Interface Virtual-Access1, changed state to up 25-11-2006 11:58:58 Syslog.Debug 192.168.1.254 813: 000809: Nov 25 12:58:37.272 CET: Vi1 IPCP: Timeout: State ACKsent 25-11-2006 11:58:58 Syslog.Debug 192.168.1.254 814: 000810: Nov 25 12:58:37.272 CET: Vi1 IPCP: O CONFREQ [ACKsent] id 2 len 10 25-11-2006 11:58:58 Syslog.Debug 192.168.1.254 815: 000811: Nov 25 12:58:37.272 CET: Vi1 IPCP: Address 0.0.0.0 (0x030600000000) 25-11-2006 11:58:58 Syslog.Debug 192.168.1.254 816: 000812: Nov 25 12:58:37.332 CET: Vi1 IPCP: I CONFNAK [ACKsent] id 2 len 10 25-11-2006 11:58:58 Syslog.Debug 192.168.1.254 817: 000813: Nov 25 12:58:37.332 CET: Vi1 IPCP: Address 83.233.168.124 (0x030653E9A87C) 25-11-2006 11:58:58 Syslog.Debug 192.168.1.254 818: 000814: Nov 25 12:58:37.332 CET: Vi1 IPCP: O CONFREQ [ACKsent] id 3 len 10 25-11-2006 11:58:58 Syslog.Debug 192.168.1.254 819: 000815: Nov 25 12:58:37.332 CET: Vi1 IPCP: Address 83.233.168.124 (0x030653E9A87C) 25-11-2006 11:58:58 Syslog.Debug 192.168.1.254 820: 000816: Nov 25 12:58:37.392 CET: Vi1 IPCP: I CONFACK [ACKsent] id 3 len 10 25-11-2006 11:58:59 Syslog.Debug 192.168.1.254 821: 000817: Nov 25 12:58:37.392 CET: Vi1 IPCP: Address 83.233.168.124 (0x030653E9A87C) 25-11-2006 11:58:59 Syslog.Debug 192.168.1.254 822: 000818: Nov 25 12:58:37.392 CET: Vi1 IPCP: State is Open 25-11-2006 11:58:59 Syslog.Debug 192.168.1.254 823: 000819: Nov 25 12:58:37.392 CET: Di0 IPCP: Install negotiated IP interface address 83.233.168.124 25-11-2006 11:58:59 Syslog.Debug 192.168.1.254 824: 000820: Nov 25 12:58:37.400 CET: Di0 IPCP: Install route to 83.233.168.2 25-11-2006 11:58:59 Syslog.Debug 192.168.1.254 825: 000821: Nov 25 12:58:37.404 CET: Vi1 IPCP: Add link info for cef entry 83.233.168.2
From: Dan Lanciani on 26 Nov 2006 16:44 In article <XrmdnZ0Xks1fhPXYnZ2dnUVZ8s-dnZ2d(a)kpnqwest.it>, admin(a)NOSPAMspadhausen.com (E. S.) writes: | | "Dan Lanciani" <ddl(a)danlan.*com> ha scritto nel messaggio | news:1334753(a)news1.IPSWITCHS.CMM... | > In article <MYidnQsPj5ZcU_rYnZ2dnUVZ8qSdnZ2d(a)kpnqwest.it>, | > admin(a)NOSPAMspadhausen.com (E. S.) writes: | > | > | IT WORKED. | > | > What did you change to fix the previous two problems you posted about? | | Well | I had to put the entry dialer string 123, that I missed to insert. And then | the router dialed out and worked. | | > | The only problem wich lasts now is that the connection stays up and then | > | drops every minute or two. | > | > Are you sure that it is working correctly when it is up? That kind of | > cycling is a typical symptom of the routing loop issue I mentioned. | | -Many PPTP servers use their primary address (i.e., the address that | you might use in the vpdn-group's "initiate-to ip" command) for their end | of the ppp connection. This is a problem because IOS will install a /32 | route to that address through the dialer interface thus creating a loop | that chokes the connection (and possibly even crashes the router). If | you can't find an alternate address for the server you will need to use | policy routing to work around the problem as it appears that nothing can | compete with a /32 "directly" connected interface route. | | Is there any way to resolve this? Yes, you can work around it with policy based routing. Are you actually having this problem? That is, is the address assigned to the server's end of the PPP link the same as an address used in your vpdn initiate-to statements? | When the dialer interface is up, I browse the internet with the dialer0 ip | that the router negotiated via the pptp link. That certainly suggests that you aren't having the above problem. | Everything is fast and ok, but after 30~60secs the connection drops, then | reconnects. You may have to find out what the other end is doing. I saw your lost echo requests and I assume the server was killing the connection for similar reasons when you turned keepalives off. It isn't obvious at first glance what is going on... | I put an mty of 1500, because i received this warning: | | 25-11-2006 04:28:05 Syslog.Warning 192.168.1.254 32: 000028: Nov 25 | 05:27:43.791 CET: %DIALER-4-MTU_WARNING: Current MTU setting of 1500 on | Virtual-Access1 is being overwritten by setting of 1450 defined by Dialer0. The warning is normal. I would not increase the MTU until you are sure it is not causing a problem. Dan Lanciani ddl(a)danlan.*com
From: Elia Spadoni on 26 Nov 2006 17:22 Hello Mr Lanciani you don't know how much I waited for your answer!! In all the newsgroups I visited you are the only one that can help me! For me it is very important to setup this VPN, because at this moment I set up on a Win 2003 server with Internet connection sharing enabled... It is not the solution I planned. I need the tunnel on the perimeter router. I also set the NAT on the router via Dialer0 interface, so If the VPN is down, the lan clients won't browse the internet! "Dan Lanciani" <ddl(a)danlan.*com> wrote in message news:1334759(a)news1.IPSWITCHS.CMM > > | When the dialer interface is up, I browse the internet with the dialer0 ip > | that the router negotiated via the pptp link. > > That certainly suggests that you aren't having the above problem. Yes, when the interface is up, I browse the internet as I was expecting. Very well, very fast and with the correct wan IP (the vpn ip). > | Everything is fast and ok, but after 30~60secs the connection drops, then > | reconnects. > > You may have to find out what the other end is doing. I saw your lost > echo requests and I assume the server was killing the connection for > similar reasons when you turned keepalives off. It isn't obvious at > first glance what is going on... I have to resolve this issue. If I connect with Win XP SP2, or a Windows 2003 server SP1 as a PPTP client the connection is fine and never disconnects. With the cisco, it disconnects randomly after 60secs or more. > | I put an mty of 1500, because i received this warning: > | > | 25-11-2006 04:28:05 Syslog.Warning 192.168.1.254 32: 000028: Nov 25 > | 05:27:43.791 CET: %DIALER-4-MTU_WARNING: Current MTU setting of 1500 on > | Virtual-Access1 is being overwritten by setting of 1450 defined by Dialer0. > > The warning is normal. I would not increase the MTU until you are sure > it is not causing a problem. > With MTU, please suggest what I have to set on the dialer vpn interface. Dan Lanciani ddl(a)danlan.*com -- Posted via Mailgate.ORG Server - http://www.Mailgate.ORG
First
|
Prev
|
Next
|
Last
Pages: 1 2 3 4 5 Prev: FLASH Write Error #5 on Aironet 350 Next: Client 4.7 installation error with DNE |