отваливается радиус при массовых дисконнектах PPPoE

Bug reports
Post Reply
NiTr0
Posts: 28
Joined: 18 Apr 2015, 11:11

отваливается радиус при массовых дисконнектах PPPoE

Post by NiTr0 »

при массовых дисконнектах клиента аксель (коммит fd46f0d, март) почему-то прекращает слать радиус запросы коннекта/дисконнекта.

выглядит это примерно так в логах:

Code: Select all

Jul 19 15:02:37 127 accel-pppd: ppp35:<CLIENT>: connect: ppp35 <--> pppoe(MAC)
Jul 19 15:02:37 127 accel-pppd: ppp424:<CLIENT>: send [RADIUS(1) Accounting-Request id=6 <User-Name "<CLIENT>"> <NAS-Identifier "accel-ppp"> <NAS-IP-Address 192.168.255.65> <NAS-Port 424> <NAS-Port-Id "ppp424"> <NAS-Port-Type Virtual> <Service-Type Framed-User> <Framed-Protocol PPP> <Calling-Station-Id "MAC"> <Called-Station-Id "MAC"> <Acct-Status-Type Stop> <Acct-Authentic RADIUS> <Acct-Session-Id "3656108fd03b9c6c"> <Acct-Session-Time 508> 
<Acct-Input-Octets 3666> <Acct-Output-Octets 3755> <Acct-Input-Packets 54> <Acct-Output-Packets 38> <Acct-Input-Gigawords 0> <Acct-Output-Gigawords 0> <Framed-IP-Address IP> <Acct-Terminate-Cause Lost-Carrier>]
Jul 19 15:02:37 127 accel-pppd: ppp424:: disconnected
Jul 19 15:02:37 127 accel-pppd: ppp283:<CLIENT>: lcp: no echo reply
Jul 19 15:02:37 127 accel-pppd: ppp146:<CLIENT>: send [RADIUS(1) Accounting-Request id=3e <User-Name "<CLIENT>"> <NAS-Identifier "accel-ppp"> <NAS-IP-Address 192.168.255.65> <NAS-Port 146> <NAS-Port-Id "ppp146"> <NAS-Port-Type Virtual> <Service-Type Framed-User> <Framed-Protocol PPP> <Calling-Station-Id "MAC"> <Called-Station-Id "MAC"> <Acct-Status-Type Stop> <Acct-Authentic RADIUS> <Acct-Session-Id "3656108fd03b95d5"> <Acct-Session-Time 7290> <Acct-
Input-Octets 287339721> <Acct-Output-Octets 1996686437> <Acct-Input-Packets 2167777> <Acct-Output-Packets 5264401> <Acct-Input-Gigawords 0> <Acct-Output-Gigawords 1> <Framed-IP-Address IP> <Acct-Terminate-Cause Lost-Carrier>]
Jul 19 15:02:37 127 accel-pppd: ppp35:<CLIENT>: <CLIENT>: authentication succeeded
Jul 19 15:02:37 127 accel-pppd: ppp35:<CLIENT>: send [RADIUS(1) Accounting-Request id=1 <User-Name "<CLIENT>"> <NAS-Identifier "accel-ppp"> <NAS-IP-Address 192.168.255.65> <NAS-Port 35> <NAS-Port-Id "ppp35"> <NAS-Port-Type Virtua
l> <Service-Type Framed-User> <Framed-Protocol PPP> <Calling-Station-Id "MAC"> <Called-Station-Id "MAC"> <Acct-Status-Type Start> <Acct-Authentic RADIUS> <Acct-Session-Id "3656108fd03b9d96"> <Acct-Session-Time
 0> <Acct-Input-Octets 0> <Acct-Output-Octets 0> <Acct-Input-Packets 0> <Acct-Output-Packets 0> <Acct-Input-Gigawords 0> <Acct-Output-Gigawords 0> <Framed-IP-Address IP>]
