[ 8.829077][ C2] TCP: TCP-AO: the keyid 100 from SYN packet is not present - not sending SYNACK [ 8.829103][ C2] [ 8.829104][ C2] ======================================================== [ 8.829105][ C2] WARNING: possible irq lock inversion dependency detected [ 8.829107][ C2] 7.2.0-virtme #1 Tainted: G W [ 8.829109][ C2] -------------------------------------------------------- [ 8.829109][ C2] connect-deny_ip/169 just changed the state of lock: [ 8.829111][ C2] ffffffffa0299660 (console_owner){..-.}-{0:0}, at: console_lock_spinning_enable+0x40/0x60 [ 8.829124][ C2] but this lock took another, SOFTIRQ-unsafe lock in the past: [ 8.829125][ C2] (fs_reclaim){+.+.}-{0:0} [ 8.829126][ C2] [ 8.829126][ C2] [ 8.829126][ C2] and interrupts could create inverse lock ordering between them. [ 8.829126][ C2] [ 8.829127][ C2] [ 8.829127][ C2] other info that might help us debug this: [ 8.829127][ C2] Possible interrupt unsafe locking scenario: [ 8.829127][ C2] [ 8.829128][ C2] CPU0 CPU1 [ 8.829128][ C2] ---- ---- [ 8.829129][ C2] lock(fs_reclaim); [ 8.829130][ C2] local_irq_disable(); [ 8.829130][ C2] lock(console_owner); [ 8.829131][ C2] lock(fs_reclaim); [ 8.829132][ C2] [ 8.829132][ C2] lock(console_owner); [ 8.829133][ C2] [ 8.829133][ C2] *** DEADLOCK *** [ 8.829133][ C2] [ 8.829133][ C2] locks held by connect-deny_ip/169: 9, last CPU#2: [ 8.829135][ C2] #0: ff11000010099d90 (sk_lock-AF_INET){+.+.}-{0:0}, at: inet_stream_connect+0x44/0xb0 [ 8.829140][ C2] #1: ffffffffa0390b00 (rcu_read_lock){....}-{1:3}, at: __ip_queue_xmit+0x63/0x1650 [ 8.829145][ C2] #2: ffffffffa0390b00 (rcu_read_lock){....}-{1:3}, at: ip_output+0xa9/0x660 [ 8.829148][ C2] #3: ffffffffa0390b00 (rcu_read_lock){....}-{1:3}, at: ip_finish_output2+0x25c/0x1bc0 [ 8.829151][ C2] #4: ffffffffa0390b00 (rcu_read_lock){....}-{1:3}, at: process_backlog+0x3f1/0x14c0 [ 8.829156][ C2] #5: ffffffffa0390b00 (rcu_read_lock){....}-{1:3}, at: ip_local_deliver_finish+0x2ba/0x610 [ 8.829159][ C2] #6: ffffffffa0390b00 (rcu_read_lock){....}-{1:3}, at: tcp_rcv_listen_state_process+0x108/0x380 [ 8.829163][ C2] #7: ffffffffa0379cc0 (console_lock){+.+.}-{0:0}, at: vprintk_emit+0x320/0x3e0 [ 8.829167][ C2] #8: ffffffffa0379d38 (console_srcu){....}-{0:0}, at: console_flush_one_record+0x106/0x710 [ 8.829170][ C2] [ 8.829170][ C2] the shortest dependencies between 2nd lock and 1st lock: [ 8.829174][ C2] -> (fs_reclaim){+.+.}-{0:0} { [ 8.829176][ C2] HARDIRQ-ON-W at: [ 8.829178][ C2] __lock_acquire+0x388/0xc20 [ 8.829181][ C2] lock_acquire.part.0+0xd4/0x280 [ 8.829182][ C2] fs_reclaim_acquire+0xd5/0x120 [ 8.829185][ C2] __kmalloc_cache_noprof+0x6e/0x620 [ 8.829188][ C2] kthread_create_worker_on_node+0xea/0x210 [ 8.829190][ C2] workqueue_init+0x2a/0x680 [ 8.829193][ C2] kernel_init_freeable+0x2fe/0x630 [ 8.829196][ C2] kernel_init+0x21/0x150 [ 8.829199][ C2] ret_from_fork+0x474/0x6b0 [ 8.829202][ C2] ret_from_fork_asm+0x11/0x20 [ 8.829205][ C2] SOFTIRQ-ON-W at: [ 8.829205][ C2] __lock_acquire+0x388/0xc20 [ 8.829207][ C2] lock_acquire.part.0+0xd4/0x280 [ 8.829208][ C2] fs_reclaim_acquire+0xd5/0x120 [ 8.829209][ C2] __kmalloc_cache_noprof+0x6e/0x620 [ 8.829215][ C2] kthread_create_worker_on_node+0xea/0x210 [ 8.829216][ C2] workqueue_init+0x2a/0x680 [ 8.829217][ C2] kernel_init_freeable+0x2fe/0x630 [ 8.829219][ C2] kernel_init+0x21/0x150 [ 8.829220][ C2] ret_from_fork+0x474/0x6b0 [ 8.829221][ C2] ret_from_fork_asm+0x11/0x20 [ 8.829222][ C2] INITIAL USE at: [ 8.829223][ C2] __lock_acquire+0x388/0xc20 [ 8.829225][ C2] lock_acquire.part.0+0xd4/0x280 [ 8.829226][ C2] fs_reclaim_acquire+0xd5/0x120 [ 8.829227][ C2] __kmalloc_cache_noprof+0x6e/0x620 [ 8.829229][ C2] kthread_create_worker_on_node+0xea/0x210 [ 8.829230][ C2] workqueue_init+0x2a/0x680 [ 8.829231][ C2] kernel_init_freeable+0x2fe/0x630 [ 8.829233][ C2] kernel_init+0x21/0x150 [ 8.829234][ C2] ret_from_fork+0x474/0x6b0 [ 8.829235][ C2] ret_from_fork_asm+0x11/0x20 [ 8.829236][ C2] } [ 8.829236][ C2] ... key at: [] __fs_reclaim_map+0x0/0xbe0 [ 8.829240][ C2] ... acquired at: [ 8.829241][ C2] __lock_acquire+0x518/0xc20 [ 8.829243][ C2] lock_acquire.part.0+0xd4/0x280 [ 8.829244][ C2] fs_reclaim_acquire+0xd5/0x120 [ 8.829245][ C2] __kmalloc_noprof+0xd3/0x760 [ 8.829246][ C2] alloc_buf.isra.0+0x4b/0x260 [ 8.829249][ C2] put_chars+0x1e1/0x2f0 [ 8.829251][ C2] hvc_console_print+0x292/0x780 [ 8.829253][ C2] console_emit_next_record+0x22f/0x4c0 [ 8.829255][ C2] console_flush_one_record+0x46f/0x710 [ 8.829257][ C2] console_unlock+0xee/0x1f0 [ 8.829258][ C2] vprintk_emit+0x37c/0x3e0 [ 8.829259][ C2] dev_vprintk_emit+0x27f/0x2c0 [ 8.829263][ C2] dev_printk_emit+0xb9/0xee [ 8.829264][ C2] _dev_info+0xe2/0x116 [ 8.829266][ C2] __devm_rtc_register_device.cold+0xc3/0x3a8 [ 8.829269][ C2] cmos_do_probe+0x73b/0x98a [ 8.829270][ C2] platform_probe+0xfe/0x1f0 [ 8.829272][ C2] call_driver_probe+0x61/0x1c0 [ 8.829274][ C2] really_probe+0x199/0x760 [ 8.829276][ C2] __driver_probe_device+0x24f/0x440 [ 8.829277][ C2] driver_probe_device+0x4a/0xf0 [ 8.829279][ C2] __driver_attach+0x1b8/0x540 [ 8.829280][ C2] bus_for_each_dev+0x130/0x1e0 [ 8.829282][ C2] bus_add_driver+0x2c8/0x530 [ 8.829283][ C2] driver_register+0x1a3/0x390 [ 8.829285][ C2] __platform_driver_probe+0x13f/0x270 [ 8.829286][ C2] cmos_init+0x31/0x40 [ 8.829289][ C2] do_one_initcall+0x124/0x4f0 [ 8.829290][ C2] kernel_init_freeable+0x596/0x630 [ 8.829292][ C2] kernel_init+0x21/0x150 [ 8.829293][ C2] ret_from_fork+0x474/0x6b0 [ 8.829294][ C2] ret_from_fork_asm+0x11/0x20 [ 8.829296][ C2] [ 8.829296][ C2] -> (console_owner){..-.}-{0:0} { [ 8.829298][ C2] IN-SOFTIRQ-W at: [ 8.829298][ C2] __lock_acquire+0x388/0xc20 [ 8.829300][ C2] lock_acquire.part.0+0xd4/0x280 [ 8.829301][ C2] console_lock_spinning_enable+0x5c/0x60 [ 8.829303][ C2] console_emit_next_record+0x1d1/0x4c0 [ 8.829304][ C2] console_flush_one_record+0x46f/0x710 [ 8.829306][ C2] console_unlock+0xee/0x1f0 [ 8.829307][ C2] vprintk_emit+0x37c/0x3e0 [ 8.829309][ C2] _printk+0xc7/0x100 [ 8.829312][ C2] tcp_make_synack.cold+0x36/0xb6 [ 8.829314][ C2] tcp_v4_send_synack+0x103/0xb20 [ 8.829316][ C2] tcp_conn_request+0x1f15/0x2d20 [ 8.829321][ C2] tcp_rcv_listen_state_process+0x1ab/0x380 [ 8.829323][ C2] tcp_v4_rcv_listen.constprop.0.isra.0+0x13f/0x4f0 [ 8.829324][ C2] tcp_v4_rcv+0x253c/0x2b70 [ 8.829326][ C2] ip_protocol_deliver_rcu+0x82/0x350 [ 8.829327][ C2] ip_local_deliver_finish+0x36f/0x610 [ 8.829329][ C2] ip_local_deliver+0x184/0x4c0 [ 8.829330][ C2] ip_rcv+0xdc/0x3d0 [ 8.829331][ C2] __netif_receive_skb_one_core+0xfc/0x180 [ 8.829333][ C2] process_backlog+0x431/0x14c0 [ 8.829335][ C2] __napi_poll+0xa7/0x3b0 [ 8.829336][ C2] net_rx_action+0x513/0xf50 [ 8.829338][ C2] handle_softirqs+0x1d3/0x900 [ 8.829341][ C2] do_softirq+0xac/0xe0 [ 8.829342][ C2] __local_bh_enable_ip+0x118/0x150 [ 8.829343][ C2] __dev_queue_xmit+0x979/0x1b80 [ 8.829345][ C2] ip_finish_output2+0xd9b/0x1bc0 [ 8.829346][ C2] ip_output+0x1ca/0x660 [ 8.829348][ C2] __ip_queue_xmit+0x774/0x1650 [ 8.829349][ C2] __tcp_transmit_skb+0x1b6e/0x3c10 [ 8.829350][ C2] tcp_connect+0x1024/0x1e20 [ 8.829351][ C2] tcp_v4_connect+0x12bd/0x1960 [ 8.829353][ C2] __inet_stream_connect+0x2ed/0xd00 [ 8.829354][ C2] inet_stream_connect+0x59/0xb0 [ 8.829355][ C2] __sys_connect+0x1cf/0x2e0 [ 8.829358][ C2] __x64_sys_connect+0x72/0xd0 [ 8.829359][ C2] do_syscall_64+0xff/0x530 [ 8.829362][ C2] entry_SYSCALL_64_after_hwframe+0x4b/0x53 [ 8.829363][ C2] INITIAL USE at: [ 8.829364][ C2] } [ 8.829365][ C2] ... key at: [] console_owner_dep_map+0x0/0x60 [ 8.829368][ C2] ... acquired at: [ 8.829369][ C2] mark_lock+0x1d7/0xa00 [ 8.829370][ C2] mark_usage+0x42/0x170 [ 8.829371][ C2] __lock_acquire+0x388/0xc20 [ 8.829373][ C2] lock_acquire.part.0+0xd4/0x280 [ 8.829374][ C2] console_lock_spinning_enable+0x5c/0x60 [ 8.829375][ C2] console_emit_next_record+0x1d1/0x4c0 [ 8.829377][ C2] console_flush_one_record+0x46f/0x710 [ 8.829378][ C2] console_unlock+0xee/0x1f0 [ 8.829380][ C2] vprintk_emit+0x37c/0x3e0 [ 8.829381][ C2] _printk+0xc7/0x100 [ 8.829383][ C2] tcp_make_synack.cold+0x36/0xb6 [ 8.829384][ C2] tcp_v4_send_synack+0x103/0xb20 [ 8.829385][ C2] tcp_conn_request+0x1f15/0x2d20 [ 8.829387][ C2] tcp_rcv_listen_state_process+0x1ab/0x380 [ 8.829389][ C2] tcp_v4_rcv_listen.constprop.0.isra.0+0x13f/0x4f0 [ 8.829390][ C2] tcp_v4_rcv+0x253c/0x2b70 [ 8.829391][ C2] ip_protocol_deliver_rcu+0x82/0x350 [ 8.829393][ C2] ip_local_deliver_finish+0x36f/0x610 [ 8.829394][ C2] ip_local_deliver+0x184/0x4c0 [ 8.829395][ C2] ip_rcv+0xdc/0x3d0 [ 8.829396][ C2] __netif_receive_skb_one_core+0xfc/0x180 [ 8.829398][ C2] process_backlog+0x431/0x14c0 [ 8.829400][ C2] __napi_poll+0xa7/0x3b0 [ 8.829401][ C2] net_rx_action+0x513/0xf50 [ 8.829403][ C2] handle_softirqs+0x1d3/0x900 [ 8.829404][ C2] do_softirq+0xac/0xe0 [ 8.829405][ C2] __local_bh_enable_ip+0x118/0x150 [ 8.829406][ C2] __dev_queue_xmit+0x979/0x1b80 [ 8.829408][ C2] ip_finish_output2+0xd9b/0x1bc0 [ 8.829409][ C2] ip_output+0x1ca/0x660 [ 8.829411][ C2] __ip_queue_xmit+0x774/0x1650 [ 8.829412][ C2] __tcp_transmit_skb+0x1b6e/0x3c10 [ 8.829413][ C2] tcp_connect+0x1024/0x1e20 [ 8.829414][ C2] tcp_v4_connect+0x12bd/0x1960 [ 8.829415][ C2] __inet_stream_connect+0x2ed/0xd00 [ 8.829416][ C2] inet_stream_connect+0x59/0xb0 [ 8.829418][ C2] __sys_connect+0x1cf/0x2e0 [ 8.829419][ C2] __x64_sys_connect+0x72/0xd0 [ 8.829420][ C2] do_syscall_64+0xff/0x530 [ 8.829422][ C2] entry_SYSCALL_64_after_hwframe+0x4b/0x53 [ 8.829423][ C2] [ 8.829423][ C2] [ 8.829423][ C2] stack backtrace: [ 8.829426][ C2] CPU: 2 UID: 0 PID: 169 Comm: connect-deny_ip Tainted: G W 7.2.0-virtme #1 PREEMPT(full) [ 8.829429][ C2] Tainted: [W]=WARN [ 8.829429][ C2] Hardware name: Bochs Bochs, BIOS Bochs 01/01/2011 [ 8.829431][ C2] Call Trace: [ 8.829432][ C2] [ 8.829433][ C2] dump_stack_lvl+0x6f/0xa0 [ 8.829437][ C2] print_irq_inversion_bug.part.0.cold+0xe6/0x143 [ 8.829439][ C2] mark_lock_irq+0x989/0x9c0 [ 8.829441][ C2] mark_lock+0x1d7/0xa00 [ 8.829443][ C2] mark_usage+0x42/0x170 [ 8.829445][ C2] __lock_acquire+0x388/0xc20 [ 8.829447][ C2] lock_acquire.part.0+0xd4/0x280 [ 8.829448][ C2] ? console_lock_spinning_enable+0x40/0x60 [ 8.829450][ C2] ? rcu_is_watching+0x16/0xd0 [ 8.829454][ C2] ? lock_acquire+0x13c/0x160 [ 8.829456][ C2] console_lock_spinning_enable+0x5c/0x60 [ 8.829458][ C2] ? console_lock_spinning_enable+0x40/0x60 [ 8.829459][ C2] console_emit_next_record+0x1d1/0x4c0 [ 8.829461][ C2] ? devkmsg_read+0x4b0/0x4b0 [ 8.829463][ C2] ? console_flush_one_record+0x106/0x710 [ 8.829465][ C2] ? rcu_is_watching+0x16/0xd0 [ 8.829466][ C2] ? lock_acquire+0x13c/0x160 [ 8.829468][ C2] console_flush_one_record+0x46f/0x710 [ 8.829470][ C2] ? console_emit_next_record+0x4c0/0x4c0 [ 8.829472][ C2] ? __lock_acquire+0x518/0xc20 [ 8.829474][ C2] console_unlock+0xee/0x1f0 [ 8.829476][ C2] ? console_flush_one_record+0x710/0x710 [ 8.829478][ C2] ? rcu_is_watching+0x16/0xd0 [ 8.829479][ C2] ? lock_acquire+0x60/0x160 [ 8.829481][ C2] ? __down_trylock_console_sem+0x5e/0xa0 [ 8.829483][ C2] ? vprintk_emit+0x320/0x3e0 [ 8.829485][ C2] vprintk_emit+0x37c/0x3e0 [ 8.829487][ C2] ? wake_up_klogd_work_func+0x90/0x90 [ 8.829489][ C2] ? __lock_release.isra.0+0x69/0x1a0 [ 8.829491][ C2] _printk+0xc7/0x100 [ 8.829492][ C2] ? snapshot_read.cold+0x21/0x21 [ 8.829494][ C2] ? ___ratelimit+0x4e7/0xa00 [ 8.829497][ C2] ? idr_get_free+0x830/0x830 [ 8.829499][ C2] tcp_make_synack.cold+0x36/0xb6 [ 8.829501][ C2] ? tcp_send_synack+0x1570/0x1570 [ 8.829503][ C2] ? lockdep_hardirqs_on_prepare.part.0+0x9a/0x160 [ 8.829504][ C2] ? _raw_spin_unlock_irqrestore+0x53/0x80 [ 8.829507][ C2] ? do_raw_spin_unlock+0x59/0x250 [ 8.829509][ C2] ? add_timer_on+0x580/0x580 [ 8.829512][ C2] tcp_v4_send_synack+0x103/0xb20 [ 8.829514][ C2] ? tcp_v4_timewait_ack+0x870/0x870 [ 8.829516][ C2] ? tcp_fastopen_add_skb+0xc0/0xc0 [ 8.829519][ C2] ? secure_tcpv6_seq_and_ts_off+0x300/0x300 [ 8.829521][ C2] ? inet_csk_route_req+0x747/0xc30 [ 8.829523][ C2] ? inet_csk_reqsk_queue_hash_add+0x4c/0x60 [ 8.829525][ C2] tcp_conn_request+0x1f15/0x2d20 [ 8.829527][ C2] ? tcp_ao_calc_traffic_key+0x2a0/0x2a0 [ 8.829530][ C2] ? tcp_get_syncookie_mss+0x300/0x300 [ 8.829532][ C2] ? __lock_acquire+0x518/0xc20 [ 8.829534][ C2] ? lock_acquire.part.0+0xd4/0x280 [ 8.829536][ C2] ? __lock_acquire+0x518/0xc20 [ 8.829537][ C2] ? down_read_nested+0xe7/0x500 [ 8.829540][ C2] ? rcu_is_watching+0x16/0xd0 [ 8.829542][ C2] ? tcp_rcv_listen_state_process+0x1ab/0x380 [ 8.829544][ C2] tcp_rcv_listen_state_process+0x1ab/0x380 [ 8.829546][ C2] tcp_v4_rcv_listen.constprop.0.isra.0+0x13f/0x4f0 [ 8.829548][ C2] ? tcp_v4_fill_cb+0x33/0x430 [ 8.829549][ C2] tcp_v4_rcv+0x253c/0x2b70 [ 8.829552][ C2] ? mark_usage+0x61/0x170 [ 8.829553][ C2] ? tcp_add_backlog+0x1e30/0x1e30 [ 8.829555][ C2] ? lock_acquire.part.0+0xd4/0x280 [ 8.829557][ C2] ? ip_local_deliver_finish+0x2ba/0x610 [ 8.829559][ C2] ip_protocol_deliver_rcu+0x82/0x350 [ 8.829560][ C2] ? process_backlog+0x3f1/0x14c0 [ 8.829562][ C2] ip_local_deliver_finish+0x36f/0x610 [ 8.829564][ C2] ip_local_deliver+0x184/0x4c0 [ 8.829566][ C2] ? ip_local_deliver_finish+0x610/0x610 [ 8.829567][ C2] ? ip_rcv_finish_core+0x6ed/0x14c0 [ 8.829570][ C2] ? process_backlog+0x3f1/0x14c0 [ 8.829571][ C2] ip_rcv+0xdc/0x3d0 [ 8.829573][ C2] ? ip_local_deliver+0x4c0/0x4c0 [ 8.829574][ C2] ? rcu_read_lock_any_held+0x3c/0x90 [ 8.829576][ C2] ? mark_usage+0x61/0x170 [ 8.829578][ C2] ? __lock_acquire+0x518/0xc20 [ 8.829579][ C2] ? trace_raw_output_rcu_invoke_kfree_bulk_callback+0x57/0x130 [ 8.829582][ C2] __netif_receive_skb_one_core+0xfc/0x180 [ 8.829583][ C2] ? lock_acquire.part.0+0xd4/0x280 [ 8.829585][ C2] ? process_backlog+0x3f1/0x14c0 [ 8.829587][ C2] ? __netif_receive_skb_list_core+0x9e0/0x9e0 [ 8.829588][ C2] ? rcu_is_watching+0x16/0xd0 [ 8.829591][ C2] process_backlog+0x431/0x14c0 [ 8.829593][ C2] __napi_poll+0xa7/0x3b0 [ 8.829596][ C2] net_rx_action+0x513/0xf50 [ 8.829598][ C2] ? __napi_poll+0x3b0/0x3b0 [ 8.829600][ C2] ? find_held_lock+0x2b/0x80 [ 8.829603][ C2] ? mark_held_locks+0x40/0x70 [ 8.829605][ C2] handle_softirqs+0x1d3/0x900 [ 8.829607][ C2] ? _local_bh_enable+0xc0/0xc0 [ 8.829608][ C2] ? rcu_is_watching+0x16/0xd0 [ 8.829610][ C2] ? trace_csd_function_exit+0xb3/0x180 [ 8.829612][ C2] ? __dev_queue_xmit+0x964/0x1b80 [ 8.829614][ C2] do_softirq+0xac/0xe0 [ 8.829616][ C2] [ 8.829616][ C2] [ 8.829617][ C2] __local_bh_enable_ip+0x118/0x150 [ 8.829618][ C2] __dev_queue_xmit+0x979/0x1b80 [ 8.829620][ C2] ? __asan_memcpy+0x3c/0x60 [ 8.829623][ C2] ? netdev_core_pick_tx+0x2c0/0x2c0 [ 8.829625][ C2] ? lock_acquire.part.0+0xd4/0x280 [ 8.829626][ C2] ? find_held_lock+0x2b/0x80 [ 8.829628][ C2] ? __lock_release.isra.0+0x69/0x1a0 [ 8.829629][ C2] ? rcu_is_watching+0x16/0xd0 [ 8.829631][ C2] ? mark_held_locks+0x40/0x70 [ 8.829633][ C2] ? __asan_memcpy+0x3c/0x60 [ 8.829634][ C2] ? neigh_hh_output+0x152/0x4c0 [ 8.829636][ C2] ip_finish_output2+0xd9b/0x1bc0 [ 8.829638][ C2] ? ip_dst_mtu_maybe_forward+0x261/0x670 [ 8.829639][ C2] ? lock_acquire.part.0+0xd4/0x280 [ 8.829641][ C2] ? ip_fragment.constprop.0+0x2c0/0x2c0 [ 8.829644][ C2] ip_output+0x1ca/0x660 [ 8.829645][ C2] ? ip_finish_output+0x460/0x460 [ 8.829647][ C2] ? find_held_lock+0x2b/0x80 [ 8.829648][ C2] ? __lock_release.isra.0+0x69/0x1a0 [ 8.829650][ C2] ? ip4_dst_hoplimit+0x15b/0x320 [ 8.829652][ C2] __ip_queue_xmit+0x774/0x1650 [ 8.829655][ C2] __tcp_transmit_skb+0x1b6e/0x3c10 [ 8.829657][ C2] ? __tcp_select_window+0xf20/0xf20 [ 8.829659][ C2] ? lockdep_hardirqs_on+0x91/0x130 [ 8.829661][ C2] ? ktime_get+0x18e/0x2d0 [ 8.829662][ C2] ? kvm_clock_get_cycles+0x19/0x30 [ 8.829665][ C2] ? ktime_get+0x1dd/0x2d0 [ 8.829667][ C2] tcp_connect+0x1024/0x1e20 [ 8.829669][ C2] tcp_v4_connect+0x12bd/0x1960 [ 8.829672][ C2] ? tcp_v4_ao_sign_reset+0x8c0/0x8c0 [ 8.829673][ C2] ? do_raw_spin_lock+0x131/0x280 [ 8.829675][ C2] ? find_held_lock+0x2b/0x80 [ 8.829677][ C2] __inet_stream_connect+0x2ed/0xd00 [ 8.829678][ C2] ? lockdep_hardirqs_on+0x91/0x130 [ 8.829680][ C2] inet_stream_connect+0x59/0xb0 [ 8.829681][ C2] __sys_connect+0x1cf/0x2e0 [ 8.829683][ C2] ? do_fcntl+0x36f/0xc50 [ 8.829686][ C2] ? __sys_connect_file+0x250/0x250 [ 8.829689][ C2] ? fput+0x1f/0xa0 [ 8.829691][ C2] __x64_sys_connect+0x72/0xd0 [ 8.829693][ C2] ? lockdep_hardirqs_on+0x91/0x130 [ 8.829694][ C2] ? do_syscall_64+0xa6/0x530 [ 8.829695][ C2] do_syscall_64+0xff/0x530 [ 8.829697][ C2] ? exc_page_fault+0xee/0x100 [ 8.829698][ C2] entry_SYSCALL_64_after_hwframe+0x4b/0x53 [ 8.829700][ C2] RIP: 0033:0x7f1c16d36312 [ 8.829703][ C2] Code: 08 0f 85 71 41 ff ff 49 89 fb 48 89 f0 48 89 d7 48 89 ce 4c 89 c2 4d 89 ca 4c 8b 44 24 08 4c 8b 4c 24 10 4c 89 5c 24 08 0f 05 66 2e 0f 1f 84 00 00 00 00 00 0f 1f 00 f3 0f 1e fa 55 bf 01 00 [ 8.829705][ C2] RSP: 002b:00007f1c164b3988 EFLAGS: 00000246 ORIG_RAX: 000000000000002a [ 8.829708][ C2] RAX: ffffffffffffffda RBX: 000000000000000a RCX: 00007f1c16d36312 [ 8.829709][ C2] RDX: 0000000000000010 RSI: 00007f1c164b3c40 RDI: 000000000000000a [ 8.829710][ C2] RBP: 00007f1c164b39b0 R08: 0000000000000000 R09: 0000000000000000 [ 8.829711][ C2] R10: 0000000000000000 R11: 0000000000000246 R12: 00007f1c164b3c40 [ 8.829711][ C2] R13: 0000000000000010 R14: 0000000000000001 R15: 0000000000412230 [ 8.829714][ C2] [ 8.829718][ C2] BUG: sleeping function called from invalid context at ./include/linux/sched/mm.h:322 [ 8.829719][ C2] in_atomic(): 1, irqs_disabled(): 1, non_block: 0, pid: 169, name: connect-deny_ip [ 8.829720][ C2] preempt_count: 302, expected: 0 [ 8.829721][ C2] RCU nest depth: 6, expected: 0 [ 8.829722][ C2] INFO: lockdep is turned off. [ 8.829722][ C2] irq event stamp: 9943 [ 8.829723][ C2] hardirqs last enabled at (9942): [] __down_trylock_console_sem+0x86/0xa0 [ 8.829725][ C2] hardirqs last disabled at (9943): [] console_emit_next_record+0x3d4/0x4c0 [ 8.829727][ C2] softirqs last enabled at (9778): [] __dev_queue_xmit+0x964/0x1b80 [ 8.829729][ C2] softirqs last disabled at (9779): [] do_softirq+0xac/0xe0 [ 8.829730][ C2] Preemption disabled at: [ 8.829731][ C2] [] __dev_queue_xmit+0x204/0x1b80 [ 8.829734][ C2] CPU: 2 UID: 0 PID: 169 Comm: connect-deny_ip Tainted: G W 7.2.0-virtme #1 PREEMPT(full) [ 8.829736][ C2] Tainted: [W]=WARN [ 8.829736][ C2] Hardware name: Bochs Bochs, BIOS Bochs 01/01/2011 [ 8.829737][ C2] Call Trace: [ 8.829737][ C2] [ 8.829738][ C2] dump_stack_lvl+0x6f/0xa0 [ 8.829740][ C2] ? __dev_queue_xmit+0x204/0x1b80 [ 8.829742][ C2] __might_resched.cold+0x1fe/0x2c1 [ 8.829745][ C2] ? perf_trace_sched_switch+0x7c0/0x7c0 [ 8.829747][ C2] ? rcu_is_watching+0x16/0xd0 [ 8.829750][ C2] __kmalloc_noprof+0x443/0x760 [ 8.829751][ C2] ? __rwlock_init+0x150/0x150 [ 8.829753][ C2] ? alloc_buf.isra.0+0x4b/0x260 [ 8.829755][ C2] ? do_raw_spin_unlock+0x59/0x250 [ 8.829756][ C2] alloc_buf.isra.0+0x4b/0x260 [ 8.829758][ C2] put_chars+0x1e1/0x2f0 [ 8.829760][ C2] ? __send_to_port+0x420/0x420 [ 8.829763][ C2] hvc_console_print+0x292/0x780 [ 8.829764][ C2] ? __lock_acquire+0x388/0xc20 [ 8.829767][ C2] ? hvc_write+0x3a0/0x3a0 [ 8.829768][ C2] ? rcu_is_watching+0x16/0xd0 [ 8.829770][ C2] ? lock_acquire+0x13c/0x160 [ 8.829772][ C2] console_emit_next_record+0x22f/0x4c0 [ 8.829774][ C2] ? devkmsg_read+0x4b0/0x4b0 [ 8.829776][ C2] ? console_flush_one_record+0x106/0x710 [ 8.829778][ C2] ? rcu_is_watching+0x16/0xd0 [ 8.829779][ C2] ? lock_acquire+0x13c/0x160 [ 8.829781][ C2] console_flush_one_record+0x46f/0x710 [ 8.829783][ C2] ? console_emit_next_record+0x4c0/0x4c0 [ 8.829785][ C2] ? __lock_acquire+0x518/0xc20 [ 8.829787][ C2] console_unlock+0xee/0x1f0 [ 8.829789][ C2] ? console_flush_one_record+0x710/0x710 [ 8.829791][ C2] ? rcu_is_watching+0x16/0xd0 [ 8.829792][ C2] ? lock_acquire+0x60/0x160 [ 8.829794][ C2] ? __down_trylock_console_sem+0x5e/0xa0 [ 8.829796][ C2] ? vprintk_emit+0x320/0x3e0 [ 8.829798][ C2] vprintk_emit+0x37c/0x3e0 [ 8.829800][ C2] ? wake_up_klogd_work_func+0x90/0x90 [ 8.829802][ C2] ? __lock_release.isra.0+0x69/0x1a0 [ 8.829804][ C2] _printk+0xc7/0x100 [ 8.829805][ C2] ? snapshot_read.cold+0x21/0x21 [ 8.829807][ C2] ? ___ratelimit+0x4e7/0xa00 [ 8.829809][ C2] ? idr_get_free+0x830/0x830 [ 8.829811][ C2] tcp_make_synack.cold+0x36/0xb6 [ 8.829813][ C2] ? tcp_send_synack+0x1570/0x1570 [ 8.829815][ C2] ? lockdep_hardirqs_on_prepare.part.0+0x9a/0x160 [ 8.829816][ C2] ? _raw_spin_unlock_irqrestore+0x53/0x80 [ 8.829818][ C2] ? do_raw_spin_unlock+0x59/0x250 [ 8.829820][ C2] ? add_timer_on+0x580/0x580 [ 8.829822][ C2] tcp_v4_send_synack+0x103/0xb20 [ 8.829824][ C2] ? tcp_v4_timewait_ack+0x870/0x870 [ 8.829826][ C2] ? tcp_fastopen_add_skb+0xc0/0xc0 [ 8.829829][ C2] ? secure_tcpv6_seq_and_ts_off+0x300/0x300 [ 8.829830][ C2] ? inet_csk_route_req+0x747/0xc30 [ 8.829832][ C2] ? inet_csk_reqsk_queue_hash_add+0x4c/0x60 [ 8.829833][ C2] tcp_conn_request+0x1f15/0x2d20 [ 8.829835][ C2] ? tcp_ao_calc_traffic_key+0x2a0/0x2a0 [ 8.829838][ C2] ? tcp_get_syncookie_mss+0x300/0x300 [ 8.829840][ C2] ? __lock_acquire+0x518/0xc20 [ 8.829842][ C2] ? lock_acquire.part.0+0xd4/0x280 [ 8.829843][ C2] ? __lock_acquire+0x518/0xc20 [ 8.829845][ C2] ? down_read_nested+0xe7/0x500 [ 8.829847][ C2] ? rcu_is_watching+0x16/0xd0 [ 8.829849][ C2] ? tcp_rcv_listen_state_process+0x1ab/0x380 [ 8.829851][ C2] tcp_rcv_listen_state_process+0x1ab/0x380 [ 8.829853][ C2] tcp_v4_rcv_listen.constprop.0.isra.0+0x13f/0x4f0 [ 8.829855][ C2] ? tcp_v4_fill_cb+0x33/0x430 [ 8.829856][ C2] tcp_v4_rcv+0x253c/0x2b70 [ 8.829859][ C2] ? mark_usage+0x61/0x170 [ 8.829860][ C2] ? tcp_add_backlog+0x1e30/0x1e30 [ 8.829862][ C2] ? lock_acquire.part.0+0xd4/0x280 [ 8.829864][ C2] ? ip_local_deliver_finish+0x2ba/0x610 [ 8.829866][ C2] ip_protocol_deliver_rcu+0x82/0x350 [ 8.829867][ C2] ? process_backlog+0x3f1/0x14c0 [ 8.829869][ C2] ip_local_deliver_finish+0x36f/0x610 [ 8.829871][ C2] ip_local_deliver+0x184/0x4c0 [ 8.829873][ C2] ? ip_local_deliver_finish+0x610/0x610 [ 8.829874][ C2] ? ip_rcv_finish_core+0x6ed/0x14c0 [ 8.829877][ C2] ? process_backlog+0x3f1/0x14c0 [ 8.829878][ C2] ip_rcv+0xdc/0x3d0 [ 8.829880][ C2] ? ip_local_deliver+0x4c0/0x4c0 [ 8.829881][ C2] ? rcu_read_lock_any_held+0x3c/0x90 [ 8.829883][ C2] ? mark_usage+0x61/0x170 [ 8.829885][ C2] ? __lock_acquire+0x518/0xc20 [ 8.829886][ C2] ? trace_raw_output_rcu_invoke_kfree_bulk_callback+0x57/0x130 [ 8.829888][ C2] __netif_receive_skb_one_core+0xfc/0x180 [ 8.829890][ C2] ? lock_acquire.part.0+0xd4/0x280 [ 8.829891][ C2] ? process_backlog+0x3f1/0x14c0 [ 8.829893][ C2] ? __netif_receive_skb_list_core+0x9e0/0x9e0 [ 8.829895][ C2] ? rcu_is_watching+0x16/0xd0 [ 8.829898][ C2] process_backlog+0x431/0x14c0 [ 8.829900][ C2] __napi_poll+0xa7/0x3b0 [ 8.829902][ C2] net_rx_action+0x513/0xf50 [ 8.829905][ C2] ? __napi_poll+0x3b0/0x3b0 [ 8.829907][ C2] ? find_held_lock+0x2b/0x80 [ 8.829910][ C2] ? mark_held_locks+0x40/0x70 [ 8.829912][ C2] handle_softirqs+0x1d3/0x900 [ 8.829914][ C2] ? _local_bh_enable+0xc0/0xc0 [ 8.829915][ C2] ? rcu_is_watching+0x16/0xd0 [ 8.829917][ C2] ? trace_csd_function_exit+0xb3/0x180 [ 8.829918][ C2] ? __dev_queue_xmit+0x964/0x1b80 [ 8.829920][ C2] do_softirq+0xac/0xe0 [ 8.829921][ C2] [ 8.829922][ C2] [ 8.829922][ C2] __local_bh_enable_ip+0x118/0x150 [ 8.829924][ C2] __dev_queue_xmit+0x979/0x1b80 [ 8.829926][ C2] ? __asan_memcpy+0x3c/0x60 [ 8.829928][ C2] ? netdev_core_pick_tx+0x2c0/0x2c0 [ 8.829930][ C2] ? lock_acquire.part.0+0xd4/0x280 [ 8.829931][ C2] ? find_held_lock+0x2b/0x80 [ 8.829933][ C2] ? __lock_release.isra.0+0x69/0x1a0 [ 8.829934][ C2] ? rcu_is_watching+0x16/0xd0 [ 8.829936][ C2] ? mark_held_locks+0x40/0x70 [ 8.829937][ C2] ? __asan_memcpy+0x3c/0x60 [ 8.829938][ C2] ? neigh_hh_output+0x152/0x4c0 [ 8.829941][ C2] ip_finish_output2+0xd9b/0x1bc0 [ 8.829942][ C2] ? ip_dst_mtu_maybe_forward+0x261/0x670 [ 8.829944][ C2] ? lock_acquire.part.0+0xd4/0x280 [ 8.829946][ C2] ? ip_fragment.constprop.0+0x2c0/0x2c0 [ 8.829948][ C2] ip_output+0x1ca/0x660 [ 8.829950][ C2] ? ip_finish_output+0x460/0x460 [ 8.829952][ C2] ? find_held_lock+0x2b/0x80 [ 8.829953][ C2] ? __lock_release.isra.0+0x69/0x1a0 [ 8.829955][ C2] ? ip4_dst_hoplimit+0x15b/0x320 [ 8.829957][ C2] __ip_queue_xmit+0x774/0x1650 [ 8.829959][ C2] __tcp_transmit_skb+0x1b6e/0x3c10 [ 8.829962][ C2] ? __tcp_select_window+0xf20/0xf20 [ 8.829964][ C2] ? lockdep_hardirqs_on+0x91/0x130 [ 8.829965][ C2] ? ktime_get+0x18e/0x2d0 [ 8.829966][ C2] ? kvm_clock_get_cycles+0x19/0x30 [ 8.829968][ C2] ? ktime_get+0x1dd/0x2d0 [ 8.829969][ C2] tcp_connect+0x1024/0x1e20 [ 8.829972][ C2] tcp_v4_connect+0x12bd/0x1960 [ 8.829974][ C2] ? tcp_v4_ao_sign_reset+0x8c0/0x8c0 [ 8.829976][ C2] ? do_raw_spin_lock+0x131/0x280 [ 8.829977][ C2] ? find_held_lock+0x2b/0x80 [ 8.829979][ C2] __inet_stream_connect+0x2ed/0xd00 [ 8.829981][ C2] ? lockdep_hardirqs_on+0x91/0x130 [ 8.829982][ C2] inet_stream_connect+0x59/0xb0 [ 8.829983][ C2] __sys_connect+0x1cf/0x2e0 [ 8.829985][ C2] ? do_fcntl+0x36f/0xc50 [ 8.829987][ C2] ? __sys_connect_file+0x250/0x250 [ 8.829990][ C2] ? fput+0x1f/0xa0 [ 8.829991][ C2] __x64_sys_connect+0x72/0xd0 [ 8.829993][ C2] ? lockdep_hardirqs_on+0x91/0x130 [ 8.829994][ C2] ? do_syscall_64+0xa6/0x530 [ 8.829996][ C2] do_syscall_64+0xff/0x530 [ 8.829997][ C2] ? exc_page_fault+0xee/0x100 [ 8.829999][ C2] entry_SYSCALL_64_after_hwframe+0x4b/0x53 [ 8.830000][ C2] RIP: 0033:0x7f1c16d36312 [ 8.830001][ C2] Code: 08 0f 85 71 41 ff ff 49 89 fb 48 89 f0 48 89 d7 48 89 ce 4c 89 c2 4d 89 ca 4c 8b 44 24 08 4c 8b 4c 24 10 4c 89 5c 24 08 0f 05 66 2e 0f 1f 84 00 00 00 00 00 0f 1f 00 f3 0f 1e fa 55 bf 01 00 [ 8.830002][ C2] RSP: 002b:00007f1c164b3988 EFLAGS: 00000246 ORIG_RAX: 000000000000002a [ 8.830004][ C2] RAX: ffffffffffffffda RBX: 000000000000000a RCX: 00007f1c16d36312 [ 8.830004][ C2] RDX: 0000000000000010 RSI: 00007f1c164b3c40 RDI: 000000000000000a [ 8.830005][ C2] RBP: 00007f1c164b39b0 R08: 0000000000000000 R09: 0000000000000000 [ 8.830006][ C2] R10: 0000000000000000 R11: 0000000000000246 R12: 00007f1c164b3c40 [ 8.830006][ C2] R13: 0000000000000010 R14: 0000000000000001 R15: 0000000000412230 [ 8.830009][ C2] [ 9.841429][ C2] TCP: TCP-AO: the keyid 100 from SYN packet is not present - not sending SYNACK [ 9.841446][ C2] BUG: sleeping function called from invalid context at ./include/linux/sched/mm.h:322 [ 9.841448][ C2] in_atomic(): 1, irqs_disabled(): 1, non_block: 0, pid: 0, name: swapper/2 [ 9.841450][ C2] preempt_count: 102, expected: 0 [ 9.841451][ C2] RCU nest depth: 0, expected: 0 [ 9.841452][ C2] INFO: lockdep is turned off. [ 9.841453][ C2] irq event stamp: 301308 [ 9.841454][ C2] hardirqs last enabled at (301307): [] default_idle_call+0x98/0xb0 [ 9.841463][ C2] hardirqs last disabled at (301308): [] __schedule+0x1246/0x20e0 [ 9.841465][ C2] softirqs last enabled at (301270): [] handle_softirqs+0x67c/0x900 [ 9.841468][ C2] softirqs last disabled at (301173): [] __irq_exit_rcu+0x145/0x1c0 [ 9.841470][ C2] Preemption disabled at: [ 9.841471][ C2] [<0000000000000000>] 0x0 [ 9.841477][ C2] CPU: 2 UID: 0 PID: 0 Comm: swapper/2 Tainted: G W 7.2.0-virtme #1 PREEMPT(full) [ 9.841480][ C2] Tainted: [W]=WARN [ 9.841481][ C2] Hardware name: Bochs Bochs, BIOS Bochs 01/01/2011 [ 9.841483][ C2] Call Trace: [ 9.841485][ C2] [ 9.841486][ C2] dump_stack_lvl+0x6f/0xa0 [ 9.841492][ C2] __might_resched.cold+0x1fe/0x2c1 [ 9.841495][ C2] ? perf_trace_sched_switch+0x7c0/0x7c0 [ 9.841498][ C2] ? rcu_is_watching+0x16/0xd0 [ 9.841502][ C2] __kmalloc_noprof+0x443/0x760 [ 9.841506][ C2] ? __rwlock_init+0x150/0x150 [ 9.841508][ C2] ? alloc_buf.isra.0+0x4b/0x260 [ 9.841512][ C2] ? do_raw_spin_unlock+0x59/0x250 [ 9.841514][ C2] alloc_buf.isra.0+0x4b/0x260 [ 9.841516][ C2] put_chars+0x1e1/0x2f0 [ 9.841518][ C2] ? __send_to_port+0x420/0x420 [ 9.841520][ C2] ? printk_get_next_message+0x240/0x650 [ 9.841523][ C2] hvc_console_print+0x292/0x780 [ 9.841527][ C2] ? hvc_write+0x3a0/0x3a0 [ 9.841528][ C2] ? __rwlock_init+0x150/0x150 [ 9.841530][ C2] ? rcu_is_watching+0x16/0xd0 [ 9.841532][ C2] ? lock_acquire+0x13c/0x160 [ 9.841534][ C2] console_emit_next_record+0x22f/0x4c0 [ 9.841536][ C2] ? devkmsg_read+0x4b0/0x4b0 [ 9.841538][ C2] ? rcu_is_watching+0x16/0xd0 [ 9.841540][ C2] ? rcu_is_watching+0x16/0xd0 [ 9.841541][ C2] ? rcu_is_watching+0x16/0xd0 [ 9.841543][ C2] ? lock_acquire+0x13c/0x160 [ 9.841545][ C2] ? console_flush_one_record+0x111/0x710 [ 9.841547][ C2] console_flush_one_record+0x46f/0x710 [ 9.841549][ C2] ? console_emit_next_record+0x4c0/0x4c0 [ 9.841551][ C2] console_unlock+0xee/0x1f0 [ 9.841553][ C2] ? lock_acquire+0x13c/0x160 [ 9.841555][ C2] ? console_flush_one_record+0x710/0x710 [ 9.841556][ C2] ? rcu_is_watching+0x16/0xd0 [ 9.841558][ C2] ? lock_release+0x184/0x1f0 [ 9.841559][ C2] ? lock_acquire+0x60/0x160 [ 9.841561][ C2] ? __rcu_read_lock+0x30/0x70 [ 9.841563][ C2] ? __down_trylock_console_sem+0x5e/0xa0 [ 9.841564][ C2] ? vprintk_emit+0x320/0x3e0 [ 9.841566][ C2] vprintk_emit+0x37c/0x3e0 [ 9.841569][ C2] ? wake_up_klogd_work_func+0x90/0x90 [ 9.841570][ C2] ? do_raw_spin_trylock+0xb6/0x180 [ 9.841572][ C2] ? rcu_is_watching+0x16/0xd0 [ 9.841574][ C2] ? lock_acquire+0x13c/0x160 [ 9.841576][ C2] _printk+0xc7/0x100 [ 9.841579][ C2] ? snapshot_read.cold+0x21/0x21 [ 9.841580][ C2] ? ___ratelimit+0x4e7/0xa00 [ 9.841583][ C2] ? trace_hardirqs_on+0x36/0x40 [ 9.841586][ C2] ? idr_get_free+0x830/0x830 [ 9.841587][ C2] ? trace_irq_enable.constprop.0+0x30/0x160 [ 9.841589][ C2] tcp_make_synack.cold+0x36/0xb6 [ 9.841593][ C2] ? tcp_send_synack+0x1570/0x1570 [ 9.841596][ C2] ? rcu_is_watching+0x16/0xd0 [ 9.841598][ C2] ? inet_csk_route_req+0x747/0xc30 [ 9.841601][ C2] tcp_v4_send_synack+0x103/0xb20 [ 9.841604][ C2] ? tcp_v4_timewait_ack+0x870/0x870 [ 9.841606][ C2] ? trace_irq_enable.constprop.0+0x9b/0x160 [ 9.841607][ C2] ? trace_hardirqs_on+0x36/0x40 [ 9.841608][ C2] ? get_random_u16+0x740/0x740 [ 9.841611][ C2] tcp_rtx_synack+0x150/0x440 [ 9.841612][ C2] ? tcp_send_probe0+0x590/0x590 [ 9.841615][ C2] ? sched_balance_rq+0x324/0x1e30 [ 9.841617][ C2] ? do_raw_spin_lock+0x131/0x280 [ 9.841619][ C2] reqsk_timer_handler+0x8d1/0xe30 [ 9.841621][ C2] ? __inet_csk_reqsk_queue_drop+0x420/0x420 [ 9.841622][ C2] ? lock_acquire+0x6a/0x160 [ 9.841623][ C2] ? do_raw_spin_unlock+0x59/0x250 [ 9.841625][ C2] ? __inet_csk_reqsk_queue_drop+0x420/0x420 [ 9.841626][ C2] call_timer_fn+0x160/0x4d0 [ 9.841629][ C2] ? detach_if_pending+0x1d0/0x1d0 [ 9.841631][ C2] ? debug_object_active_state+0x430/0x430 [ 9.841635][ C2] ? __rwlock_init+0x150/0x150 [ 9.841637][ C2] ? timer_recalc_next_expiry+0xf0/0x210 [ 9.841638][ C2] ? rcu_is_watching+0x16/0xd0 [ 9.841641][ C2] __run_timers+0x68f/0xaa0 [ 9.841643][ C2] ? __inet_csk_reqsk_queue_drop+0x420/0x420 [ 9.841644][ C2] ? __bpf_trace_itimer_expire+0x10/0x10 [ 9.841647][ C2] ? do_raw_spin_lock+0x131/0x280 [ 9.841649][ C2] ? __rwlock_init+0x150/0x150 [ 9.841651][ C2] run_timer_softirq+0xf0/0x160 [ 9.841653][ C2] ? __run_timers+0xaa0/0xaa0 [ 9.841655][ C2] ? trace_irq_enable.constprop.0+0x9b/0x160 [ 9.841656][ C2] ? rcu_is_watching+0x16/0xd0 [ 9.841658][ C2] handle_softirqs+0x1d3/0x900 [ 9.841660][ C2] ? _local_bh_enable+0xc0/0xc0 [ 9.841661][ C2] ? rcu_is_watching+0x16/0xd0 [ 9.841663][ C2] ? lock_release+0x184/0x1f0 [ 9.841665][ C2] __irq_exit_rcu+0x145/0x1c0 [ 9.841666][ C2] irq_exit_rcu+0xe/0x30 [ 9.841667][ C2] sysvec_apic_timer_interrupt+0x9d/0xe0 [ 9.841669][ C2] [ 9.841670][ C2] [ 9.841670][ C2] ? _raw_spin_unlock+0x2d/0x50 [ 9.841672][ C2] asm_sysvec_apic_timer_interrupt+0x1a/0x20 [ 9.841675][ C2] RIP: 0010:pv_native_safe_halt+0xf/0x10 [ 9.841677][ C2] Code: 48 8b 3d 94 12 06 02 e8 1f 00 00 00 48 2b 05 58 13 a0 00 c3 0f 1f 80 00 00 00 00 f3 0f 1e fa eb 07 0f 00 2d 13 b6 17 00 fb f4 0f 1f 40 d6 48 83 ec 20 8b 17 49 89 f8 83 e2 fe 41 89 d2 0f 01 [ 9.841679][ C2] RSP: 0018:ffa0000000157e00 EFLAGS: 00000246 [ 9.841682][ C2] RAX: 0000000000000002 RBX: ff11000001bf46c0 RCX: 0000000000000001 [ 9.841684][ C2] RDX: 0000000000000002 RSI: ffffffff9f88dc60 RDI: ffffffff9cefa307 [ 9.841685][ C2] RBP: 0000000000000000 R08: ffffffff9f51e421 R09: 1fe2200006a663a2 [ 9.841685][ C2] R10: 0000000000000002 R11: 0000000000000000 R12: 1ff400000002afc3 [ 9.841686][ C2] R13: 0000000000000000 R14: dffffc0000000000 R15: 0000000000000000 [ 9.841687][ C2] ? ct_kernel_exit.constprop.0+0x101/0x160 [ 9.841689][ C2] ? cpuidle_idle_call.constprop.0+0x237/0x410 [ 9.841691][ C2] default_idle+0x9/0x10 [ 9.841692][ C2] default_idle_call+0x6e/0xb0 [ 9.841694][ C2] cpuidle_idle_call.constprop.0+0x237/0x410 [ 9.841695][ C2] ? arch_cpu_idle_exit+0x40/0x40 [ 9.841697][ C2] ? mark_tsc_async_resets+0x30/0x30 [ 9.841699][ C2] ? rcu_is_watching+0x16/0xd0 [ 9.841701][ C2] ? rcu_is_watching+0x16/0xd0 [ 9.841703][ C2] do_idle+0xd8/0x190 [ 9.841704][ C2] cpu_startup_entry+0x53/0x70 [ 9.841706][ C2] start_secondary+0x204/0x2b0 [ 9.841708][ C2] ? set_cpu_sibling_map+0x2130/0x2130 [ 9.841710][ C2] common_startup_64+0x13e/0x148 [ 9.841714][ C2] [ 9.969525][ C2] TCP: TCP-AO: the keyid 100 from SYN packet is not present - not sending SYNACK [ 10.993409][ C2] TCP: TCP-AO: the keyid 100 from SYN packet is not present - not sending SYNACK [ 10.993424][ C2] BUG: sleeping function called from invalid context at ./include/linux/sched/mm.h:322 [ 10.993427][ C2] in_atomic(): 1, irqs_disabled(): 1, non_block: 0, pid: 0, name: swapper/2 [ 10.993429][ C2] preempt_count: 102, expected: 0 [ 10.993429][ C2] RCU nest depth: 0, expected: 0 [ 10.993430][ C2] INFO: lockdep is turned off. [ 10.993432][ C2] irq event stamp: 301308 [ 10.993433][ C2] hardirqs last enabled at (301307): [] default_idle_call+0x98/0xb0 [ 10.993441][ C2] hardirqs last disabled at (301308): [] __schedule+0x1246/0x20e0 [ 10.993444][ C2] softirqs last enabled at (301270): [] handle_softirqs+0x67c/0x900 [ 10.993447][ C2] softirqs last disabled at (301173): [] __irq_exit_rcu+0x145/0x1c0 [ 10.993449][ C2] Preemption disabled at: [ 10.993450][ C2] [<0000000000000000>] 0x0 [ 10.993457][ C2] CPU: 2 UID: 0 PID: 0 Comm: swapper/2 Tainted: G W 7.2.0-virtme #1 PREEMPT(full) [ 10.993460][ C2] Tainted: [W]=WARN [ 10.993461][ C2] Hardware name: Bochs Bochs, BIOS Bochs 01/01/2011 [ 10.993463][ C2] Call Trace: [ 10.993465][ C2] [ 10.993467][ C2] dump_stack_lvl+0x6f/0xa0 [ 10.993472][ C2] __might_resched.cold+0x1fe/0x2c1 [ 10.993476][ C2] ? perf_trace_sched_switch+0x7c0/0x7c0 [ 10.993479][ C2] ? rcu_is_watching+0x16/0xd0 [ 10.993483][ C2] __kmalloc_noprof+0x443/0x760 [ 10.993486][ C2] ? __rwlock_init+0x150/0x150 [ 10.993489][ C2] ? alloc_buf.isra.0+0x4b/0x260 [ 10.993492][ C2] ? do_raw_spin_unlock+0x59/0x250 [ 10.993494][ C2] alloc_buf.isra.0+0x4b/0x260 [ 10.993496][ C2] put_chars+0x1e1/0x2f0 [ 10.993498][ C2] ? __send_to_port+0x420/0x420 [ 10.993500][ C2] ? printk_get_next_message+0x240/0x650 [ 10.993503][ C2] hvc_console_print+0x292/0x780 [ 10.993507][ C2] ? hvc_write+0x3a0/0x3a0 [ 10.993508][ C2] ? __rwlock_init+0x150/0x150 [ 10.993510][ C2] ? rcu_is_watching+0x16/0xd0 [ 10.993512][ C2] ? lock_acquire+0x13c/0x160 [ 10.993514][ C2] console_emit_next_record+0x22f/0x4c0 [ 10.993516][ C2] ? devkmsg_read+0x4b0/0x4b0 [ 10.993518][ C2] ? rcu_is_watching+0x16/0xd0 [ 10.993520][ C2] ? rcu_is_watching+0x16/0xd0 [ 10.993521][ C2] ? rcu_is_watching+0x16/0xd0 [ 10.993523][ C2] ? lock_acquire+0x13c/0x160 [ 10.993525][ C2] ? console_flush_one_record+0x111/0x710 [ 10.993527][ C2] console_flush_one_record+0x46f/0x710 [ 10.993529][ C2] ? console_emit_next_record+0x4c0/0x4c0 [ 10.993532][ C2] console_unlock+0xee/0x1f0 [ 10.993533][ C2] ? lock_acquire+0x13c/0x160 [ 10.993535][ C2] ? console_flush_one_record+0x710/0x710 [ 10.993536][ C2] ? rcu_is_watching+0x16/0xd0 [ 10.993538][ C2] ? lock_release+0x184/0x1f0 [ 10.993540][ C2] ? lock_acquire+0x60/0x160 [ 10.993541][ C2] ? __rcu_read_lock+0x30/0x70 [ 10.993543][ C2] ? __down_trylock_console_sem+0x5e/0xa0 [ 10.993545][ C2] ? vprintk_emit+0x320/0x3e0 [ 10.993547][ C2] vprintk_emit+0x37c/0x3e0 [ 10.993550][ C2] ? wake_up_klogd_work_func+0x90/0x90 [ 10.993551][ C2] ? do_raw_spin_trylock+0xb6/0x180 [ 10.993553][ C2] ? rcu_is_watching+0x16/0xd0 [ 10.993555][ C2] ? lock_acquire+0x13c/0x160 [ 10.993556][ C2] _printk+0xc7/0x100 [ 10.993559][ C2] ? snapshot_read.cold+0x21/0x21 [ 10.993561][ C2] ? ___ratelimit+0x4e7/0xa00 [ 10.993563][ C2] ? trace_hardirqs_on+0x36/0x40 [ 10.993566][ C2] ? idr_get_free+0x830/0x830 [ 10.993568][ C2] ? trace_irq_enable.constprop.0+0x30/0x160 [ 10.993569][ C2] tcp_make_synack.cold+0x36/0xb6 [ 10.993573][ C2] ? tcp_send_synack+0x1570/0x1570 [ 10.993576][ C2] ? lock_release+0x184/0x1f0 [ 10.993578][ C2] ? rcu_is_watching+0x16/0xd0 [ 10.993580][ C2] ? inet_csk_route_req+0x747/0xc30 [ 10.993583][ C2] tcp_v4_send_synack+0x103/0xb20 [ 10.993585][ C2] ? tcp_v4_timewait_ack+0x870/0x870 [ 10.993587][ C2] ? sched_balance_find_src_group+0xda/0x760 [ 10.993589][ C2] ? trace_irq_enable.constprop.0+0x9b/0x160 [ 10.993591][ C2] ? trace_hardirqs_on+0x36/0x40 [ 10.993592][ C2] ? get_random_u16+0x740/0x740 [ 10.993594][ C2] tcp_rtx_synack+0x150/0x440 [ 10.993596][ C2] ? tcp_send_probe0+0x590/0x590 [ 10.993598][ C2] ? sched_balance_rq+0x324/0x1e30 [ 10.993600][ C2] ? do_raw_spin_lock+0x131/0x280 [ 10.993602][ C2] reqsk_timer_handler+0x8d1/0xe30 [ 10.993604][ C2] ? __inet_csk_reqsk_queue_drop+0x420/0x420 [ 10.993605][ C2] ? lock_acquire+0x6a/0x160 [ 10.993606][ C2] ? do_raw_spin_unlock+0x59/0x250 [ 10.993608][ C2] ? __inet_csk_reqsk_queue_drop+0x420/0x420 [ 10.993609][ C2] call_timer_fn+0x160/0x4d0 [ 10.993613][ C2] ? detach_if_pending+0x1d0/0x1d0 [ 10.993614][ C2] ? debug_object_active_state+0x430/0x430 [ 10.993618][ C2] ? __rwlock_init+0x150/0x150 [ 10.993620][ C2] ? timer_recalc_next_expiry+0xf0/0x210 [ 10.993621][ C2] ? rcu_is_watching+0x16/0xd0 [ 10.993623][ C2] __run_timers+0x68f/0xaa0 [ 10.993625][ C2] ? __inet_csk_reqsk_queue_drop+0x420/0x420 [ 10.993627][ C2] ? __bpf_trace_itimer_expire+0x10/0x10 [ 10.993630][ C2] ? do_raw_spin_lock+0x131/0x280 [ 10.993632][ C2] ? __rwlock_init+0x150/0x150 [ 10.993634][ C2] run_timer_softirq+0xf0/0x160 [ 10.993636][ C2] ? __run_timers+0xaa0/0xaa0 [ 10.993638][ C2] ? trace_irq_enable.constprop.0+0x9b/0x160 [ 10.993639][ C2] ? rcu_is_watching+0x16/0xd0 [ 10.993640][ C2] handle_softirqs+0x1d3/0x900 [ 10.993643][ C2] ? _local_bh_enable+0xc0/0xc0 [ 10.993644][ C2] ? rcu_is_watching+0x16/0xd0 [ 10.993646][ C2] ? lock_release+0x184/0x1f0 [ 10.993647][ C2] __irq_exit_rcu+0x145/0x1c0 [ 10.993649][ C2] irq_exit_rcu+0xe/0x30 [ 10.993650][ C2] sysvec_apic_timer_interrupt+0x9d/0xe0 [ 10.993652][ C2] [ 10.993653][ C2] [ 10.993653][ C2] ? _raw_spin_unlock+0x2d/0x50 [ 10.993655][ C2] asm_sysvec_apic_timer_interrupt+0x1a/0x20 [ 10.993657][ C2] RIP: 0010:pv_native_safe_halt+0xf/0x10 [ 10.993660][ C2] Code: 48 8b 3d 94 12 06 02 e8 1f 00 00 00 48 2b 05 58 13 a0 00 c3 0f 1f 80 00 00 00 00 f3 0f 1e fa eb 07 0f 00 2d 13 b6 17 00 fb f4 0f 1f 40 d6 48 83 ec 20 8b 17 49 89 f8 83 e2 fe 41 89 d2 0f 01 [ 10.993661][ C2] RSP: 0018:ffa0000000157e00 EFLAGS: 00000246 [ 10.993665][ C2] RAX: 0000000000000002 RBX: ff11000001bf46c0 RCX: 0000000000000001 [ 10.993666][ C2] RDX: 0000000000000002 RSI: ffffffff9f88dc60 RDI: ffffffff9cefa307 [ 10.993667][ C2] RBP: 0000000000000000 R08: ffffffff9f51e421 R09: 1fe2200006a663a2 [ 10.993667][ C2] R10: 0000000000000002 R11: 0000000000000000 R12: 1ff400000002afc3 [ 10.993668][ C2] R13: 0000000000000000 R14: dffffc0000000000 R15: 0000000000000000 [ 10.993669][ C2] ? ct_kernel_exit.constprop.0+0x101/0x160 [ 10.993671][ C2] ? cpuidle_idle_call.constprop.0+0x237/0x410 [ 10.993673][ C2] default_idle+0x9/0x10 [ 10.993675][ C2] default_idle_call+0x6e/0xb0 [ 10.993676][ C2] cpuidle_idle_call.constprop.0+0x237/0x410 [ 10.993678][ C2] ? arch_cpu_idle_exit+0x40/0x40 [ 10.993679][ C2] ? mark_tsc_async_resets+0x30/0x30 [ 10.993682][ C2] ? rcu_is_watching+0x16/0xd0 [ 10.993683][ C2] ? rcu_is_watching+0x16/0xd0 [ 10.993685][ C2] do_idle+0xd8/0x190 [ 10.993687][ C2] cpu_startup_entry+0x53/0x70 [ 10.993688][ C2] start_secondary+0x204/0x2b0 [ 10.993690][ C2] ? set_cpu_sibling_map+0x2130/0x2130 [ 10.993692][ C2] common_startup_64+0x13e/0x148 [ 10.993696][ C2] [ 11.016563][ C2] TCP: TCP-AO: the keyid 100 from SYN packet is not present - not sending SYNACK [ 12.018417][ C2] TCP: TCP-AO: the keyid 100 from SYN packet is not present - not sending SYNACK [ 12.018432][ C2] BUG: sleeping function called from invalid context at ./include/linux/sched/mm.h:322 [ 12.018434][ C2] in_atomic(): 1, irqs_disabled(): 1, non_block: 0, pid: 0, name: swapper/2 [ 12.018436][ C2] preempt_count: 102, expected: 0 [ 12.018437][ C2] RCU nest depth: 0, expected: 0 [ 12.018437][ C2] INFO: lockdep is turned off. [ 12.018439][ C2] irq event stamp: 301308 [ 12.018440][ C2] hardirqs last enabled at (301307): [] default_idle_call+0x98/0xb0 [ 12.018448][ C2] hardirqs last disabled at (301308): [] __schedule+0x1246/0x20e0 [ 12.018450][ C2] softirqs last enabled at (301270): [] handle_softirqs+0x67c/0x900 [ 12.018454][ C2] softirqs last disabled at (301173): [] __irq_exit_rcu+0x145/0x1c0 [ 12.018456][ C2] Preemption disabled at: [ 12.018456][ C2] [<0000000000000000>] 0x0 [ 12.018464][ C2] CPU: 2 UID: 0 PID: 0 Comm: swapper/2 Tainted: G W 7.2.0-virtme #1 PREEMPT(full) [ 12.018468][ C2] Tainted: [W]=WARN [ 12.018469][ C2] Hardware name: Bochs Bochs, BIOS Bochs 01/01/2011 [ 12.018470][ C2] Call Trace: [ 12.018472][ C2] [ 12.018474][ C2] dump_stack_lvl+0x6f/0xa0 [ 12.018479][ C2] __might_resched.cold+0x1fe/0x2c1 [ 12.018483][ C2] ? perf_trace_sched_switch+0x7c0/0x7c0 [ 12.018486][ C2] ? rcu_is_watching+0x16/0xd0 [ 12.018490][ C2] __kmalloc_noprof+0x443/0x760 [ 12.018494][ C2] ? __rwlock_init+0x150/0x150 [ 12.018496][ C2] ? alloc_buf.isra.0+0x4b/0x260 [ 12.018500][ C2] ? do_raw_spin_unlock+0x59/0x250 [ 12.018502][ C2] alloc_buf.isra.0+0x4b/0x260 [ 12.018504][ C2] put_chars+0x1e1/0x2f0 [ 12.018507][ C2] ? __send_to_port+0x420/0x420 [ 12.018508][ C2] ? printk_get_next_message+0x240/0x650 [ 12.018512][ C2] hvc_console_print+0x292/0x780 [ 12.018516][ C2] ? hvc_write+0x3a0/0x3a0 [ 12.018517][ C2] ? __rwlock_init+0x150/0x150 [ 12.018519][ C2] ? rcu_is_watching+0x16/0xd0 [ 12.018520][ C2] ? lock_acquire+0x13c/0x160 [ 12.018522][ C2] console_emit_next_record+0x22f/0x4c0 [ 12.018525][ C2] ? devkmsg_read+0x4b0/0x4b0 [ 12.018527][ C2] ? rcu_is_watching+0x16/0xd0 [ 12.018528][ C2] ? rcu_is_watching+0x16/0xd0 [ 12.018530][ C2] ? rcu_is_watching+0x16/0xd0 [ 12.018532][ C2] ? lock_acquire+0x13c/0x160 [ 12.018533][ C2] ? console_flush_one_record+0x111/0x710 [ 12.018535][ C2] console_flush_one_record+0x46f/0x710 [ 12.018537][ C2] ? console_emit_next_record+0x4c0/0x4c0 [ 12.018540][ C2] console_unlock+0xee/0x1f0 [ 12.018542][ C2] ? lock_acquire+0x13c/0x160 [ 12.018543][ C2] ? console_flush_one_record+0x710/0x710 [ 12.018545][ C2] ? rcu_is_watching+0x16/0xd0 [ 12.018546][ C2] ? lock_release+0x184/0x1f0 [ 12.018547][ C2] ? lock_acquire+0x60/0x160 [ 12.018549][ C2] ? __rcu_read_lock+0x30/0x70 [ 12.018551][ C2] ? __down_trylock_console_sem+0x5e/0xa0 [ 12.018553][ C2] ? vprintk_emit+0x320/0x3e0 [ 12.018555][ C2] vprintk_emit+0x37c/0x3e0 [ 12.018557][ C2] ? wake_up_klogd_work_func+0x90/0x90 [ 12.018559][ C2] ? do_raw_spin_trylock+0xb6/0x180 [ 12.018560][ C2] ? rcu_is_watching+0x16/0xd0 [ 12.018562][ C2] ? lock_acquire+0x13c/0x160 [ 12.018564][ C2] _printk+0xc7/0x100 [ 12.018567][ C2] ? snapshot_read.cold+0x21/0x21 [ 12.018568][ C2] ? ___ratelimit+0x4e7/0xa00 [ 12.018571][ C2] ? trace_hardirqs_on+0x36/0x40 [ 12.018573][ C2] ? idr_get_free+0x830/0x830 [ 12.018575][ C2] ? trace_irq_enable.constprop.0+0x30/0x160 [ 12.018577][ C2] tcp_make_synack.cold+0x36/0xb6 [ 12.018580][ C2] ? tcp_send_synack+0x1570/0x1570 [ 12.018584][ C2] ? lock_release+0x184/0x1f0 [ 12.018585][ C2] ? rcu_is_watching+0x16/0xd0 [ 12.018587][ C2] ? inet_csk_route_req+0x747/0xc30 [ 12.018590][ C2] tcp_v4_send_synack+0x103/0xb20 [ 12.018593][ C2] ? tcp_v4_timewait_ack+0x870/0x870 [ 12.018594][ C2] ? sched_balance_find_src_group+0xda/0x760 [ 12.018597][ C2] ? trace_irq_enable.constprop.0+0x9b/0x160 [ 12.018598][ C2] ? trace_hardirqs_on+0x36/0x40 [ 12.018600][ C2] ? get_random_u16+0x740/0x740 [ 12.018602][ C2] tcp_rtx_synack+0x150/0x440 [ 12.018603][ C2] ? trace_pelt_cfs_tp+0x9b/0x190 [ 12.018605][ C2] ? tcp_send_probe0+0x590/0x590 [ 12.018606][ C2] ? __update_load_avg_cfs_rq+0x36c/0x10c0 [ 12.018609][ C2] ? update_cfs_rq_load_avg+0x4b/0x660 [ 12.018611][ C2] ? do_raw_spin_lock+0x131/0x280 [ 12.018613][ C2] reqsk_timer_handler+0x8d1/0xe30 [ 12.018614][ C2] ? __inet_csk_reqsk_queue_drop+0x420/0x420 [ 12.018616][ C2] ? lock_acquire+0x6a/0x160 [ 12.018617][ C2] ? do_raw_spin_unlock+0x59/0x250 [ 12.018619][ C2] ? __inet_csk_reqsk_queue_drop+0x420/0x420 [ 12.018620][ C2] call_timer_fn+0x160/0x4d0 [ 12.018623][ C2] ? detach_if_pending+0x1d0/0x1d0 [ 12.018624][ C2] ? debug_object_active_state+0x430/0x430 [ 12.018629][ C2] ? trace_sched_wakeup+0x9b/0x160 [ 12.018631][ C2] ? timer_recalc_next_expiry+0xf0/0x210 [ 12.018632][ C2] ? rcu_is_watching+0x16/0xd0 [ 12.018634][ C2] __run_timers+0x68f/0xaa0 [ 12.018636][ C2] ? __inet_csk_reqsk_queue_drop+0x420/0x420 [ 12.018638][ C2] ? debug_object_deactivate+0x2f7/0x440 [ 12.018640][ C2] ? __bpf_trace_itimer_expire+0x10/0x10 [ 12.018642][ C2] ? do_raw_spin_lock+0x131/0x280 [ 12.018644][ C2] ? __rwlock_init+0x150/0x150 [ 12.018646][ C2] run_timer_softirq+0xf0/0x160 [ 12.018648][ C2] ? __run_timers+0xaa0/0xaa0 [ 12.018650][ C2] ? trace_irq_enable.constprop.0+0x9b/0x160 [ 12.018651][ C2] ? rcu_is_watching+0x16/0xd0 [ 12.018653][ C2] handle_softirqs+0x1d3/0x900 [ 12.018655][ C2] ? _local_bh_enable+0xc0/0xc0 [ 12.018656][ C2] ? rcu_is_watching+0x16/0xd0 [ 12.018658][ C2] ? lock_release+0x184/0x1f0 [ 12.018660][ C2] __irq_exit_rcu+0x145/0x1c0 [ 12.018661][ C2] irq_exit_rcu+0xe/0x30 [ 12.018663][ C2] sysvec_apic_timer_interrupt+0x9d/0xe0 [ 12.018664][ C2] [ 12.018665][ C2] [ 12.018665][ C2] ? _raw_spin_unlock+0x2d/0x50 [ 12.018667][ C2] asm_sysvec_apic_timer_interrupt+0x1a/0x20 [ 12.018670][ C2] RIP: 0010:pv_native_safe_halt+0xf/0x10 [ 12.018672][ C2] Code: 48 8b 3d 94 12 06 02 e8 1f 00 00 00 48 2b 05 58 13 a0 00 c3 0f 1f 80 00 00 00 00 f3 0f 1e fa eb 07 0f 00 2d 13 b6 17 00 fb f4 0f 1f 40 d6 48 83 ec 20 8b 17 49 89 f8 83 e2 fe 41 89 d2 0f 01 [ 12.018673][ C2] RSP: 0018:ffa0000000157e00 EFLAGS: 00000246 [ 12.018677][ C2] RAX: 0000000000000002 RBX: ff11000001bf46c0 RCX: 0000000000000001 [ 12.018678][ C2] RDX: 0000000000000002 RSI: ffffffff9f88dc60 RDI: ffffffff9cefa307 [ 12.018679][ C2] RBP: 0000000000000000 R08: ffffffff9f51e421 R09: 1fe2200006a663a2 [ 12.018680][ C2] R10: 0000000000000002 R11: 0000000000000000 R12: 1ff400000002afc3 [ 12.018680][ C2] R13: 0000000000000000 R14: dffffc0000000000 R15: 0000000000000000 [ 12.018682][ C2] ? ct_kernel_exit.constprop.0+0x101/0x160 [ 12.018683][ C2] ? cpuidle_idle_call.constprop.0+0x237/0x410 [ 12.018685][ C2] default_idle+0x9/0x10 [ 12.018687][ C2] default_idle_call+0x6e/0xb0 [ 12.018688][ C2] cpuidle_idle_call.constprop.0+0x237/0x410 [ 12.018690][ C2] ? arch_cpu_idle_exit+0x40/0x40 [ 12.018691][ C2] ? mark_tsc_async_resets+0x30/0x30 [ 12.018694][ C2] ? rcu_is_watching+0x16/0xd0 [ 12.018696][ C2] ? rcu_is_watching+0x16/0xd0 [ 12.018697][ C2] do_idle+0xd8/0x190 [ 12.018699][ C2] cpu_startup_entry+0x53/0x70 [ 12.018700][ C2] start_secondary+0x204/0x2b0 [ 12.018702][ C2] ? set_cpu_sibling_map+0x2130/0x2130 [ 12.018704][ C2] common_startup_64+0x13e/0x148 [ 12.018708][ C2] [ 12.042752][ C2] TCP: TCP-AO: the keyid 100 from SYN packet is not present - not sending SYNACK [ 13.105422][ C2] TCP: TCP-AO: the keyid 100 from SYN packet is not present - not sending SYNACK [ 13.105437][ C2] BUG: sleeping function called from invalid context at ./include/linux/sched/mm.h:322 [ 13.105439][ C2] in_atomic(): 1, irqs_disabled(): 1, non_block: 0, pid: 0, name: swapper/2 [ 13.105440][ C2] preempt_count: 102, expected: 0 [ 13.105441][ C2] RCU nest depth: 0, expected: 0 [ 13.105442][ C2] INFO: lockdep is turned off. [ 13.105443][ C2] irq event stamp: 301308 [ 13.105444][ C2] hardirqs last enabled at (301307): [] default_idle_call+0x98/0xb0 [ 13.105452][ C2] hardirqs last disabled at (301308): [] __schedule+0x1246/0x20e0 [ 13.105455][ C2] softirqs last enabled at (301270): [] handle_softirqs+0x67c/0x900 [ 13.105458][ C2] softirqs last disabled at (301173): [] __irq_exit_rcu+0x145/0x1c0 [ 13.105461][ C2] Preemption disabled at: [ 13.105461][ C2] [<0000000000000000>] 0x0 [ 13.105468][ C2] CPU: 2 UID: 0 PID: 0 Comm: swapper/2 Tainted: G W 7.2.0-virtme #1 PREEMPT(full) [ 13.105471][ C2] Tainted: [W]=WARN [ 13.105472][ C2] Hardware name: Bochs Bochs, BIOS Bochs 01/01/2011 [ 13.105474][ C2] Call Trace: [ 13.105476][ C2] [ 13.105478][ C2] dump_stack_lvl+0x6f/0xa0 [ 13.105483][ C2] __might_resched.cold+0x1fe/0x2c1 [ 13.105487][ C2] ? perf_trace_sched_switch+0x7c0/0x7c0 [ 13.105490][ C2] ? rcu_is_watching+0x16/0xd0 [ 13.105494][ C2] __kmalloc_noprof+0x443/0x760 [ 13.105498][ C2] ? __rwlock_init+0x150/0x150 [ 13.105500][ C2] ? alloc_buf.isra.0+0x4b/0x260 [ 13.105504][ C2] ? do_raw_spin_unlock+0x59/0x250 [ 13.105506][ C2] alloc_buf.isra.0+0x4b/0x260 [ 13.105508][ C2] put_chars+0x1e1/0x2f0 [ 13.105510][ C2] ? __send_to_port+0x420/0x420 [ 13.105512][ C2] ? printk_get_next_message+0x240/0x650 [ 13.105515][ C2] hvc_console_print+0x292/0x780 [ 13.105519][ C2] ? hvc_write+0x3a0/0x3a0 [ 13.105521][ C2] ? __rwlock_init+0x150/0x150 [ 13.105522][ C2] ? rcu_is_watching+0x16/0xd0 [ 13.105524][ C2] ? lock_acquire+0x13c/0x160 [ 13.105526][ C2] console_emit_next_record+0x22f/0x4c0 [ 13.105528][ C2] ? devkmsg_read+0x4b0/0x4b0 [ 13.105530][ C2] ? rcu_is_watching+0x16/0xd0 [ 13.105532][ C2] ? rcu_is_watching+0x16/0xd0 [ 13.105534][ C2] ? rcu_is_watching+0x16/0xd0 [ 13.105535][ C2] ? lock_acquire+0x13c/0x160 [ 13.105537][ C2] ? console_flush_one_record+0x111/0x710 [ 13.105539][ C2] console_flush_one_record+0x46f/0x710 [ 13.105541][ C2] ? console_emit_next_record+0x4c0/0x4c0 [ 13.105543][ C2] console_unlock+0xee/0x1f0 [ 13.105545][ C2] ? lock_acquire+0x13c/0x160 [ 13.105546][ C2] ? console_flush_one_record+0x710/0x710 [ 13.105548][ C2] ? rcu_is_watching+0x16/0xd0 [ 13.105550][ C2] ? lock_release+0x184/0x1f0 [ 13.105551][ C2] ? lock_acquire+0x60/0x160 [ 13.105553][ C2] ? __rcu_read_lock+0x30/0x70 [ 13.105555][ C2] ? __down_trylock_console_sem+0x5e/0xa0 [ 13.105556][ C2] ? vprintk_emit+0x320/0x3e0 [ 13.105558][ C2] vprintk_emit+0x37c/0x3e0 [ 13.105561][ C2] ? wake_up_klogd_work_func+0x90/0x90 [ 13.105562][ C2] ? do_raw_spin_trylock+0xb6/0x180 [ 13.105564][ C2] ? rcu_is_watching+0x16/0xd0 [ 13.105566][ C2] ? lock_acquire+0x13c/0x160 [ 13.105568][ C2] _printk+0xc7/0x100 [ 13.105570][ C2] ? snapshot_read.cold+0x21/0x21 [ 13.105572][ C2] ? ___ratelimit+0x4e7/0xa00 [ 13.105575][ C2] ? trace_hardirqs_on+0x36/0x40 [ 13.105577][ C2] ? idr_get_free+0x830/0x830 [ 13.105579][ C2] ? trace_irq_enable.constprop.0+0x30/0x160 [ 13.105580][ C2] tcp_make_synack.cold+0x36/0xb6 [ 13.105584][ C2] ? tcp_send_synack+0x1570/0x1570 [ 13.105587][ C2] ? rcu_is_watching+0x16/0xd0 [ 13.105589][ C2] ? inet_csk_route_req+0x747/0xc30 [ 13.105592][ C2] tcp_v4_send_synack+0x103/0xb20 [ 13.105594][ C2] ? enqueue_task_fair+0x44a/0xa50 [ 13.105596][ C2] ? tcp_v4_timewait_ack+0x870/0x870 [ 13.105598][ C2] ? trace_irq_enable.constprop.0+0x9b/0x160 [ 13.105600][ C2] ? trace_hardirqs_on+0x36/0x40 [ 13.105601][ C2] ? lock_release+0x184/0x1f0 [ 13.105602][ C2] ? do_raw_spin_unlock+0x59/0x250 [ 13.105604][ C2] ? get_random_u16+0x740/0x740 [ 13.105606][ C2] tcp_rtx_synack+0x150/0x440 [ 13.105607][ C2] ? rcu_is_watching+0x16/0xd0 [ 13.105609][ C2] ? tcp_send_probe0+0x590/0x590 [ 13.105611][ C2] ? lock_release+0x184/0x1f0 [ 13.105613][ C2] ? __queue_work+0x3ab/0xd30 [ 13.105616][ C2] reqsk_timer_handler+0x8d1/0xe30 [ 13.105617][ C2] ? __inet_csk_reqsk_queue_drop+0x420/0x420 [ 13.105619][ C2] ? lock_acquire+0x6a/0x160 [ 13.105620][ C2] ? do_raw_spin_unlock+0x59/0x250 [ 13.105622][ C2] ? __inet_csk_reqsk_queue_drop+0x420/0x420 [ 13.105623][ C2] call_timer_fn+0x160/0x4d0 [ 13.105626][ C2] ? detach_if_pending+0x1d0/0x1d0 [ 13.105627][ C2] ? debug_object_active_state+0x430/0x430 [ 13.105632][ C2] ? rcu_is_watching+0x16/0xd0 [ 13.105634][ C2] __run_timers+0x68f/0xaa0 [ 13.105636][ C2] ? __inet_csk_reqsk_queue_drop+0x420/0x420 [ 13.105638][ C2] ? __bpf_trace_itimer_expire+0x10/0x10 [ 13.105640][ C2] ? do_raw_spin_lock+0x131/0x280 [ 13.105642][ C2] ? __rwlock_init+0x150/0x150 [ 13.105644][ C2] run_timer_softirq+0xf0/0x160 [ 13.105646][ C2] ? __run_timers+0xaa0/0xaa0 [ 13.105648][ C2] ? trace_irq_enable.constprop.0+0x9b/0x160 [ 13.105649][ C2] ? rcu_is_watching+0x16/0xd0 [ 13.105651][ C2] handle_softirqs+0x1d3/0x900 [ 13.105652][ C2] ? _local_bh_enable+0xc0/0xc0 [ 13.105654][ C2] ? rcu_is_watching+0x16/0xd0 [ 13.105656][ C2] ? lock_release+0x184/0x1f0 [ 13.105657][ C2] __irq_exit_rcu+0x145/0x1c0 [ 13.105659][ C2] irq_exit_rcu+0xe/0x30 [ 13.105660][ C2] sysvec_apic_timer_interrupt+0x9d/0xe0 [ 13.105662][ C2] [ 13.105663][ C2] [ 13.105663][ C2] ? _raw_spin_unlock+0x2d/0x50 [ 13.105665][ C2] asm_sysvec_apic_timer_interrupt+0x1a/0x20 [ 13.105668][ C2] RIP: 0010:pv_native_safe_halt+0xf/0x10 [ 13.105670][ C2] Code: 48 8b 3d 94 12 06 02 e8 1f 00 00 00 48 2b 05 58 13 a0 00 c3 0f 1f 80 00 00 00 00 f3 0f 1e fa eb 07 0f 00 2d 13 b6 17 00 fb f4 0f 1f 40 d6 48 83 ec 20 8b 17 49 89 f8 83 e2 fe 41 89 d2 0f 01 [ 13.105671][ C2] RSP: 0018:ffa0000000157e00 EFLAGS: 00000246 [ 13.105675][ C2] RAX: 0000000000000002 RBX: ff11000001bf46c0 RCX: 0000000000000001 [ 13.105676][ C2] RDX: 0000000000000002 RSI: ffffffff9f88dc60 RDI: ffffffff9cefa307 [ 13.105677][ C2] RBP: 0000000000000000 R08: ffffffff9f51e421 R09: 1fe2200006a663a2 [ 13.105677][ C2] R10: 0000000000000002 R11: 0000000000000000 R12: 1ff400000002afc3 [ 13.105678][ C2] R13: 0000000000000000 R14: dffffc0000000000 R15: 0000000000000000 [ 13.105679][ C2] ? ct_kernel_exit.constprop.0+0x101/0x160 [ 13.105681][ C2] ? cpuidle_idle_call.constprop.0+0x237/0x410 [ 13.105683][ C2] default_idle+0x9/0x10 [ 13.105684][ C2] default_idle_call+0x6e/0xb0 [ 13.105686][ C2] cpuidle_idle_call.constprop.0+0x237/0x410 [ 13.105688][ C2] ? arch_cpu_idle_exit+0x40/0x40 [ 13.105689][ C2] ? mark_tsc_async_resets+0x30/0x30 [ 13.105692][ C2] ? rcu_is_watching+0x16/0xd0 [ 13.105693][ C2] ? rcu_is_watching+0x16/0xd0 [ 13.105695][ C2] do_idle+0xd8/0x190 [ 13.105697][ C2] cpu_startup_entry+0x53/0x70 [ 13.105698][ C2] start_secondary+0x204/0x2b0 [ 13.105700][ C2] ? set_cpu_sibling_map+0x2130/0x2130 [ 13.105701][ C2] common_startup_64+0x13e/0x148 [ 13.105706][ C2] [ 13.132793][ C2] TCP: TCP-AO: the keyid 100 from SYN packet is not present - not sending SYNACK [ 14.193415][ C2] TCP: TCP-AO: the keyid 100 from SYN packet is not present - not sending SYNACK [ 14.193429][ C2] BUG: sleeping function called from invalid context at ./include/linux/sched/mm.h:322 [ 14.193432][ C2] in_atomic(): 1, irqs_disabled(): 1, non_block: 0, pid: 0, name: swapper/2 [ 14.193433][ C2] preempt_count: 102, expected: 0 [ 14.193434][ C2] RCU nest depth: 0, expected: 0 [ 14.193435][ C2] INFO: lockdep is turned off. [ 14.193436][ C2] irq event stamp: 301308 [ 14.193437][ C2] hardirqs last enabled at (301307): [] default_idle_call+0x98/0xb0 [ 14.193445][ C2] hardirqs last disabled at (301308): [] __schedule+0x1246/0x20e0 [ 14.193447][ C2] softirqs last enabled at (301270): [] handle_softirqs+0x67c/0x900 [ 14.193451][ C2] softirqs last disabled at (301173): [] __irq_exit_rcu+0x145/0x1c0 [ 14.193453][ C2] Preemption disabled at: [ 14.193453][ C2] [<0000000000000000>] 0x0 [ 14.193460][ C2] CPU: 2 UID: 0 PID: 0 Comm: swapper/2 Tainted: G W 7.2.0-virtme #1 PREEMPT(full) [ 14.193463][ C2] Tainted: [W]=WARN [ 14.193463][ C2] Hardware name: Bochs Bochs, BIOS Bochs 01/01/2011 [ 14.193465][ C2] Call Trace: [ 14.193466][ C2] [ 14.193469][ C2] dump_stack_lvl+0x6f/0xa0 [ 14.193474][ C2] __might_resched.cold+0x1fe/0x2c1 [ 14.193478][ C2] ? perf_trace_sched_switch+0x7c0/0x7c0 [ 14.193481][ C2] ? rcu_is_watching+0x16/0xd0 [ 14.193485][ C2] __kmalloc_noprof+0x443/0x760 [ 14.193488][ C2] ? __rwlock_init+0x150/0x150 [ 14.193491][ C2] ? alloc_buf.isra.0+0x4b/0x260 [ 14.193494][ C2] ? do_raw_spin_unlock+0x59/0x250 [ 14.193496][ C2] alloc_buf.isra.0+0x4b/0x260 [ 14.193498][ C2] put_chars+0x1e1/0x2f0 [ 14.193500][ C2] ? __send_to_port+0x420/0x420 [ 14.193502][ C2] ? printk_get_next_message+0x240/0x650 [ 14.193505][ C2] hvc_console_print+0x292/0x780 [ 14.193509][ C2] ? hvc_write+0x3a0/0x3a0 [ 14.193511][ C2] ? __rwlock_init+0x150/0x150 [ 14.193512][ C2] ? rcu_is_watching+0x16/0xd0 [ 14.193514][ C2] ? lock_acquire+0x13c/0x160 [ 14.193516][ C2] console_emit_next_record+0x22f/0x4c0 [ 14.193519][ C2] ? devkmsg_read+0x4b0/0x4b0 [ 14.193521][ C2] ? rcu_is_watching+0x16/0xd0 [ 14.193522][ C2] ? rcu_is_watching+0x16/0xd0 [ 14.193524][ C2] ? rcu_is_watching+0x16/0xd0 [ 14.193525][ C2] ? lock_acquire+0x13c/0x160 [ 14.193527][ C2] ? console_flush_one_record+0x111/0x710 [ 14.193529][ C2] console_flush_one_record+0x46f/0x710 [ 14.193531][ C2] ? console_emit_next_record+0x4c0/0x4c0 [ 14.193534][ C2] console_unlock+0xee/0x1f0 [ 14.193536][ C2] ? lock_acquire+0x13c/0x160 [ 14.193537][ C2] ? console_flush_one_record+0x710/0x710 [ 14.193539][ C2] ? rcu_is_watching+0x16/0xd0 [ 14.193540][ C2] ? lock_release+0x184/0x1f0 [ 14.193542][ C2] ? lock_acquire+0x60/0x160 [ 14.193543][ C2] ? __rcu_read_lock+0x30/0x70 [ 14.193545][ C2] ? __down_trylock_console_sem+0x5e/0xa0 [ 14.193547][ C2] ? vprintk_emit+0x320/0x3e0 [ 14.193549][ C2] vprintk_emit+0x37c/0x3e0 [ 14.193551][ C2] ? wake_up_klogd_work_func+0x90/0x90 [ 14.193553][ C2] ? do_raw_spin_trylock+0xb6/0x180 [ 14.193555][ C2] ? rcu_is_watching+0x16/0xd0 [ 14.193557][ C2] ? lock_acquire+0x13c/0x160 [ 14.193558][ C2] _printk+0xc7/0x100 [ 14.193561][ C2] ? snapshot_read.cold+0x21/0x21 [ 14.193563][ C2] ? ___ratelimit+0x4e7/0xa00 [ 14.193566][ C2] ? idr_get_free+0x830/0x830 [ 14.193568][ C2] ? trace_irq_enable.constprop.0+0x30/0x160 [ 14.193570][ C2] tcp_make_synack.cold+0x36/0xb6 [ 14.193574][ C2] ? tcp_send_synack+0x1570/0x1570 [ 14.193577][ C2] ? rcu_is_watching+0x16/0xd0 [ 14.193580][ C2] ? inet_csk_route_req+0x747/0xc30 [ 14.193582][ C2] tcp_v4_send_synack+0x103/0xb20 [ 14.193585][ C2] ? tcp_v4_timewait_ack+0x870/0x870 [ 14.193587][ C2] ? trace_irq_enable.constprop.0+0x9b/0x160 [ 14.193588][ C2] ? trace_hardirqs_on+0x36/0x40 [ 14.193589][ C2] ? get_random_u16+0x740/0x740 [ 14.193591][ C2] tcp_rtx_synack+0x150/0x440 [ 14.193593][ C2] ? tcp_send_probe0+0x590/0x590 [ 14.193595][ C2] ? sched_balance_rq+0x324/0x1e30 [ 14.193598][ C2] ? do_raw_spin_lock+0x131/0x280 [ 14.193600][ C2] reqsk_timer_handler+0x8d1/0xe30 [ 14.193602][ C2] ? __inet_csk_reqsk_queue_drop+0x420/0x420 [ 14.193603][ C2] ? lock_acquire+0x6a/0x160 [ 14.193604][ C2] ? do_raw_spin_unlock+0x59/0x250 [ 14.193606][ C2] ? __inet_csk_reqsk_queue_drop+0x420/0x420 [ 14.193607][ C2] call_timer_fn+0x160/0x4d0 [ 14.193610][ C2] ? detach_if_pending+0x1d0/0x1d0 [ 14.193612][ C2] ? debug_object_active_state+0x430/0x430 [ 14.193616][ C2] ? __rwlock_init+0x150/0x150 [ 14.193618][ C2] ? timer_recalc_next_expiry+0xf0/0x210 [ 14.193619][ C2] ? rcu_is_watching+0x16/0xd0 [ 14.193621][ C2] __run_timers+0x68f/0xaa0 [ 14.193623][ C2] ? __inet_csk_reqsk_queue_drop+0x420/0x420 [ 14.193625][ C2] ? __bpf_trace_itimer_expire+0x10/0x10 [ 14.193627][ C2] ? do_raw_spin_lock+0x131/0x280 [ 14.193630][ C2] ? __rwlock_init+0x150/0x150 [ 14.193632][ C2] run_timer_softirq+0xf0/0x160 [ 14.193634][ C2] ? __run_timers+0xaa0/0xaa0 [ 14.193635][ C2] ? trace_irq_enable.constprop.0+0x9b/0x160 [ 14.193636][ C2] ? rcu_is_watching+0x16/0xd0 [ 14.193638][ C2] handle_softirqs+0x1d3/0x900 [ 14.193640][ C2] ? _local_bh_enable+0xc0/0xc0 [ 14.193642][ C2] ? rcu_is_watching+0x16/0xd0 [ 14.193643][ C2] ? lock_release+0x184/0x1f0 [ 14.193645][ C2] __irq_exit_rcu+0x145/0x1c0 [ 14.193646][ C2] irq_exit_rcu+0xe/0x30 [ 14.193648][ C2] sysvec_apic_timer_interrupt+0x9d/0xe0 [ 14.193650][ C2] [ 14.193650][ C2] [ 14.193651][ C2] ? _raw_spin_unlock+0x2d/0x50 [ 14.193653][ C2] asm_sysvec_apic_timer_interrupt+0x1a/0x20 [ 14.193655][ C2] RIP: 0010:pv_native_safe_halt+0xf/0x10 [ 14.193657][ C2] Code: 48 8b 3d 94 12 06 02 e8 1f 00 00 00 48 2b 05 58 13 a0 00 c3 0f 1f 80 00 00 00 00 f3 0f 1e fa eb 07 0f 00 2d 13 b6 17 00 fb f4 0f 1f 40 d6 48 83 ec 20 8b 17 49 89 f8 83 e2 fe 41 89 d2 0f 01 [ 14.193658][ C2] RSP: 0018:ffa0000000157e00 EFLAGS: 00000246 [ 14.193661][ C2] RAX: 0000000000000002 RBX: ff11000001bf46c0 RCX: 0000000000000001 [ 14.193663][ C2] RDX: 0000000000000002 RSI: ffffffff9f88dc60 RDI: ffffffff9cefa307 [ 14.193663][ C2] RBP: 0000000000000000 R08: ffffffff9f51e421 R09: 1fe2200006a663a2 [ 14.193664][ C2] R10: 0000000000000002 R11: 0000000000000000 R12: 1ff400000002afc3 [ 14.193665][ C2] R13: 0000000000000000 R14: dffffc0000000000 R15: 0000000000000000 [ 14.193666][ C2] ? ct_kernel_exit.constprop.0+0x101/0x160 [ 14.193668][ C2] ? cpuidle_idle_call.constprop.0+0x237/0x410 [ 14.193670][ C2] default_idle+0x9/0x10 [ 14.193671][ C2] default_idle_call+0x6e/0xb0 [ 14.193673][ C2] cpuidle_idle_call.constprop.0+0x237/0x410 [ 14.193674][ C2] ? arch_cpu_idle_exit+0x40/0x40 [ 14.193676][ C2] ? mark_tsc_async_resets+0x30/0x30 [ 14.193678][ C2] ? rcu_is_watching+0x16/0xd0 [ 14.193680][ C2] ? rcu_is_watching+0x16/0xd0 [ 14.193682][ C2] do_idle+0xd8/0x190 [ 14.193683][ C2] cpu_startup_entry+0x53/0x70 [ 14.193685][ C2] start_secondary+0x204/0x2b0 [ 14.193686][ C2] ? set_cpu_sibling_map+0x2130/0x2130 [ 14.193688][ C2] common_startup_64+0x13e/0x148 [ 14.193692][ C2] [ 14.220631][ C2] TCP: TCP-AO: the keyid 100 from SYN packet is not present - not sending SYNACK [ 15.282401][ C2] TCP: TCP-AO: the keyid 100 from SYN packet is not present - not sending SYNACK [ 15.282415][ C2] BUG: sleeping function called from invalid context at ./include/linux/sched/mm.h:322 [ 15.282417][ C2] in_atomic(): 1, irqs_disabled(): 1, non_block: 0, pid: 0, name: swapper/2 [ 15.282418][ C2] preempt_count: 102, expected: 0 [ 15.282419][ C2] RCU nest depth: 0, expected: 0 [ 15.282420][ C2] INFO: lockdep is turned off. [ 15.282421][ C2] irq event stamp: 301308 [ 15.282422][ C2] hardirqs last enabled at (301307): [] default_idle_call+0x98/0xb0 [ 15.282430][ C2] hardirqs last disabled at (301308): [] __schedule+0x1246/0x20e0 [ 15.282432][ C2] softirqs last enabled at (301270): [] handle_softirqs+0x67c/0x900 [ 15.282435][ C2] softirqs last disabled at (301173): [] __irq_exit_rcu+0x145/0x1c0 [ 15.282437][ C2] Preemption disabled at: [ 15.282438][ C2] [<0000000000000000>] 0x0 [ 15.282445][ C2] CPU: 2 UID: 0 PID: 0 Comm: swapper/2 Tainted: G W 7.2.0-virtme #1 PREEMPT(full) [ 15.282448][ C2] Tainted: [W]=WARN [ 15.282448][ C2] Hardware name: Bochs Bochs, BIOS Bochs 01/01/2011 [ 15.282450][ C2] Call Trace: [ 15.282452][ C2] [ 15.282454][ C2] dump_stack_lvl+0x6f/0xa0 [ 15.282460][ C2] __might_resched.cold+0x1fe/0x2c1 [ 15.282463][ C2] ? perf_trace_sched_switch+0x7c0/0x7c0 [ 15.282466][ C2] ? rcu_is_watching+0x16/0xd0 [ 15.282470][ C2] __kmalloc_noprof+0x443/0x760 [ 15.282473][ C2] ? __rwlock_init+0x150/0x150 [ 15.282476][ C2] ? alloc_buf.isra.0+0x4b/0x260 [ 15.282479][ C2] ? do_raw_spin_unlock+0x59/0x250 [ 15.282481][ C2] alloc_buf.isra.0+0x4b/0x260 [ 15.282483][ C2] put_chars+0x1e1/0x2f0 [ 15.282485][ C2] ? __send_to_port+0x420/0x420 [ 15.282487][ C2] ? printk_get_next_message+0x240/0x650 [ 15.282490][ C2] hvc_console_print+0x292/0x780 [ 15.282494][ C2] ? hvc_write+0x3a0/0x3a0 [ 15.282496][ C2] ? __rwlock_init+0x150/0x150 [ 15.282497][ C2] ? rcu_is_watching+0x16/0xd0 [ 15.282499][ C2] ? lock_acquire+0x13c/0x160 [ 15.282501][ C2] console_emit_next_record+0x22f/0x4c0 [ 15.282504][ C2] ? devkmsg_read+0x4b0/0x4b0 [ 15.282506][ C2] ? rcu_is_watching+0x16/0xd0 [ 15.282507][ C2] ? rcu_is_watching+0x16/0xd0 [ 15.282509][ C2] ? rcu_is_watching+0x16/0xd0 [ 15.282510][ C2] ? lock_acquire+0x13c/0x160 [ 15.282512][ C2] ? console_flush_one_record+0x111/0x710 [ 15.282514][ C2] console_flush_one_record+0x46f/0x710 [ 15.282516][ C2] ? console_emit_next_record+0x4c0/0x4c0 [ 15.282519][ C2] console_unlock+0xee/0x1f0 [ 15.282520][ C2] ? lock_acquire+0x13c/0x160 [ 15.282522][ C2] ? console_flush_one_record+0x710/0x710 [ 15.282523][ C2] ? rcu_is_watching+0x16/0xd0 [ 15.282525][ C2] ? lock_release+0x184/0x1f0 [ 15.282527][ C2] ? lock_acquire+0x60/0x160 [ 15.282528][ C2] ? __rcu_read_lock+0x30/0x70 [ 15.282530][ C2] ? __down_trylock_console_sem+0x5e/0xa0 [ 15.282532][ C2] ? vprintk_emit+0x320/0x3e0 [ 15.282534][ C2] vprintk_emit+0x37c/0x3e0 [ 15.282536][ C2] ? wake_up_klogd_work_func+0x90/0x90 [ 15.282538][ C2] ? do_raw_spin_trylock+0xb6/0x180 [ 15.282540][ C2] ? rcu_is_watching+0x16/0xd0 [ 15.282541][ C2] ? lock_acquire+0x13c/0x160 [ 15.282543][ C2] _printk+0xc7/0x100 [ 15.282546][ C2] ? snapshot_read.cold+0x21/0x21 [ 15.282547][ C2] ? ___ratelimit+0x4e7/0xa00 [ 15.282550][ C2] ? trace_hardirqs_on+0x36/0x40 [ 15.282552][ C2] ? idr_get_free+0x830/0x830 [ 15.282554][ C2] ? trace_irq_enable.constprop.0+0x30/0x160 [ 15.282555][ C2] tcp_make_synack.cold+0x36/0xb6 [ 15.282559][ C2] ? tcp_send_synack+0x1570/0x1570 [ 15.282562][ C2] ? rcu_is_watching+0x16/0xd0 [ 15.282564][ C2] ? inet_csk_route_req+0x747/0xc30 [ 15.282567][ C2] tcp_v4_send_synack+0x103/0xb20 [ 15.282569][ C2] ? tcp_v4_timewait_ack+0x870/0x870 [ 15.282571][ C2] ? sched_balance_find_src_group+0xda/0x760 [ 15.282574][ C2] ? trace_irq_enable.constprop.0+0x9b/0x160 [ 15.282575][ C2] ? trace_hardirqs_on+0x36/0x40 [ 15.282576][ C2] ? get_random_u16+0x740/0x740 [ 15.282578][ C2] tcp_rtx_synack+0x150/0x440 [ 15.282580][ C2] ? tcp_send_probe0+0x590/0x590 [ 15.282582][ C2] ? sched_balance_rq+0x324/0x1e30 [ 15.282584][ C2] ? do_raw_spin_lock+0x131/0x280 [ 15.282586][ C2] reqsk_timer_handler+0x8d1/0xe30 [ 15.282588][ C2] ? __inet_csk_reqsk_queue_drop+0x420/0x420 [ 15.282589][ C2] ? lock_acquire+0x6a/0x160 [ 15.282590][ C2] ? do_raw_spin_unlock+0x59/0x250 [ 15.282592][ C2] ? __inet_csk_reqsk_queue_drop+0x420/0x420 [ 15.282593][ C2] call_timer_fn+0x160/0x4d0 [ 15.282596][ C2] ? detach_if_pending+0x1d0/0x1d0 [ 15.282598][ C2] ? debug_object_active_state+0x430/0x430 [ 15.282602][ C2] ? __rwlock_init+0x150/0x150 [ 15.282604][ C2] ? timer_recalc_next_expiry+0x71/0x210 [ 15.282605][ C2] ? rcu_is_watching+0x16/0xd0 [ 15.282608][ C2] __run_timers+0x68f/0xaa0 [ 15.282609][ C2] ? __inet_csk_reqsk_queue_drop+0x420/0x420 [ 15.282611][ C2] ? __bpf_trace_itimer_expire+0x10/0x10 [ 15.282613][ C2] ? do_raw_spin_lock+0x131/0x280 [ 15.282616][ C2] ? __rwlock_init+0x150/0x150 [ 15.282618][ C2] run_timer_softirq+0xf0/0x160 [ 15.282620][ C2] ? __run_timers+0xaa0/0xaa0 [ 15.282621][ C2] ? trace_irq_enable.constprop.0+0x9b/0x160 [ 15.282623][ C2] ? rcu_is_watching+0x16/0xd0 [ 15.282624][ C2] handle_softirqs+0x1d3/0x900 [ 15.282626][ C2] ? _local_bh_enable+0xc0/0xc0 [ 15.282628][ C2] ? rcu_is_watching+0x16/0xd0 [ 15.282629][ C2] ? lock_release+0x184/0x1f0 [ 15.282631][ C2] __irq_exit_rcu+0x145/0x1c0 [ 15.282633][ C2] irq_exit_rcu+0xe/0x30 [ 15.282634][ C2] sysvec_apic_timer_interrupt+0x9d/0xe0 [ 15.282636][ C2] [ 15.282636][ C2] [ 15.282637][ C2] ? _raw_spin_unlock+0x2d/0x50 [ 15.282639][ C2] asm_sysvec_apic_timer_interrupt+0x1a/0x20 [ 15.282642][ C2] RIP: 0010:pv_native_safe_halt+0xf/0x10 [ 15.282644][ C2] Code: 48 8b 3d 94 12 06 02 e8 1f 00 00 00 48 2b 05 58 13 a0 00 c3 0f 1f 80 00 00 00 00 f3 0f 1e fa eb 07 0f 00 2d 13 b6 17 00 fb f4 0f 1f 40 d6 48 83 ec 20 8b 17 49 89 f8 83 e2 fe 41 89 d2 0f 01 [ 15.282645][ C2] RSP: 0018:ffa0000000157e00 EFLAGS: 00000246 [ 15.282648][ C2] RAX: 0000000000000002 RBX: ff11000001bf46c0 RCX: 0000000000000001 [ 15.282650][ C2] RDX: 0000000000000002 RSI: ffffffff9f88dc60 RDI: ffffffff9cefa307 [ 15.282650][ C2] RBP: 0000000000000000 R08: ffffffff9f51e421 R09: 1fe2200006a663a2 [ 15.282651][ C2] R10: 0000000000000002 R11: 0000000000000000 R12: 1ff400000002afc3 [ 15.282652][ C2] R13: 0000000000000000 R14: dffffc0000000000 R15: 0000000000000000 [ 15.282653][ C2] ? ct_kernel_exit.constprop.0+0x101/0x160 [ 15.282655][ C2] ? cpuidle_idle_call.constprop.0+0x237/0x410 [ 15.282657][ C2] default_idle+0x9/0x10 [ 15.282659][ C2] default_idle_call+0x6e/0xb0 [ 15.282660][ C2] cpuidle_idle_call.constprop.0+0x237/0x410 [ 15.282662][ C2] ? arch_cpu_idle_exit+0x40/0x40 [ 15.282663][ C2] ? mark_tsc_async_resets+0x30/0x30 [ 15.282665][ C2] ? rcu_is_watching+0x16/0xd0 [ 15.282667][ C2] ? rcu_is_watching+0x16/0xd0 [ 15.282669][ C2] do_idle+0xd8/0x190 [ 15.282671][ C2] cpu_startup_entry+0x53/0x70 [ 15.282672][ C2] start_secondary+0x204/0x2b0 [ 15.282674][ C2] ? set_cpu_sibling_map+0x2130/0x2130 [ 15.282676][ C2] common_startup_64+0x13e/0x148 [ 15.282680][ C2]