pptp debug问题

包含网卡/无线网的网络问题和ADSL/校园网/宽带拨号支持及代理/共享等网络使用问题
回复
普陀听禅
帖子: 22
注册时间: 2014-03-12 20:25
系统: windows

pptp debug问题

#1

帖子 普陀听禅 »

科学上网的问题最后还是暂时通过goagent解决了,但是还是不懂为什么我的vpn现在不能用了,在网上找到打印debug 的log的方法,请大家看看到底是什么地方有问题。谢谢

代码: 全选

lyb@lyb-Lenovo-G490:~$ sudo /usr/lib/NetworkManager/nm-pptp-service --debug
** Message: nm-pptp-service (version 0.9.8.2) starting...

connection
	name : "connection"
	id : "VPN connection 1" (s)
	uuid : "c7e83828-f5e5-4f45-9779-6b66af0c5427" (s)
	type : "vpn" (s)
	permissions : ['user:lyb:'] (s)
	autoconnect : FALSE (s)
	timestamp : 0 (sd)
	read-only : FALSE (sd)
	zone : NULL (sd)
	master : NULL (sd)
	slave-type : NULL (sd)
	secondaries : [] (sd)


vpn
	name : "vpn"
	service-type : "org.freedesktop.NetworkManager.pptp" (s)
	user-name : "lyb" (s)
	data : [ { 'gateway': 88.150.133.20 }, { 'require-mppe': yes }, { 'user': vpn123 }, { 'refuse-eap': yes }, { 'password-flags': 1 }, ] (s)
	secrets : [ { 'password': 869259 }, ] (s)


ipv4
	name : "ipv4"
	method : "auto" (s)
	dns : [] (s)
	dns-search : [] (sd)
	addresses : [] (s)
	routes : [] (s)
	ignore-auto-routes : FALSE (sd)
	ignore-auto-dns : FALSE (sd)
	dhcp-client-id : NULL (sd)
	dhcp-send-hostname : TRUE (sd)
	dhcp-hostname : NULL (sd)
	never-default : FALSE (sd)
	may-fail : TRUE (sd)


** Message: pppd started with pid 8878
Plugin /usr/lib/pppd/2.4.5/nm-pptp-pppd-plugin.so loaded.
** Message: nm-pptp-ppp-plugin: (plugin_init): initializing
** Message: nm-pptp-ppp-plugin: (nm_phasechange): status 3 / phase 'serial connection'
using channel 3
Using interface ppp0
Connect: ppp0 <--> /dev/pts/7
** Message: nm-pptp-ppp-plugin: (nm_phasechange): status 5 / phase 'establish'
sent [LCP ConfReq id=0x1 <asyncmap 0x0> <magic 0xe8e6d2e0> <pcomp> <accomp>]
rcvd [LCP ConfReq id=0x0 <mru 1400> <auth eap> <magic 0x41e0406b> <pcomp> <accomp> <callback CBCP> <mrru 1614> <endpoint [local:7d.33.bb.1b.08.92.4c.55.b6.52.44.b5.98.55.a8.78.00.00.00.00]> < 17 04 04 6b>]
sent [LCP ConfRej id=0x0 <callback CBCP> <mrru 1614> < 17 04 04 6b>]
rcvd [LCP ConfAck id=0x1 <asyncmap 0x0> <magic 0xe8e6d2e0> <pcomp> <accomp>]
sent [LCP ConfReq id=0x1 <asyncmap 0x0> <magic 0xe8e6d2e0> <pcomp> <accomp>]
rcvd [LCP ConfReq id=0x1 <mru 1400> <auth eap> <magic 0x41e0406b> <pcomp> <accomp> <callback CBCP> <mrru 1614> <endpoint [local:7d.33.bb.1b.08.92.4c.55.b6.52.44.b5.98.55.a8.78.00.00.00.00]> < 17 04 04 6b>]
sent [LCP ConfRej id=0x1 <callback CBCP> <mrru 1614> < 17 04 04 6b>]
sent [LCP ConfReq id=0x1 <asyncmap 0x0> <magic 0xe8e6d2e0> <pcomp> <accomp>]
rcvd [LCP ConfReq id=0x2 <mru 1400> <auth eap> <magic 0x41e0406b> <pcomp> <accomp> <callback CBCP> <mrru 1614> <endpoint [local:7d.33.bb.1b.08.92.4c.55.b6.52.44.b5.98.55.a8.78.00.00.00.00]> < 17 04 04 6b>]
sent [LCP ConfRej id=0x2 <callback CBCP> <mrru 1614> < 17 04 04 6b>]
sent [LCP ConfReq id=0x1 <asyncmap 0x0> <magic 0xe8e6d2e0> <pcomp> <accomp>]
rcvd [LCP ConfReq id=0x3 <mru 1400> <auth eap> <magic 0x41e0406b> <pcomp> <accomp> <callback CBCP> <mrru 1614> <endpoint [local:7d.33.bb.1b.08.92.4c.55.b6.52.44.b5.98.55.a8.78.00.00.00.00]> < 17 04 04 6b>]
sent [LCP ConfRej id=0x3 <callback CBCP> <mrru 1614> < 17 04 04 6b>]
sent [LCP ConfReq id=0x1 <asyncmap 0x0> <magic 0xe8e6d2e0> <pcomp> <accomp>]
rcvd [LCP ConfReq id=0x4 <mru 1400> <auth eap> <magic 0x41e0406b> <pcomp> <accomp> <callback CBCP> <mrru 1614> <endpoint [local:7d.33.bb.1b.08.92.4c.55.b6.52.44.b5.98.55.a8.78.00.00.00.00]> < 17 04 04 6b>]
sent [LCP ConfRej id=0x4 <callback CBCP> <mrru 1614> < 17 04 04 6b>]
sent [LCP ConfReq id=0x1 <asyncmap 0x0> <magic 0xe8e6d2e0> <pcomp> <accomp>]
sent [LCP ConfReq id=0x1 <asyncmap 0x0> <magic 0xe8e6d2e0> <pcomp> <accomp>]
rcvd [LCP ConfReq id=0x5 <mru 1400> <auth eap> <magic 0x41e0406b> <pcomp> <accomp> <callback CBCP> <mrru 1614> <endpoint [local:7d.33.bb.1b.08.92.4c.55.b6.52.44.b5.98.55.a8.78.00.00.00.00]> < 17 04 04 6b>]
sent [LCP ConfRej id=0x5 <callback CBCP> <mrru 1614> < 17 04 04 6b>]
sent [LCP ConfReq id=0x1 <asyncmap 0x0> <magic 0xe8e6d2e0> <pcomp> <accomp>]
rcvd [LCP ConfReq id=0x6 <mru 1400> <auth eap> <magic 0x41e0406b> <pcomp> <accomp> <callback CBCP> <mrru 1614> <endpoint [local:7d.33.bb.1b.08.92.4c.55.b6.52.44.b5.98.55.a8.78.00.00.00.00]> < 17 04 04 6b>]
sent [LCP ConfRej id=0x6 <callback CBCP> <mrru 1614> < 17 04 04 6b>]
sent [LCP ConfReq id=0x1 <asyncmap 0x0> <magic 0xe8e6d2e0> <pcomp> <accomp>]
rcvd [LCP ConfReq id=0x7 <mru 1400> <auth eap> <magic 0x41e0406b> <pcomp> <accomp> <callback CBCP> <mrru 1614> <endpoint [local:7d.33.bb.1b.08.92.4c.55.b6.52.44.b5.98.55.a8.78.00.00.00.00]> < 17 04 04 6b>]
sent [LCP ConfRej id=0x7 <callback CBCP> <mrru 1614> < 17 04 04 6b>]
sent [LCP ConfReq id=0x1 <asyncmap 0x0> <magic 0xe8e6d2e0> <pcomp> <accomp>]
sent [LCP ConfReq id=0x1 <asyncmap 0x0> <magic 0xe8e6d2e0> <pcomp> <accomp>]
rcvd [LCP ConfReq id=0x8 <mru 1400> <auth eap> <magic 0x41e0406b> <pcomp> <accomp> <callback CBCP> <mrru 1614> <endpoint [local:7d.33.bb.1b.08.92.4c.55.b6.52.44.b5.98.55.a8.78.00.00.00.00]> < 17 04 04 6b>]
sent [LCP ConfRej id=0x8 <callback CBCP> <mrru 1614> < 17 04 04 6b>]
LCP: timeout sending Config-Requests
** Message: nm-pptp-ppp-plugin: (nm_phasechange): status 11 / phase 'disconnect'
Connection terminated.
** Message: nm-pptp-ppp-plugin: (nm_phasechange): status 1 / phase 'dead'
Modem hangup
Waiting for 1 child processes...
  script /usr/sbin/pptp 88.150.133.20 --nolaunchpppd --loglevel 2 --logstring nm-pptp-service-8838, pid 8880
