Freeradius crashing due to load?

8zero2 operations 8zero2ops at gmail.com
Thu Mar 1 08:29:58 CET 2018


Hi,

I am attaching error logs of freeradius getting crashed randomly during day.

Thu Mar  1 11:45:22 2018 : Info: (1304581) eap_peap:   Look for "reject" or
"fail".  Those earlier messages will tell you

Thu Mar  1 11:45:22 2018 : Info: (1304581) eap_peap:   what went wrong, and
how to fix the problem

Thu Mar  1 11:45:24 2018 : Info: rlm_sql (sql): Need 7 more connections to
reach 10 spares

Thu Mar  1 11:45:24 2018 : Info: rlm_sql (sql): Opening additional
connection (3869), 1 of 21 pending slots used

Thu Mar  1 11:45:24 2018 : Info: rlm_sql (sql): Need 6 more connections to
reach 10 spares

Thu Mar  1 11:45:24 2018 : Info: rlm_sql (sql): Opening additional
connection (3870), 2 of 21 pending slots used

Thu Mar  1 11:45:24 2018 : Info: rlm_sql (sql): Need 5 more connections to
reach 10 spares

Thu Mar  1 11:45:24 2018 : Info: rlm_sql (sql): Opening additional
connection (3871), 3 of 21 pending slots used

Thu Mar  1 11:45:24 2018 : Info: rlm_sql (sql): Need 4 more connections to
reach 10 spares

Thu Mar  1 11:45:24 2018 : Info: rlm_sql (sql): Opening additional
connection (3872), 4 of 21 pending slots used

Thu Mar  1 11:45:24 2018 : Error: (1304488) Ignoring duplicate packet from
client XXXXXXXX port 44953 - ID: 35 due to unfinished request in component
authorize module

Thu Mar  1 11:45:24 2018 : Info: rlm_sql (sql): Need 3 more connections to
reach 10 spares

Thu Mar  1 11:45:24 2018 : Info: rlm_sql (sql): Opening additional
connection (3873), 5 of 21 pending slots used

Thu Mar  1 11:45:24 2018 : Info: rlm_sql (sql): Need 2 more connections to
reach 10 spares

Thu Mar  1 11:45:24 2018 : Info: rlm_sql (sql): Opening additional
connection (3874), 6 of 21 pending slots used

Thu Mar  1 11:45:24 2018 : Info: rlm_sql (sql): Need 1 more connections to
reach 10 spares

Thu Mar  1 11:45:24 2018 : Info: rlm_sql (sql): Opening additional
connection (3875), 7 of 21 pending slots used

Thu Mar  1 11:45:24 2018 : Info: (1304661) eap_peap:   The users session
was previously rejected: returning reject (again.)

Thu Mar  1 11:45:24 2018 : Info: (1304661) eap_peap:   This means you need
to read the PREVIOUS messages in the debug output

Thu Mar  1 11:45:24 2018 : Info: (1304661) eap_peap:   to find out the
reason why the user was rejected

Thu Mar  1 11:45:24 2018 : Info: (1304661) eap_peap:   Look for "reject" or
"fail".  Those earlier messages will tell you

Thu Mar  1 11:45:24 2018 : Info: (1304661) eap_peap:   what went wrong, and
how to fix the problem

Thu Mar  1 11:45:25 2018 : Error: (1304618) Ignoring duplicate packet from
client XXXXXXXX port 59536 - ID: 16 due to unfinished request in component
accounting module

Thu Mar  1 11:45:26 2018 : Error: (1304488) Ignoring duplicate packet from
client XXXXXXXX port 44953 - ID: 35 due to unfinished request in component
authorize module

Thu Mar  1 11:45:26 2018 : Error: (1304633) Ignoring duplicate packet from
client XXXXXXXX port 41018 - ID: 188 due to unfinished request in component
accounting module

Thu Mar  1 11:45:26 2018 : Error: rlm_eap (EAP): No EAP session matching
state 0x947bd4f29372cdbc

