xfs
[Top] [All Lists]

Re: wbee (sample_hsm) dumped core

To: Dean Roehrich <roehrich@xxxxxxx>
Subject: Re: wbee (sample_hsm) dumped core
From: Takayuki Sasaki <sasaki@xxxxxxxxxxxxxxxxxx>
Date: Thu, 04 Oct 2001 17:34:49 +0900
Cc: linux-xfs@xxxxxxxxxxx
In-reply-to: Your message of Wed, 03 Oct 2001 11:37:32 -0500. <200110031637.LAA33083@slobber.americas.sgi.com>
Sender: owner-linux-xfs@xxxxxxxxxxx
Hi,

Thank you for your time, Dean.

Dean Roehrich <roehrich@xxxxxxx>  wrote:
> 
> >Takayuki Sasaki <sasaki@xxxxxxxxxxxxxxxxxx>  wrote:
> >
> >> migin daemon in sample_hsm started with the patch which I
> >> posted, but if I try to read the migrated file then it
> >> stalled. It was caused by
> >> linux-2.4-xfs/cmd/xfstests/dmapi/src/sample_hsm/wbee which was
> >> dispatched by migin dumped core.
> >
> >In the above situation, I killed the stalled command ( cp ) and
> >migin by pressing Ctrl + c to find out what is wrong.  Then,
> >unmount the XFS file system, the following console messages
> >appeared:
> >
> >  XFS unmount got error 16
> >  linvfs_put_super: vfsp/0xc2acb38c left dangling!
> >  VFS: Busy inodes after unmount. Self-destruct in 5 seconds.  Have a nice 
> > day
> >...
> 
> Do you have a trace from the wbee core dump?

Yes, but you know, it was fixed by a patch as I posted ( and it
have been committed to the CVS tree already ). Offcause, these
masseages are not appeared with the latest wbee.

What I would like to know is why these message are displayed.
If the cause is a bug, then it may be fixed :) but if the cause
is wrong operations, I would like to know correct one.

> You should also know that memory-mapped I/O is not going to trigger DMAPI
> read/write events, yet--I've been experimenting with a fix for that for a
> while now.  Apparently your cp didn't do memory-mapped I/O in this case, else
> it wouldn't have blocked.  Something to keep in mind.
>
> Is your stagedir on the same filesystem that migin is monitoring?  They should
> be different filesystems.

Here are the operations which I do:

sasaki]# cd linux-2.4-xfs/cmd/xfstests/dmapi/src/sample_hsm
sample_hsm]# uname -a
Linux XXX.YYY.ZZZ.nec.co.jp 2.4.10-xfs #1 SMP Tue Oct 2 08:33:33 JST 2001 i686 
unknown
sample_hsm]# lvscan
lvscan -- ACTIVE            "/dev/vg0/kana1" [100 MB]
lvscan -- ACTIVE            "/dev/vg0/migfs" [32 MB]
lvscan -- ACTIVE            "/dev/vg0/xfstest11" [52 MB]
lvscan -- ACTIVE            "/dev/vg0/dmapi_fs" [32 MB]
lvscan -- ACTIVE            "/dev/vg0/masano1" [32 MB]
lvscan -- 5 logical volumes with 248 MB total in 1 volume group
lvscan -- 5 active logical volumes

sample_hsm]# mkfs.xfs -f /dev/vg0/dmapi_fs
meta-data=/dev/vg0/dmapi_fs      isize=256    agcount=2, agsize=4096 blks
data     =                       bsize=4096   blocks=8192, imaxpct=25
         =                       sunit=0      swidth=0 blks, unwritten=0
         =                       imaxbits=17
naming   =version 2              bsize=4096
log      =internal log           bsize=4096   blocks=1200
realtime =none                   extsz=65536  blocks=0, rtextents=0
sample_hsm]# mkfs.xfs -f /dev/vg0/migfs
meta-data=/dev/vg0/migfs         isize=256    agcount=2, agsize=4096 blks
data     =                       bsize=4096   blocks=8192, imaxpct=25
         =                       sunit=0      swidth=0 blks, unwritten=0
         =                       imaxbits=17
naming   =version 2              bsize=4096
log      =internal log           bsize=4096   blocks=1200
realtime =none                   extsz=65536  blocks=0, rtextents=0
sample_hsm]# mount -t xfs -o dmapi /dev/vg0/dmapi_fs /mnt/dmapi_fs
sample_hsm]# mount -t xfs -o dmapi /dev/vg0/migfs /mnt/migfs
sample_hsm]# mkdir /mnt/dmapi_fs/stage_dir
sample_hsm]# xfs_mkfile 1m /mnt/migfs/tfile
sample_hsm]# ./migfind -s 800k /mnt/migfs >& cand_file
sample_hsm]# cat ./cand_file
24      6e581f87d41649a90e000000000000008300000000000000        1048576
sample_hsm]# df -k /mnt/migfs /mnt/dmapi_fs
Filesystem           1k-blocks      Used Available Use% Mounted on
/dev/vg0/migfs           27968      1072     26896   4% /mnt/migfs
/dev/vg0/dmapi_fs        27968        48     27920   1% /mnt/dmapi_fs
sample_hsm]# ./migout /mnt/dmapi_fs/stage_dir < cand_file
sample_hsm]# df -k /mnt/migfs /mnt/dmapi_fs
Filesystem           1k-blocks      Used Available Use% Mounted on
/dev/vg0/migfs           27968        60     27908   1% /mnt/migfs
/dev/vg0/dmapi_fs        27968      1096     26872   4% /mnt/dmapi_fs
sample_hsm]# ./migin -l dmapi_log /mnt/migfs &
[1] 1205
sample_hsm]# ./mrmean -l
Session (3) name: DMAPI test session
sample_hsm]# cp /mnt/migfs/tfile /mnt/migfs/aaa               <<<<< hung

