INFO: task syz-executor.5:15248 can't die for more than 143 seconds. syz-executor.5 D26888 15248 6654 0x00004004 Call Trace: context_switch kernel/sched/core.c:3384 [inline] __schedule+0x828/0x1c20 kernel/sched/core.c:4065 schedule+0xd9/0x260 kernel/sched/core.c:4132 schedule_preempt_disabled+0x13/0x20 kernel/sched/core.c:4191 __mutex_lock_common kernel/locking/mutex.c:1033 [inline] __mutex_lock+0x7b0/0x13c0 kernel/locking/mutex.c:1103 mutex_lock_nested+0x16/0x20 kernel/locking/mutex.c:1118 pipe_lock_nested fs/pipe.c:63 [inline] pipe_lock fs/pipe.c:71 [inline] pipe_wait+0x1ce/0x1f0 fs/pipe.c:119 pipe_write+0x5fa/0xf40 fs/pipe.c:497 call_write_iter include/linux/fs.h:1902 [inline] new_sync_write+0x4d3/0x770 fs/read_write.c:483 __vfs_write+0xe1/0x110 fs/read_write.c:496 vfs_write+0x268/0x5d0 fs/read_write.c:558 ksys_write+0x14f/0x290 fs/read_write.c:611 __do_sys_write fs/read_write.c:623 [inline] __se_sys_write fs/read_write.c:620 [inline] __x64_sys_write+0x73/0xb0 fs/read_write.c:620 do_syscall_64+0xfa/0x760 arch/x86/entry/common.c:290 entry_SYSCALL_64_after_hwframe+0x49/0xbe RIP: 0033:0x4598e9 Code: Bad RIP value. RSP: 002b:00007f60456b2c78 EFLAGS: 00000246 ORIG_RAX: 0000000000000001 RAX: ffffffffffffffda RBX: 0000000000000003 RCX: 00000000004598e9 RDX: 00000000fffffc8f RSI: 0000000020000140 RDI: 0000000000000009 RBP: 000000000075bf20 R08: 0000000000000000 R09: 0000000000000000 R10: 0000000000000000 R11: 0000000000000246 R12: 00007f60456b36d4 R13: 00000000004c9a0d R14: 00000000004e10e8 R15: 00000000ffffffff INFO: task syz-executor.5:15248 blocked for more than 143 seconds. Not tainted 5.3.0-next-20190918 #0 "echo 0 > /proc/sys/kernel/hung_task_timeout_secs" disables this message. syz-executor.5 D26888 15248 6654 0x00004004 Call Trace: context_switch kernel/sched/core.c:3384 [inline] __schedule+0x828/0x1c20 kernel/sched/core.c:4065 schedule+0xd9/0x260 kernel/sched/core.c:4132 schedule_preempt_disabled+0x13/0x20 kernel/sched/core.c:4191 __mutex_lock_common kernel/locking/mutex.c:1033 [inline] __mutex_lock+0x7b0/0x13c0 kernel/locking/mutex.c:1103 mutex_lock_nested+0x16/0x20 kernel/locking/mutex.c:1118 pipe_lock_nested fs/pipe.c:63 [inline] pipe_lock fs/pipe.c:71 [inline] pipe_wait+0x1ce/0x1f0 fs/pipe.c:119 pipe_write+0x5fa/0xf40 fs/pipe.c:497 call_write_iter include/linux/fs.h:1902 [inline] new_sync_write+0x4d3/0x770 fs/read_write.c:483 __vfs_write+0xe1/0x110 fs/read_write.c:496 vfs_write+0x268/0x5d0 fs/read_write.c:558 ksys_write+0x14f/0x290 fs/read_write.c:611 __do_sys_write fs/read_write.c:623 [inline] __se_sys_write fs/read_write.c:620 [inline] __x64_sys_write+0x73/0xb0 fs/read_write.c:620 do_syscall_64+0xfa/0x760 arch/x86/entry/common.c:290 entry_SYSCALL_64_after_hwframe+0x49/0xbe RIP: 0033:0x4598e9 Code: Bad RIP value. RSP: 002b:00007f60456b2c78 EFLAGS: 00000246 ORIG_RAX: 0000000000000001 RAX: ffffffffffffffda RBX: 0000000000000003 RCX: 00000000004598e9 RDX: 00000000fffffc8f RSI: 0000000020000140 RDI: 0000000000000009 RBP: 000000000075bf20 R08: 0000000000000000 R09: 0000000000000000 R10: 0000000000000000 R11: 0000000000000246 R12: 00007f60456b36d4 R13: 00000000004c9a0d R14: 00000000004e10e8 R15: 00000000ffffffff INFO: task syz-executor.5:15250 can't die for more than 144 seconds. syz-executor.5 R running task 25208 15250 6654 0x00004006 Call Trace: INFO: task syz-executor.5:15251 can't die for more than 144 seconds. syz-executor.5 D28544 15251 6654 0x00000004 Call Trace: context_switch kernel/sched/core.c:3384 [inline] __schedule+0x828/0x1c20 kernel/sched/core.c:4065 schedule+0xd9/0x260 kernel/sched/core.c:4132 rwsem_down_write_slowpath+0x70b/0xf90 kernel/locking/rwsem.c:1238 __down_write kernel/locking/rwsem.c:1392 [inline] down_write+0x13c/0x150 kernel/locking/rwsem.c:1535 inode_lock include/linux/fs.h:791 [inline] process_measurement+0x6cf/0x16b0 security/integrity/ima/ima_main.c:230 ima_file_check+0xc5/0x110 security/integrity/ima/ima_main.c:438 do_last fs/namei.c:3412 [inline] path_openat+0x1142/0x46d0 fs/namei.c:3525 do_filp_open+0x1a1/0x280 fs/namei.c:3555 do_sys_open+0x3fe/0x5d0 fs/open.c:1097 __do_sys_openat fs/open.c:1124 [inline] __se_sys_openat fs/open.c:1118 [inline] __x64_sys_openat+0x9d/0x100 fs/open.c:1118 do_syscall_64+0xfa/0x760 arch/x86/entry/common.c:290 entry_SYSCALL_64_after_hwframe+0x49/0xbe RIP: 0033:0x4598e9 Code: Bad RIP value. RSP: 002b:00007f6045670c78 EFLAGS: 00000246 ORIG_RAX: 0000000000000101 RAX: ffffffffffffffda RBX: 0000000000000004 RCX: 00000000004598e9 RDX: 0000000000007a05 RSI: 0000000020000140 RDI: ffffffffffffff9c RBP: 000000000075c070 R08: 0000000000000000 R09: 0000000000000000 R10: 0000000000001700 R11: 0000000000000246 R12: 00007f60456716d4 R13: 00000000004c6115 R14: 00000000004daec0 R15: 00000000ffffffff INFO: task syz-executor.5:15251 blocked for more than 145 seconds. Not tainted 5.3.0-next-20190918 #0 "echo 0 > /proc/sys/kernel/hung_task_timeout_secs" disables this message. syz-executor.5 D28544 15251 6654 0x00000004 Call Trace: context_switch kernel/sched/core.c:3384 [inline] __schedule+0x828/0x1c20 kernel/sched/core.c:4065 schedule+0xd9/0x260 kernel/sched/core.c:4132 rwsem_down_write_slowpath+0x70b/0xf90 kernel/locking/rwsem.c:1238 __down_write kernel/locking/rwsem.c:1392 [inline] down_write+0x13c/0x150 kernel/locking/rwsem.c:1535 inode_lock include/linux/fs.h:791 [inline] process_measurement+0x6cf/0x16b0 security/integrity/ima/ima_main.c:230 ima_file_check+0xc5/0x110 security/integrity/ima/ima_main.c:438 do_last fs/namei.c:3412 [inline] path_openat+0x1142/0x46d0 fs/namei.c:3525 do_filp_open+0x1a1/0x280 fs/namei.c:3555 do_sys_open+0x3fe/0x5d0 fs/open.c:1097 __do_sys_openat fs/open.c:1124 [inline] __se_sys_openat fs/open.c:1118 [inline] __x64_sys_openat+0x9d/0x100 fs/open.c:1118 do_syscall_64+0xfa/0x760 arch/x86/entry/common.c:290 entry_SYSCALL_64_after_hwframe+0x49/0xbe RIP: 0033:0x4598e9 Code: Bad RIP value. RSP: 002b:00007f6045670c78 EFLAGS: 00000246 ORIG_RAX: 0000000000000101 RAX: ffffffffffffffda RBX: 0000000000000004 RCX: 00000000004598e9 RDX: 0000000000007a05 RSI: 0000000020000140 RDI: ffffffffffffff9c RBP: 000000000075c070 R08: 0000000000000000 R09: 0000000000000000 R10: 0000000000001700 R11: 0000000000000246 R12: 00007f60456716d4 R13: 00000000004c6115 R14: 00000000004daec0 R15: 00000000ffffffff Showing all locks held in the system: 1 lock held by khungtaskd/1065: #0: ffffffff88fa9e80 (rcu_read_lock){....}, at: debug_show_all_locks+0x5f/0x27e kernel/locking/lockdep.c:5337 3 locks held by rs:main Q:Reg/8696: #0: ffff8880a748ce20 (&f->f_pos_lock){+.+.}, at: __fdget_pos+0xee/0x110 fs/file.c:801 #1: ffff888215f0c420 (sb_writers#3){.+.+}, at: file_start_write include/linux/fs.h:2886 [inline] #1: ffff888215f0c420 (sb_writers#3){.+.+}, at: vfs_write+0x485/0x5d0 fs/read_write.c:557 #2: ffff8880a2a848c8 (&sb->s_type->i_mutex_key#11){++++}, at: inode_lock include/linux/fs.h:791 [inline] #2: ffff8880a2a848c8 (&sb->s_type->i_mutex_key#11){++++}, at: __generic_file_fsync+0xb5/0x200 fs/libfs.c:1000 1 lock held by rsyslogd/8698: #0: ffff888097a5f8a0 (&f->f_pos_lock){+.+.}, at: __fdget_pos+0xee/0x110 fs/file.c:801 2 locks held by getty/8789: #0: ffff88808eaa0090 (&tty->ldisc_sem){++++}, at: ldsem_down_read+0x33/0x40 drivers/tty/tty_ldsem.c:340 #1: ffffc90005f312e0 (&ldata->atomic_read_lock){+.+.}, at: n_tty_read+0x232/0x1c10 drivers/tty/n_tty.c:2156 2 locks held by getty/8790: #0: ffff888098e5e090 (&tty->ldisc_sem){++++}, at: ldsem_down_read+0x33/0x40 drivers/tty/tty_ldsem.c:340 #1: ffffc90005f392e0 (&ldata->atomic_read_lock){+.+.}, at: n_tty_read+0x232/0x1c10 drivers/tty/n_tty.c:2156 2 locks held by getty/8791: #0: ffff888091dbc090 (&tty->ldisc_sem){++++}, at: ldsem_down_read+0x33/0x40 drivers/tty/tty_ldsem.c:340 #1: ffffc90005f352e0 (&ldata->atomic_read_lock){+.+.}, at: n_tty_read+0x232/0x1c10 drivers/tty/n_tty.c:2156 2 locks held by getty/8792: #0: ffff88809a652090 (&tty->ldisc_sem){++++}, at: ldsem_down_read+0x33/0x40 drivers/tty/tty_ldsem.c:340 #1: ffffc90005f152e0 (&ldata->atomic_read_lock){+.+.}, at: n_tty_read+0x232/0x1c10 drivers/tty/n_tty.c:2156 2 locks held by getty/8793: #0: ffff8880a1bad090 (&tty->ldisc_sem){++++}, at: ldsem_down_read+0x33/0x40 drivers/tty/tty_ldsem.c:340 #1: ffffc90005f1d2e0 (&ldata->atomic_read_lock){+.+.}, at: n_tty_read+0x232/0x1c10 drivers/tty/n_tty.c:2156 2 locks held by getty/8794: #0: ffff8880a81c6090 (&tty->ldisc_sem){++++}, at: ldsem_down_read+0x33/0x40 drivers/tty/tty_ldsem.c:340 #1: ffffc90005f092e0 (&ldata->atomic_read_lock){+.+.}, at: n_tty_read+0x232/0x1c10 drivers/tty/n_tty.c:2156 2 locks held by getty/6284: #0: ffff88805f324090 (&tty->ldisc_sem){++++}, at: ldsem_down_read+0x33/0x40 drivers/tty/tty_ldsem.c:340 #1: ffffc9000193f2e0 (&ldata->atomic_read_lock){+.+.}, at: n_tty_read+0x232/0x1c10 drivers/tty/n_tty.c:2156 1 lock held by syz-executor.5/15248: #0: ffff88809a56b060 (&pipe->mutex/1){+.+.}, at: pipe_lock_nested fs/pipe.c:63 [inline] #0: ffff88809a56b060 (&pipe->mutex/1){+.+.}, at: pipe_lock fs/pipe.c:71 [inline] #0: ffff88809a56b060 (&pipe->mutex/1){+.+.}, at: pipe_wait+0x1ce/0x1f0 fs/pipe.c:119 3 locks held by syz-executor.5/15250: 2 locks held by syz-executor.5/15251: #0: ffff888215f0c420 (sb_writers#3){.+.+}, at: sb_start_write include/linux/fs.h:1650 [inline] #0: ffff888215f0c420 (sb_writers#3){.+.+}, at: mnt_want_write+0x3f/0xc0 fs/namespace.c:354 #1: ffff8880950eaa48 (&sb->s_type->i_mutex_key#11){++++}, at: inode_lock include/linux/fs.h:791 [inline] #1: ffff8880950eaa48 (&sb->s_type->i_mutex_key#11){++++}, at: process_measurement+0x6cf/0x16b0 security/integrity/ima/ima_main.c:230 ============================================= NMI backtrace for cpu 0 CPU: 0 PID: 1065 Comm: khungtaskd Not tainted 5.3.0-next-20190918 #0 Hardware name: Google Google Compute Engine/Google Compute Engine, BIOS Google 01/01/2011 Call Trace: __dump_stack lib/dump_stack.c:77 [inline] dump_stack+0x172/0x1f0 lib/dump_stack.c:113 nmi_cpu_backtrace.cold+0x70/0xb2 lib/nmi_backtrace.c:101 nmi_trigger_cpumask_backtrace+0x23b/0x28b 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:146 [inline] check_hung_uninterruptible_tasks kernel/hung_task.c:269 [inline] watchdog+0xc99/0x1360 kernel/hung_task.c:353 kthread+0x361/0x430 kernel/kthread.c:255 ret_from_fork+0x24/0x30 arch/x86/entry/entry_64.S:352 Sending NMI from CPU 0 to CPUs 1: NMI backtrace for cpu 1 CPU: 1 PID: 15250 Comm: syz-executor.5 Not tainted 5.3.0-next-20190918 #0 Hardware name: Google Google Compute Engine/Google Compute Engine, BIOS Google 01/01/2011 RIP: 0010:__sanitizer_cov_trace_pc+0x26/0x50 kernel/kcov.c:102 Code: 90 90 90 90 55 48 89 e5 65 48 8b 04 25 40 fe 01 00 65 8b 15 84 28 8f 7e 81 e2 00 01 1f 00 48 8b 75 08 75 2b 8b 90 00 13 00 00 <83> fa 02 75 20 48 8b 88 08 13 00 00 8b 80 04 13 00 00 48 8b 11 48 RSP: 0018:ffff88805f31f358 EFLAGS: 00000246 RAX: ffff888058b96680 RBX: 0000000000000000 RCX: ffffffff83402d38 RDX: 0000000000000002 RSI: ffffffff83402a9d RDI: 0000000000000005 RBP: ffff88805f31f358 R08: ffff888058b96680 R09: ffffffff81f9dca0 R10: ffff88805f31f730 R11: ffff8880950ea757 R12: 0000000000000000 R13: 000000000000f000 R14: 0000000000000000 R15: 0000000000000000 FS: 00007f6045692700(0000) GS:ffff8880ae900000(0000) knlGS:0000000000000000 CS: 0010 DS: 0000 ES: 0000 CR0: 0000000080050033 CR2: ffffffffff600400 CR3: 0000000068a37000 CR4: 00000000001406e0 DR0: 0000000000000000 DR1: 0000000000000000 DR2: 0000000000000000 DR3: 0000000000000000 DR6: 00000000fffe0ff0 DR7: 0000000000000400 Call Trace: iov_iter_alignment+0x34d/0x830 lib/iov_iter.c:1200 do_blockdev_direct_IO+0x1dd/0x8420 fs/direct-io.c:1181 __blockdev_direct_IO+0xa1/0xca fs/direct-io.c:1413 ext4_direct_IO_write fs/ext4/inode.c:3742 [inline] ext4_direct_IO+0xd60/0x1c30 fs/ext4/inode.c:3871 generic_file_direct_write+0x20a/0x4a0 mm/filemap.c:3207 __generic_file_write_iter+0x2ee/0x630 mm/filemap.c:3390 ext4_file_write_iter+0x317/0x13c0 fs/ext4/file.c:268 call_write_iter include/linux/fs.h:1902 [inline] do_iter_readv_writev+0x5f8/0x8f0 fs/read_write.c:693 do_iter_write fs/read_write.c:970 [inline] do_iter_write+0x184/0x610 fs/read_write.c:951 vfs_iter_write+0x77/0xb0 fs/read_write.c:983 iter_file_splice_write+0x66d/0xbe0 fs/splice.c:746 do_splice_from fs/splice.c:848 [inline] do_splice+0x785/0x1540 fs/splice.c:1161 __do_sys_splice fs/splice.c:1436 [inline] __se_sys_splice fs/splice.c:1416 [inline] __x64_sys_splice+0x2c6/0x330 fs/splice.c:1416 do_syscall_64+0xfa/0x760 arch/x86/entry/common.c:290 entry_SYSCALL_64_after_hwframe+0x49/0xbe RIP: 0033:0x4598e9 Code: fd b7 fb ff c3 66 2e 0f 1f 84 00 00 00 00 00 66 90 48 89 f8 48 89 f7 48 89 d6 48 89 ca 4d 89 c2 4d 89 c8 4c 8b 4c 24 08 0f 05 <48> 3d 01 f0 ff ff 0f 83 cb b7 fb ff c3 66 2e 0f 1f 84 00 00 00 00 RSP: 002b:00007f6045691c78 EFLAGS: 00000246 ORIG_RAX: 0000000000000113 RAX: ffffffffffffffda RBX: 0000000000000006 RCX: 00000000004598e9 RDX: 000000000000000a RSI: 0000000000000000 RDI: 0000000000000008 RBP: 000000000075bfc8 R08: 000100000000ffe0 R09: 0000000000000000 R10: 0000000000000000 R11: 0000000000000246 R12: 00007f60456926d4 R13: 00000000004c90ca R14: 00000000004df570 R15: 00000000ffffffff