INFO: task syz-executor444:23528 blocked for more than 140 seconds. Not tainted 4.19.157-syzkaller #0 "echo 0 > /proc/sys/kernel/hung_task_timeout_secs" disables this message. syz-executor444 D28368 23528 8128 0x00000004 Call Trace: context_switch kernel/sched/core.c:2828 [inline] __schedule+0x887/0x2040 kernel/sched/core.c:3517 schedule+0x8d/0x1b0 kernel/sched/core.c:3561 schedule_timeout+0x92d/0xfe0 kernel/time/timer.c:1801 do_wait_for_common kernel/sched/completion.c:83 [inline] __wait_for_common kernel/sched/completion.c:104 [inline] wait_for_common+0x29c/0x470 kernel/sched/completion.c:115 rdma_destroy_id+0x4c9/0x950 drivers/infiniband/core/cma.c:1750 ucma_close+0x140/0x360 drivers/infiniband/core/ucma.c:1819 __fput+0x2ce/0x890 fs/file_table.c:278 task_work_run+0x148/0x1c0 kernel/task_work.c:113 tracehook_notify_resume include/linux/tracehook.h:193 [inline] exit_to_usermode_loop+0x251/0x2a0 arch/x86/entry/common.c:167 prepare_exit_to_usermode arch/x86/entry/common.c:198 [inline] syscall_return_slowpath arch/x86/entry/common.c:271 [inline] do_syscall_64+0x538/0x620 arch/x86/entry/common.c:296 entry_SYSCALL_64_after_hwframe+0x49/0xbe RIP: 0033:0x401b50 Code: 01 f0 ff ff 0f 83 40 0d 00 00 c3 66 2e 0f 1f 84 00 00 00 00 00 0f 1f 44 00 00 83 3d dd 9b 2d 00 00 75 14 b8 03 00 00 00 0f 05 <48> 3d 01 f0 ff ff 0f 83 14 0d 00 00 c3 48 83 ec 08 e8 7a 02 00 00 RSP: 002b:00007ffdd784f318 EFLAGS: 00000246 ORIG_RAX: 0000000000000003 RAX: 0000000000000000 RBX: 0000000000000004 RCX: 0000000000401b50 RDX: 0000000000000048 RSI: 0000000020000140 RDI: 0000000000000003 RBP: 0000000000000000 R08: 00000000bb1414ac R09: 00000000bb1414ac R10: 00000000bb1414ac R11: 0000000000000246 R12: 00000000000b5422 R13: 0000000000000000 R14: 0000000000000000 R15: 0000000000000000 Showing all locks held in the system: 1 lock held by khungtaskd/1566: #0: 00000000170bded2 (rcu_read_lock){....}, at: debug_show_all_locks+0x53/0x265 kernel/locking/lockdep.c:4440 1 lock held by in:imklog/7836: #0: 000000001f329f29 (&f->f_pos_lock){+.+.}, at: __fdget_pos+0x26f/0x310 fs/file.c:767 3 locks held by syz-executor444/8135: #0: 00000000be972154 (&rq->lock){-.-.}, at: rq_lock kernel/sched/sched.h:1830 [inline] #0: 00000000be972154 (&rq->lock){-.-.}, at: __schedule+0x1f9/0x2040 kernel/sched/core.c:3455 #1: 00000000170bded2 (rcu_read_lock){....}, at: trace_sched_stat_runtime include/trace/events/sched.h:428 [inline] #1: 00000000170bded2 (rcu_read_lock){....}, at: update_curr+0x2c3/0x870 kernel/sched/fair.c:857 #2: 00000000128d0a77 (pool_lock){-.-.}, at: __free_object+0x17/0x1e0 lib/debugobjects.c:251 1 lock held by syz-executor444/31283: #0: 00000000df536fb9 (&rq->lock){-.-.}, at: rq_lock kernel/sched/sched.h:1830 [inline] #0: 00000000df536fb9 (&rq->lock){-.-.}, at: __schedule+0x1f9/0x2040 kernel/sched/core.c:3455 5 locks held by syz-executor444/31286: #0: 00000000df536fb9 (&rq->lock){-.-.}, at: rq_lock kernel/sched/sched.h:1830 [inline] #0: 00000000df536fb9 (&rq->lock){-.-.}, at: __schedule+0x1f9/0x2040 kernel/sched/core.c:3455 #1: 00000000170bded2 (rcu_read_lock){....}, at: trace_sched_stat_runtime include/trace/events/sched.h:428 [inline] #1: 00000000170bded2 (rcu_read_lock){....}, at: update_curr+0x2c3/0x870 kernel/sched/fair.c:857 #2: 00000000170bded2 (rcu_read_lock){....}, at: trace_sched_stat_runtime include/trace/events/sched.h:428 [inline] #2: 00000000170bded2 (rcu_read_lock){....}, at: update_curr+0x2c3/0x870 kernel/sched/fair.c:857 #3: 00000000170bded2 (rcu_read_lock){....}, at: lock_page_memcg+0x0/0x220 include/linux/page_counter.h:64 #4: 00000000170bded2 (rcu_read_lock){....}, at: trace_sched_stat_runtime include/trace/events/sched.h:428 [inline] #4: 00000000170bded2 (rcu_read_lock){....}, at: update_curr+0x2c3/0x870 kernel/sched/fair.c:857 1 lock held by syz-executor444/31327: #0: 00000000df536fb9 (&rq->lock){-.-.}, at: idle_balance kernel/sched/fair.c:9701 [inline] #0: 00000000df536fb9 (&rq->lock){-.-.}, at: pick_next_task_fair+0x556/0x1570 kernel/sched/fair.c:6840 1 lock held by syz-executor444/31330: #0: 000000005a8efe0b (misc_mtx){+.+.}, at: misc_open+0x55/0x4a0 drivers/char/misc.c:107 1 lock held by syz-executor444/31340: #0: 000000005a8efe0b (misc_mtx){+.+.}, at: misc_open+0x55/0x4a0 drivers/char/misc.c:107 1 lock held by syz-executor444/31342: 1 lock held by syz-executor444/31346: 1 lock held by syz-executor444/31352: #0: 00000000df536fb9 (&rq->lock){-.-.}, at: rq_lock kernel/sched/sched.h:1830 [inline] #0: 00000000df536fb9 (&rq->lock){-.-.}, at: __schedule+0x1f9/0x2040 kernel/sched/core.c:3455 1 lock held by syz-executor444/31360: #0: 00000000df536fb9 (&rq->lock){-.-.}, at: rq_lock kernel/sched/sched.h:1830 [inline] #0: 00000000df536fb9 (&rq->lock){-.-.}, at: __schedule+0x1f9/0x2040 kernel/sched/core.c:3455 1 lock held by syz-executor444/31373: #0: 00000000df536fb9 (&rq->lock){-.-.}, at: rq_lock kernel/sched/sched.h:1830 [inline] #0: 00000000df536fb9 (&rq->lock){-.-.}, at: __schedule+0x1f9/0x2040 kernel/sched/core.c:3455 1 lock held by syz-executor444/31378: #0: 00000000df536fb9 (&rq->lock){-.-.}, at: rq_lock kernel/sched/sched.h:1830 [inline] #0: 00000000df536fb9 (&rq->lock){-.-.}, at: __schedule+0x1f9/0x2040 kernel/sched/core.c:3455 1 lock held by syz-executor444/31386: #0: 000000005a8efe0b (misc_mtx){+.+.}, at: misc_open+0x55/0x4a0 drivers/char/misc.c:107 2 locks held by syz-executor444/31390: #0: 00000000df536fb9 (&rq->lock){-.-.}, at: rq_lock kernel/sched/sched.h:1830 [inline] #0: 00000000df536fb9 (&rq->lock){-.-.}, at: __schedule+0x1f9/0x2040 kernel/sched/core.c:3455 #1: 00000000170bded2 (rcu_read_lock){....}, at: trace_sched_stat_runtime include/trace/events/sched.h:428 [inline] #1: 00000000170bded2 (rcu_read_lock){....}, at: update_curr+0x2c3/0x870 kernel/sched/fair.c:857 1 lock held by syz-executor444/31406: #0: 00000000df536fb9 (&rq->lock){-.-.}, at: rq_lock kernel/sched/sched.h:1830 [inline] #0: 00000000df536fb9 (&rq->lock){-.-.}, at: __schedule+0x1f9/0x2040 kernel/sched/core.c:3455 1 lock held by syz-executor444/31414: #0: 00000000df536fb9 (&rq->lock){-.-.}, at: rq_lock kernel/sched/sched.h:1830 [inline] #0: 00000000df536fb9 (&rq->lock){-.-.}, at: __schedule+0x1f9/0x2040 kernel/sched/core.c:3455 1 lock held by syz-executor444/31429: #0: 00000000df536fb9 (&rq->lock){-.-.}, at: rq_lock kernel/sched/sched.h:1830 [inline] #0: 00000000df536fb9 (&rq->lock){-.-.}, at: __schedule+0x1f9/0x2040 kernel/sched/core.c:3455 1 lock held by syz-executor444/31434: #0: 00000000be972154 (&rq->lock){-.-.}, at: rq_lock kernel/sched/sched.h:1830 [inline] #0: 00000000be972154 (&rq->lock){-.-.}, at: __schedule+0x1f9/0x2040 kernel/sched/core.c:3455 1 lock held by syz-executor444/31438: #0: 00000000df536fb9 (&rq->lock){-.-.}, at: rq_lock kernel/sched/sched.h:1830 [inline] #0: 00000000df536fb9 (&rq->lock){-.-.}, at: __schedule+0x1f9/0x2040 kernel/sched/core.c:3455 1 lock held by syz-executor444/31445: #0: 00000000be972154 (&rq->lock){-.-.}, at: rq_lock kernel/sched/sched.h:1830 [inline] #0: 00000000be972154 (&rq->lock){-.-.}, at: __schedule+0x1f9/0x2040 kernel/sched/core.c:3455 1 lock held by syz-executor444/31450: 1 lock held by syz-executor444/31454: #0: 00000000df536fb9 (&rq->lock){-.-.}, at: rq_lock kernel/sched/sched.h:1830 [inline] #0: 00000000df536fb9 (&rq->lock){-.-.}, at: __schedule+0x1f9/0x2040 kernel/sched/core.c:3455 1 lock held by syz-executor444/31461: 1 lock held by syz-executor444/31462: #0: 000000005a8efe0b (misc_mtx){+.+.}, at: misc_open+0x55/0x4a0 drivers/char/misc.c:107 1 lock held by syz-executor444/31471: #0: 00000000be972154 (&rq->lock){-.-.}, at: rq_lock kernel/sched/sched.h:1830 [inline] #0: 00000000be972154 (&rq->lock){-.-.}, at: __schedule+0x1f9/0x2040 kernel/sched/core.c:3455 1 lock held by syz-executor444/31490: #0: 000000005a8efe0b (misc_mtx){+.+.}, at: misc_open+0x55/0x4a0 drivers/char/misc.c:107 1 lock held by syz-executor444/31504: #0: 00000000be972154 (&rq->lock){-.-.}, at: rq_lock kernel/sched/sched.h:1830 [inline] #0: 00000000be972154 (&rq->lock){-.-.}, at: __schedule+0x1f9/0x2040 kernel/sched/core.c:3455 1 lock held by syz-executor444/31510: #0: 00000000df536fb9 (&rq->lock){-.-.}, at: rq_lock kernel/sched/sched.h:1830 [inline] #0: 00000000df536fb9 (&rq->lock){-.-.}, at: __schedule+0x1f9/0x2040 kernel/sched/core.c:3455 3 locks held by syz-executor444/31514: #0: 00000000be972154 (&rq->lock){-.-.}, at: rq_lock kernel/sched/sched.h:1830 [inline] #0: 00000000be972154 (&rq->lock){-.-.}, at: __schedule+0x1f9/0x2040 kernel/sched/core.c:3455 #1: 00000000170bded2 (rcu_read_lock){....}, at: trace_sched_stat_runtime include/trace/events/sched.h:428 [inline] #1: 00000000170bded2 (rcu_read_lock){....}, at: update_curr+0x2c3/0x870 kernel/sched/fair.c:857 #2: 00000000117ff563 (&sig->wait_chldexit){....}, at: __wake_up_common_lock+0xb0/0x170 kernel/sched/wait.c:120 ============================================= NMI backtrace for cpu 1 CPU: 1 PID: 1566 Comm: khungtaskd Not tainted 4.19.157-syzkaller #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+0x1fc/0x2fe lib/dump_stack.c:118 nmi_cpu_backtrace.cold+0x63/0xa2 lib/nmi_backtrace.c:101 nmi_trigger_cpumask_backtrace+0x1a6/0x1eb lib/nmi_backtrace.c:62 trigger_all_cpu_backtrace include/linux/nmi.h:146 [inline] check_hung_uninterruptible_tasks kernel/hung_task.c:203 [inline] watchdog+0x991/0xe60 kernel/hung_task.c:287 kthread+0x33f/0x460 kernel/kthread.c:259 ret_from_fork+0x24/0x30 arch/x86/entry/entry_64.S:415 Sending NMI from CPU 1 to CPUs 0: NMI backtrace for cpu 0 CPU: 0 PID: 9 Comm: ksoftirqd/0 Not tainted 4.19.157-syzkaller #0 Hardware name: Google Google Compute Engine/Google Compute Engine, BIOS Google 01/01/2011 RIP: 0010:unwind_next_frame+0x450/0x1c60 arch/x86/kernel/unwind_orc.c:427 Code: b8 00 00 00 00 00 fc ff df 4c 89 c2 48 c1 ea 03 0f b6 04 02 4c 89 c2 83 e2 07 38 d0 7f 08 84 c0 0f 85 80 10 00 00 0f b6 41 04 0f 0f 85 a9 00 00 00 48 8d 79 05 48 b8 00 00 00 00 00 fc ff df RSP: 0018:ffff8880b5a6f850 EFLAGS: 00000046 RAX: 0000000000000015 RBX: 1ffff11016b4df12 RCX: ffffffff8b99b8ea RDX: 0000000000000006 RSI: ffffffff8b99b8ea RDI: ffffffff8b38eee0 RBP: 0000000000000001 R08: ffffffff8b99b8ee R09: ffffffff8b99b8ea R10: 0000000000074071 R11: 0000000000023617 R12: ffff8880b5a6f980 R13: ffff8880b5a6f96d R14: ffff8880b5a6f970 R15: ffff8880b5a6f938 FS: 0000000000000000(0000) GS:ffff8880ba000000(0000) knlGS:0000000000000000 CS: 0010 DS: 0000 ES: 0000 CR0: 0000000080050033 CR2: 00000000006d3090 CR3: 000000009c816000 CR4: 00000000001406f0 DR0: 0000000000000000 DR1: 0000000000000000 DR2: 0000000000000000 DR3: 0000000000000000 DR6: 00000000fffe0ff0 DR7: 0000000000000400 Call Trace: __save_stack_trace+0xd6/0x190 arch/x86/kernel/stacktrace.c:44 save_stack mm/kasan/kasan.c:448 [inline] set_track mm/kasan/kasan.c:460 [inline] __kasan_slab_free+0x126/0x1f0 mm/kasan/kasan.c:521 __cache_free mm/slab.c:3503 [inline] kfree+0xcc/0x210 mm/slab.c:3822 aa_free_task_ctx security/apparmor/include/task.h:61 [inline] apparmor_task_free+0x143/0x1e0 security/apparmor/lsm.c:93 security_task_free+0x3e/0x70 security/security.c:992 __put_task_struct+0xea/0x340 kernel/fork.c:688 put_task_struct include/linux/sched/task.h:98 [inline] delayed_put_task_struct+0x1dc/0x320 kernel/exit.c:181 __rcu_reclaim kernel/rcu/rcu.h:236 [inline] rcu_do_batch kernel/rcu/tree.c:2584 [inline] invoke_rcu_callbacks kernel/rcu/tree.c:2897 [inline] __rcu_process_callbacks kernel/rcu/tree.c:2864 [inline] rcu_process_callbacks+0x8ff/0x18b0 kernel/rcu/tree.c:2881 __do_softirq+0x26c/0x9a0 kernel/softirq.c:292 run_ksoftirqd+0x57/0x110 kernel/softirq.c:653 smpboot_thread_fn+0x655/0x9e0 kernel/smpboot.c:164 kthread+0x33f/0x460 kernel/kthread.c:259 ret_from_fork+0x24/0x30 arch/x86/entry/entry_64.S:415