Script /usr/sbin/pptp 88.150.133.20 --nolaunchpppd --loglevel 2 --logstring nm-pptp-service-8838 finished (pid 8880), status = 0x0
** Message: nm-pptp-ppp-plugin: (nm_exit_notify): cleaning up

** (nm-pptp-service:8838): WARNING **: pppd exited with error code 16
然后是sys的log

代码: 全选

Jul 31 09:32:45 lyb-Lenovo-G490 NetworkManager[953]: <warn> nl_recvmsgs() error: (-33) Dump inconsistency detected, interrupted
Jul 31 09:32:45 lyb-Lenovo-G490 NetworkManager[953]: <warn> nl_recvmsgs() error: (-33) Dump inconsistency detected, interrupted
Jul 31 09:32:48 lyb-Lenovo-G490 NetworkManager[953]: <info> VPN plugin state changed: starting (3)
Jul 31 09:32:48 lyb-Lenovo-G490 NetworkManager[953]: <info> VPN connection 'VPN connection 1' (Connect) reply received.
Jul 31 09:32:48 lyb-Lenovo-G490 pppd[5221]: Plugin /usr/lib/pppd/2.4.5/nm-pptp-pppd-plugin.so loaded.
Jul 31 09:32:48 lyb-Lenovo-G490 pppd[5221]: pppd 2.4.5 started by root, uid 0
Jul 31 09:32:48 lyb-Lenovo-G490 pppd[5221]: using channel 2
Jul 31 09:32:48 lyb-Lenovo-G490 pppd[5221]: Using interface ppp0
Jul 31 09:32:48 lyb-Lenovo-G490 pppd[5221]: Connect: ppp0 <--> /dev/pts/7
Jul 31 09:32:48 lyb-Lenovo-G490 NetworkManager[953]:    SCPlugin-Ifupdown: devices added (path: /sys/devices/virtual/net/ppp0, iface: ppp0)
Jul 31 09:32:48 lyb-Lenovo-G490 NetworkManager[953]:    SCPlugin-Ifupdown: device added (path: /sys/devices/virtual/net/ppp0, iface: ppp0): no ifupdown configuration found.
Jul 31 09:32:48 lyb-Lenovo-G490 NetworkManager[953]: <warn> /sys/devices/virtual/net/ppp0: couldn't determine device driver; ignoring...
Jul 31 09:32:48 lyb-Lenovo-G490 pptp[5226]: nm-pptp-service-5172 log[main:pptp.c:314]: The synchronous pptp option is NOT activated
Jul 31 09:32:48 lyb-Lenovo-G490 pptp[5239]: nm-pptp-service-5172 log[ctrlp_rep:pptp_ctrl.c:251]: Sent control packet type is 1 'Start-Control-Connection-Request'
Jul 31 09:32:49 lyb-Lenovo-G490 pptp[5239]: nm-pptp-service-5172 log[ctrlp_disp:pptp_ctrl.c:739]: Received Start Control Connection Reply
Jul 31 09:32:49 lyb-Lenovo-G490 pptp[5239]: nm-pptp-service-5172 log[ctrlp_disp:pptp_ctrl.c:773]: Client connection established.
Jul 31 09:32:49 lyb-Lenovo-G490 pppd[5221]: sent [LCP ConfReq id=0x1 <asyncmap 0x0> <magic 0xb987a7fa> <pcomp> <accomp>]
Jul 31 09:32:49 lyb-Lenovo-G490 pptp[5239]: nm-pptp-service-5172 log[ctrlp_rep:pptp_ctrl.c:251]: Sent control packet type is 7 'Outgoing-Call-Request'
Jul 31 09:32:50 lyb-Lenovo-G490 pptp[5239]: nm-pptp-service-5172 log[ctrlp_disp:pptp_ctrl.c:858]: Received Outgoing Call Reply.
Jul 31 09:32:50 lyb-Lenovo-G490 pptp[5239]: nm-pptp-service-5172 log[ctrlp_disp:pptp_ctrl.c:897]: Outgoing call established (call ID 0, peer's call ID 11848).
Jul 31 09:32:50 lyb-Lenovo-G490 pptp[5226]: nm-pptp-service-5172 log[decaps_gre:pptp_gre.c:395]: accepting packet 0
Jul 31 09:32:50 lyb-Lenovo-G490 pppd[5221]: rcvd [LCP ConfReq id=0x0 <mru 1400> <auth eap> <magic 0x59f82a3d> <pcomp> <accomp> <callback CBCP> <mrru 1614> <endpoint [local:7d.33.bb.1b.08.92.4c.55.b6.52.44.b5.98.55.a8.78.00.00.00.00]> < 17 04 04 37>]
Jul 31 09:32:50 lyb-Lenovo-G490 pppd[5221]: sent [LCP ConfRej id=0x0 <callback CBCP> <mrru 1614> < 17 04 04 37>]
Jul 31 09:32:50 lyb-Lenovo-G490 pptp[5226]: nm-pptp-service-5172 log[decaps_gre:pptp_gre.c:395]: accepting packet 1
Jul 31 09:32:50 lyb-Lenovo-G490 pppd[5221]: rcvd [LCP ConfAck id=0x1 <asyncmap 0x0> <magic 0xb987a7fa> <pcomp> <accomp>]
Jul 31 09:32:52 lyb-Lenovo-G490 pppd[5221]: sent [LCP ConfReq id=0x1 <asyncmap 0x0> <magic 0xb987a7fa> <pcomp> <accomp>]
Jul 31 09:32:52 lyb-Lenovo-G490 pptp[5226]: nm-pptp-service-5172 log[decaps_gre:pptp_gre.c:395]: accepting packet 2
Jul 31 09:32:52 lyb-Lenovo-G490 pppd[5221]: rcvd [LCP ConfReq id=0x1 <mru 1400> <auth eap> <magic 0x59f82a3d> <pcomp> <accomp> <callback CBCP> <mrru 1614> <endpoint [local:7d.33.bb.1b.08.92.4c.55.b6.52.44.b5.98.55.a8.78.00.00.00.00]> < 17 04 04 37>]
Jul 31 09:32:52 lyb-Lenovo-G490 pppd[5221]: sent [LCP ConfRej id=0x1 <callback CBCP> <mrru 1614> < 17 04 04 37>]
Jul 31 09:32:55 lyb-Lenovo-G490 pppd[5221]: sent [LCP ConfReq id=0x1 <asyncmap 0x0> <magic 0xb987a7fa> <pcomp> <accomp>]
Jul 31 09:32:55 lyb-Lenovo-G490 pptp[5226]: nm-pptp-service-5172 log[decaps_gre:pptp_gre.c:395]: accepting packet 3
Jul 31 09:32:55 lyb-Lenovo-G490 pppd[5221]: rcvd [LCP ConfReq id=0x2 <mru 1400> <auth eap> <magic 0x59f82a3d> <pcomp> <accomp> <callback CBCP> <mrru 1614> <endpoint [local:7d.33.bb.1b.08.92.4c.55.b6.52.44.b5.98.55.a8.78.00.00.00.00]> < 17 04 04 37>]
Jul 31 09:32:55 lyb-Lenovo-G490 pppd[5221]: sent [LCP ConfRej id=0x2 <callback CBCP> <mrru 1614> < 17 04 04 37>]
Jul 31 09:32:58 lyb-Lenovo-G490 pppd[5221]: sent [LCP ConfReq id=0x1 <asyncmap 0x0> <magic 0xb987a7fa> <pcomp> <accomp>]
Jul 31 09:32:59 lyb-Lenovo-G490 pptp[5226]: nm-pptp-service-5172 log[decaps_gre:pptp_gre.c:395]: accepting packet 4
Jul 31 09:32:59 lyb-Lenovo-G490 pppd[5221]: rcvd [LCP ConfReq id=0x3 <mru 1400> <auth eap> <magic 0x59f82a3d> <pcomp> <accomp> <callback CBCP> <mrru 1614> <endpoint [local:7d.33.bb.1b.08.92.4c.55.b6.52.44.b5.98.55.a8.78.00.00.00.00]> < 17 04 04 37>]
Jul 31 09:32:59 lyb-Lenovo-G490 pppd[5221]: sent [LCP ConfRej id=0x3 <callback CBCP> <mrru 1614> < 17 04 04 37>]
Jul 31 09:33:01 lyb-Lenovo-G490 pppd[5221]: sent [LCP ConfReq id=0x1 <asyncmap 0x0> <magic 0xb987a7fa> <pcomp> <accomp>]
Jul 31 09:33:03 lyb-Lenovo-G490 pptp[5226]: nm-pptp-service-5172 log[decaps_gre:pptp_gre.c:395]: accepting packet 5
Jul 31 09:33:03 lyb-Lenovo-G490 pppd[5221]: rcvd [LCP ConfReq id=0x4 <mru 1400> <auth eap> <magic 0x59f82a3d> <pcomp> <accomp> <callback CBCP> <mrru 1614> <endpoint [local:7d.33.bb.1b.08.92.4c.55.b6.52.44.b5.98.55.a8.78.00.00.00.00]> < 17 04 04 37>]
Jul 31 09:33:03 lyb-Lenovo-G490 pppd[5221]: sent [LCP ConfRej id=0x4 <callback CBCP> <mrru 1614> < 17 04 04 37>]
Jul 31 09:33:04 lyb-Lenovo-G490 pppd[5221]: sent [LCP ConfReq id=0x1 <asyncmap 0x0> <magic 0xb987a7fa> <pcomp> <accomp>]
Jul 31 09:33:07 lyb-Lenovo-G490 pptp[5226]: nm-pptp-service-5172 log[decaps_gre:pptp_gre.c:395]: accepting packet 6
Jul 31 09:33:07 lyb-Lenovo-G490 pppd[5221]: sent [LCP ConfReq id=0x1 <asyncmap 0x0> <magic 0xb987a7fa> <pcomp> <accomp>]
Jul 31 09:33:07 lyb-Lenovo-G490 pppd[5221]: rcvd [LCP ConfReq id=0x5 <mru 1400> <auth eap> <magic 0x59f82a3d> <pcomp> <accomp> <callback CBCP> <mrru 1614> <endpoint [local:7d.33.bb.1b.08.92.4c.55.b6.52.44.b5.98.55.a8.78.00.00.00.00]> < 17 04 04 37>]
Jul 31 09:33:07 lyb-Lenovo-G490 pppd[5221]: sent [LCP ConfRej id=0x5 <callback CBCP> <mrru 1614> < 17 04 04 37>]
Jul 31 09:33:10 lyb-Lenovo-G490 pppd[5221]: sent [LCP ConfReq id=0x1 <asyncmap 0x0> <magic 0xb987a7fa> <pcomp> <accomp>]
Jul 31 09:33:11 lyb-Lenovo-G490 pptp[5226]: nm-pptp-service-5172 log[decaps_gre:pptp_gre.c:395]: accepting packet 7
Jul 31 09:33:11 lyb-Lenovo-G490 pppd[5221]: rcvd [LCP ConfReq id=0x6 <mru 1400> <auth eap> <magic 0x59f82a3d> <pcomp> <accomp> <callback CBCP> <mrru 1614> <endpoint [local:7d.33.bb.1b.08.92.4c.55.b6.52.44.b5.98.55.a8.78.00.00.00.00]> < 17 04 04 37>]
Jul 31 09:33:11 lyb-Lenovo-G490 pppd[5221]: sent [LCP ConfRej id=0x6 <callback CBCP> <mrru 1614> < 17 04 04 37>]
Jul 31 09:33:13 lyb-Lenovo-G490 pppd[5221]: sent [LCP ConfReq id=0x1 <asyncmap 0x0> <magic 0xb987a7fa> <pcomp> <accomp>]
Jul 31 09:33:15 lyb-Lenovo-G490 pptp[5226]: nm-pptp-service-5172 log[decaps_gre:pptp_gre.c:395]: accepting packet 8
Jul 31 09:33:15 lyb-Lenovo-G490 pppd[5221]: rcvd [LCP ConfReq id=0x7 <mru 1400> <auth eap> <magic 0x59f82a3d> <pcomp> <accomp> <callback CBCP> <mrru 1614> <endpoint [local:7d.33.bb.1b.08.92.4c.55.b6.52.44.b5.98.55.a8.78.00.00.00.00]> < 17 04 04 37>]
Jul 31 09:33:15 lyb-Lenovo-G490 pppd[5221]: sent [LCP ConfRej id=0x7 <callback CBCP> <mrru 1614> < 17 04 04 37>]
Jul 31 09:33:16 lyb-Lenovo-G490 pppd[5221]: sent [LCP ConfReq id=0x1 <asyncmap 0x0> <magic 0xb987a7fa> <pcomp> <accomp>]
Jul 31 09:33:19 lyb-Lenovo-G490 pptp[5226]: nm-pptp-service-5172 log[decaps_gre:pptp_gre.c:395]: accepting packet 9
Jul 31 09:33:19 lyb-Lenovo-G490 pppd[5221]: sent [LCP ConfReq id=0x1 <asyncmap 0x0> <magic 0xb987a7fa> <pcomp> <accomp>]
Jul 31 09:33:19 lyb-Lenovo-G490 pppd[5221]: rcvd [LCP ConfReq id=0x8 <mru 1400> <auth eap> <magic 0x59f82a3d> <pcomp> <accomp> <callback CBCP> <mrru 1614> <endpoint [local:7d.33.bb.1b.08.92.4c.55.b6.52.44.b5.98.55.a8.78.00.00.00.00]> < 17 04 04 37>]
Jul 31 09:33:19 lyb-Lenovo-G490 pppd[5221]: sent [LCP ConfRej id=0x8 <callback CBCP> <mrru 1614> < 17 04 04 37>]
Jul 31 09:33:22 lyb-Lenovo-G490 pppd[5221]: LCP: timeout sending Config-Requests
Jul 31 09:33:22 lyb-Lenovo-G490 pppd[5221]: Connection terminated.
Jul 31 09:33:22 lyb-Lenovo-G490 NetworkManager[953]: <warn> VPN plugin failed: 1
Jul 31 09:25:39 lyb-Lenovo-G490 avahi-daemon[929]: message repeated 2 times: [ Withdrawing workstation service for tun0.]
Jul 31 09:33:22 lyb-Lenovo-G490 avahi-daemon[929]: Withdrawing workstation service for ppp0.
Jul 31 09:33:22 lyb-Lenovo-G490 NetworkManager[953]:    SCPlugin-Ifupdown: devices removed (path: /sys/devices/virtual/net/ppp0, iface: ppp0)
Jul 31 09:33:22 lyb-Lenovo-G490 pptp[5226]: nm-pptp-service-5172 warn[decaps_hdlc:pptp_gre.c:204]: short read (-1): Input/output error
Jul 31 09:33:22 lyb-Lenovo-G490 pptp[5226]: nm-pptp-service-5172 warn[decaps_hdlc:pptp_gre.c:216]: pppd may have shutdown, see pppd log
Jul 31 09:33:22 lyb-Lenovo-G490 pppd[5221]: Modem hangup
Jul 31 09:33:22 lyb-Lenovo-G490 pppd[5221]: Waiting for 1 child processes...
Jul 31 09:33:22 lyb-Lenovo-G490 pppd[5221]:   script /usr/sbin/pptp 88.150.133.20 --nolaunchpppd --loglevel 2 --logstring nm-pptp-service-5172, pid 5223
Jul 31 09:33:22 lyb-Lenovo-G490 pptp[5239]: nm-pptp-service-5172 log[callmgr_main:pptp_callmgr.c:234]: Closing connection (unhandled)
Jul 31 09:33:22 lyb-Lenovo-G490 pppd[5221]: Script /usr/sbin/pptp 88.150.133.20 --nolaunchpppd --loglevel 2 --logstring nm-pptp-service-5172 finished (pid 5223), status = 0x0
Jul 31 09:33:22 lyb-Lenovo-G490 pptp[5239]: nm-pptp-service-5172 log[ctrlp_rep:pptp_ctrl.c:251]: Sent control packet type is 12 'Call-Clear-Request'
Jul 31 09:33:22 lyb-Lenovo-G490 pppd[5221]: Exit.
Jul 31 09:33:22 lyb-Lenovo-G490 NetworkManager[953]: <warn> VPN plugin failed: 1
Jul 31 09:33:22 lyb-Lenovo-G490 pptp[5239]: nm-pptp-service-5172 log[call_callback:pptp_callmgr.c:79]: Closing connection (call state)
Jul 31 09:33:22 lyb-Lenovo-G490 NetworkManager[953]: <warn> VPN plugin failed: 1
Jul 31 09:33:22 lyb-Lenovo-G490 NetworkManager[953]: <info> VPN plugin state changed: stopped (6)
Jul 31 09:33:22 lyb-Lenovo-G490 NetworkManager[953]: <info> VPN plugin state change reason: 0
Jul 31 09:33:22 lyb-Lenovo-G490 NetworkManager[953]: <info> Policy set 'wcc-androidroom' (wlan0) as default for IPv4 routing and DNS.
Jul 31 09:33:22 lyb-Lenovo-G490 NetworkManager[953]: <warn> error disconnecting VPN: Could not process the request because no VPN connection was active.
Jul 31 09:33:42 lyb-Lenovo-G490 NetworkManager[953]: <info> VPN service 'pptp' disappeared
Jul 31 09:39:39 lyb-Lenovo-G490 dbus[896]: [system] Activating service name='com.ubuntu.SoftwareProperties' (using servicehelper)
Jul 31 09:39:40 lyb-Lenovo-G490 dbus[896]: [system] Successfully activated service 'com.ubuntu.SoftwareProperties'
Jul 31 09:40:45 lyb-Lenovo-G490 NetworkManager[953]: <warn> nl_recvmsgs() error: (-33) Dump inconsistency detected, interrupted
Jul 31 09:41:36 lyb-Lenovo-G490 dbus[896]: [system] Activating service name='org.freedesktop.hostname1' (using servicehelper)
Jul 31 09:41:36 lyb-Lenovo-G490 dbus[896]: [system] Successfully activated service 'org.freedesktop.hostname1'
Jul 31 09:41:36 lyb-Lenovo-G490 kernel: [ 2072.878706] systemd-hostnamed[7727]: Warning: nss-myhostname is not installed. Changing the local hostname might make it unresolveable. Please install nss-myhostname!
Jul 31 09:41:37 lyb-Lenovo-G490 dbus[896]: [system] Activating service name='org.freedesktop.PackageKit' (using servicehelper)
Jul 31 09:41:38 lyb-Lenovo-G490 AptDaemon: INFO: Initializing daemon
Jul 31 09:41:38 lyb-Lenovo-G490 AptDaemon.PackageKit: INFO: Initializing PackageKit compat layer
Jul 31 09:41:38 lyb-Lenovo-G490 dbus[896]: [system] Successfully activated service 'org.freedesktop.PackageKit'
Jul 31 09:41:38 lyb-Lenovo-G490 AptDaemon.PackageKit: INFO: CreateTransaction() was called
Jul 31 09:41:38 lyb-Lenovo-G490 AptDaemon.PackageKit: INFO: Initializing PackageKit transaction
Jul 31 09:41:38 lyb-Lenovo-G490 AptDaemon.PackageKit: INFO: GetUpdates() was called
Jul 31 09:41:38 lyb-Lenovo-G490 AptDaemon.Worker: INFO: Simulating trans: /org/debian/apt/transaction/1273beac1c2b41338f6542efa671fa36
Jul 31 09:41:38 lyb-Lenovo-G490 AptDaemon.Worker: INFO: Processing transaction /org/debian/apt/transaction/1273beac1c2b41338f6542efa671fa36
Jul 31 09:42:14 lyb-Lenovo-G490 AptDaemon.Worker: INFO: Finished transaction /org/debian/apt/transaction/1273beac1c2b41338f6542efa671fa36
Jul 31 09:42:53 lyb-Lenovo-G490 AptDaemon: INFO: UpdateCache() was called
Jul 31 09:42:53 lyb-Lenovo-G490 AptDaemon.Trans: INFO: Queuing transaction /org/debian/apt/transaction/870de1a528b94d8ba4ced16df7ca3d54
Jul 31 09:42:53 lyb-Lenovo-G490 AptDaemon.Worker: INFO: Simulating trans: /org/debian/apt/transaction/870de1a528b94d8ba4ced16df7ca3d54
Jul 31 09:42:53 lyb-Lenovo-G490 AptDaemon.Worker: INFO: Processing transaction /org/debian/apt/transaction/870de1a528b94d8ba4ced16df7ca3d54
Jul 31 09:42:53 lyb-Lenovo-G490 AptDaemon.Worker: INFO: Updating cache
Jul 31 09:43:34 lyb-Lenovo-G490 AptDaemon.Worker: INFO: Finished transaction /org/debian/apt/transaction/870de1a528b94d8ba4ced16df7ca3d54
Jul 31 09:44:45 lyb-Lenovo-G490 NetworkManager[953]: <warn> nl_recvmsgs() error: (-33) Dump inconsistency detected, interrupted
Jul 31 09:45:10 lyb-Lenovo-G490 NetworkManager[953]: <info> VPN service 'pptp' appeared; activating connections
Jul 31 09:45:19 lyb-Lenovo-G490 NetworkManager[953]: <info> VPN plugin state changed: starting (3)
Jul 31 09:45:19 lyb-Lenovo-G490 NetworkManager[953]: <info> VPN connection 'VPN connection 1' (Connect) reply received.
Jul 31 09:45:19 lyb-Lenovo-G490 pppd[8878]: Plugin /usr/lib/pppd/2.4.5/nm-pptp-pppd-plugin.so loaded.
Jul 31 09:45:19 lyb-Lenovo-G490 pppd[8878]: pppd 2.4.5 started by root, uid 0
Jul 31 09:45:19 lyb-Lenovo-G490 pppd[8878]: using channel 3
Jul 31 09:45:19 lyb-Lenovo-G490 pppd[8878]: Using interface ppp0
Jul 31 09:45:19 lyb-Lenovo-G490 pppd[8878]: Connect: ppp0 <--> /dev/pts/7
Jul 31 09:45:19 lyb-Lenovo-G490 NetworkManager[953]:    SCPlugin-Ifupdown: devices added (path: /sys/devices/virtual/net/ppp0, iface: ppp0)
Jul 31 09:45:19 lyb-Lenovo-G490 NetworkManager[953]:    SCPlugin-Ifupdown: device added (path: /sys/devices/virtual/net/ppp0, iface: ppp0): no ifupdown configuration found.
Jul 31 09:45:19 lyb-Lenovo-G490 NetworkManager[953]: <warn> /sys/devices/virtual/net/ppp0: couldn't determine device driver; ignoring...
Jul 31 09:45:19 lyb-Lenovo-G490 pptp[8883]: nm-pptp-service-8838 log[main:pptp.c:314]: The synchronous pptp option is NOT activated
Jul 31 09:45:19 lyb-Lenovo-G490 pptp[8896]: nm-pptp-service-8838 log[ctrlp_rep:pptp_ctrl.c:251]: Sent control packet type is 1 'Start-Control-Connection-Request'
Jul 31 09:45:20 lyb-Lenovo-G490 pppd[8878]: sent [LCP ConfReq id=0x1 <asyncmap 0x0> <magic 0xe8e6d2e0> <pcomp> <accomp>]
Jul 31 09:45:20 lyb-Lenovo-G490 pptp[8896]: nm-pptp-service-8838 log[ctrlp_disp:pptp_ctrl.c:739]: Received Start Control Connection Reply
Jul 31 09:45:20 lyb-Lenovo-G490 pptp[8896]: nm-pptp-service-8838 log[ctrlp_disp:pptp_ctrl.c:773]: Client connection established.
Jul 31 09:45:20 lyb-Lenovo-G490 pptp[8896]: nm-pptp-service-8838 log[ctrlp_rep:pptp_ctrl.c:251]: Sent control packet type is 7 'Outgoing-Call-Request'
Jul 31 09:45:20 lyb-Lenovo-G490 pptp[8896]: nm-pptp-service-8838 log[ctrlp_disp:pptp_ctrl.c:858]: Received Outgoing Call Reply.
Jul 31 09:45:20 lyb-Lenovo-G490 pptp[8896]: nm-pptp-service-8838 log[ctrlp_disp:pptp_ctrl.c:897]: Outgoing call established (call ID 0, peer's call ID 25672).
Jul 31 09:45:21 lyb-Lenovo-G490 pptp[8883]: nm-pptp-service-8838 log[decaps_gre:pptp_gre.c:395]: accepting packet 0
Jul 31 09:45:21 lyb-Lenovo-G490 pppd[8878]: rcvd [LCP ConfReq id=0x0 <mru 1400> <auth eap> <magic 0x41e0406b> <pcomp> <accomp> <callback CBCP> <mrru 1614> <endpoint [local:7d.33.bb.1b.08.92.4c.55.b6.52.44.b5.98.55.a8.78.00.00.00.00]> < 17 04 04 6b>]
Jul 31 09:45:21 lyb-Lenovo-G490 pppd[8878]: sent [LCP ConfRej id=0x0 <callback CBCP> <mrru 1614> < 17 04 04 6b>]
Jul 31 09:45:21 lyb-Lenovo-G490 pptp[8883]: nm-pptp-service-8838 log[decaps_gre:pptp_gre.c:395]: accepting packet 1
Jul 31 09:45:21 lyb-Lenovo-G490 pppd[8878]: rcvd [LCP ConfAck id=0x1 <asyncmap 0x0> <magic 0xe8e6d2e0> <pcomp> <accomp>]
Jul 31 09:45:23 lyb-Lenovo-G490 pppd[8878]: sent [LCP ConfReq id=0x1 <asyncmap 0x0> <magic 0xe8e6d2e0> <pcomp> <accomp>]
Jul 31 09:45:23 lyb-Lenovo-G490 pptp[8883]: nm-pptp-service-8838 log[decaps_gre:pptp_gre.c:395]: accepting packet 2
Jul 31 09:45:23 lyb-Lenovo-G490 pppd[8878]: rcvd [LCP ConfReq id=0x1 <mru 1400> <auth eap> <magic 0x41e0406b> <pcomp> <accomp> <callback CBCP> <mrru 1614> <endpoint [local:7d.33.bb.1b.08.92.4c.55.b6.52.44.b5.98.55.a8.78.00.00.00.00]> < 17 04 04 6b>]
Jul 31 09:45:23 lyb-Lenovo-G490 pppd[8878]: sent [LCP ConfRej id=0x1 <callback CBCP> <mrru 1614> < 17 04 04 6b>]
Jul 31 09:45:26 lyb-Lenovo-G490 pppd[8878]: sent [LCP ConfReq id=0x1 <asyncmap 0x0> <magic 0xe8e6d2e0> <pcomp> <accomp>]
Jul 31 09:45:26 lyb-Lenovo-G490 pptp[8883]: nm-pptp-service-8838 log[decaps_gre:pptp_gre.c:395]: accepting packet 3
Jul 31 09:45:26 lyb-Lenovo-G490 pppd[8878]: rcvd [LCP ConfReq id=0x2 <mru 1400> <auth eap> <magic 0x41e0406b> <pcomp> <accomp> <callback CBCP> <mrru 1614> <endpoint [local:7d.33.bb.1b.08.92.4c.55.b6.52.44.b5.98.55.a8.78.00.00.00.00]> < 17 04 04 6b>]
Jul 31 09:45:26 lyb-Lenovo-G490 pppd[8878]: sent [LCP ConfRej id=0x2 <callback CBCP> <mrru 1614> < 17 04 04 6b>]
Jul 31 09:45:29 lyb-Lenovo-G490 pppd[8878]: sent [LCP ConfReq id=0x1 <asyncmap 0x0> <magic 0xe8e6d2e0> <pcomp> <accomp>]
Jul 31 09:45:30 lyb-Lenovo-G490 pptp[8883]: nm-pptp-service-8838 log[decaps_gre:pptp_gre.c:395]: accepting packet 4
Jul 31 09:45:30 lyb-Lenovo-G490 pppd[8878]: rcvd [LCP ConfReq id=0x3 <mru 1400> <auth eap> <magic 0x41e0406b> <pcomp> <accomp> <callback CBCP> <mrru 1614> <endpoint [local:7d.33.bb.1b.08.92.4c.55.b6.52.44.b5.98.55.a8.78.00.00.00.00]> < 17 04 04 6b>]
Jul 31 09:45:30 lyb-Lenovo-G490 pppd[8878]: sent [LCP ConfRej id=0x3 <callback CBCP> <mrru 1614> < 17 04 04 6b>]
Jul 31 09:45:32 lyb-Lenovo-G490 pppd[8878]: sent [LCP ConfReq id=0x1 <asyncmap 0x0> <magic 0xe8e6d2e0> <pcomp> <accomp>]
Jul 31 09:45:34 lyb-Lenovo-G490 pptp[8883]: nm-pptp-service-8838 log[decaps_gre:pptp_gre.c:395]: accepting packet 5
Jul 31 09:45:34 lyb-Lenovo-G490 pppd[8878]: rcvd [LCP ConfReq id=0x4 <mru 1400> <auth eap> <magic 0x41e0406b> <pcomp> <accomp> <callback CBCP> <mrru 1614> <endpoint [local:7d.33.bb.1b.08.92.4c.55.b6.52.44.b5.98.55.a8.78.00.00.00.00]> < 17 04 04 6b>]
Jul 31 09:45:34 lyb-Lenovo-G490 pppd[8878]: sent [LCP ConfRej id=0x4 <callback CBCP> <mrru 1614> < 17 04 04 6b>]
Jul 31 09:45:35 lyb-Lenovo-G490 pppd[8878]: sent [LCP ConfReq id=0x1 <asyncmap 0x0> <magic 0xe8e6d2e0> <pcomp> <accomp>]
Jul 31 09:45:38 lyb-Lenovo-G490 pptp[8883]: nm-pptp-service-8838 log[decaps_gre:pptp_gre.c:395]: accepting packet 6
Jul 31 09:45:38 lyb-Lenovo-G490 pppd[8878]: sent [LCP ConfReq id=0x1 <asyncmap 0x0> <magic 0xe8e6d2e0> <pcomp> <accomp>]
Jul 31 09:45:38 lyb-Lenovo-G490 pppd[8878]: rcvd [LCP ConfReq id=0x5 <mru 1400> <auth eap> <magic 0x41e0406b> <pcomp> <accomp> <callback CBCP> <mrru 1614> <endpoint [local:7d.33.bb.1b.08.92.4c.55.b6.52.44.b5.98.55.a8.78.00.00.00.00]> < 17 04 04 6b>]
Jul 31 09:45:38 lyb-Lenovo-G490 pppd[8878]: sent [LCP ConfRej id=0x5 <callback CBCP> <mrru 1614> < 17 04 04 6b>]
Jul 31 09:45:41 lyb-Lenovo-G490 pppd[8878]: sent [LCP ConfReq id=0x1 <asyncmap 0x0> <magic 0xe8e6d2e0> <pcomp> <accomp>]
Jul 31 09:45:42 lyb-Lenovo-G490 pptp[8883]: nm-pptp-service-8838 log[decaps_gre:pptp_gre.c:395]: accepting packet 7
Jul 31 09:45:42 lyb-Lenovo-G490 pppd[8878]: rcvd [LCP ConfReq id=0x6 <mru 1400> <auth eap> <magic 0x41e0406b> <pcomp> <accomp> <callback CBCP> <mrru 1614> <endpoint [local:7d.33.bb.1b.08.92.4c.55.b6.52.44.b5.98.55.a8.78.00.00.00.00]> < 17 04 04 6b>]
Jul 31 09:45:42 lyb-Lenovo-G490 pppd[8878]: sent [LCP ConfRej id=0x6 <callback CBCP> <mrru 1614> < 17 04 04 6b>]
Jul 31 09:45:44 lyb-Lenovo-G490 pppd[8878]: sent [LCP ConfReq id=0x1 <asyncmap 0x0> <magic 0xe8e6d2e0> <pcomp> <accomp>]
Jul 31 09:45:46 lyb-Lenovo-G490 pptp[8883]: nm-pptp-service-8838 log[decaps_gre:pptp_gre.c:395]: accepting packet 8
Jul 31 09:45:46 lyb-Lenovo-G490 pppd[8878]: rcvd [LCP ConfReq id=0x7 <mru 1400> <auth eap> <magic 0x41e0406b> <pcomp> <accomp> <callback CBCP> <mrru 1614> <endpoint [local:7d.33.bb.1b.08.92.4c.55.b6.52.44.b5.98.55.a8.78.00.00.00.00]> < 17 04 04 6b>]
Jul 31 09:45:46 lyb-Lenovo-G490 pppd[8878]: sent [LCP ConfRej id=0x7 <callback CBCP> <mrru 1614> < 17 04 04 6b>]
Jul 31 09:45:47 lyb-Lenovo-G490 pppd[8878]: sent [LCP ConfReq id=0x1 <asyncmap 0x0> <magic 0xe8e6d2e0> <pcomp> <accomp>]
Jul 31 09:45:50 lyb-Lenovo-G490 pptp[8883]: nm-pptp-service-8838 log[decaps_gre:pptp_gre.c:395]: accepting packet 9
Jul 31 09:45:50 lyb-Lenovo-G490 pppd[8878]: sent [LCP ConfReq id=0x1 <asyncmap 0x0> <magic 0xe8e6d2e0> <pcomp> <accomp>]
Jul 31 09:45:50 lyb-Lenovo-G490 pppd[8878]: rcvd [LCP ConfReq id=0x8 <mru 1400> <auth eap> <magic 0x41e0406b> <pcomp> <accomp> <callback CBCP> <mrru 1614> <endpoint [local:7d.33.bb.1b.08.92.4c.55.b6.52.44.b5.98.55.a8.78.00.00.00.00]> < 17 04 04 6b>]
Jul 31 09:45:50 lyb-Lenovo-G490 pppd[8878]: sent [LCP ConfRej id=0x8 <callback CBCP> <mrru 1614> < 17 04 04 6b>]
Jul 31 09:45:53 lyb-Lenovo-G490 pppd[8878]: LCP: timeout sending Config-Requests
Jul 31 09:45:53 lyb-Lenovo-G490 pppd[8878]: Connection terminated.
Jul 31 09:45:53 lyb-Lenovo-G490 NetworkManager[953]: <warn> VPN plugin failed: 1
Jul 31 09:45:53 lyb-Lenovo-G490 NetworkManager[953]:    SCPlugin-Ifupdown: devices removed (path: /sys/devices/virtual/net/ppp0, iface: ppp0)
Jul 31 09:45:53 lyb-Lenovo-G490 pptp[8883]: nm-pptp-service-8838 warn[decaps_hdlc:pptp_gre.c:204]: short read (-1): Input/output error
Jul 31 09:45:53 lyb-Lenovo-G490 pptp[8883]: nm-pptp-service-8838 warn[decaps_hdlc:pptp_gre.c:216]: pppd may have shutdown, see pppd log
Jul 31 09:45:53 lyb-Lenovo-G490 pppd[8878]: Modem hangup
Jul 31 09:45:53 lyb-Lenovo-G490 pppd[8878]: Waiting for 1 child processes...
Jul 31 09:45:53 lyb-Lenovo-G490 pppd[8878]:   script /usr/sbin/pptp 88.150.133.20 --nolaunchpppd --loglevel 2 --logstring nm-pptp-service-8838, pid 8880
Jul 31 09:45:53 lyb-Lenovo-G490 pptp[8896]: nm-pptp-service-8838 log[callmgr_main:pptp_callmgr.c:234]: Closing connection (unhandled)
Jul 31 09:45:53 lyb-Lenovo-G490 NetworkManager[953]: <warn> VPN plugin failed: 1
Jul 31 09:45:53 lyb-Lenovo-G490 pptp[8896]: nm-pptp-service-8838 log[ctrlp_rep:pptp_ctrl.c:251]: Sent control packet type is 12 'Call-Clear-Request'
Jul 31 09:45:53 lyb-Lenovo-G490 pptp[8896]: nm-pptp-service-8838 log[call_callback:pptp_callmgr.c:79]: Closing connection (call state)
Jul 31 09:45:53 lyb-Lenovo-G490 pppd[8878]: Script /usr/sbin/pptp 88.150.133.20 --nolaunchpppd --loglevel 2 --logstring nm-pptp-service-8838 finished (pid 8880), status = 0x0
Jul 31 09:45:53 lyb-Lenovo-G490 pppd[8878]: Exit.
Jul 31 09:45:53 lyb-Lenovo-G490 NetworkManager[953]: <warn> VPN plugin failed: 1
Jul 31 09:45:53 lyb-Lenovo-G490 NetworkManager[953]: <info> VPN plugin state changed: stopped (6)
Jul 31 09:45:53 lyb-Lenovo-G490 NetworkManager[953]: <info> VPN plugin state change reason: 0
Jul 31 09:45:53 lyb-Lenovo-G490 NetworkManager[953]: <info> Policy set 'wcc-androidroom' (wlan0) as default for IPv4 routing and DNS.
Jul 31 09:45:53 lyb-Lenovo-G490 NetworkManager[953]: <warn> error disconnecting VPN: Could not process the request because no VPN connection was active.
Jul 31 09:46:13 lyb-Lenovo-G490 NetworkManager[953]: <info> VPN service 'pptp' disappeared
Jul 31 09:48:45 lyb-Lenovo-G490 NetworkManager[953]: <warn> nl_recvmsgs() error: (-33) Dump inconsistency detected, interrupted

希望得到大神的帮助,或者是给出方向,我也去学习学习。谢谢
taohunter
帖子: 1555
注册时间: 2012-03-31 3:29

Re: pptp debug问题

#2

帖子 taohunter »

看到88.150.133.20这个熟悉的ip我 :em04 ,我现在正在用这个vpn来连接论坛给你回复。

以下是可能的情况:

1. 'password': 869259,这个password你是怎么得到的?--我知道这个vpn的password是动态变化的,每次连接前都要先去取新的password,不能一直存在那里。

2. 有关pptp的设置,下面是我刚在windows下截的图,你对比一下你的设定,肯定不一样。按照我图中的改,提醒一句,最好别用命令行方式去改配置文件,直接用nm-applet(也就是顶栏右上的网络图标里的那个编辑功能),省得又改错了。
PPTP_Security.PNG
3. 提醒一句,现在的国情下,各地的isp会不时干扰特定ip的vpn连接,所以当出现连接不上vpn server的时候最好先重启一下自己的路由器或重新连接一遍dsl。

4. vpn server端也不是永远可用的,当达到server设定的连接数上限时也有可能短暂出现无法连接的情况。如果属于这种情况,一般再试个一、两次就行了。
三年后终于回到16.04--稳定了!
回复