incorrect password length - bug?

Pierre Belanger pbelang1 at oss.cantel.rogers.com
Wed Jan 29 19:42:56 GMT 2003


I forgot to mention this is under "LANMAN" . I attached
a debug 9 "output".

If the supplied password is not good, we shouldn't get
that far... I guess? Unless there's something I don't
get...

I tried to change in lanman.c api_SamOEMChangePassword to
"anon not Ok" by adding "True" for fun, didn't work ;-)

Regards,
Pierre B.


Pierre Belanger wrote:
> Hi,
> 
> Before writing this mail, I queried google (there's so
> many Samba installation hoping I could find an answer!).
> I did find an old message posted on samba-technical back in
> 2001 but my query did not lead me to *the* answer.
> 
> Reference:
> 
> http://lists.samba.org/pipermail/samba-technical/2001-August/015596.html
> 
> I was playing around with smbpasswd last night. I first thought
> something committed in CVS broke something, I checked all changes
> made since the past 1-2 days and found nothing :(  I than
> downgraded to an old copie of samba I kept and was quite surprised
> to see I was still having the same behavior!
> 
> Here we go. Using smbpasswd -r localhost -U <username>
> if you type in the wrong current (old) password, smbd
> reports:
> 
> [2003/01/29 14:13:05, 0] smbd/chgpasswd.c:check_oem_password(817)
> check_oem_password: incorrect password length (1980737076).
> 
> This value comes from new_pw_len = IVAL(lmdata, 512) in
> chgpasswd.c . I tried hard to find the reason, even with
> debug level @ 9, I caaaaan't :(
> 
> Same behavior under both 2.2.x and 3.0.
> 
> I have to admit it was a nice XP (experience) to dig around
> the source code. Perhaps I need better glasses, LOL! ;-)
> 
> Thank you,
> Pierre B.
> 

-------------- next part --------------
[2003/01/29 13:58:40, 6] param/loadparm.c:lp_file_list_changed(2328)
  lp_file_list_changed()
  file /usr/local/samba3/lib/smb.conf -> /usr/local/samba3/lib/smb.conf  last mod_time: Wed Jan 29 11:23:53 2003
  
[2003/01/29 13:58:40, 3] smbd/oplock.c:init_oplocks(1212)
  open_oplock_ipc: opening loopback UDP socket.
[2003/01/29 13:58:40, 3] smbd/oplock.c:init_oplocks(1243)
  open_oplock ipc: pid = 2344, global_oplock_port = 46477
[2003/01/29 13:58:40, 4] lib/time.c:get_serverzone(122)
  Serverzone is 18000
[2003/01/29 13:58:40, 3] lib/access.c:check_access(311)
  check_access: no hostnames in host allow/deny list.
[2003/01/29 13:58:40, 2] lib/access.c:check_access(322)
  Allowed connection from  (127.0.0.1)
[2003/01/29 13:58:40, 6] smbd/process.c:process_smb(881)
  got message type 0x0 of len 0xb3
[2003/01/29 13:58:40, 3] smbd/process.c:process_smb(882)
  Transaction 0 of length 183
[2003/01/29 13:58:40, 5] lib/util.c:show_msg(461)
[2003/01/29 13:58:40, 5] lib/util.c:show_msg(471)
  size=179
  smb_com=0x72
  smb_rcls=0
  smb_reh=0
  smb_err=0
  smb_flg=8
  smb_flg2=2049
  smb_tid=0
  smb_pid=2343
  smb_uid=0
  smb_mid=1
  smt_wct=0
  smb_bcc=144
[2003/01/29 13:58:40, 3] smbd/process.c:switch_message(676)
  switch message SMBnegprot (pid 2344)
[2003/01/29 13:58:40, 3] smbd/sec_ctx.c:set_sec_ctx(288)
  setting sec ctx (0, 0) - sec_ctx_stack_ndx = 0
[2003/01/29 13:58:40, 5] auth/auth_util.c:debug_nt_user_token(481)
  NT user token: (NULL)
[2003/01/29 13:58:40, 5] auth/auth_util.c:debug_unix_user_token(500)
  UNIX token of user 0
  Primary group is 0 and contains 0 supplementary groups
[2003/01/29 13:58:40, 5] smbd/uid.c:change_to_root_user(218)
  change_to_root_user: now uid=(0,0) gid=(0,0)
[2003/01/29 13:58:40, 3] smbd/negprot.c:reply_negprot(427)
  Requested protocol [PC NETWORK PROGRAM 1.0]
[2003/01/29 13:58:40, 3] smbd/negprot.c:reply_negprot(427)
  Requested protocol [MICROSOFT NETWORKS 1.03]
[2003/01/29 13:58:40, 3] smbd/negprot.c:reply_negprot(427)
  Requested protocol [MICROSOFT NETWORKS 3.0]
[2003/01/29 13:58:40, 3] smbd/negprot.c:reply_negprot(427)
  Requested protocol [LANMAN1.0]
