.xsession-errors kept open after session has been close
Hello,
I'm using libpam-mount to mount/umount my dm-crypt'ed home directory
upon login/logout.
umount of my home directory and removal of the dm-crypt'ed device always
fails because a 'kdeinit' process keeps $HOME/.xession-errors open after
logout, and supposedly after my session has been closed (kdm claims to
have done so in auth.log, at least).
All I could find out so far is that the offending kdeinit process is
started *after* I logout (I determined this through acct).
The man page says kdeinit is a process launcher, so I'm guessing the
real offender is some other process. Can anybody give me any hints on
how I might figure out what kdeinit is launching?
Is it safe for kdm (or any ?dm) to rely on a file in $HOME after the
session has been closed? I'm not calling bug, I'm just asking out of
curiosity.
I've attached a sample snippet from my auth.log file for an entire
session (libpam-mount was running in debug mode).
Regards,
Chris
--
Christian Kastner
PGP Key: AE90E13F
May 7 00:12:27 ckdesk kdm: :0[12492]: (pam_unix) session opened for user chris by (uid=0)
May 7 00:12:27 ckdesk kdm: :0[12492]: pam_mount(readconfig.c:197) reading options_allow...
May 7 00:12:27 ckdesk kdm: :0[12492]: pam_mount(readconfig.c:180) reading options_require...
May 7 00:12:27 ckdesk kdm: :0[12492]: pam_mount(pam_mount.c:439) back from global readconfig
May 7 00:12:27 ckdesk kdm: :0[12492]: pam_mount(pam_mount.c:441) per-user configurations not allowed by pam_mount.conf
May 7 00:12:27 ckdesk kdm: :0[12492]: pam_mount(pam_mount.c:459) pam_sm_open_session: real uid/gid=0:0, effective uid/gid=0:0
May 7 00:12:27 ckdesk kdm: :0[12492]: pam_mount(readconfig.c:418) checking sanity of volume record (/dev/md0)
May 7 00:12:27 ckdesk kdm: :0[12492]: pam_mount(pam_mount.c:474) about to perform mount operations
May 7 00:12:27 ckdesk kdm: :0[12492]: pam_mount(mount.c:368) information for mount:
May 7 00:12:27 ckdesk kdm: :0[12492]: pam_mount(mount.c:369) ----------------------
May 7 00:12:27 ckdesk kdm: :0[12492]: pam_mount(mount.c:370) (defined by globalconf)
May 7 00:12:27 ckdesk kdm: :0[12492]: pam_mount(mount.c:373) user: chris
May 7 00:12:27 ckdesk kdm: :0[12492]: pam_mount(mount.c:374) server:
May 7 00:12:27 ckdesk kdm: :0[12492]: pam_mount(mount.c:375) volume: /dev/md0
May 7 00:12:27 ckdesk kdm: :0[12492]: pam_mount(mount.c:376) mountpoint: /home/chris
May 7 00:12:27 ckdesk kdm: :0[12492]: pam_mount(mount.c:377) options: fsck,exec,nosuid,nodev,fstype=jfs,cipher=aes-cbc-essiv:sha256,hash=sha512,keysize=256
May 7 00:12:27 ckdesk kdm: :0[12492]: pam_mount(mount.c:378) fs_key_cipher: aes-256-cbc
May 7 00:12:27 ckdesk kdm: :0[12492]: pam_mount(mount.c:379) fs_key_path: /autofs/keychain/chris.home.key
May 7 00:12:27 ckdesk kdm: :0[12492]: pam_mount(mount.c:380) use_fstab: 0
May 7 00:12:27 ckdesk kdm: :0[12492]: pam_mount(mount.c:381) ----------------------
May 7 00:12:27 ckdesk kdm: :0[12492]: pam_mount(mount.c:177) realpath of volume "/home/chris" is "/home/chris"
May 7 00:12:27 ckdesk kdm: :0[12492]: pam_mount(mount.c:182) checking to see if /dev/mapper/_dev_md0 is already mounted at /home/chris
May 7 00:12:27 ckdesk kdm: :0[12492]: pam_mount(mount.c:799) checking for encrypted filesystem key configuration
May 7 00:12:27 ckdesk kdm: :0[12492]: pam_mount(mount.c:803) decrypting FS key using system auth. token and aes-256-cbc
May 7 00:12:27 ckdesk kdm: :0[12492]: pam_mount(mount.c:819) about to start building mount command
May 7 00:12:27 ckdesk kdm: :0[12492]: pam_mount(misc.c:264) command: /bin/mount [-t] [crypt] [-ofsck,exec,nosuid,nodev,fstype=jfs,cipher=aes-cbc-essiv:sha256,hash=sha512,keysize=256] [/dev/md0] [/
May 7 00:12:27 ckdesk kdm: :0[12559]: pam_mount(misc.c:341) set_myuid(pre): real uid/gid=0:0, effective uid/gid=0:0
May 7 00:12:27 ckdesk kdm: :0[12559]: pam_mount(misc.c:376) set_myuid(post): real uid/gid=0:0, effective uid/gid=0:0
May 7 00:12:27 ckdesk kdm: :0[12492]: pam_mount(mount.c:851) mount errors (should be empty):
May 7 00:12:27 ckdesk kdm: :0[12492]: pam_mount(mount.c:100) pam_mount(misc.c:341) set_myuid(pre): real uid/gid=0:0, effective uid/gid=0:0
May 7 00:12:27 ckdesk kdm: :0[12492]: pam_mount(mount.c:100) pam_mount(misc.c:376) set_myuid(post): real uid/gid=0:0, effective uid/gid=0:0
May 7 00:12:27 ckdesk kdm: :0[12492]: pam_mount(mount.c:854) waiting for mount
May 7 00:12:27 ckdesk kdm: :0[12492]: pam_mount(pam_mount.c:123) clean system authtok (0)
May 7 00:12:27 ckdesk kdm: :0[12492]: pam_mount(misc.c:264) command: /usr/sbin/pmvarrun [-u] [chris] [-o] [1]
May 7 00:12:27 ckdesk kdm: :0[12574]: pam_mount(misc.c:341) set_myuid(pre): real uid/gid=0:0, effective uid/gid=0:0
May 7 00:12:27 ckdesk kdm: :0[12574]: pam_mount(misc.c:376) set_myuid(post): real uid/gid=0:0, effective uid/gid=0:0
May 7 00:12:27 ckdesk kdm: :0[12492]: pam_mount(pam_mount.c:360) pmvarrun says login count is 1
May 7 00:12:27 ckdesk kdm: :0[12492]: pam_mount(pam_mount.c:491) done opening session
May 7 00:13:22 ckdesk kdm: :0[12492]: (pam_unix) session closed for user chris
May 7 00:13:22 ckdesk kdm: :0[12492]: pam_mount(pam_mount.c:533) received order to close things
May 7 00:13:22 ckdesk kdm: :0[12492]: pam_mount(pam_mount.c:534) real and effective user ID are 0 and 0.
May 7 00:13:22 ckdesk kdm: :0[12492]: pam_mount(misc.c:264) command: /usr/sbin/pmvarrun [-u] [chris] [-o] [-1]
May 7 00:13:22 ckdesk kdm: :0[12790]: pam_mount(misc.c:341) set_myuid(pre): real uid/gid=0:0, effective uid/gid=0:0
May 7 00:13:22 ckdesk kdm: :0[12790]: pam_mount(misc.c:376) set_myuid(post): real uid/gid=0:0, effective uid/gid=0:0
May 7 00:13:22 ckdesk kdm: :0[12492]: pam_mount(pam_mount.c:360) pmvarrun says login count is 0
May 7 00:13:22 ckdesk kdm: :0[12492]: pam_mount(pam_mount.c:556) going to unmount
May 7 00:13:22 ckdesk kdm: :0[12492]: pam_mount(mount.c:368) information for mount:
May 7 00:13:22 ckdesk kdm: :0[12492]: pam_mount(mount.c:369) ----------------------
May 7 00:13:22 ckdesk kdm: :0[12492]: pam_mount(mount.c:370) (defined by globalconf)
May 7 00:13:22 ckdesk kdm: :0[12492]: pam_mount(mount.c:373) user: chris
May 7 00:13:22 ckdesk kdm: :0[12492]: pam_mount(mount.c:374) server:
May 7 00:13:22 ckdesk kdm: :0[12492]: pam_mount(mount.c:375) volume: /dev/md0
May 7 00:13:22 ckdesk kdm: :0[12492]: pam_mount(mount.c:376) mountpoint: /home/chris
May 7 00:13:22 ckdesk kdm: :0[12492]: pam_mount(mount.c:377) options: fsck,exec,nosuid,nodev,fstype=jfs,cipher=aes-cbc-essiv:sha256,hash=sha512,keysize=256
May 7 00:13:22 ckdesk kdm: :0[12492]: pam_mount(mount.c:378) fs_key_cipher: aes-256-cbc
May 7 00:13:22 ckdesk kdm: :0[12492]: pam_mount(mount.c:379) fs_key_path: /autofs/keychain/chris.home.key
May 7 00:13:22 ckdesk kdm: :0[12492]: pam_mount(mount.c:380) use_fstab: 0
May 7 00:13:22 ckdesk kdm: :0[12492]: pam_mount(mount.c:381) ----------------------
May 7 00:13:22 ckdesk kdm: :0[12492]: pam_mount(misc.c:264) command: /usr/bin/lsof [/home/chris]
May 7 00:13:22 ckdesk kdm: :0[12492]: pam_mount(mount.c:131) lsof output (should be empty)...
May 7 00:13:22 ckdesk kdm: :0[12492]: pam_mount(mount.c:100) COMMAND PID USER FD TYPE DEVICE SIZE NODE NAME
May 7 00:13:22 ckdesk kdm: :0[12492]: pam_mount(mount.c:100) kdeinit 12767 chris cwd DIR 253,4 4096 2 /home/chris
May 7 00:13:22 ckdesk kdm: :0[12492]: pam_mount(mount.c:100) kdeinit 12767 chris 1w REG 253,4 2005 25 /home/chris/.xsession-errors
May 7 00:13:22 ckdesk kdm: :0[12492]: pam_mount(mount.c:100) kdeinit 12767 chris 2w REG 253,4 2005 25 /home/chris/.xsession-errors
May 7 00:13:22 ckdesk kdm: :0[12492]: pam_mount(mount.c:133) waiting for lsof
May 7 00:13:22 ckdesk kdm: :0[12492]: pam_mount(misc.c:264) command: /sbin/umount.crypt [/home/chris]
May 7 00:13:22 ckdesk kdm: :0[12793]: pam_mount(misc.c:341) set_myuid(pre): real uid/gid=0:0, effective uid/gid=0:0
May 7 00:13:22 ckdesk kdm: :0[12793]: pam_mount(misc.c:376) set_myuid(post): real uid/gid=0:0, effective uid/gid=0:0
May 7 00:13:22 ckdesk kdm: :0[12492]: pam_mount(mount.c:487) umount errors (should be empty):
May 7 00:13:22 ckdesk kdm: :0[12492]: pam_mount(mount.c:100) pam_mount(misc.c:341) set_myuid(pre): real uid/gid=0:0, effective uid/gid=0:0
May 7 00:13:22 ckdesk kdm: :0[12492]: pam_mount(mount.c:100) pam_mount(misc.c:376) set_myuid(post): real uid/gid=0:0, effective uid/gid=0:0
May 7 00:13:22 ckdesk kdm: :0[12492]: pam_mount(mount.c:100) umount: /home/chris: device is busy
May 7 00:13:22 ckdesk kdm: :0[12492]: pam_mount(mount.c:100) umount: /home/chris: device is busy
May 7 00:13:22 ckdesk kdm: :0[12492]: pam_mount(mount.c:100) umount.crypt: error unmounting /home/chris
May 7 00:13:22 ckdesk kdm: :0[12492]: pam_mount(mount.c:490) waiting for umount
May 7 00:13:22 ckdesk kdm: :0[12492]: pam_mount(pam_mount.c:558) unmount of /dev/md0 failed
May 7 00:13:22 ckdesk kdm: :0[12492]: pam_mount(pam_mount.c:567) pam_mount execution complete
May 7 00:13:22 ckdesk kdm: :0[12492]: pam_mount(pam_mount.c:106) Clean global config (0)
May 7 00:13:22 ckdesk kdm: :0[12492]: pam_mount(pam_mount.c:123) clean system authtok (0)
Reply to: