[24374.821953] run fstests generic/272 at 2022-04-04 03:42:43
[24375.045145] BTRFS info (device dm-0): flagging fs with big metadata feature
[24375.045436] BTRFS info (device dm-0): using free space tree
[24375.045638] BTRFS info (device dm-0): has skinny extents
[24375.205813] BTRFS: device fsid e8779c65-c1f0-40b1-8596-859c7cf9905c devid 1 transid 6 /dev/mapper/vg0-lv7 scanned by mkfs.btrfs (770658)
[24375.217947] BTRFS info (device dm-7): flagging fs with big metadata feature
[24375.218202] BTRFS info (device dm-7): use zlib compression, level 3
[24375.218454] BTRFS info (device dm-7): using free space tree
[24375.218676] BTRFS info (device dm-7): has skinny extents
[24375.242894] BTRFS info (device dm-7): checking UUID tree
[24375.461959] BTRFS: device fsid 5b1844e5-d84b-4a88-b768-2fd35aed386a devid 1 transid 6 /dev/mapper/vg0-lv7 scanned by mkfs.btrfs (770734)
[24375.550921] BTRFS info (device dm-9): flagging fs with big metadata feature
[24375.551146] BTRFS info (device dm-9): use zlib compression, level 3
[24375.551330] BTRFS info (device dm-9): using free space tree
[24375.551498] BTRFS info (device dm-9): has skinny extents
[24375.554015] BTRFS info (device dm-9): checking UUID tree
[24375.727892] BTRFS info (device dm-9): flagging fs with big metadata feature
[24375.728111] BTRFS info (device dm-9): use zlib compression, level 3
[24375.728297] BTRFS info (device dm-9): using free space tree
[24375.728466] BTRFS info (device dm-9): has skinny extents
[24376.057533] Buffer I/O error on dev dm-9, logical block 2621424, async page read
[24376.093127] BTRFS warning (device dm-9): error -5 while searching for dev_stats item for device /dev/mapper/error-test
[24376.093443] BTRFS warning (device dm-9): Skipping commit of aborted transaction.
[24376.093678] BTRFS: error (device dm-9: state A) in cleanup_transaction:1982: errno=-5 IO failure
[24376.093959] BTRFS info (device dm-9: state EA): forced readonly
[24376.136790] BUG: sleeping function called from invalid context at block/blk-sysfs.c:766
[24376.137067] in_atomic(): 1, irqs_disabled(): 0, non_block: 0, pid: 770830, name: 272
[24376.137309] preempt_count: 102, expected: 0
[24376.137456] RCU nest depth: 1, expected: 0
[24376.137605] INFO: lockdep is turned off.
[24376.137746] Preemption disabled at:
[24376.137747] [<0000000000000000>] 0x0
[24376.138044] CPU: 0 PID: 770830 Comm: 272 Tainted: G W 5.17.0+ #641
[24376.138295] Hardware name: QEMU Standard PC (Q35 + ICH9, 2009), BIOS 1.13.0-2.fc32 04/01/2014
[24376.138554] Call Trace:
[24376.138675]
[24376.138791] dump_stack_lvl+0x56/0x6f
[24376.138933] __might_resched.cold+0xff/0x13a
[24376.139084] blk_release_queue+0x24/0x120
[24376.139244] kobject_put+0x7c/0x1d0
[24376.145213] ? rcu_do_batch+0x1ac/0x570
[24376.145364] blkg_free.part.0+0x41/0x60
[24376.145525] rcu_do_batch+0x1e1/0x570
[24376.145666] ? rcu_do_batch+0x1ac/0x570
[24376.145812] rcu_core+0x2cb/0x460
[24376.145955] __do_softirq+0x178/0x517
[24376.146106] __irq_exit_rcu+0xe3/0x160
[24376.146260] irq_exit_rcu+0xa/0x20
[24376.146398] sysvec_apic_timer_interrupt+0xa2/0xd0
[24376.146557]
[24376.146668]
[24376.146783] asm_sysvec_apic_timer_interrupt+0x12/0x20
[24376.146949] RIP: 0010:check_preemption_disabled+0x17/0xe0
[24376.147115] Code: 01 e8 d9 88 f8 ff e9 79 ff ff ff cc cc cc cc cc cc cc cc 41 54 55 53 48 83 ec 08 65 44 8b 25 b0 57 1c 5d 65 8b 05 59 bc 1c 5d ff ff ff 7f 74 0c 48 83 c4 08 44 89 e0 5b 5d 41 5c c3 9c 58 0f
[24376.147580] RSP: 0018:ffffb94a042ffc30 EFLAGS: 00000286
[24376.147746] RAX: 0000000080000002 RBX: 0000000000000000 RCX: 0000000000000000
[24376.147941] RDX: ffff963444773200 RSI: ffffffffa387e4d9 RDI: ffffffffa383354b
[24376.148154] RBP: ffffdfe605cf3300 R08: 0000000000000000 R09: 0000000000000000
[24376.148360] R10: 0000000000000000 R11: ffffffffa23cd75c R12: 0000000000000000
[24376.148554] R13: 00007fd5ee84c000 R14: ffffb94a042ffdf8 R15: 0000000173ccc025
[24376.148759] ? free_unref_page_list+0x12c/0x560
[24376.148919] rcu_is_watching+0xd/0x40
[24376.149058] unlock_page_memcg+0x53/0x140
[24376.149218] page_remove_rmap+0x105/0x5c0
[24376.149366] unmap_page_range+0x706/0x10e0
[24376.149519] ? lock_release+0x1ed/0x2c0
[24376.149674] unmap_vmas+0xb3/0x130
[24376.149812] exit_mmap+0x91/0x1b0
[24376.149956] __mmput+0x4a/0x150
[24376.150093] do_exit+0x325/0xbf0
[24376.150239] ? up_read+0x17/0x20
[24376.150374] do_group_exit+0x33/0xb0
[24376.150516] __x64_sys_exit_group+0x14/0x20
[24376.150671] do_syscall_64+0x38/0x90
[24376.150816] entry_SYSCALL_64_after_hwframe+0x44/0xae
[24376.150977] RIP: 0033:0x7fd5ee866021
[24376.151127] Code: Unable to access opcode bytes at RIP 0x7fd5ee865ff7.
[24376.151321] RSP: 002b:00007ffccf64f6a8 EFLAGS: 00000246 ORIG_RAX: 00000000000000e7
[24376.151565] RAX: ffffffffffffffda RBX: 00007fd5ee95e470 RCX: 00007fd5ee866021
[24376.151758] RDX: 000000000000003c RSI: 00000000000000e7 RDI: 0000000000000000
[24376.151953] RBP: 0000000000000000 R08: ffffffffffffff88 R09: 0000000000000001
[24376.152793] R10: 0000000000000000 R11: 0000000000000246 R12: 00007fd5ee95e470
[24376.153000] R13: 0000000000000001 R14: 00007fd5ee95e948 R15: 0000000000000000
[24376.153222]
[24376.160184] BTRFS info (device dm-7): flagging fs with big metadata feature
[24376.160404] BTRFS info (device dm-7): use zlib compression, level 3
[24376.160589] BTRFS info (device dm-7): using free space tree
[24376.160757] BTRFS info (device dm-7): has skinny extents