[2003/01/29 13:58:40, 3] smbd/negprot.c:reply_negprot(427)
  Requested protocol [LM1.2X002]
[2003/01/29 13:58:40, 3] smbd/negprot.c:reply_negprot(427)
  Requested protocol [DOS LANMAN2.1]
[2003/01/29 13:58:40, 3] smbd/negprot.c:reply_negprot(427)
  Requested protocol [Samba]
[2003/01/29 13:58:40, 6] param/loadparm.c:lp_file_list_changed(2328)
  lp_file_list_changed()
  file /usr/local/samba3/lib/smb.conf -> /usr/local/samba3/lib/smb.conf  last mod_time: Wed Jan 29 11:23:53 2003
  
[2003/01/29 13:58:40, 6] param/loadparm.c:lp_file_list_changed(2328)
  lp_file_list_changed()
  file /usr/local/samba3/lib/smb.conf -> /usr/local/samba3/lib/smb.conf  last mod_time: Wed Jan 29 11:23:53 2003
  
[2003/01/29 13:58:40, 3] smbd/negprot.c:reply_nt1(301)
  using SPNEGO
[2003/01/29 13:58:40, 3] smbd/negprot.c:reply_negprot(504)
  Selected protocol NT LANMAN 1.0
[2003/01/29 13:58:40, 5] smbd/negprot.c:reply_negprot(510)
  negprot index=7
[2003/01/29 13:58:40, 5] lib/util.c:show_msg(461)
[2003/01/29 13:58:40, 5] lib/util.c:show_msg(471)
  size=127
  smb_com=0x72
  smb_rcls=0
  smb_reh=0
  smb_err=0
  smb_flg=136
  smb_flg2=18433
  smb_tid=0
  smb_pid=2343
  smb_uid=0
  smb_mid=1
  smt_wct=17
  smb_vwv[ 0]=    7 (0x7)
  smb_vwv[ 1]=12803 (0x3203)
  smb_vwv[ 2]=  256 (0x100)
  smb_vwv[ 3]= 1024 (0x400)
  smb_vwv[ 4]=   65 (0x41)
  smb_vwv[ 5]=    0 (0x0)
  smb_vwv[ 6]=  256 (0x100)
  smb_vwv[ 7]=10240 (0x2800)
  smb_vwv[ 8]=    9 (0x9)
  smb_vwv[ 9]=64768 (0xFD00)
  smb_vwv[10]=  243 (0xF3)
  smb_vwv[11]=  128 (0x80)
  smb_vwv[12]=41200 (0xA0F0)
  smb_vwv[13]=51311 (0xC86F)
  smb_vwv[14]=49863 (0xC2C7)
  smb_vwv[15]=11265 (0x2C01)
  smb_vwv[16]=14849 (0x3A01)
  smb_bcc=58
[2003/01/29 13:58:40, 6] lib/util_sock.c:write_socket(403)
  write_socket(17,131)
[2003/01/29 13:58:40, 6] lib/util_sock.c:write_socket(406)
  write_socket(17,131) wrote 131
[2003/01/29 13:58:40, 6] smbd/process.c:process_smb(881)
  got message type 0x0 of len 0x58
[2003/01/29 13:58:40, 3] smbd/process.c:process_smb(882)
  Transaction 1 of length 92
[2003/01/29 13:58:40, 5] lib/util.c:show_msg(461)
[2003/01/29 13:58:40, 5] lib/util.c:show_msg(471)
  size=88
  smb_com=0x73
  smb_rcls=0
  smb_reh=0
  smb_err=0
  smb_flg=8
  smb_flg2=51201
  smb_tid=0
  smb_pid=2343
  smb_uid=0
  smb_mid=1
  smt_wct=13
  smb_vwv[ 0]=  255 (0xFF)
  smb_vwv[ 1]=    0 (0x0)
  smb_vwv[ 2]=65535 (0xFFFF)
  smb_vwv[ 3]=    2 (0x2)
  smb_vwv[ 4]= 2343 (0x927)
  smb_vwv[ 5]= 2344 (0x928)
  smb_vwv[ 6]=    0 (0x0)
  smb_vwv[ 7]=    0 (0x0)
  smb_vwv[ 8]=    0 (0x0)
  smb_vwv[ 9]=    0 (0x0)
  smb_vwv[10]=    0 (0x0)
  smb_vwv[11]=   92 (0x5C)
  smb_vwv[12]=    0 (0x0)
  smb_bcc=27
[2003/01/29 13:58:40, 3] smbd/process.c:switch_message(676)
  switch message SMBsesssetupX (pid 2344)
[2003/01/29 13:58:40, 3] smbd/sec_ctx.c:set_sec_ctx(288)
  setting sec ctx (0, 0) - sec_ctx_stack_ndx = 0
[2003/01/29 13:58:40, 5] auth/auth_util.c:debug_nt_user_token(481)
  NT user token: (NULL)