[other terminal] # ps -ef
(snip)
root      1205  1165  0 16:48 pts/0    00:00:00 ./migin -l dmapi_log /mnt/migfs
root      1207  1165  0 16:49 pts/0    00:00:00 cp -i /mnt/migfs/tfile 
/mnt/migfs/aaa
root      1208  1205  0 16:49 pts/0    00:00:00 [wbee <defunct>]

( Press Ctrl + c to terminate cp )
sample_hsm]# df -k /mnt/migfs /mnt/dmapi_fs
Filesystem           1k-blocks      Used Available Use% Mounted on
/dev/vg0/migfs           27968      1076     26892   4% /mnt/migfs
/dev/vg0/dmapi_fs        27968      1072     26896   4% /mnt/dmapi_fs
sample_hsm]# ./mrmean -l
Session (3) name: DMAPI test session
sample_hsm]# kill -SIGINT 1205
sample_hsm]# ./mrmean -l
Session (3) name: DMAPI test session
[1]+  Done                    ./migin -l dmapi_log /mnt/migfs
sample_hsm]# ls -R /proc/fs/xfs/dmapi_d
/proc/fs/xfs/dmapi_d:
fsreg  sessions  summary

/proc/fs/xfs/dmapi_d/fsreg:
0xc6da68a4  0xc6da6ab4

/proc/fs/xfs/dmapi_d/sessions:
0xc59f0000
sample_hsm]# cat /proc/fs/xfs/dmapi_d/summary
dm_sessions_active=1
dm_next_sessid=4
dm_next_token=3
dm_next_sequence=3
dm_fsys_cnt=2
sample_hsm]# cat /proc/fs/xfs/dmapi_d/fsreg/0xc6da68a4
fsrp=0xc6da68a4
fr_next=0x00000000
fr_vfsp=0xc6d5a5cc
fr_tevp=0x00000000
fr_fsid=?
fr_msg=0xc6cca524
fr_msgsize=100
fr_state=mounted
fr_dispq=?
fr_dispcnt=0
fr_evt_dispq.eq_head=0x00000000
fr_evt_dispq.eq_tail=0x00000000
fr_evt_dispq.eq_count=0
fr_queue=?
fr_lock=?
fr_hdlcnt=0
fr_vfscnt=0
fr_unmount=0
fr_rattr=
sample_hsm]# cat /proc/fs/xfs/dmapi_d/fsreg/0xc6da6ab4
fsrp=0xc6da6ab4
fr_next=0xc6da68a4
fr_vfsp=0xc6d5a4f4
fr_tevp=0x00000000
fr_fsid=?
fr_msg=0xc6cca38c
fr_msgsize=97
fr_state=mounted
fr_dispq=?
fr_dispcnt=0
fr_evt_dispq.eq_head=0x00000000
fr_evt_dispq.eq_tail=0x00000000
fr_evt_dispq.eq_count=0
fr_queue=?
fr_lock=?
fr_hdlcnt=0
fr_vfscnt=0
fr_unmount=0
fr_rattr=
fr_sessp[16]=0xc59f0000
fr_sessp[17]=0xc59f0000
fr_sessp[18]=0xc59f0000
sample_hsm]# cat /proc/fs/xfs/dmapi_d/sessions/0xc59f0000
sessp=0xc59f0000
sn_next=0x00000000
sn_sessid=3
sn_flags=0
sn_qlock=?
sn_readerq=?
sn_writerq=?
sn_readercnt=0
sn_writercnt=0
sn_newq.eq_head=0x00000000
sn_newq.eq_tail=0x00000000
sn_newq.eq_count=0
sn_delq.eq_head=0xc6da6cc4
sn_delq.eq_tail=0xc6da6cc4
sn_delq.eq_count=1
sn_evt_writerq.eq_head=0x00000000
sn_evt_writerq.eq_tail=0x00000000
sn_evt_writerq.eq_count=0
sn_info="DMAPI test session"
sample_hsm]# umount /mnt/migfs
sample_hsm]# dmesg | tail -5
XFS mounting filesystem lvm(58,1)
xfs_unmount: xfs_ibusy says error/16
XFS unmount got error 16
linvfs_put_super: vfsp/0xc6d5a4f4 left dangling!
VFS: Busy inodes after unmount. Self-destruct in 5 seconds.  Have a nice day...
sample_hsm]#


P.S.
migin which is used in above test is not updated yet
( i.e. "TAKE - Cleanup for dmapi test migin" is not taked yet )

cheers,

Takayuki


<Prev in Thread] Current Thread [Next in Thread>