RV: FreeRadius 3.0.6 failed

Oscar Jofre oscar at jofre.com
Tue Oct 27 23:50:47 CET 2015


Hi,

I have configuring a new FreeRadius 3.0.6 on Centos7 and MariaDB.

Is has been working ok (had to increase max connextion and other values) but
now I'm getting the radius down every time.

MariaDB has radacct with over 10.000.000 rows.
I'm connecting 10.000 PPTP users authentication with this Radius, Interim
every 30seconds and client-pptp-session 10minutes, but after start mariadb
and freeradius exits with this message:

[root at rad ~]# systemctl status radiusd
radiusd.service - FreeRADIUS high performance RADIUS server.
   Loaded: loaded (/usr/lib/systemd/system/radiusd.service; disabled)
   Active: failed (Result: signal) since mar 2015-10-27 22:41:14 CET; 17min
ago
  Process: 12086 ExecStart=/usr/sbin/radiusd -d /etc/raddb (code=exited,
status=0/SUCCESS)
  Process: 12083 ExecStartPre=/usr/sbin/radiusd -C (code=exited,
status=0/SUCCESS)
  Process: 12080 ExecStartPre=/bin/chown -R radiusd.radiusd /var/run/radiusd
(code=exited, status=0/SUCCESS)  Main PID: 12090 (code=killed, signal=ABRT)
   CGroup: /system.slice/radiusd.service

oct 27 22:36:16 rad.aaa.com systemd[1]: Starting FreeRADIUS high performance
RADIUS server....
oct 27 22:36:17 rad.aaa.com systemd[1]: Started FreeRADIUS high performance
RADIUS server..
oct 27 22:41:14 rad.aaa.com systemd[1]: radiusd.service: main process
exited, code=killed, status=6/ABRT oct 27 22:41:14 rad.aaa.com systemd[1]:
Unit radiusd.service entered failed state.

Last Lines from radius.log


Tue Oct 27 23:14:20 2015 : ERROR: (73758) ERROR: <queue> : Received
conflicting packet from client 0.0.0.0/0 port 53359 - ID: 220 due to
unfinished request.  Giving up on old request.
Tue Oct 27 23:14:20 2015 : ERROR: (73736)  ERROR: detail : Received
conflicting packet from client 0.0.0.0/0 port 48163 - ID: 146 due to
unfinished request.  Giving up on old request.
Tue Oct 27 23:14:20 2015 : ERROR: (73737)  ERROR: detail : Received
conflicting packet from client 0.0.0.0/0 port 59445 - ID: 144 due to
unfinished request.  Giving up on old request.
Tue Oct 27 23:14:20 2015 : Warning: No such configuration item .type..query
Tue Oct 27 23:14:20 2015 : Warning: No such configuration item .type..query
Tue Oct 27 23:14:20 2015 : ERROR: (73751) ERROR: <queue> : Received
conflicting packet from client 0.0.0.0/0 port 33445 - ID: 148 due to
unfinished request.  Giving up on old request.
Tue Oct 27 23:14:20 2015 : ERROR: (73757) ERROR: <queue> : Received
conflicting packet from client 0.0.0.0/0 port 53686 - ID: 147 due to
unfinished request.  Giving up on old request.
Tue Oct 27 23:14:20 2015 : Warning: No such configuration item .type..query
Tue Oct 27 23:14:20 2015 : ERROR: (73752)  ERROR: detail : Received
conflicting packet from client 0.0.0.0/0 port 43723 - ID: 144 due to
unfinished request.  Giving up on old request.
Tue Oct 27 23:14:20 2015 : ERROR: (73753)  ERROR: sql : Received conflicting
packet from client 0.0.0.0/0 port 44422 - ID: 145 due to unfinished request.
Giving up on old request.

Also I have all this warnings/errors on log. What is really important to fix
and how ??? 

1)  START RADIUS