[2003/01/29 13:58:40, 5] auth/auth_util.c:debug_unix_user_token(500)
  UNIX token of user 0
  Primary group is 0 and contains 0 supplementary groups
[2003/01/29 13:58:40, 5] smbd/uid.c:change_to_root_user(218)
  change_to_root_user: now uid=(0,0) gid=(0,0)
[2003/01/29 13:58:40, 3] smbd/sesssetup.c:reply_sesssetup_and_X(483)
  wct=13 flg2=0xc801
[2003/01/29 13:58:40, 3] smbd/sesssetup.c:reply_sesssetup_and_X(584)
  Domain=[]  NativeOS=[Unix] NativeLanMan=[Samba]
[2003/01/29 13:58:40, 3] smbd/sesssetup.c:reply_sesssetup_and_X(594)
  sesssetupX:name=[]\[]@[127.0.0.1]
[2003/01/29 13:58:40, 6] param/loadparm.c:lp_file_list_changed(2328)
  lp_file_list_changed()
  file /usr/local/samba3/lib/smb.conf -> /usr/local/samba3/lib/smb.conf  last mod_time: Wed Jan 29 11:23:53 2003
  
[2003/01/29 13:58:40, 3] smbd/sesssetup.c:check_guest_password(115)
  Got anonymous request
[2003/01/29 13:58:40, 5] auth/auth.c:make_auth_context_subsystem(402)
  Making default auth method list for security=user, encrypt passwords = yes
[2003/01/29 13:58:40, 5] auth/auth.c:make_auth_context_text_list(340)
  make_auth_context_text_list: Attempting to find an auth method to match guest
[2003/01/29 13:58:40, 5] auth/auth.c:make_auth_context_text_list(356)
  make_auth_context_text_list: Found auth method guest (at pos 0)
[2003/01/29 13:58:40, 5] auth/auth.c:make_auth_context_text_list(359)
  make_auth_context_text_list: auth method guest has a valid init
[2003/01/29 13:58:40, 5] auth/auth.c:make_auth_context_text_list(340)
  make_auth_context_text_list: Attempting to find an auth method to match sam
[2003/01/29 13:58:40, 5] auth/auth.c:make_auth_context_text_list(356)
  make_auth_context_text_list: Found auth method sam (at pos 3)
[2003/01/29 13:58:40, 5] auth/auth.c:make_auth_context_text_list(359)
  make_auth_context_text_list: auth method sam has a valid init
[2003/01/29 13:58:40, 5] auth/auth_util.c:make_user_info(95)
  attempting to make a user_info for  ()
[2003/01/29 13:58:40, 5] auth/auth_util.c:make_user_info(105)
  making strings for 's user_info struct
[2003/01/29 13:58:40, 5] auth/auth_util.c:make_user_info(147)
  making blobs for 's user_info struct
[2003/01/29 13:58:40, 3] auth/auth.c:check_ntlm_password(190)
  check_ntlm_password:  Checking password for unmapped user []\[]@[] with the new password interface
[2003/01/29 13:58:40, 3] auth/auth.c:check_ntlm_password(193)
  check_ntlm_password:  mapped user is: []\[]@[]
[2003/01/29 13:58:40, 5] lib/util.c:dump_data(1831)
  [000] 00 00 00 00 00 00 00 00                           ........ 
[2003/01/29 13:58:40, 3] smbd/sec_ctx.c:push_sec_ctx(256)
  push_sec_ctx(0, 0) : sec_ctx_stack_ndx = 1
[2003/01/29 13:58:40, 3] smbd/uid.c:push_conn_ctx(287)
  push_conn_ctx(0) : conn_ctx_stack_ndx = 0
[2003/01/29 13:58:40, 3] smbd/sec_ctx.c:set_sec_ctx(288)
  setting sec ctx (0, 0) - sec_ctx_stack_ndx = 1
[2003/01/29 13:58:40, 5] auth/auth_util.c:debug_nt_user_token(481)
  NT user token: (NULL)
[2003/01/29 13:58:40, 5] auth/auth_util.c:debug_unix_user_token(500)
  UNIX token of user 0
  Primary group is 0 and contains 0 supplementary groups
[2003/01/29 13:58:40, 5] passdb/pdb_smbpasswd.c:getsmbfilepwent(454)
  getsmbfilepwent: returning passwd entry for user pbelang2, uid 30114
[2003/01/29 13:58:40, 5] passdb/pdb_smbpasswd.c:getsmbfilepwent(454)
  getsmbfilepwent: returning passwd entry for user pbelang1, uid 30114
[2003/01/29 13:58:40, 5] passdb/pdb_smbpasswd.c:getsmbfilepwent(503)
  getsmbfilepwent: end of file reached.
[2003/01/29 13:58:40, 7] passdb/pdb_smbpasswd.c:endsmbfilepwent(277)
  endsmbfilepwent_internal: closed password file.
[2003/01/29 13:58:40, 4] lib/substitute.c:automount_server(267)
  Home server: alkonost
