Hello Mohammed -

On Sun, 21 May 2000, Mohammed Ali wrote:
> Hi Hugh,
> 
> Here's some of my logfile, I also noticed that after the first
> accounting request the rest of the requests I get from ASCEND have "NULL"
> as the username and they are all inserted into my mSQL Accounting table.
> 
> P.S: my users flat file has the format:
> 
> test128       User-Password = "test128"
>         Service-Type = Framed-User,
>         Ascend-Metric = 2,
>         Ascend-Maximum-Channels = 2,
>         Ascend-Idle-Limit = 0,
>         Framed-Protocol = MPP,
>         Framed-Routing = None,
>         Framed-Compression = Van-Jacobson-TCP-IP
>         Framed-Address = 192.168.1.1,
>         Framed-Netmask = 255.255.255.0
> 
> thanks,
> [EMAIL PROTECTED]
> ------------------- snip of logfile ---------------------------
> 
> Sat May 20 14:27:42 2000: DEBUG: Reading users file
> /usr/ali/raddb/users_testmax
> Sat May 20 14:27:42 2000: INFO: Server started
> Sat May 20 14:28:47 2000: DEBUG: Packet dump:
> *** Received from 206.29.116.6 port 1025 ....
> Code:       Access-Request
> Identifier: 111
> Authentic:  x_G<175><203><186>MJ<145><173><210><206><140>d"Q
> Attributes:
>         User-Name = "test128"
>         User-Password = "#<11><200>h<181>Q<191>2"
>         NAS-Identifier = 206.29.116.6
>         NAS-Port = 20000
>         NAS-Port-Type = Virtual
>         Service-Type = Login-User
>         State = ""
>         Ascend-Third-Prompt = ""
>         Client-Port-DNIS = "<225>"
>         Acct-Session-Id = "269493545"
> 
> Sat May 20 14:28:47 2000: DEBUG: Handling request with Handler
> 'Realm=DEFAULT'
> Sat May 20 14:28:47 2000: DEBUG: Rewrote user name to test128
> Sat May 20 14:28:47 2000: DEBUG: Rewrote user name to test128
> Sat May 20 14:28:47 2000: DEBUG: Query is: select NAS_Identifier,
> NAS_Port, Acct_Session_Id from RADONLINE where Username='test128'
> 
> Sat May 20 14:28:47 2000: DEBUG: Handling with Radius::AuthSQL
> Sat May 20 14:28:47 2000: DEBUG: Handling with Radius::AuthFILE
> Sat May 20 14:28:47 2000: DEBUG: Radius::AuthFILE looks for match with
> test128
> Sat May 20 14:28:47 2000: DEBUG: Query is: select NAS_Identifier,
> NAS_Port, Acct_Session_Id from RADONLINE where Username='test128'
> 
> Sat May 20 14:28:47 2000: DEBUG: Radius::AuthFILE ACCEPT:
> Sat May 20 14:28:47 2000: DEBUG: Access accepted for test128
> Sat May 20 14:28:47 2000: DEBUG: Packet dump:
> *** Sending to 206.29.116.6 port 1025 ....
> Code:       Access-Accept
> Identifier: 111
> Authentic:  x_G<175><203><186>MJ<145><173><210><206><140>d"Q
> Attributes:
>         Service-Type = Framed-User
>         Ascend-Metric = 2
>         Ascend-Maximum-Channels = 2
>         Ascend-Idle-Limit = 0
>         Framed-Protocol = MPP
>         Framed-Routing = None
>         Framed-Compression = Van-Jacobson-TCP-IP        Framed-Address =
> 192.168.1
> .1
>          Framed-Netmask = 255.255.255.0
> 
> Sat May 20 14:28:47 2000: DEBUG: Packet dump:
> *** Received from 206.29.116.6 port 1033 ....
> Code:       Accounting-Request
> Identifier: 215
> Authentic:  ca'Q<249>N<132><251><189> <251><239><164><218><190><238>
> Attributes:
>         User-Name = "test128"
>         NAS-Identifier = 206.29.116.6
>         NAS-Port = 20000
>         NAS-Port-Type = Virtual
>         Acct-Status-Type = Start
>         Acct-Delay-Time = 0
>         Acct-Session-Id = "269493545"
>         Acct-Authentic = RADIUS
>         Client-Port-DNIS = "<2>"
>         Framed-Protocol = PPP
>         Framed-Address = 206.29.116.22
> 
> 
> Sat May 20 14:28:47 2000: DEBUG: Handling request with Handler
> 'Realm=DEFAULT'
> Sat May 20 14:28:47 2000: DEBUG: Rewrote user name to test128
> Sat May 20 14:28:47 2000: DEBUG: Rewrote user name to test128
> Sat May 20 14:28:47 2000: DEBUG: Handling with Radius::AuthSQL
> Sat May 20 14:28:47 2000: DEBUG: Handling accounting with Radius::AuthSQL
> Sat May 20 14:28:47 2000: DEBUG: do query is: insert into ACCOUNTING
>                 (Framed_Protocol, Username, NAS_Identifier, NAS_Port,
> Acct_Session
> _Id, the_time, Client_Port_DNIS, Framed_Address, Acct_Delay_Time,
> the_date, Acct_S
> tatus_Type)
>                 values
>                 ('PPP', 'test128', '206.29.116.6', 20000, '269493545',
> '14:28:47',
>  '^B', '206.29.116.22', 0, '20-05-2000', 'Start')
> 
> Sat May 20 14:28:47 2000: DEBUG:  Adding session for test128,
> 206.29.116.6, 20000
> Sat May 20 14:28:47 2000: DEBUG: do query is: delete from RADONLINE where
> Username
> ='test128' and NAS_Identifier='206.29.116.6' and NAS_Port=20000
> 
> Sat May 20 14:28:47 2000: DEBUG: do query is: insert into RADONLINE
> (Username, Tim
> e_Stamp, NAS_Identifier, NAS_Port, Acct_Session_Id, Framed_Address,
> Nas_Port_Type,
>  Service_Type) values ('test128', 958850927,'206.29.116.6', 20000,
> '269493545', ''
> , '', '')
> 
> Sat May 20 14:28:47 2000: DEBUG: Accounting accepted
> Sat May 20 14:28:47 2000: DEBUG: Packet dump:
> *** Sending to 206.29.116.6 port 1033 ....
> Code:       Accounting-Response
> Identifier: 215
> Authentic:  ca'Q<249>N<132><251><189> <251><239><164><218><190><238>
> Attributes:
> 

Thanks for sending the logfile, however there is nothing wrong with it. The log
correctly shows an Access-Request from the NAS, an Access-Accept returned to
the NAS, followed by an Accounting-Reqeust from the NAS to start the session,
and an Accounting-Accept retruned to the NAS. This is all perfectly normal.

You mention above something about additional requests from the NAS with a NULL
username. Could you send me more of the logfile showing what happens with them?

thanks

Hugh


-- 
Radiator: the most portable, flexible and configurable RADIUS server 
anywhere. SQL, proxy, DBM, files, LDAP, NIS+, password, NT, Emerald, 
Platypus, Freeside, Interbiller, TACACS+, PAM, external, etc, etc.
Available on Unix, Linux, FreeBSD, Windows 95/98/2000, NT, MacOS X.



===
Archive at http://www.starport.net/~radiator/
Announcements on [EMAIL PROTECTED]
To unsubscribe, email '[EMAIL PROTECTED]' with
'unsubscribe radiator' in the body of the message.

Reply via email to