https://bugzilla.kernel.org/show_bug.cgi?id=218229 --- Comment #1 from chandanbabu@xxxxxxxxxx --- On Tue, Dec 05, 2023 at 12:26:54 PM +0000, bugzilla-daemon@xxxxxxxxxx wrote: > https://bugzilla.kernel.org/show_bug.cgi?id=218229 > > Bug ID: 218229 > Summary: xfstests xfs/438 hung > Product: File System > Version: 2.5 > Hardware: Intel > OS: Linux > Status: NEW > Severity: normal > Priority: P3 > Component: XFS > Assignee: filesystem_xfs@xxxxxxxxxxxxxxxxxxxxxx > Reporter: dagmcr@xxxxxxxxx > Regression: No > > While doing fstests baseline testing on v6.6-rc5 with kdevops [0] we found a > failure rate of ~1/2 for xfs/438 test. > > [0] https://github.com/linux-kdevops > > This fails on the following test sections as defined by kdevops [1]: > > * xfs_crc_logdev > * xfs_reflink_logdev > > [0] https://github.com/linux-kdevops > [1] > > https://github.com/linux-kdevops/kdevops/blob/master/playbooks/roles/fstests/templates/xfs/xfs.config > > Below is just one full trace. > > Oct 17 19:10:05 line-xfs-crc-logdev unknown: run fstests xfs/438 at > 2023-10-17 > 19:10:05 > Oct 17 19:10:06 line-xfs-crc-logdev kernel: XFS (dm-0): Mounting V5 > Filesystem > 3e1fc16c-f101-4acb-bacb-39ae396320fe > Oct 17 19:10:07 line-xfs-crc-logdev kernel: XFS (dm-0): Ending clean mount > Oct 17 19:10:07 line-xfs-crc-logdev kernel: XFS (dm-0): Quotacheck needed: > Please wait. > Oct 17 19:10:07 line-xfs-crc-logdev kernel: XFS (dm-0): Quotacheck: Done. > Oct 17 19:10:07 line-xfs-crc-logdev kernel: XFS (dm-0): Filesystem has been > shut down due to log error (0x2). > Oct 17 19:10:07 line-xfs-crc-logdev kernel: XFS (dm-0): Please unmount the > filesystem and rectify the problem(s). > Oct 17 19:10:09 line-xfs-crc-logdev kernel: XFS (dm-0): Unmounting Filesystem > 3e1fc16c-f101-4acb-bacb-39ae396320fe > Oct 17 19:14:04 line-xfs-crc-logdev kernel: INFO: task umount:17146 blocked > for > more than 120 seconds. > Oct 17 19:14:04 line-xfs-crc-logdev kernel: Not tainted 6.6.0-rc5 #2 > Oct 17 19:14:04 line-xfs-crc-logdev kernel: "echo 0 > > /proc/sys/kernel/hung_task_timeout_secs" disables this message. > Oct 17 19:14:04 line-xfs-crc-logdev kernel: task:umount state:D > stack:0 pid:17146 ppid:16828 flags:0x00004002 > Oct 17 19:14:04 line-xfs-crc-logdev kernel: Call Trace: > Oct 17 19:14:04 line-xfs-crc-logdev kernel: <TASK> > Oct 17 19:14:04 line-xfs-crc-logdev kernel: __schedule+0x3ab/0xab0 > Oct 17 19:14:04 line-xfs-crc-logdev kernel: schedule+0x5d/0xe0 > Oct 17 19:14:04 line-xfs-crc-logdev kernel: schedule_timeout+0x143/0x150 > Oct 17 19:14:04 line-xfs-crc-logdev kernel: ? __flush_workqueue+0x184/0x400 > Oct 17 19:14:04 line-xfs-crc-logdev kernel: __down_common+0xf6/0x200 > Oct 17 19:14:04 line-xfs-crc-logdev kernel: ? > __pfx_preempt_count_add+0x10/0x10 > Oct 17 19:14:04 line-xfs-crc-logdev kernel: ? preempt_count_add+0x6a/0xa0 > Oct 17 19:14:04 line-xfs-crc-logdev kernel: down+0x43/0x60 > Oct 17 19:14:04 line-xfs-crc-logdev kernel: xfs_log_unmount+0x4a/0xc0 [xfs] > Oct 17 19:14:04 line-xfs-crc-logdev kernel: xfs_unmountfs+0x9a/0x1b0 [xfs] > Oct 17 19:14:04 line-xfs-crc-logdev kernel: xfs_fs_put_super+0x37/0x80 [xfs] > Oct 17 19:14:04 line-xfs-crc-logdev kernel: > generic_shutdown_super+0x7c/0x110 > Oct 17 19:14:04 line-xfs-crc-logdev kernel: kill_block_super+0x16/0x40 > Oct 17 19:14:04 line-xfs-crc-logdev kernel: xfs_kill_sb+0xe/0x20 [xfs] > Oct 17 19:14:04 line-xfs-crc-logdev kernel: > deactivate_locked_super+0x2f/0xb0 > Oct 17 19:14:04 line-xfs-crc-logdev kernel: cleanup_mnt+0xbd/0x150 > Oct 17 19:14:04 line-xfs-crc-logdev kernel: task_work_run+0x59/0x90 > Oct 17 19:14:04 line-xfs-crc-logdev kernel: > exit_to_user_mode_prepare+0x15c/0x160 > Oct 17 19:14:04 line-xfs-crc-logdev kernel: > syscall_exit_to_user_mode+0x22/0x50 > Oct 17 19:14:04 line-xfs-crc-logdev kernel: do_syscall_64+0x46/0x90 > Oct 17 19:14:04 line-xfs-crc-logdev kernel: > entry_SYSCALL_64_after_hwframe+0x6e/0xd8 > Oct 17 19:14:04 line-xfs-crc-logdev kernel: RIP: 0033:0x7fb9538db737 > Oct 17 19:14:04 line-xfs-crc-logdev kernel: RSP: 002b:00007fffaf33f768 > EFLAGS: > 00000246 ORIG_RAX: 00000000000000a6 > Oct 17 19:14:04 line-xfs-crc-logdev kernel: RAX: 0000000000000000 RBX: > 000055b4718dcb60 RCX: 00007fb9538db737 > Oct 17 19:14:04 line-xfs-crc-logdev kernel: RDX: 0000000000000000 RSI: > 0000000000000000 RDI: 000055b4718e0820 > Oct 17 19:14:04 line-xfs-crc-logdev kernel: RBP: 0000000000000000 R08: > 0000000000000007 R09: 000055b4718e0cc0 > Oct 17 19:14:04 line-xfs-crc-logdev kernel: R10: 0000000000000000 R11: > 0000000000000246 R12: 00007fb953a2623c > Oct 17 19:14:04 line-xfs-crc-logdev kernel: R13: 000055b4718e0820 R14: > 000055b4718dce70 R15: 000055b4718dca60 > Oct 17 19:14:04 line-xfs-crc-logdev kernel: </TASK> > Oct 17 19:16:05 line-xfs-crc-logdev kernel: INFO: task umount:17146 blocked > for > more than 241 seconds. > Oct 17 19:16:05 line-xfs-crc-logdev kernel: Not tainted 6.6.0-rc5 #2 > Oct 17 19:16:05 line-xfs-crc-logdev kernel: "echo 0 > > /proc/sys/kernel/hung_task_timeout_secs" disables this message. > Oct 17 19:16:05 line-xfs-crc-logdev kernel: task:umount state:D > stack:0 pid:17146 ppid:16828 flags:0x00004002 > Oct 17 19:16:05 line-xfs-crc-logdev kernel: Call Trace: > Oct 17 19:16:05 line-xfs-crc-logdev kernel: <TASK> > Oct 17 19:16:05 line-xfs-crc-logdev kernel: __schedule+0x3ab/0xab0 > Oct 17 19:16:05 line-xfs-crc-logdev kernel: schedule+0x5d/0xe0 > Oct 17 19:16:05 line-xfs-crc-logdev kernel: schedule_timeout+0x143/0x150 > Oct 17 19:16:05 line-xfs-crc-logdev kernel: ? __flush_workqueue+0x184/0x400 > Oct 17 19:16:05 line-xfs-crc-logdev kernel: __down_common+0xf6/0x200 > Oct 17 19:16:05 line-xfs-crc-logdev kernel: ? > __pfx_preempt_count_add+0x10/0x10 > Oct 17 19:16:05 line-xfs-crc-logdev kernel: ? preempt_count_add+0x6a/0xa0 > Oct 17 19:16:05 line-xfs-crc-logdev kernel: down+0x43/0x60 > Oct 17 19:16:05 line-xfs-crc-logdev kernel: xfs_log_unmount+0x4a/0xc0 [xfs] > Oct 17 19:16:05 line-xfs-crc-logdev kernel: xfs_unmountfs+0x9a/0x1b0 [xfs] > Oct 17 19:16:05 line-xfs-crc-logdev kernel: xfs_fs_put_super+0x37/0x80 [xfs] > Oct 17 19:16:05 line-xfs-crc-logdev kernel: > generic_shutdown_super+0x7c/0x110 > Oct 17 19:16:05 line-xfs-crc-logdev kernel: kill_block_super+0x16/0x40 > Oct 17 19:16:05 line-xfs-crc-logdev kernel: xfs_kill_sb+0xe/0x20 [xfs] > Oct 17 19:16:05 line-xfs-crc-logdev kernel: > deactivate_locked_super+0x2f/0xb0 > Oct 17 19:16:05 line-xfs-crc-logdev kernel: cleanup_mnt+0xbd/0x150 > Oct 17 19:16:05 line-xfs-crc-logdev kernel: task_work_run+0x59/0x90 > Oct 17 19:16:05 line-xfs-crc-logdev kernel: > exit_to_user_mode_prepare+0x15c/0x160 > Oct 17 19:16:05 line-xfs-crc-logdev kernel: > syscall_exit_to_user_mode+0x22/0x50 > Oct 17 19:16:05 line-xfs-crc-logdev kernel: do_syscall_64+0x46/0x90 > Oct 17 19:16:05 line-xfs-crc-logdev kernel: > entry_SYSCALL_64_after_hwframe+0x6e/0xd8 > Oct 17 19:16:05 line-xfs-crc-logdev kernel: RIP: 0033:0x7fb9538db737 > Oct 17 19:16:05 line-xfs-crc-logdev kernel: RSP: 002b:00007fffaf33f768 > EFLAGS: > 00000246 ORIG_RAX: 00000000000000a6 > Oct 17 19:16:05 line-xfs-crc-logdev kernel: RAX: 0000000000000000 RBX: > 000055b4718dcb60 RCX: 00007fb9538db737 > Oct 17 19:16:05 line-xfs-crc-logdev kernel: RDX: 0000000000000000 RSI: > 0000000000000000 RDI: 000055b4718e0820 > Oct 17 19:16:05 line-xfs-crc-logdev kernel: RBP: 0000000000000000 R08: > 0000000000000007 R09: 000055b4718e0cc0 > Oct 17 19:16:05 line-xfs-crc-logdev kernel: R10: 0000000000000000 R11: > 0000000000000246 R12: 00007fb953a2623c > Oct 17 19:16:05 line-xfs-crc-logdev kernel: R13: 000055b4718e0820 R14: > 000055b4718dce70 R15: 000055b4718dca60 > Oct 17 19:16:05 line-xfs-crc-logdev kernel: </TASK> > Oct 17 19:18:05 line-xfs-crc-logdev kernel: INFO: task umount:17146 blocked > for > more than 362 seconds. > Oct 17 19:18:05 line-xfs-crc-logdev kernel: Not tainted 6.6.0-rc5 #2 > Oct 17 19:18:05 line-xfs-crc-logdev kernel: "echo 0 > > /proc/sys/kernel/hung_task_timeout_secs" disables this message. > Oct 17 19:18:05 line-xfs-crc-logdev kernel: task:umount state:D > stack:0 pid:17146 ppid:16828 flags:0x00004002 > Oct 17 19:18:05 line-xfs-crc-logdev kernel: Call Trace: > Oct 17 19:18:05 line-xfs-crc-logdev kernel: <TASK> > Oct 17 19:18:05 line-xfs-crc-logdev kernel: __schedule+0x3ab/0xab0 > Oct 17 19:18:05 line-xfs-crc-logdev kernel: schedule+0x5d/0xe0 > Oct 17 19:18:05 line-xfs-crc-logdev kernel: schedule_timeout+0x143/0x150 > Oct 17 19:18:05 line-xfs-crc-logdev kernel: ? __flush_workqueue+0x184/0x400 > Oct 17 19:18:05 line-xfs-crc-logdev kernel: __down_common+0xf6/0x200 > Oct 17 19:18:05 line-xfs-crc-logdev kernel: ? > __pfx_preempt_count_add+0x10/0x10 > Oct 17 19:18:05 line-xfs-crc-logdev kernel: ? preempt_count_add+0x6a/0xa0 > Oct 17 19:18:05 line-xfs-crc-logdev kernel: down+0x43/0x60 > Oct 17 19:18:05 line-xfs-crc-logdev kernel: xfs_log_unmount+0x4a/0xc0 [xfs] > Oct 17 19:18:05 line-xfs-crc-logdev kernel: xfs_unmountfs+0x9a/0x1b0 [xfs] > Oct 17 19:18:06 line-xfs-crc-logdev kernel: xfs_fs_put_super+0x37/0x80 [xfs] > Oct 17 19:18:06 line-xfs-crc-logdev kernel: > generic_shutdown_super+0x7c/0x110 > Oct 17 19:18:06 line-xfs-crc-logdev kernel: kill_block_super+0x16/0x40 > Oct 17 19:18:06 line-xfs-crc-logdev kernel: xfs_kill_sb+0xe/0x20 [xfs] > Oct 17 19:18:06 line-xfs-crc-logdev kernel: > deactivate_locked_super+0x2f/0xb0 > Oct 17 19:18:06 line-xfs-crc-logdev kernel: cleanup_mnt+0xbd/0x150 > Oct 17 19:18:06 line-xfs-crc-logdev kernel: task_work_run+0x59/0x90 > Oct 17 19:18:06 line-xfs-crc-logdev kernel: > exit_to_user_mode_prepare+0x15c/0x160 > Oct 17 19:18:06 line-xfs-crc-logdev kernel: > syscall_exit_to_user_mode+0x22/0x50 > Oct 17 19:18:06 line-xfs-crc-logdev kernel: do_syscall_64+0x46/0x90 > Oct 17 19:18:06 line-xfs-crc-logdev kernel: > entry_SYSCALL_64_after_hwframe+0x6e/0xd8 > Oct 17 19:18:06 line-xfs-crc-logdev kernel: RIP: 0033:0x7fb9538db737 > Oct 17 19:18:06 line-xfs-crc-logdev kernel: RSP: 002b:00007fffaf33f768 > EFLAGS: > 00000246 ORIG_RAX: 00000000000000a6 > Oct 17 19:18:06 line-xfs-crc-logdev kernel: RAX: 0000000000000000 RBX: > 000055b4718dcb60 RCX: 00007fb9538db737 > Oct 17 19:18:06 line-xfs-crc-logdev kernel: RDX: 0000000000000000 RSI: > 0000000000000000 RDI: 000055b4718e0820 > Oct 17 19:18:06 line-xfs-crc-logdev kernel: RBP: 0000000000000000 R08: > 0000000000000007 R09: 000055b4718e0cc0 > Oct 17 19:18:06 line-xfs-crc-logdev kernel: R10: 0000000000000000 R11: > 0000000000000246 R12: 00007fb953a2623c > Oct 17 19:18:06 line-xfs-crc-logdev kernel: R13: 000055b4718e0820 R14: > 000055b4718dce70 R15: 000055b4718dca60 > Oct 17 19:18:06 line-xfs-crc-logdev kernel: </TASK> > Oct 17 19:20:06 line-xfs-crc-logdev kernel: INFO: task umount:17146 blocked > for > more than 483 seconds. > Oct 17 19:20:06 line-xfs-crc-logdev kernel: Not tainted 6.6.0-rc5 #2 > Oct 17 19:20:06 line-xfs-crc-logdev kernel: "echo 0 > > /proc/sys/kernel/hung_task_timeout_secs" disables this message. > Oct 17 19:20:06 line-xfs-crc-logdev kernel: task:umount state:D > stack:0 pid:17146 ppid:16828 flags:0x00004002 > Oct 17 19:20:06 line-xfs-crc-logdev kernel: Call Trace: > Oct 17 19:20:06 line-xfs-crc-logdev kernel: <TASK> > Oct 17 19:20:06 line-xfs-crc-logdev kernel: __schedule+0x3ab/0xab0 > Oct 17 19:20:06 line-xfs-crc-logdev kernel: schedule+0x5d/0xe0 > Oct 17 19:20:06 line-xfs-crc-logdev kernel: schedule_timeout+0x143/0x150 > Oct 17 19:20:06 line-xfs-crc-logdev kernel: ? __flush_workqueue+0x184/0x400 > Oct 17 19:20:06 line-xfs-crc-logdev kernel: __down_common+0xf6/0x200 > Oct 17 19:20:06 line-xfs-crc-logdev kernel: ? > __pfx_preempt_count_add+0x10/0x10 > Oct 17 19:20:06 line-xfs-crc-logdev kernel: ? preempt_count_add+0x6a/0xa0 > Oct 17 19:20:06 line-xfs-crc-logdev kernel: down+0x43/0x60 > Oct 17 19:20:06 line-xfs-crc-logdev kernel: xfs_log_unmount+0x4a/0xc0 [xfs] > Oct 17 19:20:06 line-xfs-crc-logdev kernel: xfs_unmountfs+0x9a/0x1b0 [xfs] > Oct 17 19:20:06 line-xfs-crc-logdev kernel: xfs_fs_put_super+0x37/0x80 [xfs] > Oct 17 19:20:06 line-xfs-crc-logdev kernel: > generic_shutdown_super+0x7c/0x110 > Oct 17 19:20:06 line-xfs-crc-logdev kernel: kill_block_super+0x16/0x40 > Oct 17 19:20:06 line-xfs-crc-logdev kernel: xfs_kill_sb+0xe/0x20 [xfs] > Oct 17 19:20:06 line-xfs-crc-logdev kernel: > deactivate_locked_super+0x2f/0xb0 > Oct 17 19:20:06 line-xfs-crc-logdev kernel: cleanup_mnt+0xbd/0x150 > Oct 17 19:20:06 line-xfs-crc-logdev kernel: task_work_run+0x59/0x90 > Oct 17 19:20:06 line-xfs-crc-logdev kernel: > exit_to_user_mode_prepare+0x15c/0x160 > Oct 17 19:20:06 line-xfs-crc-logdev kernel: > syscall_exit_to_user_mode+0x22/0x50 > Oct 17 19:20:06 line-xfs-crc-logdev kernel: do_syscall_64+0x46/0x90 > Oct 17 19:20:06 line-xfs-crc-logdev kernel: > entry_SYSCALL_64_after_hwframe+0x6e/0xd8 > Oct 17 19:20:06 line-xfs-crc-logdev kernel: RIP: 0033:0x7fb9538db737 > Oct 17 19:20:06 line-xfs-crc-logdev kernel: RSP: 002b:00007fffaf33f768 > EFLAGS: > 00000246 ORIG_RAX: 00000000000000a6 This bug was fixed by https://lore.kernel.org/linux-xfs/20231030203349.663275-1-leah.rumancik@xxxxxxxxx/ -- You may reply to this email to add a comment. You are receiving this mail because: You are watching the assignee of the bug.