[2003/01/29 13:58:40, 4] lib/substitute.c:automount_server(267)
  Home server: alkonost
[2003/01/29 13:58:40, 3] smbd/sec_ctx.c:pop_sec_ctx(386)
  pop_sec_ctx (0, 0) - sec_ctx_stack_ndx = 0
[2003/01/29 13:58:40, 3] smbd/sec_ctx.c:push_sec_ctx(256)
  push_sec_ctx(0, 0) : sec_ctx_stack_ndx = 1
[2003/01/29 13:58:40, 3] smbd/uid.c:push_conn_ctx(287)
  push_conn_ctx(0) : conn_ctx_stack_ndx = 0
[2003/01/29 13:58:40, 3] smbd/sec_ctx.c:set_sec_ctx(288)
  setting sec ctx (0, 0) - sec_ctx_stack_ndx = 1
[2003/01/29 13:58:40, 5] auth/auth_util.c:debug_nt_user_token(481)
  NT user token: (NULL)
[2003/01/29 13:58:40, 5] auth/auth_util.c:debug_unix_user_token(500)
  UNIX token of user 0
  Primary group is 0 and contains 0 supplementary groups
[2003/01/29 13:58:40, 5] passdb/pdb_smbpasswd.c:getsmbfilepwent(454)
  getsmbfilepwent: returning passwd entry for user pbelang2, uid 30114
[2003/01/29 13:58:40, 5] passdb/pdb_smbpasswd.c:getsmbfilepwent(454)
  getsmbfilepwent: returning passwd entry for user pbelang1, uid 30114
[2003/01/29 13:58:40, 5] passdb/pdb_smbpasswd.c:getsmbfilepwent(503)
  getsmbfilepwent: end of file reached.
[2003/01/29 13:58:40, 7] passdb/pdb_smbpasswd.c:endsmbfilepwent(277)
  endsmbfilepwent_internal: closed password file.
[2003/01/29 13:58:40, 4] lib/substitute.c:automount_server(267)
  Home server: alkonost
[2003/01/29 13:58:40, 4] lib/substitute.c:automount_server(267)
  Home server: alkonost
[2003/01/29 13:58:40, 3] smbd/sec_ctx.c:pop_sec_ctx(386)
  pop_sec_ctx (0, 0) - sec_ctx_stack_ndx = 0
[2003/01/29 13:58:40, 3] smbd/sec_ctx.c:push_sec_ctx(256)
  push_sec_ctx(0, 0) : sec_ctx_stack_ndx = 1
[2003/01/29 13:58:40, 3] smbd/uid.c:push_conn_ctx(287)
  push_conn_ctx(0) : conn_ctx_stack_ndx = 0
[2003/01/29 13:58:40, 3] smbd/sec_ctx.c:set_sec_ctx(288)
  setting sec ctx (0, 0) - sec_ctx_stack_ndx = 1
[2003/01/29 13:58:40, 5] auth/auth_util.c:debug_nt_user_token(481)
  NT user token: (NULL)
[2003/01/29 13:58:40, 5] auth/auth_util.c:debug_unix_user_token(500)
  UNIX token of user 0
  Primary group is 0 and contains 0 supplementary groups
[2003/01/29 13:58:40, 3] smbd/sec_ctx.c:pop_sec_ctx(386)
  pop_sec_ctx (0, 0) - sec_ctx_stack_ndx = 0
[2003/01/29 13:58:40, 5] auth/auth_util.c:debug_unix_user_token(500)
  UNIX token of user 60001
  Primary group is 60001 and contains 1 supplementary groups
  Group[  0]: 60001
[2003/01/29 13:58:40, 5] auth/auth_util.c:make_server_info_sam(787)
  make_server_info_sam: made server info for user nobody
[2003/01/29 13:58:40, 3] auth/auth.c:check_ntlm_password(227)
  check_ntlm_password: guest authentication for user [] suceeded
[2003/01/29 13:58:40, 5] auth/auth.c:check_ntlm_password(268)
  check_ntlm_password:  guest authentication for user [] -> [] -> [nobody] suceeded
[2003/01/29 13:58:40, 5] auth/auth_util.c:free_user_info(1066)
  attempting to free (and zero) a user_info structure
[2003/01/29 13:58:40, 5] auth/auth_util.c:free_user_info(1066)
  attempting to free (and zero) a user_info structure
[2003/01/29 13:58:40, 3] smbd/password.c:register_vuid(185)
  User name: nobody	Real name: Nobody
[2003/01/29 13:58:40, 3] smbd/password.c:register_vuid(195)
  UNIX uid 60001 is UNIX user nobody, and will be vuid 100
[2003/01/29 13:58:40, 5] auth/auth_util.c:free_server_info(1091)
  attempting to free (and zero) a server_info structure
