[ 289.483515] run fstests generic/269 at 2019-09-19 11:12:54 [ 289.643029] BTRFS info (device vda): disk space caching is enabled [ 289.645049] BTRFS info (device vda): has skinny extents [ 289.716273] BTRFS: device fsid e6253fb0-bc7b-4557-9059-4e420cf68100 devid 1 transid 5 /dev/vdb [ 289.732253] BTRFS info (device vdb): disk space caching is enabled [ 289.734549] BTRFS info (device vdb): has skinny extents [ 289.736324] BTRFS info (device vdb): flagging fs with big metadata feature [ 289.743039] BTRFS info (device vdb): creating UUID tree [ 297.791496] ------------[ cut here ]------------ [ 297.794342] WARNING: CPU: 0 PID: 7638 at /kbuild/src/consumer/fs/btrfs/space-info.h:110 btrfs_space_info_update_bytes_may_use.part.8+0x10/0x1c [btrfs] [ 297.800712] Modules linked in: btrfs xor zstd_decompress zstd_compress raid6_pq libcrc32c dm_mod sr_mod cdrom intel_rapl_msr intel_rapl_common sg crct10dif_pclmul crc32_pclmul crc32c_intel ghash_clmulni_intel ata_generic pata_acpi ppdev snd_pcm bochs_drm snd_timer drm_vram_helper ttm snd drm_kms_helper aesni_intel crypto_simd syscopyarea sysfillrect soundcore sysimgblt cryptd fb_sys_fops glue_helper ata_piix drm pcspkr libata joydev serio_raw i2c_piix4 parport_pc floppy parport ip_tables [ 297.818261] CPU: 0 PID: 7638 Comm: fsstress Not tainted 5.3.0-rc8-00124-g91182645075f9 #1 [ 297.822010] Hardware name: QEMU Standard PC (i440FX + PIIX, 1996), BIOS 1.10.2-1 04/01/2014 [ 297.825822] RIP: 0010:btrfs_space_info_update_bytes_may_use.part.8+0x10/0x1c [btrfs] [ 297.829406] Code: 89 fb 48 c7 c7 b0 01 7a c0 e8 83 3a 58 f0 0f 0b 48 c7 43 28 00 00 00 00 5b c3 53 48 89 fb 48 c7 c7 58 02 7a c0 e8 67 3a 58 f0 <0f> 0b 48 c7 43 28 00 00 00 00 5b c3 53 48 89 fb 48 c7 c7 b0 02 7a [ 297.837488] RSP: 0018:ffffae4a02347c68 EFLAGS: 00010286 [ 297.840449] RAX: 0000000000000024 RBX: ffff93ea7ffba600 RCX: 0000000000000000 [ 297.843937] RDX: 0000000000000000 RSI: ffff93eb3fc17778 RDI: ffff93eb3fc17778 [ 297.847405] RBP: ffff93ea7ffba600 R08: 00000000000004d0 R09: 0000000000aaaaaa [ 297.850909] R10: ffff93ea77d70000 R11: ffff93ea7eed5c00 R12: ffff93ea77d70000 [ 297.854026] R13: ffff93ea9de46ab0 R14: 00000000ffffffe4 R15: 000000000000b000 [ 297.856302] FS: 00007fe6eb999b40(0000) GS:ffff93eb3fc00000(0000) knlGS:0000000000000000 [ 297.858746] CS: 0010 DS: 0000 ES: 0000 CR0: 0000000080050033 [ 297.860706] CR2: 00007fe6eb980010 CR3: 0000000079edc000 CR4: 00000000000406f0 [ 297.862966] Call Trace: [ 297.864347] btrfs_free_reserved_data_space_noquota+0x11d/0x190 [btrfs] [ 297.866555] btrfs_free_reserved_data_space+0x4b/0x70 [btrfs] [ 297.868519] __btrfs_prealloc_file_range+0x33a/0x490 [btrfs] [ 297.870451] btrfs_prealloc_file_range+0x10/0x20 [btrfs] [ 297.872304] btrfs_fallocate+0x7cf/0x1100 [btrfs] [ 297.874047] ? selinux_file_permission+0x123/0x140 [ 297.875793] vfs_fallocate+0x13f/0x270 [ 297.877383] ksys_fallocate+0x3c/0x70 [ 297.878912] __x64_sys_fallocate+0x1a/0x20 [ 297.880507] do_syscall_64+0x5b/0x1f0 [ 297.882006] entry_SYSCALL_64_after_hwframe+0x44/0xa9 [ 297.883731] RIP: 0033:0x7fe6eae9d40a [ 297.885201] Code: 8b 0d 92 8a 2b 00 f7 d8 64 89 01 48 83 c8 ff c3 8b 05 0a e3 2b 00 49 89 ca 85 c0 75 33 48 63 f6 48 63 ff b8 1d 01 00 00 0f 05 <48> 3d 00 f0 ff ff 77 06 c3 0f 1f 44 00 00 48 8b 15 59 8a 2b 00 f7 [ 297.890183] RSP: 002b:00007ffe2b93ffa8 EFLAGS: 00000246 ORIG_RAX: 000000000000011d [ 297.892416] RAX: ffffffffffffffda RBX: 0000000000000004 RCX: 00007fe6eae9d40a [ 297.894623] RDX: 000000000038b32b RSI: 0000000000000000 RDI: 0000000000000004 [ 297.896794] RBP: 00000000000000dc R08: 000000000000004a R09: 00007ffe2b93ffcc [ 297.898954] R10: 0000000000077e3e R11: 0000000000000246 R12: 0000000000000000 [ 297.901064] R13: 0000000000077e3e R14: 000000000038b32b R15: 0000000000000000 [ 297.903215] ---[ end trace 152c7eab27778aec ]--- [ 297.914788] ------------[ cut here ]------------ [ 297.917583] WARNING: CPU: 1 PID: 201 at /kbuild/src/consumer/fs/btrfs/space-info.h:110 btrfs_space_info_update_bytes_may_use.part.8+0x10/0x1c [btrfs] [ 297.926641] Modules linked in: btrfs xor zstd_decompress zstd_compress raid6_pq libcrc32c dm_mod sr_mod cdrom intel_rapl_msr intel_rapl_common sg crct10dif_pclmul crc32_pclmul crc32c_intel ghash_clmulni_intel ata_generic pata_acpi ppdev snd_pcm bochs_drm snd_timer drm_vram_helper ttm snd drm_kms_helper aesni_intel crypto_simd syscopyarea sysfillrect soundcore sysimgblt cryptd fb_sys_fops glue_helper ata_piix drm pcspkr libata joydev serio_raw i2c_piix4 parport_pc floppy parport ip_tables [ 297.949654] CPU: 1 PID: 201 Comm: kworker/u4:2 Tainted: G W 5.3.0-rc8-00124-g91182645075f9 #1 [ 297.953304] Hardware name: QEMU Standard PC (i440FX + PIIX, 1996), BIOS 1.10.2-1 04/01/2014 [ 297.956625] Workqueue: btrfs-flush_delalloc btrfs_flush_delalloc_helper [btrfs] [ 297.959706] RIP: 0010:btrfs_space_info_update_bytes_may_use.part.8+0x10/0x1c [btrfs] [ 297.962831] Code: 89 fb 48 c7 c7 b0 01 7a c0 e8 83 3a 58 f0 0f 0b 48 c7 43 28 00 00 00 00 5b c3 53 48 89 fb 48 c7 c7 58 02 7a c0 e8 67 3a 58 f0 <0f> 0b 48 c7 43 28 00 00 00 00 5b c3 53 48 89 fb 48 c7 c7 b0 02 7a [ 297.969803] RSP: 0018:ffffae4a001677a0 EFLAGS: 00010286 [ 297.972351] RAX: 0000000000000024 RBX: ffff93ea7ffba600 RCX: 0000000000000000 [ 297.975320] RDX: 0000000000000000 RSI: ffff93eb3fd17778 RDI: ffff93eb3fd17778 [ 297.978275] RBP: ffff93ea7ffba600 R08: 00000000000004f5 R09: 0000000000aaaaaa [ 297.981228] R10: ffff93ea7e481000 R11: ffff93ea7eed4eb0 R12: ffff93ea77d70000 [ 297.984158] R13: 0000000000001000 R14: ffff93ea7e481000 R15: ffffae4a001678bc [ 297.987096] FS: 0000000000000000(0000) GS:ffff93eb3fd00000(0000) knlGS:0000000000000000 [ 297.990247] CS: 0010 DS: 0000 ES: 0000 CR0: 0000000080050033 [ 297.992936] CR2: 000055add20c24c8 CR3: 000000007ad22000 CR4: 00000000000406e0 [ 297.995896] Call Trace: [ 297.998060] btrfs_free_reserved_data_space_noquota+0x11d/0x190 [btrfs] [ 298.000903] btrfs_clear_delalloc_extent+0x1a1/0x420 [btrfs] [ 298.003549] clear_state_bit+0x77/0x1e0 [btrfs] [ 298.005929] __clear_extent_bit+0x237/0x480 [btrfs] [ 298.008367] extent_clear_unlock_delalloc+0x41/0x70 [btrfs] [ 298.010984] cow_file_range+0x26c/0x420 [btrfs] [ 298.013305] run_delalloc_nocow+0x38a/0xa90 [btrfs] [ 298.015022] btrfs_run_delalloc_range+0x494/0x4f0 [btrfs] [ 298.016835] ? find_lock_delalloc_range+0x1f4/0x220 [btrfs] [ 298.018703] writepage_delalloc+0xef/0x130 [btrfs] [ 298.020402] __extent_writepage+0x1af/0x350 [btrfs] [ 298.022150] extent_write_cache_pages+0x240/0x400 [btrfs] [ 298.023956] ? update_load_avg+0x7e/0x620 [ 298.025542] extent_writepages+0x52/0xa0 [btrfs] [ 298.027209] ? __switch_to_asm+0x40/0x70 [ 298.028743] do_writepages+0x4b/0xf0 [ 298.030221] ? __switch_to_asm+0x34/0x70 [ 298.031707] ? __switch_to_asm+0x40/0x70 [ 298.033200] ? __switch_to_asm+0x34/0x70 [ 298.034669] ? __switch_to_asm+0x40/0x70 [ 298.036118] ? __switch_to_asm+0x34/0x70 [ 298.037582] ? __switch_to_asm+0x40/0x70 [ 298.039025] ? __switch_to_asm+0x34/0x70 [ 298.040461] ? __switch_to_asm+0x34/0x70 [ 298.041915] ? __filemap_fdatawrite_range+0xc1/0x100 [ 298.043544] __filemap_fdatawrite_range+0xc1/0x100 [ 298.045111] ? __switch_to_asm+0x40/0x70 [ 298.046552] btrfs_run_delalloc_work+0x17/0x40 [btrfs] [ 298.048167] normal_work_helper+0x83/0x340 [btrfs] [ 298.049693] ? __schedule+0x25d/0x670 [ 298.050987] process_one_work+0x19c/0x3b0 [ 298.052322] worker_thread+0x3c/0x3b0 [ 298.053587] ? process_one_work+0x3b0/0x3b0 [ 298.054922] kthread+0x11e/0x140 [ 298.056072] ? kthread_park+0xa0/0xa0 [ 298.057303] ret_from_fork+0x35/0x40 [ 298.058503] ---[ end trace 152c7eab27778aed ]--- [ 298.075835] ------------[ cut here ]------------ [ 298.077439] WARNING: CPU: 0 PID: 732 at /kbuild/src/consumer/fs/btrfs/space-info.h:110 btrfs_space_info_update_bytes_may_use.part.8+0x10/0x1c [btrfs] [ 298.080924] Modules linked in: btrfs xor zstd_decompress zstd_compress raid6_pq libcrc32c dm_mod sr_mod cdrom intel_rapl_msr intel_rapl_common sg crct10dif_pclmul crc32_pclmul crc32c_intel ghash_clmulni_intel ata_generic pata_acpi ppdev snd_pcm bochs_drm snd_timer drm_vram_helper ttm snd drm_kms_helper aesni_intel crypto_simd syscopyarea sysfillrect soundcore sysimgblt cryptd fb_sys_fops glue_helper ata_piix drm pcspkr libata joydev serio_raw i2c_piix4 parport_pc floppy parport ip_tables [ 298.091107] CPU: 0 PID: 732 Comm: kworker/u4:6 Tainted: G W 5.3.0-rc8-00124-g91182645075f9 #1 [ 298.093539] Hardware name: QEMU Standard PC (i440FX + PIIX, 1996), BIOS 1.10.2-1 04/01/2014 [ 298.095724] Workqueue: btrfs-flush_delalloc btrfs_flush_delalloc_helper [btrfs] [ 298.097729] RIP: 0010:btrfs_space_info_update_bytes_may_use.part.8+0x10/0x1c [btrfs] [ 298.099789] Code: 89 fb 48 c7 c7 b0 01 7a c0 e8 83 3a 58 f0 0f 0b 48 c7 43 28 00 00 00 00 5b c3 53 48 89 fb 48 c7 c7 58 02 7a c0 e8 67 3a 58 f0 <0f> 0b 48 c7 43 28 00 00 00 00 5b c3 53 48 89 fb 48 c7 c7 b0 02 7a [ 298.104587] RSP: 0018:ffffae4a001f7890 EFLAGS: 00010286 [ 298.106219] RAX: 0000000000000024 RBX: ffff93ea7ffba600 RCX: 0000000000000000 [ 298.108189] RDX: 0000000000000000 RSI: ffff93eb3fc17778 RDI: ffff93eb3fc17778 [ 298.110174] RBP: ffff93ea7ffba600 R08: 000000000000052c R09: 0000000000aaaaaa [ 298.112140] R10: ffff93ea7e481000 R11: ffff93ea7eed41f0 R12: ffff93ea77d70000 [ 298.114131] R13: 0000000000001000 R14: ffff93ea7e481000 R15: ffffae4a001f79ac [ 298.116105] FS: 0000000000000000(0000) GS:ffff93eb3fc00000(0000) knlGS:0000000000000000 [ 298.118267] CS: 0010 DS: 0000 ES: 0000 CR0: 0000000080050033 [ 298.119995] CR2: 00007fe6eb980010 CR3: 000000007d994000 CR4: 00000000000406f0 [ 298.122133] Call Trace: [ 298.123294] btrfs_free_reserved_data_space_noquota+0x11d/0x190 [btrfs] [ 298.125234] btrfs_clear_delalloc_extent+0x1a1/0x420 [btrfs] [ 298.127143] clear_state_bit+0x77/0x1e0 [btrfs] [ 298.128734] __clear_extent_bit+0x237/0x480 [btrfs] [ 298.130519] extent_clear_unlock_delalloc+0x41/0x70 [btrfs] [ 298.132768] cow_file_range+0x26c/0x420 [btrfs] [ 298.134534] btrfs_run_delalloc_range+0x9c/0x4f0 [btrfs] [ 298.137475] ? find_lock_delalloc_range+0x1f4/0x220 [btrfs] [ 298.140148] writepage_delalloc+0xef/0x130 [btrfs] [ 298.142661] __extent_writepage+0x1af/0x350 [btrfs] [ 298.145190] extent_write_cache_pages+0x240/0x400 [btrfs] [ 298.147792] ? update_curr+0xe1/0x1e0 [ 298.150103] extent_writepages+0x52/0xa0 [btrfs] [ 298.152509] do_writepages+0x4b/0xf0 [ 298.154337] ? ttwu_do_wakeup+0x1e/0x150 [ 298.156218] ? try_to_wake_up+0x222/0x590 [ 298.158119] ? __filemap_fdatawrite_range+0xc1/0x100 [ 298.160225] __filemap_fdatawrite_range+0xc1/0x100 [ 298.162333] btrfs_run_delalloc_work+0x17/0x40 [btrfs] [ 298.164505] normal_work_helper+0x83/0x340 [btrfs] [ 298.166596] ? move_linked_works+0x6e/0xa0 [ 298.168519] process_one_work+0x19c/0x3b0 [ 298.170434] worker_thread+0x3c/0x3b0 [ 298.172312] ? process_one_work+0x3b0/0x3b0 [ 298.174806] kthread+0x11e/0x140 [ 298.176733] ? kthread_park+0xa0/0xa0 [ 298.178750] ret_from_fork+0x35/0x40 [ 298.180725] ---[ end trace 152c7eab27778aee ]---