Jul 19 15:02:37 127 accel-pppd: ppp146:: disconnected
Jul 19 15:02:38 127 accel-pppd: ppp283:: disconnected
Jul 19 15:02:38 127 accel-pppd: ppp51:<CLIENT>: lcp: no echo reply
Jul 19 15:02:38 127 accel-pppd: ppp139:<CLIENT>: lcp: no echo reply
Jul 19 15:02:38 127 accel-pppd: ppp148:<CLIENT>: lcp: no echo reply
Jul 19 15:02:38 127 accel-pppd: ppp35:<CLIENT>: recv [RADIUS(1) Accounting-Response id=1]
Jul 19 15:02:38 127 accel-pppd: recv [RADIUS(1) Accounting-Response id=3e]
Jul 19 15:02:38 127 accel-pppd: ppp618:<CLIENT>: lcp: no echo reply
Jul 19 15:02:38 127 accel-pppd: recv [RADIUS(1) Accounting-Response id=6]
Jul 19 15:02:38 127 accel-pppd: ppp148:: disconnected
Jul 19 15:02:38 127 accel-pppd: ppp51:: disconnected
Jul 19 15:02:38 127 accel-pppd: ppp139:: disconnected
Jul 19 15:02:38 127 accel-pppd: ppp618:: disconnected
Jul 19 15:02:38 127 accel-pppd: bond0.3600:: mschap-v2: timeout
Jul 19 15:02:39 127 accel-pppd: ppp308:<CLIENT>: lcp: no echo reply
Jul 19 15:02:39 127 accel-pppd: ppp308:: disconnected
Jul 19 15:02:39 127 accel-pppd: ppp329:<CLIENT>: lcp: no echo reply
Jul 19 15:02:39 127 accel-pppd: ppp93:<CLIENT>: lcp: no echo reply
Jul 19 15:02:39 127 accel-pppd: ppp513:<CLIENT>: lcp: no echo reply
Jul 19 15:02:39 127 accel-pppd: ppp59:<CLIENT>: lcp: no echo reply
Jul 19 15:02:40 127 accel-pppd: ppp330:<CLIENT>: lcp: no echo reply
....
Jul 19 15:02:48 127 accel-pppd: ppp93:: disconnected
Jul 19 15:02:48 127 accel-pppd: ppp329:: disconnected
Jul 19 15:02:48 127 accel-pppd: ppp330:: disconnected
Jul 19 15:02:48 127 accel-pppd: ppp513:: disconnected
Jul 19 15:02:48 127 accel-pppd: ppp679:: disconnected
Jul 19 15:02:48 127 accel-pppd: ppp59:: disconnected
Jul 19 15:02:48 127 accel-pppd: ppp207:: disconnected
Jul 19 15:02:48 127 accel-pppd: ppp316:: disconnected
Jul 19 15:02:48 127 accel-pppd: ppp447:: disconnected
Jul 19 15:02:48 127 accel-pppd: ppp510:: disconnected
Jul 19 15:02:48 127 accel-pppd: ppp603:: disconnected
Jul 19 15:02:48 127 accel-pppd: ppp237:: disconnected
....
Jul 19 15:19:06 127 accel-pppd: bond0.1406:: disconnected
Jul 19 15:19:23 127 accel-pppd: bond0.2304:: disconnected
Jul 19 15:19:29 127 accel-pppd: bond0.3600:: disconnected
Jul 19 15:19:32 127 accel-pppd: bond0.2612:: disconnected
Jul 19 15:19:47 127 accel-pppd: bond0.2602:: disconnected
Jul 19 15:19:49 127 accel-pppd: bond0.1406:: disconnected
Jul 19 15:20:00 127 accel-pppd: bond0.1812:: disconnected
Jul 19 15:20:00 127 accel-pppd: bond0.2305:: disconnected
Jul 19 15:20:02 127 accel-pppd: bond0.3600:: disconnected
Jul 19 15:20:26 127 accel-pppd: bond0.2503:: lcp: no echo reply
Jul 19 15:20:26 127 accel-pppd: bond0.2503:: disconnected
Jul 19 15:20:30 127 accel-pppd: bond0.2602:: disconnected
Jul 19 15:20:31 127 accel-pppd: bond0.3604:: disconnected
Jul 19 15:20:32 127 accel-pppd: bond0.1406:: disconnected
Jul 19 15:20:36 127 accel-pppd: bond0.3600:: disconnected
Jul 19 15:20:54 127 accel-pppd: bond0.3004:: disconnected
Jul 19 15:20:54 127 accel-pppd: bond0.3601:: mschap-v2: timeout
Jul 19 15:20:56 127 accel-pppd: bond0.2501:: lcp: no echo reply
Jul 19 15:20:56 127 accel-pppd: bond0.2501:: disconnected
Jul 19 15:20:59 127 accel-pppd: bond0.3601:: mschap-v2: timeout
Jul 19 15:21:04 127 accel-pppd: bond0.3601:: mschap-v2: timeout
Jul 19 15:21:04 127 accel-pppd: bond0.3601:: authentication failed
Jul 19 15:21:07 127 accel-pppd: bond0.2600:: disconnected
Jul 19 15:21:07 127 accel-pppd: bond0.3601:: disconnected
Jul 19 15:21:09 127 accel-pppd: bond0.3600:: disconnected
Jul 19 15:21:13 127 accel-pppd: bond0.2602:: disconnected
Jul 19 15:21:33 127 accel-pppd: bond0.1406:: disconnected
Jul 19 15:21:43 127 accel-pppd: bond0.3600:: disconnected
Jul 19 15:21:47 127 accel-pppd: bond0.2612:: disconnected
Jul 19 15:21:49 127 accel-pppd: bond0.2600:: disconnected
Jul 19 15:21:56 127 accel-pppd: bond0.2602:: disconnected
Jul 19 15:22:00 127 accel-pppd: bond0.1406:: disconnected
Jul 19 15:22:08 127 accel-pppd: bond0.3600:: lcp: no echo reply
Jul 19 15:22:08 127 accel-pppd: bond0.3600:: disconnected
Jul 19 15:22:16 127 accel-pppd: bond0.3600:: disconnected
Jul 19 15:22:31 127 accel-pppd: bond0.2600:: disconnected
Jul 19 15:22:33 127 accel-pppd: bond0.1406:: disconnected
Jul 19 15:22:33 127 accel-pppd: bond0.2503:: lcp: no echo reply
Jul 19 15:22:33 127 accel-pppd: bond0.2503:: disconnected
Jul 19 15:22:43 127 accel-pppd: bond0.2304:: disconnected
Jul 19 15:22:43 127 accel-pppd: bond0.2305:: mschap-v2: timeout
Jul 19 15:22:45 127 accel-pppd: bond0.2613:: disconnected
больше нигде ничего в логах нет. случается далеко не всегда, но на всех брасах с периодичностью раз в несколько дней/недель (т.е. от железа не зависит). проявилось после апдейта дистра/софта, на старой сборке 2+-летней давности не проявлялось.

вопрос: что сделать для более внятного дебага?
Top
dimka88
Posts: 872
Joined: 13 Oct 2014, 05:51
Contact:
Contact dimka88

Re: отваливается радиус при массовых дисконнектах PPPoE

Post by dimka88 »

NiTr0, привет. Сперва бы посмотреть состояние radius серверов в этот момент `accel-cmd show stat`
Еще нужно обратить внимание на journalctl/syslog/dmesg нет ли сообщений о каких либо лимитах с файловыми дескрипторами
Обрати внимание еще на core и emerge log, был ли там какой вывод?
Top
Post Reply

Return to “Bugs”