[2003/01/29 13:58:40, 5] lib/util.c:show_msg(461)
[2003/01/29 13:58:40, 5] lib/util.c:show_msg(471)
  size=72
  smb_com=0x73
  smb_rcls=0
  smb_reh=0
  smb_err=0
  smb_flg=136
  smb_flg2=51201
  smb_tid=0
  smb_pid=2343
  smb_uid=100
  smb_mid=1
  smt_wct=3
  smb_vwv[ 0]=  255 (0xFF)
  smb_vwv[ 1]=    0 (0x0)
  smb_vwv[ 2]=    1 (0x1)
  smb_bcc=31
[2003/01/29 13:58:40, 6] lib/util_sock.c:write_socket(403)
  write_socket(17,76)
[2003/01/29 13:58:40, 6] lib/util_sock.c:write_socket(406)
  write_socket(17,76) wrote 76
[2003/01/29 13:58:40, 6] smbd/process.c:process_smb(881)
  got message type 0x0 of len 0x3a
[2003/01/29 13:58:40, 3] smbd/process.c:process_smb(882)
  Transaction 2 of length 62
[2003/01/29 13:58:40, 5] lib/util.c:show_msg(461)
[2003/01/29 13:58:40, 5] lib/util.c:show_msg(471)
  size=58
  smb_com=0x75
  smb_rcls=0
  smb_reh=0
  smb_err=0
  smb_flg=8
  smb_flg2=51201
  smb_tid=0
  smb_pid=2343
  smb_uid=100
  smb_mid=1
  smt_wct=4
  smb_vwv[ 0]=  255 (0xFF)
  smb_vwv[ 1]=    0 (0x0)
  smb_vwv[ 2]=    0 (0x0)
  smb_vwv[ 3]=    1 (0x1)
  smb_bcc=15
[2003/01/29 13:58:40, 3] smbd/process.c:switch_message(676)
  switch message SMBtconX (pid 2344)
[2003/01/29 13:58:40, 3] smbd/sec_ctx.c:set_sec_ctx(288)
  setting sec ctx (0, 0) - sec_ctx_stack_ndx = 0
[2003/01/29 13:58:40, 5] auth/auth_util.c:debug_nt_user_token(481)
  NT user token: (NULL)
[2003/01/29 13:58:40, 5] auth/auth_util.c:debug_unix_user_token(500)
  UNIX token of user 0
  Primary group is 0 and contains 0 supplementary groups
[2003/01/29 13:58:40, 5] smbd/uid.c:change_to_root_user(218)
  change_to_root_user: now uid=(0,0) gid=(0,0)
[2003/01/29 13:58:40, 4] smbd/reply.c:reply_tcon_and_X(255)
  Got device type IPC
[2003/01/29 13:58:40, 5] smbd/service.c:make_connection(843)
  making a connection to 'normal' service ipc$
[2003/01/29 13:58:40, 3] lib/access.c:check_access(311)
  check_access: no hostnames in host allow/deny list.
[2003/01/29 13:58:40, 2] lib/access.c:check_access(322)
  Allowed connection from  (127.0.0.1)
[2003/01/29 13:58:40, 5] lib/username.c:Get_Pwnam(288)
  Finding user nobody
[2003/01/29 13:58:40, 5] lib/username.c:Get_Pwnam_internals(223)
  Trying _Get_Pwnam(), username as lowercase is nobody
[2003/01/29 13:58:40, 5] lib/username.c:Get_Pwnam_internals(251)
  Get_Pwnam_internals did find user [nobody]!
[2003/01/29 13:58:40, 3] smbd/service.c:make_connection_snum(525)
  Connect path is '/tmp' for service [IPC$]
[2003/01/29 13:58:40, 4] rpc_server/srv_srvsvc_nt.c:get_share_security(217)
  get_share_security: using default secdesc for IPC$
[2003/01/29 13:58:40, 3] lib/util_seaccess.c:se_access_check(267)
[2003/01/29 13:58:40, 3] lib/util_seaccess.c:se_access_check(268)
  se_access_check: user sid is S-1-5-21-554382605-1053311191-3087546751-501
  se_access_check: also S-1-5-21-554382605-1053311191-3087546751-514
  se_access_check: also S-1-1-0
  se_access_check: also S-1-5-2
  se_access_check: also S-1-5-32-546
  se_access_check: also S-1-5-21-554382605-1053311191-3087546751-121003
[2003/01/29 13:58:40, 5] lib/util_seaccess.c:se_access_check(325)
  se_access_check: access (2) granted.
[2003/01/29 13:58:40, 3] smbd/vfs.c:vfs_init_default(136)
  Initialising default vfs hooks
[2003/01/29 13:58:40, 5] smbd/connection.c:claim_connection(162)
  claiming IPC$ 0
[2003/01/29 13:58:40, 4] rpc_server/srv_srvsvc_nt.c:get_share_security(217)
  get_share_security: using default secdesc for IPC$