Tue Oct 27 22:36:17 2015 : Warning: No 'ipaddr' or 'ipv4addr' or 'ipv6addr'
field found in client 0.0.0.0/0.  Please fix your configuration Tue Oct 27
22:36:17 2015 : Warning: Support for old-style clients will be removed in a
future release Tue Oct 27 22:36:17 2015 : Info: rlm_sql (sql): Driver
rlm_sql_mysql (module
rlm_sql_mysql) loaded and linked
Tue Oct 27 22:36:17 2015 : Info: rlm_sql (sql): Attempting to connect to
database "radius"
Tue Oct 27 22:36:17 2015 : Info: Loaded virtual server <default> Tue Oct 27
22:36:17 2015 : Warning: Ignoring "ldap" (see
raddb/mods-available/README.rst)
Tue Oct 27 22:36:17 2015 : Info: Loaded virtual server default Tue Oct 27
22:36:17 2015 : Info: Loaded virtual server inner-tunnel Tue Oct 27 22:36:17
2015 : Warning: No 'ipaddr' or 'ipv4addr' or 'ipv6addr'
field found in client 0.0.0.0/0.  Please fix your configuration Tue Oct 27
22:36:17 2015 : Warning: Support for old-style clients will be removed in a
future release Tue Oct 27 22:36:17 2015 : Info: rlm_sql (sql): Driver
rlm_sql_mysql (module
rlm_sql_mysql) loaded and linked
Tue Oct 27 22:36:17 2015 : Info: rlm_sql (sql): Attempting to connect to
database "radius"
Tue Oct 27 22:36:17 2015 : Info: rlm_sql (sql): Opening additional
connection (0) Tue Oct 27 22:36:17 2015 : Info: Loaded virtual server
<default> Tue Oct 27 22:36:17 2015 : Warning: Ignoring "ldap" (see
raddb/mods-available/README.rst)
Tue Oct 27 22:36:17 2015 : Info: Loaded virtual server default Tue Oct 27
22:36:17 2015 : Info: Loaded virtual server inner-tunnel Tue Oct 27 22:36:17
2015 : Info: Ready to process requests


2)

Tue Oct 27 22:36:17 2015 : Warning: rlm_sql (sql): 1 of 1 connections in
use.  You probably need to increase "spare"
Tue Oct 27 22:36:17 2015 : Info: rlm_sql (sql): Opening additional
connection (1) Tue Oct 27 22:36:17 2015 : Warning: rlm_sql (sql): 2 of 2
connections in use.  You probably need to increase "spare"
Tue Oct 27 22:36:17 2015 : Info: rlm_sql (sql): Opening additional
connection (2) Tue Oct 27 22:36:17 2015 : Warning: rlm_sql (sql): 3 of 3
connections in use.  You probably need to increase "spare"
Tue Oct 27 22:36:17 2015 : Info: rlm_sql (sql): Opening additional
connection (3) Tue Oct 27 22:36:17 2015 : Info: rlm_sql (sql): 3 of 4
connections in use.
Need more spares
Tue Oct 27 22:36:17 2015 : Info: rlm_sql (sql): Opening additional
connection (4) Tue Oct 27 22:36:17 2015 : Info: rlm_sql (sql): 2 of 4
connections in use.
Need more spares

3)


