[РЕШЕНО] диагностика VPN

[s_lim]

Случилась у меня беда - не подключается VPN соединение (Linux Mint 10 он же Ubuntu 10.10), беспричинно (с сетевыми настройками и VPN'ом ничего не делал), просто не подключается и все говорит что не удалось установить соединение. На стороне провайдера все ОК - оффтопик7 уверенно держит соединение, ключевые пакеты переустанавливал, соединение с новым именем создавал, тыщу раз перезагружался ничего не помогло....
Вопрос первый как получить подробную отладочную инфу при соединении, типа -verbose, (я пользуюсь гномовским нетворк менеджером а он в этом отношении совершенно бессловен) и как исправить проблему

[shumtest]

Настроить не через НМ, добавить опцию debug, смотреть в логах на что ругается.

[s_lim]

shumtest
а как настроить ВПН не через НМ?

[fisher74]

Воспользоваться местным wiki, например

[s_lim]

Воспользовался... соединения создал... само собой ВПН соединение не подключается
при попытке соединения /var/log/messages говорит:

Код: [Выделить]

Mar 15 23:05:01 sulimov pppd[2321]: pppd 2.4.5 started by root, uid 0
Mar 15 23:05:03 sulimov pppd[2321]: Exit.
насколько я понял pppd напрочь отказывается работать...
остается вопрос как его заставить батрачить?

[fisher74]

А с нами поделитесь, что настроили и как подключаете?

[s_lim]

поднял eth0 - dhcp

Код: [Выделить]

/etc/network/interfaces
auto lo
iface lo inet loopback

auto eth0
iface eth0 inet dhcp

auto inetvl.ru
iface inetvl.ru inet ppp
    provider inetvl.ru

Код: [Выделить]

/etc/ppp/chap-secrets
<your login> * <your password>

Код: [Выделить]

/etc/ppp/peers/inetvl.ru
user "your login"
pty "pptp ppp.inetvl.ru --nolaunchpppd"
noipdefault
usepeerdns
defaultroute
persist
lock
noauth
nobsdcomp
nodeflate
require-mppe-128
mtu 1400
mru 1500

перезагружаю комп

Код: [Выделить]

sudo pon inetvl.ru
ifconfig - интерфейса нет... а в логе вышеуказанное сообщение

[fisher74]

Код: [Выделить]

ifconfig -a
nslookup ppp.inetvl.ruЧё кажут?
Пользователь решил продолжить мысль 15 Марта 2011, 17:26:06:И желательно добавить в секцию inetvl.ru

pre-up /sbin/ifconfig eth0 up

[s_lim]

ifconfig показывает активное eth0 и lo (loopback)

(Нажмите, чтобы показать/скрыть)

Server:      95.154.112.74
Address:   95.154.112.74#53

Name:   ppp.inetvl.ru
Address: 172.16.4.1

добавил эту строчку но погоды она не сделала...

[fisher74]

Попробуйте добавьте

Код: (/etc/ppp/peers/inetvl.ru) [Выделить]

debugможет побольше увидим
Ну и поглядите, может здесь больше информации попало?

Код: [Выделить]

grep pppd /var/log/syslog

[s_lim]

вот что появилось в /var/log/syslog после попытки поднять впн с включеным дебагом

(Нажмите, чтобы показать/скрыть)

Mar 16 00:59:57 sulimov pppd[2424]: pppd 2.4.5 started by root, uid 0
Mar 16 00:59:57 sulimov pppd[2424]: Couldn't set tty to PPP discipline: Invalid argument
Mar 16 00:59:57 sulimov pppd[2424]: last message repeated 3 times
Mar 16 00:59:57 sulimov pptp[2428]: anon log[main:pptp.c:314]: The synchronous pptp option is NOT activated
Mar 16 00:59:57 sulimov pppd[2424]: Couldn't set tty to PPP discipline: Invalid argument
Mar 16 00:59:57 sulimov pptp[2432]: anon log[main:pptp.c:314]: The synchronous pptp option is NOT activated
Mar 16 00:59:57 sulimov pppd[2424]: Couldn't set tty to PPP discipline: Invalid argument
Mar 16 00:59:57 sulimov pptp[2436]: anon log[main:pptp.c:314]: The synchronous pptp option is NOT activated
Mar 16 00:59:57 sulimov pppd[2424]: Couldn't set tty to PPP discipline: Invalid argument
Mar 16 00:59:57 sulimov pptp[2440]: anon log[main:pptp.c:314]: The synchronous pptp option is NOT activated
Mar 16 00:59:57 sulimov pppd[2424]: Couldn't set tty to PPP discipline: Invalid argument
Mar 16 00:59:57 sulimov pptp[2444]: anon log[main:pptp.c:314]: The synchronous pptp option is NOT activated
Mar 16 00:59:57 sulimov pppd[2424]: Couldn't set tty to PPP discipline: Invalid argument
Mar 16 00:59:57 sulimov pppd[2424]: Couldn't set tty to PPP discipline: Invalid argument
Mar 16 00:59:57 sulimov pppd[2424]: Waiting for 10 child processes...
Mar 16 00:59:57 sulimov pppd[2424]:   script pptp ppp.inetvl.ru --nolaunchpppd, pid 2480
Mar 16 00:59:57 sulimov pppd[2424]:   script pptp ppp.inetvl.ru --nolaunchpppd, pid 2473
Mar 16 00:59:57 sulimov pppd[2424]:   script pptp ppp.inetvl.ru --nolaunchpppd, pid 2464
Mar 16 00:59:57 sulimov pppd[2424]:   script pptp ppp.inetvl.ru --nolaunchpppd, pid 2455
Mar 16 00:59:57 sulimov pppd[2424]:   script pptp ppp.inetvl.ru --nolaunchpppd, pid 2447
Mar 16 00:59:57 sulimov pppd[2424]:   script pptp ppp.inetvl.ru --nolaunchpppd, pid 2441
Mar 16 00:59:57 sulimov pppd[2424]:   script pptp ppp.inetvl.ru --nolaunchpppd, pid 2437
Mar 16 00:59:57 sulimov pppd[2424]:   script pptp ppp.inetvl.ru --nolaunchpppd, pid 2433
Mar 16 00:59:57 sulimov pppd[2424]:   script pptp ppp.inetvl.ru --nolaunchpppd, pid 2429
Mar 16 00:59:57 sulimov pppd[2424]:   script pptp ppp.inetvl.ru --nolaunchpppd, pid 2425
Mar 16 00:59:57 sulimov pptp[2451]: anon log[main:pptp.c:314]: The synchronous pptp option is NOT activated
Mar 16 00:59:57 sulimov pptp[2491]: anon log[ctrlp_rep:pptp_ctrl.c:251]: Sent control packet type is 1 'Start-Control-Connection-Request'
Mar 16 00:59:57 sulimov pptp[2460]: anon log[main:pptp.c:314]: The synchronous pptp option is NOT activated
Mar 16 00:59:57 sulimov pptp[2452]: anon warn[open_unixsock:pptp_callmgr.c:348]: Call manager for 172.16.4.1 is already running.
Mar 16 00:59:57 sulimov pptp[2452]: anon fatal[callmgr_main:pptp_callmgr.c:129]: Could not open unix socket for 172.16.4.1
Mar 16 00:59:57 sulimov pptp[2432]: anon fatal[open_callmgr:pptp.c:487]: Call manager exited with error 256
Mar 16 00:59:57 sulimov pppd[2424]: Script pptp ppp.inetvl.ru --nolaunchpppd finished (pid 2429), status = 0x1
Mar 16 00:59:57 sulimov pptp[2469]: anon log[main:pptp.c:314]: The synchronous pptp option is NOT activated
Mar 16 00:59:57 sulimov pptp[2461]: anon warn[open_unixsock:pptp_callmgr.c:348]: Call manager for 172.16.4.1 is already running.
Mar 16 00:59:57 sulimov pptp[2461]: anon fatal[callmgr_main:pptp_callmgr.c:129]: Could not open unix socket for 172.16.4.1
Mar 16 00:59:57 sulimov pptp[2436]: anon fatal[open_callmgr:pptp.c:487]: Call manager exited with error 256
Mar 16 00:59:57 sulimov pppd[2424]: Script pptp ppp.inetvl.ru --nolaunchpppd finished (pid 2433), status = 0x1
Mar 16 00:59:57 sulimov pptp[2478]: anon log[main:pptp.c:314]: The synchronous pptp option is NOT activated
Mar 16 00:59:57 sulimov pptp[2470]: anon warn[open_unixsock:pptp_callmgr.c:348]: Call manager for 172.16.4.1 is already running.
Mar 16 00:59:57 sulimov pptp[2470]: anon fatal[callmgr_main:pptp_callmgr.c:129]: Could not open unix socket for 172.16.4.1
Mar 16 00:59:57 sulimov pptp[2440]: anon fatal[open_callmgr:pptp.c:487]: Call manager exited with error 256
Mar 16 00:59:57 sulimov pptp[2486]: anon log[main:pptp.c:314]: The synchronous pptp option is NOT activated
Mar 16 00:59:57 sulimov pppd[2424]: Script pptp ppp.inetvl.ru --nolaunchpppd finished (pid 2437), status = 0x1
Mar 16 00:59:57 sulimov pptp[2491]: anon log[ctrlp_disp:pptp_ctrl.c:739]: Received Start Control Connection Reply
Mar 16 00:59:57 sulimov pptp[2491]: anon log[ctrlp_disp:pptp_ctrl.c:773]: Client connection established.
Mar 16 00:59:57 sulimov pptp[2491]: anon log[ctrlp_rep:pptp_ctrl.c:251]: Sent control packet type is 7 'Outgoing-Call-Request'
Mar 16 00:59:57 sulimov pptp[2491]: last message repeated 3 times
Mar 16 00:59:57 sulimov pptp[2479]: anon warn[open_unixsock:pptp_callmgr.c:348]: Call manager for 172.16.4.1 is already running.
Mar 16 00:59:57 sulimov pptp[2479]: anon fatal[callmgr_main:pptp_callmgr.c:129]: Could not open unix socket for 172.16.4.1
Mar 16 00:59:57 sulimov pptp[2444]: anon fatal[open_callmgr:pptp.c:487]: Call manager exited with error 256
Mar 16 00:59:57 sulimov pppd[2424]: Script pptp ppp.inetvl.ru --nolaunchpppd finished (pid 2441), status = 0x1
Mar 16 00:59:57 sulimov pptp[2488]: anon warn[open_unixsock:pptp_callmgr.c:348]: Call manager for 172.16.4.1 is already running.
Mar 16 00:59:57 sulimov pptp[2488]: anon fatal[callmgr_main:pptp_callmgr.c:129]: Could not open unix socket for 172.16.4.1
Mar 16 00:59:57 sulimov pptp[2451]: anon fatal[open_callmgr:pptp.c:487]: Call manager exited with error 256
Mar 16 00:59:57 sulimov pppd[2424]: Script pptp ppp.inetvl.ru --nolaunchpppd finished (pid 2447), status = 0x1
Mar 16 00:59:57 sulimov pptp[2491]: anon log[ctrlp_disp:pptp_ctrl.c:858]: Received Outgoing Call Reply.
Mar 16 00:59:57 sulimov pptp[2491]: anon log[ctrlp_disp:pptp_ctrl.c:897]: Outgoing call established (call ID 0, peer's call ID 49250).
Mar 16 00:59:57 sulimov pptp[2460]: anon warn[decaps_hdlc:pptp_gre.c:204]: short read (-1): Input/output error
Mar 16 00:59:57 sulimov pptp[2460]: anon warn[decaps_hdlc:pptp_gre.c:216]: pppd may have shutdown, see pppd log
Mar 16 00:59:57 sulimov pptp[2491]: anon log[callmgr_main:pptp_callmgr.c:234]: Closing connection (unhandled)
Mar 16 00:59:57 sulimov pptp[2491]: anon log[ctrlp_rep:pptp_ctrl.c:251]: Sent control packet type is 12 'Call-Clear-Request'
Mar 16 00:59:57 sulimov pppd[2424]: Script pptp ppp.inetvl.ru --nolaunchpppd finished (pid 2455), status = 0x0
Mar 16 00:59:57 sulimov pptp[2491]: anon log[ctrlp_disp:pptp_ctrl.c:858]: Received Outgoing Call Reply.
Mar 16 00:59:57 sulimov pptp[2491]: anon log[ctrlp_disp:pptp_ctrl.c:897]: Outgoing call established (call ID 1, peer's call ID 49251).
Mar 16 00:59:57 sulimov pptp[2469]: anon warn[decaps_hdlc:pptp_gre.c:204]: short read (-1): Input/output error
Mar 16 00:59:57 sulimov pptp[2469]: anon warn[decaps_hdlc:pptp_gre.c:216]: pppd may have shutdown, see pppd log
Mar 16 00:59:57 sulimov pptp[2491]: anon log[callmgr_main:pptp_callmgr.c:234]: Closing connection (unhandled)
Mar 16 00:59:57 sulimov pptp[2491]: anon log[ctrlp_rep:pptp_ctrl.c:251]: Sent control packet type is 12 'Call-Clear-Request'
Mar 16 00:59:57 sulimov pppd[2424]: Script pptp ppp.inetvl.ru --nolaunchpppd finished (pid 2464), status = 0x0
Mar 16 00:59:57 sulimov pptp[2491]: anon log[ctrlp_disp:pptp_ctrl.c:858]: Received Outgoing Call Reply.
Mar 16 00:59:57 sulimov pptp[2491]: anon log[ctrlp_disp:pptp_ctrl.c:897]: Outgoing call established (call ID 2, peer's call ID 49252).
Mar 16 00:59:57 sulimov pptp[2478]: anon warn[decaps_hdlc:pptp_gre.c:204]: short read (-1): Input/output error
Mar 16 00:59:57 sulimov pptp[2478]: anon warn[decaps_hdlc:pptp_gre.c:216]: pppd may have shutdown, see pppd log
Mar 16 00:59:57 sulimov pptp[2491]: anon log[callmgr_main:pptp_callmgr.c:234]: Closing connection (unhandled)
Mar 16 00:59:57 sulimov pptp[2491]: anon log[ctrlp_rep:pptp_ctrl.c:251]: Sent control packet type is 12 'Call-Clear-Request'
Mar 16 00:59:57 sulimov pppd[2424]: Script pptp ppp.inetvl.ru --nolaunchpppd finished (pid 2473), status = 0x0
Mar 16 00:59:57 sulimov pptp[2491]: anon log[ctrlp_disp:pptp_ctrl.c:858]: Received Outgoing Call Reply.
Mar 16 00:59:57 sulimov pptp[2491]: anon log[ctrlp_disp:pptp_ctrl.c:897]: Outgoing call established (call ID 3, peer's call ID 49253).
Mar 16 00:59:57 sulimov pptp[2486]: anon warn[decaps_hdlc:pptp_gre.c:204]: short read (-1): Input/output error
Mar 16 00:59:57 sulimov pptp[2486]: anon warn[decaps_hdlc:pptp_gre.c:216]: pppd may have shutdown, see pppd log
Mar 16 00:59:57 sulimov pptp[2491]: anon log[callmgr_main:pptp_callmgr.c:234]: Closing connection (unhandled)
Mar 16 00:59:57 sulimov pptp[2491]: anon log[ctrlp_rep:pptp_ctrl.c:251]: Sent control packet type is 12 'Call-Clear-Request'
Mar 16 00:59:57 sulimov pptp[2491]: anon log[call_callback:pptp_callmgr.c:79]: Closing connection (call state)
Mar 16 00:59:57 sulimov pptp[2491]: anon log[call_callback:pptp_callmgr.c:79]: Closing connection (call state)
Mar 16 00:59:57 sulimov pppd[2424]: Script pptp ppp.inetvl.ru --nolaunchpppd finished (pid 2480), status = 0x0
Mar 16 00:59:58 sulimov pptp[2502]: anon log[ctrlp_rep:pptp_ctrl.c:251]: Sent control packet type is 1 'Start-Control-Connection-Request'
Mar 16 00:59:58 sulimov pptp[2502]: anon log[ctrlp_disp:pptp_ctrl.c:739]: Received Start Control Connection Reply
Mar 16 00:59:58 sulimov pptp[2502]: anon log[ctrlp_disp:pptp_ctrl.c:773]: Client connection established.
Mar 16 00:59:59 sulimov pptp[2502]: anon log[ctrlp_rep:pptp_ctrl.c:251]: Sent control packet type is 7 'Outgoing-Call-Request'
Mar 16 00:59:59 sulimov pptp[2502]: anon log[ctrlp_disp:pptp_ctrl.c:858]: Received Outgoing Call Reply.
Mar 16 00:59:59 sulimov pptp[2502]: anon log[ctrlp_disp:pptp_ctrl.c:897]: Outgoing call established (call ID 0, peer's call ID 49254).
Mar 16 00:59:59 sulimov pptp[2428]: anon warn[decaps_hdlc:pptp_gre.c:204]: short read (-1): Input/output error
Mar 16 00:59:59 sulimov pptp[2428]: anon warn[decaps_hdlc:pptp_gre.c:216]: pppd may have shutdown, see pppd log
Mar 16 00:59:59 sulimov pptp[2502]: anon log[callmgr_main:pptp_callmgr.c:234]: Closing connection (unhandled)
Mar 16 00:59:59 sulimov pptp[2502]: anon log[ctrlp_rep:pptp_ctrl.c:251]: Sent control packet type is 12 'Call-Clear-Request'
Mar 16 00:59:59 sulimov pptp[2502]: anon log[call_callback:pptp_callmgr.c:79]: Closing connection (call state)
Mar 16 00:59:59 sulimov pppd[2424]: Script pptp ppp.inetvl.ru --nolaunchpppd finished (pid 2425), status = 0x0
Mar 16 00:59:59 sulimov pppd[2424]: Exit.

лично я эту филькину грамоту вкурить не могу....

[fisher74]

Признаться, я тоже 
посмотрел на своём DD-WRT настройку pptp

Код: [Выделить]

defaultroute
usepeerdns
pty 'pptp 172.19.0.1 --nolaunchpppd --nobuffer'
user 'login_vpn_user'
nomppe
noccp
default-asyncmap
nopcomp
noaccomp
novj
nobsdcomp
nodeflate
lcp-echo-failure 6
lcp-echo-interval 3
noipdefault
lock
noauthПользователь решил продолжить мысль 15 Марта 2011, 18:18:37:Хотя смущает строка

pptp: ....The synchronous pptp option is NOT activated

попробуйте к своему добавить default-asyncmap

[s_lim]

вобщем раскурил я эту филькину грамоту - оказывается сообщение

Код: [Выделить]

Mar 16 00:59:57 sulimov pppd[2424]: Couldn't set tty to PPP discipline: Invalid argumentговорит о том что не хватает жизненно необходимого модуля ядра - ppp_async
получается что вместе с обновлениями безопасности я получил ядро 2.6.35-27 без этого модуля...
после отката на ядро 2.6.35-25 (с данным модулем) ррр0 поднялось и функционирует без проблем