[2003/01/29 13:58:40, 3] lib/util_seaccess.c:se_access_check(267)
[2003/01/29 13:58:40, 3] lib/util_seaccess.c:se_access_check(268)
  se_access_check: user sid is S-1-5-21-554382605-1053311191-3087546751-501
  se_access_check: also S-1-5-21-554382605-1053311191-3087546751-514
  se_access_check: also S-1-1-0
  se_access_check: also S-1-5-2
  se_access_check: also S-1-5-32-546
  se_access_check: also S-1-5-21-554382605-1053311191-3087546751-121003
[2003/01/29 13:58:40, 5] lib/util_seaccess.c:se_access_check(325)
  se_access_check: access (1) granted.
[2003/01/29 13:58:40, 3] smbd/sec_ctx.c:set_sec_ctx(288)
  setting sec ctx (60001, 60001) - sec_ctx_stack_ndx = 0
[2003/01/29 13:58:40, 5] auth/auth_util.c:debug_nt_user_token(486)
  NT user token of user S-1-5-21-554382605-1053311191-3087546751-501
  contains 6 SIDs
  SID[  0]: S-1-5-21-554382605-1053311191-3087546751-501
  SID[  1]: S-1-5-21-554382605-1053311191-3087546751-514
  SID[  2]: S-1-1-0
  SID[  3]: S-1-5-2
  SID[  4]: S-1-5-32-546
  SID[  5]: S-1-5-21-554382605-1053311191-3087546751-121003
[2003/01/29 13:58:40, 5] auth/auth_util.c:debug_unix_user_token(500)
  UNIX token of user 60001
  Primary group is 60001 and contains 1 supplementary groups
  Group[  0]: 60001
[2003/01/29 13:58:40, 5] smbd/uid.c:change_to_user(203)
  change_to_user uid=(0,60001) gid=(0,60001)
[2003/01/29 13:58:40, 3] smbd/service.c:make_connection_snum(681)
  127.0.0.1 (127.0.0.1) connect to service IPC$ initially as user nobody (uid=60001, gid=60001) (pid 2344)
[2003/01/29 13:58:40, 3] smbd/sec_ctx.c:set_sec_ctx(288)
  setting sec ctx (0, 0) - sec_ctx_stack_ndx = 0
[2003/01/29 13:58:40, 5] auth/auth_util.c:debug_nt_user_token(481)
  NT user token: (NULL)
[2003/01/29 13:58:40, 5] auth/auth_util.c:debug_unix_user_token(500)
  UNIX token of user 0
  Primary group is 0 and contains 0 supplementary groups
[2003/01/29 13:58:40, 5] smbd/uid.c:change_to_root_user(218)
  change_to_root_user: now uid=(0,0) gid=(0,0)
[2003/01/29 13:58:40, 3] smbd/reply.c:reply_tcon_and_X(296)
  tconX service=IPC$ 
[2003/01/29 13:58:40, 5] lib/util.c:show_msg(461)
[2003/01/29 13:58:40, 5] lib/util.c:show_msg(471)
  size=48
  smb_com=0x75
  smb_rcls=0
  smb_reh=0
  smb_err=0
  smb_flg=136
  smb_flg2=51201
  smb_tid=1
  smb_pid=2343
  smb_uid=100
  smb_mid=1
  smt_wct=3
  smb_vwv[ 0]=  255 (0xFF)
  smb_vwv[ 1]=    0 (0x0)
  smb_vwv[ 2]=    1 (0x1)
  smb_bcc=7
[2003/01/29 13:58:40, 6] lib/util_sock.c:write_socket(403)
  write_socket(17,52)
[2003/01/29 13:58:40, 6] lib/util_sock.c:write_socket(406)
  write_socket(17,52) wrote 52
[2003/01/29 13:58:40, 6] smbd/process.c:process_smb(881)
  got message type 0x0 of len 0x287
[2003/01/29 13:58:40, 3] smbd/process.c:process_smb(882)
  Transaction 3 of length 651
[2003/01/29 13:58:40, 5] lib/util.c:show_msg(461)
[2003/01/29 13:58:40, 5] lib/util.c:show_msg(471)
  size=647
  smb_com=0x25
  smb_rcls=0
  smb_reh=0
  smb_err=0
  smb_flg=8
  smb_flg2=51201
  smb_tid=1
  smb_pid=2343
  smb_uid=100
  smb_mid=1
  smt_wct=14
  smb_vwv[ 0]=   25 (0x19)
  smb_vwv[ 1]=  532 (0x214)
  smb_vwv[ 2]=    2 (0x2)
  smb_vwv[ 3]=    0 (0x0)
  smb_vwv[ 4]=    0 (0x0)
  smb_vwv[ 5]=    0 (0x0)
  smb_vwv[ 6]=    0 (0x0)
  smb_vwv[ 7]=    0 (0x0)
  smb_vwv[ 8]=    0 (0x0)
  smb_vwv[ 9]=   25 (0x19)
  smb_vwv[10]=   90 (0x5A)
  smb_vwv[11]=  532 (0x214)
  smb_vwv[12]=  115 (0x73)
  smb_vwv[13]=    0 (0x0)
  smb_bcc=584
