[ 85.433590][ T27] audit: type=1800 audit(1582062829.788:26): pid=9593 uid=0 auid=4294967295 ses=4294967295 subj==unconfined op=collect_data cause=failed(directio) comm="startpar" name="mcstrans" dev="sda1" ino=2457 res=0 [....] Starting periodic command scheduler: cron[?25l[?1c7[ ok 8[?25h[?0c. [....] Starting OpenBSD Secure Shell server: sshd[?25l[?1c7[ ok 8[?25h[?0c. [ 86.299822][ T27] kauditd_printk_skb: 2 callbacks suppressed [ 86.299834][ T27] audit: type=1800 audit(1582062830.688:29): pid=9593 uid=0 auid=4294967295 ses=4294967295 subj==unconfined op=collect_data cause=failed(directio) comm="startpar" name="rc.local" dev="sda1" ino=2432 res=0 [ 86.327071][ T27] audit: type=1800 audit(1582062830.688:30): pid=9593 uid=0 auid=4294967295 ses=4294967295 subj==unconfined op=collect_data cause=failed(directio) comm="startpar" name="rmnologin" dev="sda1" ino=2423 res=0 Debian GNU/Linux 7 syzkaller ttyS0 Warning: Permanently added '10.128.0.27' (ECDSA) to the list of known hosts. syzkaller login: [ 93.826812][ T9745] IPVS: ftp: loaded support on port[0] = 21 [ 93.871959][ T9745] chnl_net:caif_netlink_parms(): no params data found [ 93.908414][ T9745] bridge0: port 1(bridge_slave_0) entered blocking state [ 93.915898][ T9745] bridge0: port 1(bridge_slave_0) entered disabled state [ 93.924394][ T9745] device bridge_slave_0 entered promiscuous mode [ 93.932807][ T9745] bridge0: port 2(bridge_slave_1) entered blocking state [ 93.940005][ T9745] bridge0: port 2(bridge_slave_1) entered disabled state [ 93.948293][ T9745] device bridge_slave_1 entered promiscuous mode [ 93.964801][ T9745] bond0: (slave bond_slave_0): Enslaving as an active interface with an up link [ 93.976093][ T9745] bond0: (slave bond_slave_1): Enslaving as an active interface with an up link [ 93.994666][ T9745] team0: Port device team_slave_0 added [ 94.001777][ T9745] team0: Port device team_slave_1 added [ 94.016042][ T9745] batman_adv: batadv0: Adding interface: batadv_slave_0 [ 94.022993][ T9745] batman_adv: batadv0: The MTU of interface batadv_slave_0 is too small (1500) to handle the transport of batman-adv packets. Packets going over this interface will be fragmented on layer2 which could impact the performance. Setting the MTU to 1560 would solve the problem. [ 94.049313][ T9745] batman_adv: batadv0: Not using interface batadv_slave_0 (retrying later): interface not active [ 94.061655][ T9745] batman_adv: batadv0: Adding interface: batadv_slave_1 [ 94.068774][ T9745] batman_adv: batadv0: The MTU of interface batadv_slave_1 is too small (1500) to handle the transport of batman-adv packets. Packets going over this interface will be fragmented on layer2 which could impact the performance. Setting the MTU to 1560 would solve the problem. [ 94.094832][ T9745] batman_adv: batadv0: Not using interface batadv_slave_1 (retrying later): interface not active [ 94.185302][ T9745] device hsr_slave_0 entered promiscuous mode [ 94.243662][ T9745] device hsr_slave_1 entered promiscuous mode [ 94.361298][ T9745] netdevsim netdevsim0 netdevsim0: renamed from eth0 [ 94.386934][ T9745] netdevsim netdevsim0 netdevsim1: renamed from eth1 [ 94.456411][ T9745] netdevsim netdevsim0 netdevsim2: renamed from eth2 [ 94.495911][ T9745] netdevsim netdevsim0 netdevsim3: renamed from eth3 [ 94.578283][ T9745] bridge0: port 2(bridge_slave_1) entered blocking state [ 94.585498][ T9745] bridge0: port 2(bridge_slave_1) entered forwarding state [ 94.593179][ T9745] bridge0: port 1(bridge_slave_0) entered blocking state [ 94.600337][ T9745] bridge0: port 1(bridge_slave_0) entered forwarding state [ 94.639999][ T9745] 8021q: adding VLAN 0 to HW filter on device bond0 [ 94.651907][ T3094] IPv6: ADDRCONF(NETDEV_CHANGE): veth0: link becomes ready [ 94.661625][ T3094] bridge0: port 1(bridge_slave_0) entered disabled state [ 94.671319][ T3094] bridge0: port 2(bridge_slave_1) entered disabled state [ 94.679412][ T3094] IPv6: ADDRCONF(NETDEV_CHANGE): bond0: link becomes ready [ 94.694131][ T9745] 8021q: adding VLAN 0 to HW filter on device team0 [ 94.705621][ T2876] IPv6: ADDRCONF(NETDEV_CHANGE): bridge_slave_0: link becomes ready [ 94.714726][ T2876] bridge0: port 1(bridge_slave_0) entered blocking state [ 94.721819][ T2876] bridge0: port 1(bridge_slave_0) entered forwarding state [ 94.738514][ T2907] IPv6: ADDRCONF(NETDEV_CHANGE): bridge_slave_1: link becomes ready [ 94.746915][ T2907] bridge0: port 2(bridge_slave_1) entered blocking state [ 94.754225][ T2907] bridge0: port 2(bridge_slave_1) entered forwarding state [ 94.774363][ T2907] IPv6: ADDRCONF(NETDEV_CHANGE): team_slave_0: link becomes ready [ 94.782989][ T2907] IPv6: ADDRCONF(NETDEV_CHANGE): team_slave_1: link becomes ready [ 94.791979][ T2907] IPv6: ADDRCONF(NETDEV_CHANGE): hsr_slave_0: link becomes ready [ 94.801171][ T2907] IPv6: ADDRCONF(NETDEV_CHANGE): team0: link becomes ready [ 94.812310][ T2876] IPv6: ADDRCONF(NETDEV_CHANGE): hsr_slave_1: link becomes ready [ 94.823777][ T9745] IPv6: ADDRCONF(NETDEV_CHANGE): hsr0: link becomes ready [ 94.842052][ T2876] IPv6: ADDRCONF(NETDEV_CHANGE): vxcan0: link becomes ready [ 94.850734][ T2876] IPv6: ADDRCONF(NETDEV_CHANGE): vxcan1: link becomes ready [ 94.863268][ T9745] 8021q: adding VLAN 0 to HW filter on device batadv0 [ 94.882098][ T2876] IPv6: ADDRCONF(NETDEV_CHANGE): veth0_virt_wifi: link becomes ready [ 94.901113][ T2907] IPv6: ADDRCONF(NETDEV_CHANGE): veth1_vlan: link becomes ready [ 94.909982][ T2907] IPv6: ADDRCONF(NETDEV_CHANGE): veth0_vlan: link becomes ready [ 94.919992][ T9745] device veth0_vlan entered promiscuous mode [ 94.926829][ T3094] IPv6: ADDRCONF(NETDEV_CHANGE): vlan0: link becomes ready [ 94.935078][ T3094] IPv6: ADDRCONF(NETDEV_CHANGE): vlan1: link becomes ready [ 94.954487][ T9745] device veth1_vlan entered promiscuous mode [ 94.974397][ T2876] IPv6: ADDRCONF(NETDEV_CHANGE): macvlan0: link becomes ready [ 94.982605][ T2876] IPv6: ADDRCONF(NETDEV_CHANGE): macvlan1: link becomes ready [ 94.991490][ T2876] IPv6: ADDRCONF(NETDEV_CHANGE): veth1_macvtap: link becomes ready [ 95.000761][ T2876] IPv6: ADDRCONF(NETDEV_CHANGE): veth0_macvtap: link becomes ready [ 95.011725][ T9745] device veth0_macvtap entered promiscuous mode [ 95.022130][ T9745] device veth1_macvtap entered promiscuous mode [ 95.038884][ T9745] batman_adv: batadv0: Interface activated: batadv_slave_0 [ 95.047506][ T2876] IPv6: ADDRCONF(NETDEV_CHANGE): macvtap0: link becomes ready [ 95.056499][ T2876] IPv6: ADDRCONF(NETDEV_CHANGE): macsec0: link becomes ready [ 95.065107][ T2876] IPv6: ADDRCONF(NETDEV_CHANGE): batadv_slave_0: link becomes ready [ 95.073830][ T2876] IPv6: ADDRCONF(NETDEV_CHANGE): veth0_to_batadv: link becomes ready [ 95.086553][ T9745] batman_adv: batadv0: Interface activated: batadv_slave_1 [ 95.093899][ T3094] IPv6: ADDRCONF(NETDEV_CHANGE): batadv_slave_1: link becomes ready [ 95.103913][ T3094] IPv6: ADDRCONF(NETDEV_CHANGE): veth1_to_batadv: link becomes ready executing program [ 95.460281][ T9751] [ 95.462632][ T9751] ====================================================== [ 95.469629][ T9751] WARNING: possible circular locking dependency detected [ 95.476784][ T9751] 5.6.0-rc2-syzkaller #0 Not tainted [ 95.482567][ T9751] ------------------------------------------------------ [ 95.490427][ T9751] syz-executor253/9751 is trying to acquire lock: [ 95.496848][ T9751] ffff888098b1eae0 (&htab->buckets[i].lock){....}, at: htab_lru_map_delete_node+0xce/0x2f0 [ 95.507020][ T9751] [ 95.507020][ T9751] but task is already holding lock: [ 95.514518][ T9751] ffff8880973ee218 (&l->lock){....}, at: bpf_lru_pop_free+0x67f/0x1670 [ 95.522935][ T9751] [ 95.522935][ T9751] which lock already depends on the new lock. [ 95.522935][ T9751] [ 95.533513][ T9751] [ 95.533513][ T9751] the existing dependency chain (in reverse order) is: [ 95.542575][ T9751] [ 95.542575][ T9751] -> #2 (&l->lock){....}: [ 95.549112][ T9751] _raw_spin_lock+0x2f/0x40 [ 95.554138][ T9751] bpf_lru_pop_free+0x67f/0x1670 [ 95.559604][ T9751] prealloc_lru_pop+0x2c/0xa0 [ 95.564788][ T9751] __htab_lru_percpu_map_update_elem+0x67e/0xa90 [ 95.571635][ T9751] bpf_percpu_hash_update+0x16e/0x210 [ 95.577523][ T9751] bpf_map_update_value.isra.0+0x2d7/0x8e0 [ 95.583987][ T9751] generic_map_update_batch+0x41f/0x610 [ 95.590063][ T9751] bpf_map_do_batch+0x3f5/0x510 [ 95.595426][ T9751] __do_sys_bpf+0x9b7/0x41e0 [ 95.600521][ T9751] __x64_sys_bpf+0x73/0xb0 [ 95.605500][ T9751] do_syscall_64+0xfa/0x790 [ 95.610554][ T9751] entry_SYSCALL_64_after_hwframe+0x49/0xbe [ 95.616969][ T9751] [ 95.616969][ T9751] -> #1 (&loc_l->lock){....}: [ 95.623955][ T9751] _raw_spin_lock_irqsave+0x95/0xcd [ 95.629821][ T9751] bpf_lru_push_free+0x250/0x5b0 [ 95.635278][ T9751] __htab_map_lookup_and_delete_batch+0x8d4/0x1540 [ 95.642296][ T9751] htab_lru_map_lookup_and_delete_batch+0x34/0x40 [ 95.649222][ T9751] bpf_map_do_batch+0x3f5/0x510 [ 95.654656][ T9751] __do_sys_bpf+0x1f7d/0x41e0 [ 95.659925][ T9751] __x64_sys_bpf+0x73/0xb0 [ 95.664883][ T9751] do_syscall_64+0xfa/0x790 [ 95.669907][ T9751] entry_SYSCALL_64_after_hwframe+0x49/0xbe [ 95.676372][ T9751] [ 95.676372][ T9751] -> #0 (&htab->buckets[i].lock){....}: [ 95.684379][ T9751] __lock_acquire+0x2596/0x4a00 [ 95.689753][ T9751] lock_acquire+0x190/0x410 [ 95.694777][ T9751] _raw_spin_lock_irqsave+0x95/0xcd [ 95.700833][ T9751] htab_lru_map_delete_node+0xce/0x2f0 [ 95.706832][ T9751] __bpf_lru_list_shrink+0xf9/0x470 [ 95.712737][ T9751] bpf_lru_pop_free+0x87c/0x1670 [ 95.718385][ T9751] prealloc_lru_pop+0x2c/0xa0 [ 95.723703][ T9751] __htab_lru_percpu_map_update_elem+0x67e/0xa90 [ 95.730650][ T9751] bpf_percpu_hash_update+0x16e/0x210 [ 95.736596][ T9751] bpf_map_update_value.isra.0+0x2d7/0x8e0 [ 95.742921][ T9751] generic_map_update_batch+0x41f/0x610 [ 95.749093][ T9751] bpf_map_do_batch+0x3f5/0x510 [ 95.754472][ T9751] __do_sys_bpf+0x9b7/0x41e0 [ 95.759567][ T9751] __x64_sys_bpf+0x73/0xb0 [ 95.764489][ T9751] do_syscall_64+0xfa/0x790 [ 95.769508][ T9751] entry_SYSCALL_64_after_hwframe+0x49/0xbe [ 95.775903][ T9751] [ 95.775903][ T9751] other info that might help us debug this: [ 95.775903][ T9751] [ 95.786192][ T9751] Chain exists of: [ 95.786192][ T9751] &htab->buckets[i].lock --> &loc_l->lock --> &l->lock [ 95.786192][ T9751] [ 95.798960][ T9751] Possible unsafe locking scenario: [ 95.798960][ T9751] [ 95.807092][ T9751] CPU0 CPU1 [ 95.812532][ T9751] ---- ---- [ 95.817939][ T9751] lock(&l->lock); [ 95.821741][ T9751] lock(&loc_l->lock); [ 95.828398][ T9751] lock(&l->lock); [ 95.834740][ T9751] lock(&htab->buckets[i].lock); [ 95.839770][ T9751] [ 95.839770][ T9751] *** DEADLOCK *** [ 95.839770][ T9751] [ 95.847916][ T9751] 3 locks held by syz-executor253/9751: [ 95.853444][ T9751] #0: ffffffff89bac240 (rcu_read_lock){....}, at: bpf_percpu_hash_update+0x0/0x210 [ 95.862814][ T9751] #1: ffffe8ffffc784c8 (&loc_l->lock){....}, at: bpf_lru_pop_free+0x32b/0x1670 [ 95.871946][ T9751] #2: ffff8880973ee218 (&l->lock){....}, at: bpf_lru_pop_free+0x67f/0x1670 [ 95.880807][ T9751] [ 95.880807][ T9751] stack backtrace: [ 95.886804][ T9751] CPU: 0 PID: 9751 Comm: syz-executor253 Not tainted 5.6.0-rc2-syzkaller #0 [ 95.895734][ T9751] Hardware name: Google Google Compute Engine/Google Compute Engine, BIOS Google 01/01/2011 [ 95.906051][ T9751] Call Trace: [ 95.909378][ T9751] dump_stack+0x197/0x210 [ 95.913708][ T9751] print_circular_bug.isra.0.cold+0x163/0x172 [ 95.919772][ T9751] check_noncircular+0x32e/0x3e0 [ 95.924705][ T9751] ? do_huge_pmd_anonymous_page+0x1454/0x1a50 [ 95.930854][ T9751] ? print_circular_bug.isra.0+0x230/0x230 [ 95.936652][ T9751] ? do_huge_pmd_anonymous_page+0x1454/0x1a50 [ 95.942721][ T9751] ? alloc_list_entry+0xc0/0xc0 [ 95.947570][ T9751] ? __sanitizer_cov_trace_const_cmp8+0x18/0x20 [ 95.953836][ T9751] ? find_first_zero_bit+0x9a/0xc0 [ 95.959041][ T9751] __lock_acquire+0x2596/0x4a00 [ 95.963895][ T9751] ? do_raw_spin_unlock+0x181/0x270 [ 95.969207][ T9751] ? mark_held_locks+0xf0/0xf0 [ 95.973959][ T9751] ? __kasan_check_read+0x11/0x20 [ 95.978964][ T9751] ? __lock_acquire+0x16f2/0x4a00 [ 95.983995][ T9751] lock_acquire+0x190/0x410 [ 95.988501][ T9751] ? htab_lru_map_delete_node+0xce/0x2f0 [ 95.994594][ T9751] _raw_spin_lock_irqsave+0x95/0xcd [ 95.999890][ T9751] ? htab_lru_map_delete_node+0xce/0x2f0 [ 96.005515][ T9751] htab_lru_map_delete_node+0xce/0x2f0 [ 96.010996][ T9751] ? __kasan_check_write+0x14/0x20 [ 96.016097][ T9751] __bpf_lru_list_shrink+0xf9/0x470 [ 96.021286][ T9751] bpf_lru_pop_free+0x87c/0x1670 [ 96.026217][ T9751] prealloc_lru_pop+0x2c/0xa0 [ 96.030992][ T9751] __htab_lru_percpu_map_update_elem+0x67e/0xa90 [ 96.037353][ T9751] bpf_percpu_hash_update+0x16e/0x210 [ 96.042740][ T9751] bpf_map_update_value.isra.0+0x2d7/0x8e0 [ 96.048536][ T9751] generic_map_update_batch+0x41f/0x610 [ 96.054087][ T9751] ? generic_map_delete_batch+0x6a0/0x6a0 [ 96.059801][ T9751] ? __fget_light+0x1ad/0x270 [ 96.064480][ T9751] ? generic_map_delete_batch+0x6a0/0x6a0 [ 96.070229][ T9751] bpf_map_do_batch+0x3f5/0x510 [ 96.075155][ T9751] __do_sys_bpf+0x9b7/0x41e0 [ 96.079739][ T9751] ? find_held_lock+0x35/0x130 [ 96.084496][ T9751] ? bpf_prog_load+0x1820/0x1820 [ 96.089439][ T9751] ? lock_downgrade+0x920/0x920 [ 96.094380][ T9751] ? handle_mm_fault+0x292/0xa50 [ 96.099332][ T9751] ? trace_hardirqs_on_thunk+0x1a/0x1c [ 96.104797][ T9751] ? do_syscall_64+0x26/0x790 [ 96.109513][ T9751] ? entry_SYSCALL_64_after_hwframe+0x49/0xbe [ 96.115583][ T9751] ? do_syscall_64+0x26/0x790 [ 96.120251][ T9751] __x64_sys_bpf+0x73/0xb0 [ 96.124670][ T9751] do_syscall_64+0xfa/0x790 [ 96.129167][ T9751] entry_SYSCALL_64_after_hwframe+0x49/0xbe [ 96.135043][ T9751] RIP: 0033:0x449499 [ 96.139011][ T9751] Code: e8 ec 0e 03 00 48 83 c4 18 c3 0f 1f 80 00 00 00 00 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 ab 08 fc ff c3 66 2e 0f 1f 84 00 00 00 00 executing program [ 96.158760][ T9751] RSP: 002b:00007fa6d86dcdb8 EFLAGS: 00000246 ORIG_RAX: 0000000000000141 [ 96.167263][ T9751] RAX: ffffffffffffffda RBX: 00000000006dec28 RCX: 0000000000449499 [ 96.175395][ T9751] RDX: 0000000000000038 RSI: 0000000020000040 RDI: 000000000000001a [ 96.183994][ T9751] RBP: 00000000006dec20 R08: 0000000000000000 R09: 0000000000000000 [ 96.191963][ T9751] R10: 0000000000000000 R11: 0000000000000246 R12: 00000000006dec2c [ 96.199916][ T9751] R13: 00007ffc6bea610f R14: 00007fa6d86dd9c0 R15: 0000000000000000 executing program executing program executing program executing program executing program executing program executing program executing program executing program executing program executing program executing program executing program executing program executing program executing program executing program executing program executing program executing program executing program executing program executing program executing program executing program executing program executing program executing program executing program executing program executing program executing program executing program executing program executing program executing program executing program executing program executing program executing program executing program executing program executing program executing program executing program executing program executing program executing program executing program executing program executing program executing program executing program executing program [ 104.464240][ T0] NOHZ: local_softirq_pending 08 executing program executing program executing program executing program executing program executing program executing program