Thu Mar  1 11:45:26 2018 : Error: rlm_eap (EAP): No EAP session matching
state 0x947bd4f29372cdbc

Thu Mar  1 11:45:27 2018 : Error: (1304618) Ignoring duplicate packet from
client XXXXXXXX port 59536 - ID: 16 due to unfinished request in component
accounting module

Thu Mar  1 11:45:28 2018 : Error: (1304488) Ignoring duplicate packet from
client XXXXXXXX port 44953 - ID: 35 due to unfinished request in component
authorize module

Thu Mar  1 11:45:28 2018 : ERROR: (1304488)         ERROR: Timeout waiting
for child

Thu Mar  1 11:45:28 2018 : Error: (1304633) Ignoring duplicate packet from
client XXXXXXXX port 41018 - ID: 188 due to unfinished request in component
accounting module

Thu Mar  1 11:45:29 2018 : Error: (1304618) Ignoring duplicate packet from
client XXXXXXXX port 59536 - ID: 16 due to unfinished request in component
accounting module

Thu Mar  1 11:45:30 2018 : Error: (1304633) Ignoring duplicate packet from
client XXXXXXXX port 41018 - ID: 188 due to unfinished request in component
accounting module

Thu Mar  1 11:45:30 2018 : Error: (1304757) Ignoring duplicate packet from
client XXXXXXXX port 44953 - ID: 54 due to unfinished request in component
authorize module

Thu Mar  1 11:45:31 2018 : Error: (1304618) Ignoring duplicate packet from
client XXXXXXXX port 59536 - ID: 16 due to unfinished request in component
accounting module

Thu Mar  1 11:45:32 2018 : Error: (1304633) Ignoring duplicate packet from
client XXXXXXXX port 41018 - ID: 188 due to unfinished request in component
accounting module

Thu Mar  1 11:45:32 2018 : Error: (1304757) Ignoring duplicate packet from
client XXXXXXXX port 44953 - ID: 54 due to unfinished request in component
authorize module

Thu Mar  1 11:45:32 2018 : Error: rlm_eap (EAP): No EAP session matching
state 0x3b06b4a33e01ad19

Thu Mar  1 11:45:32 2018 : Error: rlm_eap (EAP): No EAP session matching
state 0x3b06b4a33e01ad19

Thu Mar  1 11:45:33 2018 : Error: (1304618) Ignoring duplicate packet from
client XXXXXXXX port 59536 - ID: 16 due to unfinished request in component
accounting module

Thu Mar  1 11:45:34 2018 : Error: (1304633) Ignoring duplicate packet from
client XXXXXXXX port 41018 - ID: 188 due to unfinished request in component
accounting module

Thu Mar  1 11:45:34 2018 : Error: rlm_eap (EAP): No EAP session matching
state 0x4aaec49748aadd2b

Thu Mar  1 11:45:34 2018 : Error: rlm_eap (EAP): No EAP session matching
state 0x4aaec49748aadd2b

Thu Mar  1 11:45:34 2018 : ERROR: (1304618)       ERROR: Timeout waiting
for child

Thu Mar  1 11:45:34 2018 : ERROR: (1304633)       ERROR: Timeout waiting
for child

This is the last log which comes.

I have database server modules enabled of sql and ldap. I have monitored
them and there is no considerable load on them when this crash happens.
I know some module is timing out but i cant quite figure out which. I
cannot run it in debug as the crash happens randomly during the day and I
have huge amount of users authenticating.

How can I debug it and find which module is unresponsive while crash? Just
point a finger to a direction i will find the way.

PS: freeradius is an awesome software so a big thanks to developers Allan ,
Arran and everybody

Regards,
Anirudh Malhotra
Mail: 8zero2.in at gmail.com
Facebook: www.facebook.com/8zero2
Twitter: @8zero2_in
Blog: blog.8zero2.in


More information about the Freeradius-Users mailing list