[2003/01/29 13:58:40, 3] smbd/process.c:switch_message(676)
  switch message SMBtrans (pid 2344)
[2003/01/29 13:58:40, 3] smbd/sec_ctx.c:set_sec_ctx(288)
  setting sec ctx (60001, 60001) - sec_ctx_stack_ndx = 0
[2003/01/29 13:58:40, 5] auth/auth_util.c:debug_nt_user_token(486)
  NT user token of user S-1-5-21-554382605-1053311191-3087546751-501
  contains 6 SIDs
  SID[  0]: S-1-5-21-554382605-1053311191-3087546751-501
  SID[  1]: S-1-5-21-554382605-1053311191-3087546751-514
  SID[  2]: S-1-1-0
  SID[  3]: S-1-5-2
  SID[  4]: S-1-5-32-546
  SID[  5]: S-1-5-21-554382605-1053311191-3087546751-121003
[2003/01/29 13:58:40, 5] auth/auth_util.c:debug_unix_user_token(500)
  UNIX token of user 60001
  Primary group is 60001 and contains 1 supplementary groups
  Group[  0]: 60001
[2003/01/29 13:58:40, 5] smbd/uid.c:change_to_user(203)
  change_to_user uid=(0,60001) gid=(0,60001)
[2003/01/29 13:58:40, 3] smbd/vfs.c:vfs_ChDir(650)
  vfs_ChDir to /tmp
[2003/01/29 13:58:40, 3] smbd/ipc.c:reply_trans(472)
  trans <\PIPE\LANMAN> data=532 params=25 setup=0
[2003/01/29 13:58:40, 5] smbd/ipc.c:reply_trans(491)
  calling named_pipe
[2003/01/29 13:58:40, 3] smbd/ipc.c:named_pipe(326)
  named pipe command on <LANMAN> name
[2003/01/29 13:58:40, 3] smbd/lanman.c:api_reply(3485)
  Got API command 214 of form <zsT> <B516B16> (tdscnt=532,tpscnt=25,mdrcnt=0,mprcnt=2)
[2003/01/29 13:58:40, 3] smbd/lanman.c:api_reply(3489)
  Doing SamOEMChangePassword
[2003/01/29 13:58:40, 3] smbd/lanman.c:api_SamOEMChangePassword(2007)
  api_SamOEMChangePassword: Change password for <pbelang1>
[2003/01/29 13:58:40, 3] smbd/sec_ctx.c:push_sec_ctx(256)
  push_sec_ctx(60001, 60001) : sec_ctx_stack_ndx = 1
[2003/01/29 13:58:40, 3] smbd/uid.c:push_conn_ctx(287)
  push_conn_ctx(100) : conn_ctx_stack_ndx = 0
[2003/01/29 13:58:40, 3] smbd/sec_ctx.c:set_sec_ctx(288)
  setting sec ctx (0, 0) - sec_ctx_stack_ndx = 1
[2003/01/29 13:58:40, 5] auth/auth_util.c:debug_nt_user_token(481)
  NT user token: (NULL)
[2003/01/29 13:58:40, 5] auth/auth_util.c:debug_unix_user_token(500)
  UNIX token of user 0
  Primary group is 0 and contains 0 supplementary groups
[2003/01/29 13:58:40, 0] smbd/chgpasswd.c:check_oem_password(807)
  check_oem_password: 1
[2003/01/29 13:58:40, 5] passdb/pdb_smbpasswd.c:getsmbfilepwent(454)
  getsmbfilepwent: returning passwd entry for user pbelang2, uid 30114
[2003/01/29 13:58:40, 5] passdb/pdb_smbpasswd.c:getsmbfilepwent(454)
  getsmbfilepwent: returning passwd entry for user pbelang1, uid 30114
[2003/01/29 13:58:40, 7] passdb/pdb_smbpasswd.c:endsmbfilepwent(277)
  endsmbfilepwent_internal: closed password file.
[2003/01/29 13:58:40, 4] lib/substitute.c:automount_server(267)
  Home server: alkonost
[2003/01/29 13:58:40, 4] lib/substitute.c:automount_server(267)
  Home server: alkonost
[2003/01/29 13:58:40, 0] smbd/chgpasswd.c:check_oem_password(809)
  check_oem_password: 2
[2003/01/29 13:58:40, 3] smbd/sec_ctx.c:pop_sec_ctx(386)
  pop_sec_ctx (60001, 60001) - sec_ctx_stack_ndx = 0
[2003/01/29 13:58:40, 0] smbd/chgpasswd.c:check_oem_password(811)
  check_oem_password: 3
[2003/01/29 13:58:40, 0] smbd/chgpasswd.c:check_oem_password(823)
  check_oem_password: 4
[2003/01/29 13:58:40, 0] smbd/chgpasswd.c:check_oem_password(827)
  check_oem_password: 5
[2003/01/29 13:58:40, 0] smbd/chgpasswd.c:check_oem_password(833)
  check_oem_password: 6
