binder: 22046:22046 transaction failed 29189/-22, size 0-0 line 3119 binder: 22047:22047 transaction failed 29189/-22, size 0-0 line 3119 binder: 22048:22048 transaction failed 29189/-22, size 0-0 line 3119 binder: 22049:22049 transaction failed 29189/-22, size 0-0 line 3119 binder: 22050:22050 transaction failed 29189/-22, size 0-0 line 3119 INFO: task init:13879 blocked for more than 140 seconds. Not tainted 4.9.184+ #6 "echo 0 > /proc/sys/kernel/hung_task_timeout_secs" disables this message. init D29304 13879 1 0x00000000 0000000000000087 ffff880180bf97c0 0000000000000000 ffff8801db721000 ffff8801d9c20000 ffff8801db721018 ffff88018040f758 ffffffff8280a5ce ffff880180bfa088 ffff880180bfa060 00ff880180bfa090 ffff8801db7218f0 Call Trace: [<00000000f559de0d>] schedule+0x92/0x1c0 kernel/sched/core.c:3546 [<00000000644725a8>] schedule_preempt_disabled+0x13/0x20 kernel/sched/core.c:3579 [<000000009c7fe0da>] __mutex_lock_common kernel/locking/mutex.c:582 [inline] [<000000009c7fe0da>] mutex_lock_nested+0x38d/0x920 kernel/locking/mutex.c:621 [<0000000064e61bfb>] tty_open_by_driver drivers/tty/tty_io.c:2062 [inline] [<0000000064e61bfb>] tty_open+0x3f9/0xe10 drivers/tty/tty_io.c:2140 [<0000000058d99065>] chrdev_open+0x230/0x630 fs/char_dev.c:398 [<00000000e442031c>] do_dentry_open+0x422/0xd20 fs/open.c:772 [<0000000090165810>] vfs_open+0x105/0x230 fs/open.c:885 [<0000000001bc456d>] do_last fs/namei.c:3457 [inline] [<0000000001bc456d>] path_openat+0xbf5/0x2f60 fs/namei.c:3581 [<000000003d46fa5a>] do_filp_open+0x1a1/0x280 fs/namei.c:3615 [<000000002212dcee>] do_sys_open+0x2f0/0x610 fs/open.c:1078 [<00000000dac2e0db>] SYSC_open fs/open.c:1096 [inline] [<00000000dac2e0db>] SyS_open+0x2d/0x40 fs/open.c:1091 [<0000000039e4b9b9>] do_syscall_64+0x1ad/0x5c0 arch/x86/entry/common.c:288 [<0000000071e2a9aa>] entry_SYSCALL_64_after_swapgs+0x5d/0xdb Showing all locks held in the system: 2 locks held by khungtaskd/24: #0: (rcu_read_lock){......}, at: [<0000000091d29584>] check_hung_uninterruptible_tasks kernel/hung_task.c:169 [inline] #0: (rcu_read_lock){......}, at: [<0000000091d29584>] watchdog+0x14b/0xaf0 kernel/hung_task.c:263 #1: (tasklist_lock){.+.+..}, at: [<00000000b8ad5d3b>] debug_show_all_locks+0x7f/0x21f kernel/locking/lockdep.c:4336 1 lock held by rsyslogd/1908: #0: (&f->f_pos_lock){+.+.+.}, at: [<00000000394dec3a>] __fdget_pos+0xa8/0xd0 fs/file.c:782 2 locks held by getty/2036: #0: (&tty->ldisc_sem){++++++}, at: [<00000000de3c1d29>] ldsem_down_read+0x33/0x40 drivers/tty/tty_ldsem.c:377 #1: (&ldata->atomic_read_lock){+.+...}, at: [<00000000a7611401>] n_tty_read+0x1fe/0x1820 drivers/tty/n_tty.c:2156 1 lock held by init/13879: #0: (tty_mutex){+.+.+.}, at: [<0000000064e61bfb>] tty_open_by_driver drivers/tty/tty_io.c:2062 [inline] #0: (tty_mutex){+.+.+.}, at: [<0000000064e61bfb>] tty_open+0x3f9/0xe10 drivers/tty/tty_io.c:2140 1 lock held by init/13880: #0: (tty_mutex){+.+.+.}, at: [<0000000064e61bfb>] tty_open_by_driver drivers/tty/tty_io.c:2062 [inline] #0: (tty_mutex){+.+.+.}, at: [<0000000064e61bfb>] tty_open+0x3f9/0xe10 drivers/tty/tty_io.c:2140 1 lock held by init/13881: #0: (tty_mutex){+.+.+.}, at: [<0000000064e61bfb>] tty_open_by_driver drivers/tty/tty_io.c:2062 [inline] #0: (tty_mutex){+.+.+.}, at: [<0000000064e61bfb>] tty_open+0x3f9/0xe10 drivers/tty/tty_io.c:2140 1 lock held by init/13882: #0: (tty_mutex){+.+.+.}, at: [<0000000064e61bfb>] tty_open_by_driver drivers/tty/tty_io.c:2062 [inline] #0: (tty_mutex){+.+.+.}, at: [<0000000064e61bfb>] tty_open+0x3f9/0xe10 drivers/tty/tty_io.c:2140 1 lock held by init/13883: #0: (tty_mutex){+.+.+.}, at: [<0000000064e61bfb>] tty_open_by_driver drivers/tty/tty_io.c:2062 [inline] #0: (tty_mutex){+.+.+.}, at: [<0000000064e61bfb>] tty_open+0x3f9/0xe10 drivers/tty/tty_io.c:2140 1 lock held by init/13884: #0: (tty_mutex){+.+.+.}, at: [<0000000064e61bfb>] tty_open_by_driver drivers/tty/tty_io.c:2062 [inline] #0: (tty_mutex){+.+.+.}, at: [<0000000064e61bfb>] tty_open+0x3f9/0xe10 drivers/tty/tty_io.c:2140 ============================================= NMI backtrace for cpu 0 CPU: 0 PID: 24 Comm: khungtaskd Not tainted 4.9.184+ #6 ffff8801d98d7cc8 ffffffff81b580a1 0000000000000000 0000000000000000 0000000000000000 ffffffff81099a01 dffffc0000000000 ffff8801d98d7d00 ffffffff81b6333c 0000000000000000 0000000000000000 0000000000000000 Call Trace: [<0000000079f8fbd8>] __dump_stack lib/dump_stack.c:15 [inline] [<0000000079f8fbd8>] dump_stack+0xc1/0x120 lib/dump_stack.c:51 [<00000000e759ec66>] nmi_cpu_backtrace.cold+0x47/0x87 lib/nmi_backtrace.c:99 [<000000005fed04e8>] nmi_trigger_cpumask_backtrace+0x124/0x155 lib/nmi_backtrace.c:60 [<00000000f63a0106>] arch_trigger_cpumask_backtrace+0x14/0x20 arch/x86/kernel/apic/hw_nmi.c:37 [<00000000fcb3bcb3>] trigger_all_cpu_backtrace include/linux/nmi.h:58 [inline] [<00000000fcb3bcb3>] check_hung_task kernel/hung_task.c:126 [inline] [<00000000fcb3bcb3>] check_hung_uninterruptible_tasks kernel/hung_task.c:183 [inline] [<00000000fcb3bcb3>] watchdog+0x670/0xaf0 kernel/hung_task.c:263 [<00000000e2765dc7>] kthread+0x278/0x310 kernel/kthread.c:211 [<0000000095624260>] ret_from_fork+0x5c/0x70 arch/x86/entry/entry_64.S:375 Sending NMI from CPU 0 to CPUs 1: NMI backtrace for cpu 1 CPU: 1 PID: 22 Comm: kworker/1:1 Not tainted 4.9.184+ #6 Workqueue: events binder_deferred_funcc task: 000000001fff39ce task.stack: 0000000015d910da RIP: 0010:[] c [<000000008b180a8d>] io_serial_in+0x6b/0x90 drivers/tty/serial/8250/8250_port.c:414 RSP: 0018:ffff8801d9c2f648 EFLAGS: 00000002 RAX: dffffc0000000000 RBX: 00000000000003fd RCX: 0000000000000000 RDX: 00000000000003fd RSI: ffffffff81d77bd1 RDI: ffffffff84b65d18 RBP: ffff8801d9c2f658 R08: 0000000000000001 R09: 0000000000000000 R10: 0000000000000001 R11: ffffffff841d45b2 R12: ffffffff84b65ce0 R13: 0000000000000020 R14: fffffbfff096cbe3 R15: fffffbfff096cba5 FS: 0000000000000000(0000) GS:ffff8801db700000(0000) knlGS:0000000000000000 CS: 0010 DS: 0000 ES: 0000 CR0: 0000000080050033 CR2: 00000000004c34c8 CR3: 00000001d429c000 CR4: 00000000001606b0 Stack: ffffffff84b65ce0c 0000000000002710c ffff8801d9c2f6a8c ffffffff81d79e74c ffffffff841d4560c ffffffff84b65d28c ffffffff84b65f1ac ffffffff841d455fc ffffffff84b65ce0c 000000000000002ac dffffc0000000000c 000000000000002ac Call Trace: [<00000000132a5b7d>] serial_in drivers/tty/serial/8250/8250.h:111 [inline] [<00000000132a5b7d>] wait_for_xmitr+0x94/0x1e0 drivers/tty/serial/8250/8250_port.c:1997 [<00000000cf5a1c3f>] serial8250_console_putchar+0x20/0x60 drivers/tty/serial/8250/8250_port.c:3103 [<00000000b557c81b>] uart_console_write+0x56/0xe0 drivers/tty/serial/serial_core.c:1880 [<000000002f722342>] serial8250_console_write+0x2fb/0x860 drivers/tty/serial/8250/8250_port.c:3169 [<00000000a8c65287>] univ8250_console_write+0x5f/0x70 drivers/tty/serial/8250/8250_core.c:594 [<00000000e5f6f79a>] call_console_drivers.isra.0.constprop.0+0x1ac/0x360 kernel/printk/printk.c:1594 [<0000000080e28265>] console_unlock+0x47c/0xb20 kernel/printk/printk.c:2454 [<0000000012e532f3>] vprintk_emit+0x43f/0x6f0 kernel/printk/printk.c:1908 [<00000000d144979a>] vprintk+0x28/0x30 kernel/printk/printk.c:1918 [<00000000eda5f1af>] vprintk_func kernel/printk/internal.h:36 [inline] [<00000000eda5f1af>] printk+0xc2/0xf5 kernel/printk/printk.c:1980 [<000000000119759a>] binder_release_work.cold+0x78/0x9d drivers/android/binder.c:4586 [<0000000032fd2b3f>] binder_thread_release+0x42e/0x530 drivers/android/binder.c:4777 [<000000007b553799>] binder_deferred_release drivers/android/binder.c:5396 [inline] [<000000007b553799>] binder_deferred_func+0x499/0xde0 drivers/android/binder.c:5479 [<00000000c5d5becd>] process_one_work+0x88b/0x1600 kernel/workqueue.c:2114 [<000000007a2706a9>] worker_thread+0x5df/0x11d0 kernel/workqueue.c:2251 [<00000000e2765dc7>] kthread+0x278/0x310 kernel/kthread.c:211 [<0000000095624260>] ret_from_fork+0x5c/0x70 arch/x86/entry/entry_64.S:375 Code: c24 cc9 c00 c00 c00 c49 c8d c7c c24 c38 c48 cb8 c00 c00 c00 c00 c00 cfc cff cdf c48 c89 cfa c48 cc1 cea c03 cd3 ce3 c80 c3c c02 c00 c75 c17 c41 c03 c5c c24 c38 c89 cda cec c<5b> c0f cb6 cc0 c41 c5c c5d cc3 ce8 c38 c53 c78 cff ceb cc2 ce8 c91 c53 c78 cff ceb c