Buffer I/O error on dev loop0, logical block 16, async page read INFO: task syz-executor4:30869 blocked for more than 120 seconds. Not tainted 4.15.0+ #296 "echo 0 > /proc/sys/kernel/hung_task_timeout_secs" disables this message. syz-executor4 D23552 30869 4234 0x00000004 Call Trace: context_switch kernel/sched/core.c:2845 [inline] __schedule+0x8eb/0x2060 kernel/sched/core.c:3421 schedule+0xf5/0x430 kernel/sched/core.c:3480 io_schedule+0x1c/0x70 kernel/sched/core.c:5096 wait_on_page_bit_common+0x4b3/0x770 mm/filemap.c:1099 wait_on_page_bit mm/filemap.c:1132 [inline] wait_on_page_writeback include/linux/pagemap.h:546 [inline] __filemap_fdatawait_range+0x282/0x430 mm/filemap.c:533 filemap_fdatawait_keep_errors+0x2a/0xb0 mm/filemap.c:600 fdatawait_one_bdev+0x50/0x70 fs/sync.c:95 iterate_bdevs+0x109/0x260 fs/block_dev.c:2147 sys_sync+0x120/0x1c0 fs/sync.c:117 entry_SYSCALL_64_fastpath+0x29/0xa0 RIP: 0033:0x453299 RSP: 002b:00007f15a5e38c58 EFLAGS: 00000212 ORIG_RAX: 00000000000000a2 RAX: ffffffffffffffda RBX: 000000000071bea0 RCX: 0000000000453299 RDX: 0000000000000000 RSI: 0000000000000000 RDI: 0000000000000000 RBP: 00000000000003d9 R08: 0000000000000000 R09: 0000000000000000 R10: 0000000000000000 R11: 0000000000000212 R12: 00000000006f4cf8 R13: 00000000ffffffff R14: 00007f15a5e396d4 R15: 0000000000000000 Showing all locks held in the system: 3 locks held by kworker/u4:1/21: #0: ((wq_completion)"writeback"){+.+.}, at: [<0000000068bb7994>] process_one_work+0xaaf/0x1af0 kernel/workqueue.c:2084 #1: ((work_completion)(&(&wb->dwork)->work)){+.+.}, at: [<0000000087fed8ea>] process_one_work+0xb01/0x1af0 kernel/workqueue.c:2088 #2: (&type->s_umount_key#27){++++}, at: [<00000000b2d337bf>] trylock_super+0x20/0x100 fs/super.c:395 2 locks held by khungtaskd/757: #0: (rcu_read_lock){....}, at: [<000000008cf8ac19>] check_hung_uninterruptible_tasks kernel/hung_task.c:175 [inline] #0: (rcu_read_lock){....}, at: [<000000008cf8ac19>] watchdog+0x1c5/0xd60 kernel/hung_task.c:249 #1: (tasklist_lock){.+.+}, at: [<00000000beefb0e2>] debug_show_all_locks+0xd3/0x3d0 kernel/locking/lockdep.c:4470 1 lock held by rsyslogd/4029: #0: (&f->f_pos_lock){+.+.}, at: [<0000000082f6e8dc>] __fdget_pos+0x12b/0x190 fs/file.c:765 2 locks held by getty/4151: #0: (&tty->ldisc_sem){++++}, at: [<000000003637b4fb>] ldsem_down_read+0x37/0x40 drivers/tty/tty_ldsem.c:365 #1: (&ldata->atomic_read_lock){+.+.}, at: [<000000000a8265a5>] n_tty_read+0x2ef/0x1a00 drivers/tty/n_tty.c:2131 2 locks held by getty/4152: #0: (&tty->ldisc_sem){++++}, at: [<000000003637b4fb>] ldsem_down_read+0x37/0x40 drivers/tty/tty_ldsem.c:365 #1: (&ldata->atomic_read_lock){+.+.}, at: [<000000000a8265a5>] n_tty_read+0x2ef/0x1a00 drivers/tty/n_tty.c:2131 2 locks held by getty/4153: #0: (&tty->ldisc_sem){++++}, at: [<000000003637b4fb>] ldsem_down_read+0x37/0x40 drivers/tty/tty_ldsem.c:365 #1: (&ldata->atomic_read_lock){+.+.}, at: [<000000000a8265a5>] n_tty_read+0x2ef/0x1a00 drivers/tty/n_tty.c:2131 2 locks held by getty/4154: #0: (&tty->ldisc_sem){++++}, at: [<000000003637b4fb>] ldsem_down_read+0x37/0x40 drivers/tty/tty_ldsem.c:365 #1: (&ldata->atomic_read_lock){+.+.}, at: [<000000000a8265a5>] n_tty_read+0x2ef/0x1a00 drivers/tty/n_tty.c:2131 2 locks held by getty/4155: #0: (&tty->ldisc_sem){++++}, at: [<000000003637b4fb>] ldsem_down_read+0x37/0x40 drivers/tty/tty_ldsem.c:365 #1: (&ldata->atomic_read_lock){+.+.}, at: [<000000000a8265a5>] n_tty_read+0x2ef/0x1a00 drivers/tty/n_tty.c:2131 2 locks held by getty/4156: #0: (&tty->ldisc_sem){++++}, at: [<000000003637b4fb>] ldsem_down_read+0x37/0x40 drivers/tty/tty_ldsem.c:365 #1: (&ldata->atomic_read_lock){+.+.}, at: [<000000000a8265a5>] n_tty_read+0x2ef/0x1a00 drivers/tty/n_tty.c:2131 2 locks held by getty/4157: #0: (&tty->ldisc_sem){++++}, at: [<000000003637b4fb>] ldsem_down_read+0x37/0x40 drivers/tty/tty_ldsem.c:365 #1: (&ldata->atomic_read_lock){+.+.}, at: [<000000000a8265a5>] n_tty_read+0x2ef/0x1a00 drivers/tty/n_tty.c:2131 1 lock held by blkid/30421: #0: (&bdev->bd_mutex){+.+.}, at: [<00000000e9a2034c>] blkdev_put+0x2a/0x4f0 fs/block_dev.c:1793 1 lock held by syz-executor4/30869: #0: (&bdev->bd_mutex){+.+.}, at: [<00000000684dff21>] iterate_bdevs+0xc8/0x260 fs/block_dev.c:2145 1 lock held by syz-executor4/30878: #0: (&bdev->bd_mutex){+.+.}, at: [<00000000684dff21>] iterate_bdevs+0xc8/0x260 fs/block_dev.c:2145 ============================================= NMI backtrace for cpu 0 CPU: 0 PID: 757 Comm: khungtaskd Not tainted 4.15.0+ #296 Hardware name: Google Google Compute Engine/Google Compute Engine, BIOS Google 01/01/2011 Call Trace: __dump_stack lib/dump_stack.c:17 [inline] dump_stack+0x194/0x257 lib/dump_stack.c:53 nmi_cpu_backtrace+0x1d2/0x210 lib/nmi_backtrace.c:103 nmi_trigger_cpumask_backtrace+0x122/0x180 lib/nmi_backtrace.c:62 arch_trigger_cpumask_backtrace+0x14/0x20 arch/x86/kernel/apic/hw_nmi.c:38 trigger_all_cpu_backtrace include/linux/nmi.h:138 [inline] check_hung_task kernel/hung_task.c:132 [inline] check_hung_uninterruptible_tasks kernel/hung_task.c:190 [inline] watchdog+0x90c/0xd60 kernel/hung_task.c:249 kthread+0x33c/0x400 kernel/kthread.c:238 ret_from_fork+0x3a/0x50 arch/x86/entry/entry_64.S:542 Sending NMI from CPU 0 to CPUs 1: NMI backtrace for cpu 1 CPU: 1 PID: 0 Comm: swapper/1 Not tainted 4.15.0+ #296 Hardware name: Google Google Compute Engine/Google Compute Engine, BIOS Google 01/01/2011 RIP: 0010:tick_do_update_jiffies64 kernel/time/tick-sched.c:65 [inline] RIP: 0010:tick_nohz_update_jiffies kernel/time/tick-sched.c:506 [inline] RIP: 0010:tick_nohz_irq_enter kernel/time/tick-sched.c:1152 [inline] RIP: 0010:tick_irq_enter+0x1bf/0x390 kernel/time/tick-sched.c:1169 RSP: 0018:ffff8801db507d28 EFLAGS: 00000002 RAX: dffffc0000000000 RBX: 0000000000000093 RCX: 0000000000000000 RDX: ffffffff8814cca0 RSI: 0000000000000000 RDI: ffffffff8814cca0 RBP: ffff8801db507d48 R08: ffff88021fff805c R09: ffff88021fff8048 R10: ffff88021fff8050 R11: ffff88021fff805d R12: 0000000000018649 R13: ffff8801db5266a0 R14: 00000056375e1449 R15: 0000000000000001 FS: 0000000000000000(0000) GS:ffff8801db500000(0000) knlGS:0000000000000000 CS: 0010 DS: 0000 ES: 0000 CR0: 0000000080050033 CR2: 0000000000ab0000 CR3: 0000000006a22002 CR4: 00000000001606e0 Call Trace: irq_enter+0xb6/0xd0 kernel/softirq.c:346 scheduler_ipi+0x23d/0x820 kernel/sched/core.c:1794 smp_reschedule_interrupt+0xe6/0x670 arch/x86/kernel/smp.c:277 reschedule_interrupt+0xa9/0xb0 arch/x86/entry/entry_64.S:962 RIP: 0010:native_safe_halt+0x6/0x10 arch/x86/include/asm/irqflags.h:54 RSP: 0018:ffff8801d9f1fcb0 EFLAGS: 00000286 ORIG_RAX: ffffffffffffff02 RAX: dffffc0000000000 RBX: 1ffff1003b3e3f99 RCX: 0000000000000000 RDX: 1ffffffff0d59280 RSI: 0000000000000001 RDI: ffffffff86ac9400 RBP: ffff8801d9f1fcb0 R08: 0000000000000000 R09: 0000000000000000 R10: 0000000000000000 R11: 0000000000000000 R12: 0000000000000001 R13: ffff8801d9f1fd68 R14: ffffffff87268d60 R15: 0000000000000000 arch_safe_halt arch/x86/include/asm/paravirt.h:93 [inline] default_idle+0xbf/0x430 arch/x86/kernel/process.c:354 arch_cpu_idle+0xa/0x10 arch/x86/kernel/process.c:345 default_idle_call+0x36/0x90 kernel/sched/idle.c:98 cpuidle_idle_call kernel/sched/idle.c:156 [inline] do_idle+0x24a/0x3b0 kernel/sched/idle.c:246 cpu_startup_entry+0x104/0x120 kernel/sched/idle.c:351 start_secondary+0x40a/0x590 arch/x86/kernel/smpboot.c:267 secondary_startup_64+0xa5/0xb0 arch/x86/kernel/head_64.S:237 Code: 00 fa 66 0f 1f 44 00 00 e8 6f 63 f1 ff 48 c7 c7 a0 cc 14 88 48 b8 00 00 00 00 00 fc ff df 4d 89 f4 48 89 fa 4c 2b 25 b1 71 b0 06 <48> c1 ea 03 80 3c 02 00 0f 85 a4 01 00 00 4c 3b 25 3c 6e b0 06