Tue Oct 27 22:36:51 2015 : ERROR: (4217)  ERROR: sql : Received conflicting
packet from client 0.0.0.0/0 port 39418 - ID: 59 due to unfinished request.
Giving up on old request.
Tue Oct 27 22:36:51 2015 : ERROR: (4220)  ERROR: sql : Received conflicting
packet from client 0.0.0.0/0 port 50628 - ID: 62 due to unfinished request.
Giving up on old request.
Tue Oct 27 22:36:51 2015 : ERROR: (4221)  ERROR: sql : Received conflicting
packet from client 0.0.0.0/0 port 55753 - ID: 63 due to unfinished request.
Giving up on old request.
Tue Oct 27 22:36:51 2015 : ERROR: (4224)  ERROR: sql : Received conflicting
packet from client 0.0.0.0/0 port 41959 - ID: 66 due to unfinished request.
Giving up on old request.
Tue Oct 27 22:36:51 2015 : ERROR: (4229)  ERROR: sql : Received conflicting
packet from client 0.0.0.0/0 port 57022 - ID: 71 due to unfinished request.
Giving up on old request.
Tue Oct 27 22:36:52 2015 : ERROR: (4260)  ERROR: sql : Received conflicting
packet from client 0.0.0.0/0 port 45267 - ID: 104 due to unfinished request.
Giving up on old request.
Tue Oct 27 22:36:52 2015 : ERROR: (4287)  ERROR: sql : Received conflicting
packet from client 0.0.0.0/0 port 47887 - ID: 120 due to unfinished request.
Giving up on old request.
Tue Oct 27 22:36:52 2015 : ERROR: (4292)  ERROR: sql : Received conflicting
packet from client 0.0.0.0/0 port 40463 - ID: 128 due to unfinished request.
Giving up on old request.
Tue Oct 27 22:36:52 2015 : ERROR: (4294)  ERROR: sql : Received conflicting
packet from client 0.0.0.0/0 port 44484 - ID: 129 due to unfinished request.
Giving up on old request.
Tue Oct 27 22:36:52 2015 : ERROR: (4303)  ERROR: sql : Received conflicting
packet from client 0.0.0.0/0 port 47015 - ID: 137 due to unfinished request.
Giving up on old request.
Tue Oct 27 22:36:52 2015 : ERROR: (4304)  ERROR: sql : Received conflicting
packet from client 0.0.0.0/0 port 48617 - ID: 138 due to unfinished request.
Giving up on old request.

4)



Tue Oct 27 22:36:54 2015 : Warning: No such configuration item .type..query
Tue Oct 27 22:36:54 2015 : Warning: No such configuration item .type..query
Tue Oct 27 22:36:54 2015 : Warning: No such configuration item .type..query
Tue Oct 27 22:36:54 2015 : Warning: No such configuration item .type..query
Tue Oct 27 22:36:54 2015 : Warning: No such configuration item .type..query
Tue Oct 27 22:36:54 2015 : Warning: No such configuration item .type..query
Tue Oct 27 22:36:54 2015 : Warning: No such configuration item .type..query
Tue Oct 27 22:36:54 2015 : Warning: No such configuration item .type..query
Tue Oct 27 22:36:54 2015 : Warning: No such configuration item .type..query
Tue Oct 27 22:36:54 2015 : Warning: No such configuration item .type..query

5)


Tue Oct 27 22:37:04 2015 : Error: (7162) Ignoring duplicate packet from
client 0.0.0.0/0 port 47432 - ID: 116 due to unfinished request in component
<core> module <queue>

6)


Tue Oct 27 22:37:09 2015 : Error: rlm_sql (sql): Duplicate entry
'30a1ada7fbf7328ec740200d6042f02b' for key 'acctuniqueid'
Tue Oct 27 22:37:09 2015 : Error: rlm_sql_mysql: Cannot store result Tue Oct
27 22:37:09 2015 : Error: rlm_sql_mysql: MySQL error 'Duplicate entry
'30a1ada7fbf7328ec740200d6042f02b' for key 'acctuniqueid''