[2003/01/29 13:58:40, 0] smbd/chgpasswd.c:check_oem_password(844)
  check_oem_password: 7
[2003/01/29 13:58:40, 0] smbd/chgpasswd.c:check_oem_password(863)
  check_oem_password: 8
[2003/01/29 13:58:40, 0] smbd/chgpasswd.c:check_oem_password(878)
  check_oem_password: incorrect password length (247673920).
[2003/01/29 13:58:40, 5] smbd/ipc.c:copy_trans_params_and_data(62)
  copy_trans_params_and_data: params[0..2] data[0..0]
[2003/01/29 13:58:40, 5] lib/util.c:show_msg(461)
[2003/01/29 13:58:40, 5] lib/util.c:show_msg(471)
  size=60
  smb_com=0x25
  smb_rcls=0
  smb_reh=0
  smb_err=0
  smb_flg=136
  smb_flg2=51201
  smb_tid=1
  smb_pid=2343
  smb_uid=100
  smb_mid=1
  smt_wct=10
  smb_vwv[ 0]=    2 (0x2)
  smb_vwv[ 1]=    0 (0x0)
  smb_vwv[ 2]=    0 (0x0)
  smb_vwv[ 3]=    2 (0x2)
  smb_vwv[ 4]=   56 (0x38)
  smb_vwv[ 5]=    0 (0x0)
  smb_vwv[ 6]=    0 (0x0)
  smb_vwv[ 7]=   60 (0x3C)
  smb_vwv[ 8]=    0 (0x0)
  smb_vwv[ 9]=    0 (0x0)
  smb_bcc=5
[2003/01/29 13:58:40, 6] lib/util_sock.c:write_socket(403)
  write_socket(17,64)
[2003/01/29 13:58:40, 6] lib/util_sock.c:write_socket(406)
  write_socket(17,64) wrote 64
[2003/01/29 13:58:40, 3] smbd/process.c:timeout_processing(1095)
  end of file from client
[2003/01/29 13:58:40, 3] smbd/sec_ctx.c:set_sec_ctx(288)
  setting sec ctx (0, 0) - sec_ctx_stack_ndx = 0
[2003/01/29 13:58:40, 5] auth/auth_util.c:debug_nt_user_token(481)
  NT user token: (NULL)
[2003/01/29 13:58:40, 5] auth/auth_util.c:debug_unix_user_token(500)
  UNIX token of user 0
  Primary group is 0 and contains 0 supplementary groups
[2003/01/29 13:58:40, 5] smbd/uid.c:change_to_root_user(218)
  change_to_root_user: now uid=(0,0) gid=(0,0)
[2003/01/29 13:58:40, 2] smbd/server.c:exit_server(543)
  Closing connections
[2003/01/29 13:58:40, 3] smbd/sec_ctx.c:set_sec_ctx(288)
  setting sec ctx (0, 0) - sec_ctx_stack_ndx = 0
[2003/01/29 13:58:40, 5] auth/auth_util.c:debug_nt_user_token(481)
  NT user token: (NULL)
[2003/01/29 13:58:40, 5] auth/auth_util.c:debug_unix_user_token(500)
  UNIX token of user 0
  Primary group is 0 and contains 0 supplementary groups
[2003/01/29 13:58:40, 5] smbd/uid.c:change_to_root_user(218)
  change_to_root_user: now uid=(0,0) gid=(0,0)
[2003/01/29 13:58:40, 3] smbd/service.c:close_cnum(861)
  127.0.0.1 (127.0.0.1) closed connection to service IPC$
[2003/01/29 13:58:40, 3] smbd/connection.c:yield_connection(61)
  Yielding connection to IPC$
[2003/01/29 13:58:40, 3] smbd/sec_ctx.c:set_sec_ctx(288)
  setting sec ctx (0, 0) - sec_ctx_stack_ndx = 0
[2003/01/29 13:58:40, 5] auth/auth_util.c:debug_nt_user_token(481)
  NT user token: (NULL)
[2003/01/29 13:58:40, 5] auth/auth_util.c:debug_unix_user_token(500)
  UNIX token of user 0
  Primary group is 0 and contains 0 supplementary groups
[2003/01/29 13:58:40, 5] smbd/uid.c:change_to_root_user(218)
  change_to_root_user: now uid=(0,0) gid=(0,0)
[2003/01/29 13:58:40, 3] smbd/vfs.c:vfs_ChDir(650)
  vfs_ChDir to /
[2003/01/29 13:58:40, 3] smbd/connection.c:yield_connection(61)
  Yielding connection to 
[2003/01/29 13:58:40, 3] smbd/connection.c:yield_connection(68)
  yield_connection: tdb_delete for name  failed with error Record does not exist.
[2003/01/29 13:58:40, 5] smbd/oplock.c:receive_local_message(107)
  receive_local_message: doing select with timeout of 1 ms
[2003/01/29 13:58:40, 3] smbd/server.c:exit_server(583)
  Server exit (normal exit)


More information about the samba-technical mailing list