[14065.737791] run fstests btrfs/100 at 2022-04-03 00:56:52
[14065.934993] BTRFS info (device dm-0): flagging fs with big metadata feature
[14065.935429] BTRFS info (device dm-0): using free space tree
[14065.935780] BTRFS info (device dm-0): has skinny extents
[14066.483422] BTRFS: device fsid 75c13cd6-de86-4a18-93d2-fd14f827dee2 devid 1 transid 6 /dev/mapper/vg0-lv8 scanned by mkfs.btrfs (3025712)
[14066.487699] BTRFS: device fsid 75c13cd6-de86-4a18-93d2-fd14f827dee2 devid 2 transid 6 /dev/mapper/error-test scanned by mkfs.btrfs (3025712)
[14066.505927] BTRFS info (device dm-8): flagging fs with big metadata feature
[14066.506425] BTRFS info (device dm-8): setting incompat feature flag for COMPRESS_LZO (0x8)
[14066.507000] BTRFS info (device dm-8): use lzo compression, level 0
[14066.507427] BTRFS info (device dm-8): disk space caching is enabled
[14066.507882] BTRFS info (device dm-8): has skinny extents
[14066.508546] BTRFS info: devid 2 device path /dev/mapper/error-test changed to /dev/dm-11 scanned by systemd-udevd (3018597)
[14066.509781] BTRFS info: devid 2 device path /dev/dm-11 changed to /dev/mapper/error-test scanned by systemd-udevd (3018597)
[14066.519810] BTRFS info (device dm-8): checking UUID tree
[14079.699045] Buffer I/O error on dev dm-11, logical block 2621424, async page read
[14079.714843] btrfs_dev_stat_print_on_error: 2 callbacks suppressed
[14079.714847] BTRFS error (device dm-8): bdev /dev/mapper/error-test errs: wr 1, rd 0, flush 0, corrupt 0, gen 0
[14079.716616] BTRFS error (device dm-8): bdev /dev/mapper/error-test errs: wr 2, rd 0, flush 0, corrupt 0, gen 0
[14079.718926] BTRFS error (device dm-8): bdev /dev/mapper/error-test errs: wr 3, rd 0, flush 0, corrupt 0, gen 0
[14079.719741] BTRFS error (device dm-8): bdev /dev/mapper/error-test errs: wr 4, rd 0, flush 0, corrupt 0, gen 0
[14079.720786] BTRFS error (device dm-8): bdev /dev/mapper/error-test errs: wr 5, rd 0, flush 0, corrupt 0, gen 0
[14079.722048] BTRFS error (device dm-8): bdev /dev/mapper/error-test errs: wr 6, rd 0, flush 0, corrupt 0, gen 0
[14079.745619] BTRFS warning (device dm-8): lost page write due to IO error on /dev/mapper/error-test (-5)
[14079.746219] BTRFS error (device dm-8): bdev /dev/mapper/error-test errs: wr 7, rd 0, flush 0, corrupt 0, gen 0
[14079.746835] BTRFS warning (device dm-8): lost page write due to IO error on /dev/mapper/error-test (-5)
[14079.747411] BTRFS error (device dm-8): bdev /dev/mapper/error-test errs: wr 8, rd 0, flush 0, corrupt 0, gen 0
[14079.749429] BTRFS error (device dm-8): error writing primary super block to device 2
[14079.749951] BTRFS info (device dm-8): dev_replace from /dev/mapper/error-test (devid 2) to /dev/mapper/vg0-lv7 started
[14079.751298] BTRFS error (device dm-8): bdev /dev/mapper/error-test errs: wr 9, rd 0, flush 0, corrupt 0, gen 0
[14079.752272] BTRFS error (device dm-8): bdev /dev/mapper/error-test errs: wr 10, rd 0, flush 0, corrupt 0, gen 0
[14079.762042] BTRFS warning (device dm-8): lost page write due to IO error on /dev/mapper/error-test (-5)
[14079.762688] BTRFS warning (device dm-8): lost page write due to IO error on /dev/mapper/error-test (-5)
[14079.765372] BTRFS error (device dm-8): error writing primary super block to device 2
[14080.185116] BTRFS warning (device dm-8): lost page write due to IO error on /dev/mapper/error-test (-5)
[14080.188533] BTRFS warning (device dm-8): lost page write due to IO error on /dev/mapper/error-test (-5)
[14080.190834] BTRFS error (device dm-8): error writing primary super block to device 2
[14080.191505] BTRFS info (device dm-8): dev_replace from /dev/mapper/error-test (devid 2) to /dev/mapper/vg0-lv7 finished
[14080.192470] Buffer I/O error on dev dm-11, logical block 16, lost async page write
[14080.193094] BTRFS warning (device dm-8): error clearing superblock number 0 (-5)
[14080.193703] Buffer I/O error on dev dm-11, logical block 16384, async page read
[14080.194926] Buffer I/O error on dev dm-11, logical block 2621424, async page read
[14080.368733] BUG: sleeping function called from invalid context at block/blk-sysfs.c:766
[14080.369229] in_atomic(): 1, irqs_disabled(): 0, non_block: 0, pid: 20, name: ksoftirqd/1
[14080.369728] preempt_count: 100, expected: 0
[14080.369983] RCU nest depth: 0, expected: 0
[14080.370225] INFO: lockdep is turned off.
[14080.370459] Preemption disabled at:
[14080.370460] [] __do_softirq+0x5e/0x517
[14080.371008] CPU: 1 PID: 20 Comm: ksoftirqd/1 Tainted: G        W         5.17.0+ #640
[14080.371466] Hardware name: QEMU Standard PC (Q35 + ICH9, 2009), BIOS 1.13.0-2.fc32 04/01/2014
[14080.371968] Call Trace:
[14080.372117]  
[14080.372250]  dump_stack_lvl+0x56/0x6f
[14080.372471]  __might_resched.cold+0xff/0x13a
[14080.372727]  blk_release_queue+0x24/0x120
[14080.372979]  kobject_put+0x7c/0x1d0
[14080.373191]  ? rcu_do_batch+0x1ac/0x570
[14080.373420]  blkg_free.part.0+0x41/0x60
[14080.373649]  rcu_do_batch+0x1e1/0x570
[14080.373869]  ? rcu_do_batch+0x1ac/0x570
[14080.374102]  rcu_core+0x2cb/0x460
[14080.374303]  __do_softirq+0x178/0x517
[14080.374524]  ? smpboot_thread_fn+0x2c/0x270
[14080.374775]  run_ksoftirqd+0x43/0x70
[14080.375097]  smpboot_thread_fn+0x1c1/0x270
[14080.375346]  ? sort_range+0x20/0x20
[14080.375557]  kthread+0xf0/0x120
[14080.375748]  ? kthread_complete_and_exit+0x20/0x20
[14080.376036]  ret_from_fork+0x1f/0x30
[14080.376255]