Tue Oct 27 22:40:14 2015 : Error: rlm_sql (sql): Duplicate entry
'51208897d76ba70d93d0a5d4486b3622' for key 'acctuniqueid'
Tue Oct 27 22:40:14 2015 : Error: rlm_sql_mysql: Cannot store result Tue Oct
27 22:40:14 2015 : Error: rlm_sql_mysql: MySQL error 'Duplicate entry
'51208897d76ba70d93d0a5d4486b3622' for key 'acctuniqueid''
Tue Oct 27 22:40:14 2015 : Error: rlm_sql (sql): Duplicate entry
'a2ccf69a14f3eb13105c3a5df8dcb81f' for key 'acctuniqueid'
Tue Oct 27 22:40:14 2015 : Error: rlm_sql_mysql: Cannot store result Tue Oct
27 22:40:14 2015 : Error: rlm_sql_mysql: MySQL error 'Duplicate entry
'a2ccf69a14f3eb13105c3a5df8dcb81f' for key 'acctuniqueid''
Tue Oct 27 22:40:14 2015 : Error: rlm_sql (sql): Duplicate entry
'b92b5f282a678d6edfec278fc07a057a' for key 'acctuniqueid'
Tue Oct 27 22:40:14 2015 : Error: rlm_sql_mysql: Cannot store result Tue Oct
27 22:40:14 2015 : Error: rlm_sql_mysql: MySQL error 'Duplicate entry
'b92b5f282a678d6edfec278fc07a057a' for key 'acctuniqueid''
Tue Oct 27 22:40:16 2015 : Error: rlm_sql (sql): Duplicate entry
'4b8983776731b1f5da36b35a1a53d9fa' for key 'acctuniqueid'
Tue Oct 27 22:40:16 2015 : Error: rlm_sql_mysql: Cannot store result Tue Oct
27 22:40:16 2015 : Error: rlm_sql_mysql: MySQL error 'Duplicate entry
'4b8983776731b1f5da36b35a1a53d9fa' for key 'acctuniqueid''
Tue Oct 27 22:40:17 2015 : Error: rlm_sql (sql): Duplicate entry
'61cb092a85b6a15acf5d79cfb60855d6' for key 'acctuniqueid'
Tue Oct 27 22:40:17 2015 : Error: rlm_sql_mysql: Cannot store result Tue Oct
27 22:40:17 2015 : Error: rlm_sql_mysql: MySQL error 'Duplicate entry
'61cb092a85b6a15acf5d79cfb60855d6' for key 'acctuniqueid''
Tue Oct 27 22:40:17 2015 : Error: rlm_sql (sql): Duplicate entry
'39df97f43a022814b698ebfa18065f02' for key 'acctuniqueid'
Tue Oct 27 22:40:17 2015 : Error: rlm_sql_mysql: Cannot store result Tue Oct
27 22:40:17 2015 : Error: rlm_sql_mysql: MySQL error 'Duplicate entry
'39df97f43a022814b698ebfa18065f02' for key 'acctuniqueid''
Tue Oct 27 22:40:17 2015 : Error: rlm_sql (sql): Duplicate entry
'370a69125a04214aae019cecdccac86d' for key 'acctuniqueid'
Tue Oct 27 22:40:17 2015 : Error: rlm_sql_mysql: Cannot store result Tue Oct
27 22:40:17 2015 : Error: rlm_sql_mysql: MySQL error 'Duplicate entry
'370a69125a04214aae019cecdccac86d' for key 'acctuniqueid''
Tue Oct 27 22:40:17 2015 : Error: rlm_sql (sql): Duplicate entry
'78108b526c3d18d0fbb5c330fae5b770' for key 'acctuniqueid'
Tue Oct 27 22:40:17 2015 : Error: rlm_sql_mysql: Cannot store result Tue Oct
27 22:40:17 2015 : Error: rlm_sql_mysql: MySQL error 'Duplicate entry
'78108b526c3d18d0fbb5c330fae5b770' for key 'acctuniqueid''
Tue Oct 27 22:40:17 2015 : Error: rlm_sql (sql): Duplicate entry
'337e085c9a8d7cde42499a130cb2d6fb' for key 'acctuniqueid'
Tue Oct 27 22:40:17 2015 : Error: rlm_sql_mysql: Cannot store result


7)


Tue Oct 27 22:38:36 2015 : Error: Unresponsive child for request 11202, in
component <core> module Tue Oct 27 22:38:36 2015 : Error: Unresponsive child
for request 11201, in component <core> module Tue Oct 27 22:38:36 2015 :
Error: Unresponsive child for request 11199, in component <core> module Tue
Oct 27 22:38:36 2015 : Error: Unresponsive child for request 11206, in
component <core> module Tue Oct 27 22:38:36 2015 : Error: Unresponsive child
for request 11205, in component <core> module Tue Oct 27 22:38:36 2015 :
Error: Unresponsive child for request 11212, in component <core> module




Thanks.




More information about the Freeradius-Users mailing list