Starting Load/Save RF Kill Switch Status... [ OK ] Started Load/Save RF Kill Switch Status. Debian GNU/Linux 9 syzkaller ttyS0 Warning: Permanently added '10.128.1.24' (ECDSA) to the list of known hosts. 2020/11/07 13:18:50 fuzzer started 2020/11/07 13:18:50 connecting to host at 10.128.0.26:40003 2020/11/07 13:18:50 checking machine... 2020/11/07 13:18:50 checking revisions... 2020/11/07 13:18:50 testing simple program... syzkaller login: [ 64.087012][ T8530] IPVS: ftp: loaded support on port[0] = 21 [ 64.256477][ T8530] chnl_net:caif_netlink_parms(): no params data found [ 64.314622][ T8530] bridge0: port 1(bridge_slave_0) entered blocking state [ 64.322239][ T8530] bridge0: port 1(bridge_slave_0) entered disabled state [ 64.330878][ T8530] device bridge_slave_0 entered promiscuous mode [ 64.340131][ T8530] bridge0: port 2(bridge_slave_1) entered blocking state [ 64.347833][ T8530] bridge0: port 2(bridge_slave_1) entered disabled state [ 64.356148][ T8530] device bridge_slave_1 entered promiscuous mode [ 64.376678][ T8530] bond0: (slave bond_slave_0): Enslaving as an active interface with an up link [ 64.387520][ T8530] bond0: (slave bond_slave_1): Enslaving as an active interface with an up link [ 64.410012][ T8530] team0: Port device team_slave_0 added [ 64.417490][ T8530] team0: Port device team_slave_1 added [ 64.436750][ T8530] batman_adv: batadv0: Adding interface: batadv_slave_0 [ 64.443689][ T8530] 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. [ 64.470194][ T8530] batman_adv: batadv0: Not using interface batadv_slave_0 (retrying later): interface not active [ 64.482922][ T8530] batman_adv: batadv0: Adding interface: batadv_slave_1 [ 64.490202][ T8530] 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. [ 64.516172][ T8530] batman_adv: batadv0: Not using interface batadv_slave_1 (retrying later): interface not active [ 64.543475][ T8530] device hsr_slave_0 entered promiscuous mode [ 64.550504][ T8530] device hsr_slave_1 entered promiscuous mode [ 64.651806][ T8530] netdevsim netdevsim0 netdevsim0: renamed from eth0 [ 64.662874][ T8530] netdevsim netdevsim0 netdevsim1: renamed from eth1 [ 64.673401][ T8530] netdevsim netdevsim0 netdevsim2: renamed from eth2 [ 64.683520][ T8530] netdevsim netdevsim0 netdevsim3: renamed from eth3 [ 64.708391][ T8530] bridge0: port 2(bridge_slave_1) entered blocking state [ 64.715576][ T8530] bridge0: port 2(bridge_slave_1) entered forwarding state [ 64.723297][ T8530] bridge0: port 1(bridge_slave_0) entered blocking state [ 64.730431][ T8530] bridge0: port 1(bridge_slave_0) entered forwarding state [ 64.778447][ T8530] 8021q: adding VLAN 0 to HW filter on device bond0 [ 64.792353][ T8749] IPv6: ADDRCONF(NETDEV_CHANGE): veth0: link becomes ready [ 64.803030][ T8749] bridge0: port 1(bridge_slave_0) entered disabled state [ 64.811818][ T8749] bridge0: port 2(bridge_slave_1) entered disabled state [ 64.820459][ T8749] IPv6: ADDRCONF(NETDEV_CHANGE): bond0: link becomes ready [ 64.833396][ T8530] 8021q: adding VLAN 0 to HW filter on device team0 [ 64.846898][ T8749] IPv6: ADDRCONF(NETDEV_CHANGE): bridge_slave_0: link becomes ready [ 64.856676][ T8749] bridge0: port 1(bridge_slave_0) entered blocking state [ 64.863748][ T8749] bridge0: port 1(bridge_slave_0) entered forwarding state [ 64.886690][ T23] IPv6: ADDRCONF(NETDEV_CHANGE): bridge_slave_1: link becomes ready [ 64.895873][ T23] bridge0: port 2(bridge_slave_1) entered blocking state [ 64.902933][ T23] bridge0: port 2(bridge_slave_1) entered forwarding state [ 64.912093][ T23] IPv6: ADDRCONF(NETDEV_CHANGE): team_slave_0: link becomes ready [ 64.920955][ T23] IPv6: ADDRCONF(NETDEV_CHANGE): team_slave_1: link becomes ready [ 64.937197][ T8530] hsr0: Slave A (hsr_slave_0) is not up; please bring it up to get a fully working HSR network [ 64.947793][ T8530] hsr0: Slave B (hsr_slave_1) is not up; please bring it up to get a fully working HSR network [ 64.960585][ T23] IPv6: ADDRCONF(NETDEV_CHANGE): team0: link becomes ready [ 64.969246][ T23] IPv6: ADDRCONF(NETDEV_CHANGE): hsr_slave_0: link becomes ready [ 64.978455][ T23] IPv6: ADDRCONF(NETDEV_CHANGE): hsr_slave_1: link becomes ready [ 64.988465][ T23] IPv6: ADDRCONF(NETDEV_CHANGE): hsr0: link becomes ready [ 65.010481][ T8530] 8021q: adding VLAN 0 to HW filter on device batadv0 [ 65.020825][ T8751] IPv6: ADDRCONF(NETDEV_CHANGE): vxcan0: link becomes ready [ 65.030782][ T8751] IPv6: ADDRCONF(NETDEV_CHANGE): vxcan1: link becomes ready [ 65.049846][ T8751] IPv6: ADDRCONF(NETDEV_CHANGE): veth0_virt_wifi: link becomes ready [ 65.070944][ T8751] IPv6: ADDRCONF(NETDEV_CHANGE): veth0_vlan: link becomes ready [ 65.079528][ T8751] IPv6: ADDRCONF(NETDEV_CHANGE): vlan0: link becomes ready [ 65.088658][ T8751] IPv6: ADDRCONF(NETDEV_CHANGE): vlan1: link becomes ready [ 65.099726][ T8530] device veth0_vlan entered promiscuous mode [ 65.111794][ T8530] device veth1_vlan entered promiscuous mode [ 65.133653][ T8749] IPv6: ADDRCONF(NETDEV_CHANGE): macvlan0: link becomes ready [ 65.141792][ T8749] IPv6: ADDRCONF(NETDEV_CHANGE): macvlan1: link becomes ready [ 65.150721][ T8749] IPv6: ADDRCONF(NETDEV_CHANGE): veth0_macvtap: link becomes ready [ 65.161608][ T8530] device veth0_macvtap entered promiscuous mode [ 65.171839][ T8530] device veth1_macvtap entered promiscuous mode [ 65.189957][ T8530] batman_adv: batadv0: Interface activated: batadv_slave_0 [ 65.198131][ T8751] IPv6: ADDRCONF(NETDEV_CHANGE): veth0_to_batadv: link becomes ready [ 65.208208][ T8751] IPv6: ADDRCONF(NETDEV_CHANGE): macvtap0: link becomes ready [ 65.219421][ T8530] batman_adv: batadv0: Interface activated: batadv_slave_1 [ 65.227286][ T8749] IPv6: ADDRCONF(NETDEV_CHANGE): batadv_slave_1: link becomes ready [ 65.236627][ T8749] IPv6: ADDRCONF(NETDEV_CHANGE): veth1_to_batadv: link becomes ready [ 65.247985][ T8530] netdevsim netdevsim0 netdevsim0: set [1, 0] type 2 family 0 port 6081 - 0 [ 65.257184][ T8530] netdevsim netdevsim0 netdevsim1: set [1, 0] type 2 family 0 port 6081 - 0 [ 65.266186][ T8530] netdevsim netdevsim0 netdevsim2: set [1, 0] type 2 family 0 port 6081 - 0 [ 65.275580][ T8530] netdevsim netdevsim0 netdevsim3: set [1, 0] type 2 family 0 port 6081 - 0 [ 65.369420][ T156] wlan0: Created IBSS using preconfigured BSSID 50:50:50:50:50:50 [ 65.391872][ T156] wlan0: Creating new IBSS network, BSSID 50:50:50:50:50:50 [ 65.409819][ T8749] IPv6: ADDRCONF(NETDEV_CHANGE): wlan0: link becomes ready [ 65.421585][ T272] wlan1: Created IBSS using preconfigured BSSID 50:50:50:50:50:50 [ 65.432013][ T272] wlan1: Creating new IBSS network, BSSID 50:50:50:50:50:50 [ 65.441364][ T8749] IPv6: ADDRCONF(NETDEV_CHANGE): wlan1: link becomes ready [ 65.476662][ T21] BUG: sleeping function called from invalid context at net/mac80211/sta_info.c:1962 [ 65.491685][ T21] in_atomic(): 0, irqs_disabled(): 0, non_block: 0, pid: 21, name: kworker/u4:1 [ 65.502819][ T21] 4 locks held by kworker/u4:1/21: [ 65.509150][ T21] #0: ffff88803044b138 ((wq_completion)phy3){+.+.}-{0:0}, at: process_one_work+0x821/0x15a0 [ 65.521808][ T21] #1: ffffc90000dbfda8 ((work_completion)(&sdata->work)){+.+.}-{0:0}, at: process_one_work+0x854/0x15a0 [ 65.535546][ T21] #2: ffff88802f78cd00 (&wdev->mtx){+.+.}-{3:3}, at: ieee80211_ibss_work+0x93/0xe80 [ 65.546364][ T21] #3: ffffffff8b337160 (rcu_read_lock){....}-{1:2}, at: sta_info_insert_rcu+0x680/0x2ba0 [ 65.557096][ T21] Preemption disabled at: [ 65.557125][ T21] [] __mutex_lock+0x10f/0x10e0 [ 65.570403][ T21] CPU: 1 PID: 21 Comm: kworker/u4:1 Not tainted 5.10.0-rc2-syzkaller #0 [ 65.578736][ T21] Hardware name: Google Google Compute Engine/Google Compute Engine, BIOS Google 01/01/2011 [ 65.588809][ T21] Workqueue: phy3 ieee80211_iface_work [ 65.594277][ T21] Call Trace: [ 65.597568][ T21] dump_stack+0x107/0x163 [ 65.601882][ T21] ? __mutex_lock+0x10f/0x10e0 [ 65.606651][ T21] ___might_sleep.cold+0x1e8/0x22e [ 65.611748][ T21] sta_info_move_state+0x32/0x8d0 [ 65.616763][ T21] sta_info_free+0x65/0x3b0 [ 65.621266][ T21] sta_info_insert_rcu+0x303/0x2ba0 [ 65.626465][ T21] ? find_held_lock+0x2d/0x110 [ 65.631233][ T21] ? rate_control_rate_init+0x32c/0x6a0 [ 65.636768][ T21] ? sta_info_free+0x3b0/0x3b0 [ 65.641515][ T21] ? __local_bh_enable_ip+0x9c/0x110 [ 65.646790][ T21] ? rate_control_rate_init+0x35f/0x6a0 [ 65.652336][ T21] ieee80211_ibss_finish_sta+0x212/0x390 [ 65.657953][ T21] ? ieee80211_ibss_build_presp+0x15f0/0x15f0 [ 65.664010][ T21] ? __local_bh_enable_ip+0x9c/0x110 [ 65.669282][ T21] ieee80211_ibss_work+0x2c7/0xe80 [ 65.675602][ T21] ? ieee80211_ibss_rx_queued_mgmt+0x1870/0x1870 [ 65.681913][ T21] ? mark_held_locks+0x9f/0xe0 [ 65.686664][ T21] ? _raw_spin_unlock_irqrestore+0x42/0x50 [ 65.692463][ T21] ? lockdep_hardirqs_on+0x79/0x100 [ 65.697644][ T21] ? _raw_spin_unlock_irqrestore+0x2f/0x50 [ 65.703449][ T21] ieee80211_iface_work+0x82e/0x970 [ 65.708647][ T21] process_one_work+0x933/0x15a0 [ 65.713572][ T21] ? lock_release+0x710/0x710 [ 65.718317][ T21] ? pwq_dec_nr_in_flight+0x320/0x320 executing program [ 65.723687][ T21] ? rwlock_bug.part.0+0x90/0x90 [ 65.728614][ T21] ? _raw_spin_lock_irq+0x41/0x50 [ 65.733628][ T21] worker_thread+0x64c/0x1120 [ 65.738295][ T21] ? __kthread_parkme+0x13f/0x1e0 [ 65.743314][ T21] ? process_one_work+0x15a0/0x15a0 [ 65.748509][ T21] kthread+0x3af/0x4a0 [ 65.752559][ T21] ? kthread_create_worker_on_cpu+0xf0/0xf0 [ 65.758525][ T21] ret_from_fork+0x1f/0x30 [ 65.794267][ T21] [ 65.796624][ T21] ============================= [ 65.801459][ T21] [ BUG: Invalid wait context ] [ 65.806300][ T21] 5.10.0-rc2-syzkaller #0 Tainted: G W [ 65.813051][ T21] ----------------------------- [ 65.817893][ T21] kworker/u4:1/21 is trying to lock: [ 65.823167][ T21] ffff88801c4c29d0 (&local->chanctx_mtx){+.+.}-{3:3}, at: ieee80211_recalc_min_chandef+0x49/0x140 [ 65.833804][ T21] other info that might help us debug this: [ 65.840211][ T21] context-{4:4} [ 65.843667][ T21] 4 locks held by kworker/u4:1/21: [ 65.848762][ T21] #0: ffff88803044b138 ((wq_completion)phy3){+.+.}-{0:0}, at: process_one_work+0x821/0x15a0 [ 65.858949][ T21] #1: ffffc90000dbfda8 ((work_completion)(&sdata->work)){+.+.}-{0:0}, at: process_one_work+0x854/0x15a0 [ 65.870239][ T21] #2: ffff88802f78cd00 (&wdev->mtx){+.+.}-{3:3}, at: ieee80211_ibss_work+0x93/0xe80 [ 65.879714][ T21] #3: ffffffff8b337160 (rcu_read_lock){....}-{1:2}, at: sta_info_insert_rcu+0x680/0x2ba0 [ 65.889610][ T21] stack backtrace: [ 65.893332][ T21] CPU: 1 PID: 21 Comm: kworker/u4:1 Tainted: G W 5.10.0-rc2-syzkaller #0 [ 65.903285][ T21] Hardware name: Google Google Compute Engine/Google Compute Engine, BIOS Google 01/01/2011 [ 65.913345][ T21] Workqueue: phy3 ieee80211_iface_work [ 65.918798][ T21] Call Trace: [ 65.922071][ T21] dump_stack+0x107/0x163 [ 65.926382][ T21] __lock_acquire.cold+0x310/0x3a2 [ 65.931480][ T21] ? lockdep_hardirqs_on_prepare+0x400/0x400 [ 65.937440][ T21] ? find_held_lock+0x2d/0x110 [ 65.942187][ T21] lock_acquire+0x2a3/0x8c0 [ 65.946687][ T21] ? ieee80211_recalc_min_chandef+0x49/0x140 [ 65.952666][ T21] ? lock_release+0x710/0x710 [ 65.957328][ T21] __mutex_lock+0x134/0x10e0 [ 65.961914][ T21] ? ieee80211_recalc_min_chandef+0x49/0x140 [ 65.967882][ T21] ? ieee80211_recalc_min_chandef+0x49/0x140 [ 65.973853][ T21] ? mutex_lock_io_nested+0xf60/0xf60 [ 65.979215][ T21] ? ieee80211_clear_fast_rx+0x58/0x80 [ 65.984657][ T21] ? mark_held_locks+0x9f/0xe0 [ 65.989410][ T21] ieee80211_recalc_min_chandef+0x49/0x140 [ 65.995207][ T21] sta_info_move_state+0x3cf/0x8d0 [ 66.001527][ T21] sta_info_free+0x65/0x3b0 [ 66.006016][ T21] sta_info_insert_rcu+0x303/0x2ba0 [ 66.011201][ T21] ? find_held_lock+0x2d/0x110 [ 66.015947][ T21] ? rate_control_rate_init+0x32c/0x6a0 [ 66.021472][ T21] ? sta_info_free+0x3b0/0x3b0 [ 66.026214][ T21] ? __local_bh_enable_ip+0x9c/0x110 [ 66.031480][ T21] ? rate_control_rate_init+0x35f/0x6a0 [ 66.037005][ T21] ieee80211_ibss_finish_sta+0x212/0x390 [ 66.042630][ T21] ? ieee80211_ibss_build_presp+0x15f0/0x15f0 [ 66.048679][ T21] ? __local_bh_enable_ip+0x9c/0x110 [ 66.053955][ T21] ieee80211_ibss_work+0x2c7/0xe80 [ 66.059056][ T21] ? ieee80211_ibss_rx_queued_mgmt+0x1870/0x1870 [ 66.068489][ T21] ? mark_held_locks+0x9f/0xe0 [ 66.073242][ T21] ? _raw_spin_unlock_irqrestore+0x42/0x50 [ 66.079026][ T21] ? lockdep_hardirqs_on+0x79/0x100 [ 66.084214][ T21] ? _raw_spin_unlock_irqrestore+0x2f/0x50 [ 66.089999][ T21] ieee80211_iface_work+0x82e/0x970 [ 66.095197][ T21] process_one_work+0x933/0x15a0 [ 66.100126][ T21] ? lock_release+0x710/0x710 [ 66.104779][ T21] ? pwq_dec_nr_in_flight+0x320/0x320 [ 66.110128][ T21] ? rwlock_bug.part.0+0x90/0x90 [ 66.115056][ T21] ? _raw_spin_lock_irq+0x41/0x50 [ 66.120058][ T21] worker_thread+0x64c/0x1120 [ 66.124715][ T21] ? __kthread_parkme+0x13f/0x1e0 [ 66.129716][ T21] ? process_one_work+0x15a0/0x15a0 [ 66.134891][ T21] kthread+0x3af/0x4a0 [ 66.138939][ T21] ? kthread_create_worker_on_cpu+0xf0/0xf0 2020/11/07 13:18:54 building call list... [ 66.144810][ T21] ret_from_fork+0x1f/0x30 [ 66.156207][ T7] Bluetooth: hci0: command 0x0409 tx timeout [ 66.347865][ T8] netdevsim netdevsim0 netdevsim3 (unregistering): unset [1, 0] type 2 family 0 port 6081 - 0 [ 66.450530][ T8] netdevsim netdevsim0 netdevsim2 (unregistering): unset [1, 0] type 2 family 0 port 6081 - 0 [ 66.539460][ T8] netdevsim netdevsim0 netdevsim1 (unregistering): unset [1, 0] type 2 family 0 port 6081 - 0 [ 66.629024][ T8] netdevsim netdevsim0 netdevsim0 (unregistering): unset [1, 0] type 2 family 0 port 6081 - 0 [ 67.849235][ T8] device hsr_slave_0 left promiscuous mode [ 67.864253][ T8] device hsr_slave_1 left promiscuous mode [ 67.870589][ T8] batman_adv: batadv0: Interface deactivated: batadv_slave_0 [ 67.879113][ T8] batman_adv: batadv0: Removing interface: batadv_slave_0 [ 67.887619][ T8] batman_adv: batadv0: Interface deactivated: batadv_slave_1 [ 67.897114][ T8] batman_adv: batadv0: Removing interface: batadv_slave_1 [ 67.905778][ T8] device bridge_slave_1 left promiscuous mode [ 67.912010][ T8] bridge0: port 2(bridge_slave_1) entered disabled state [ 67.921387][ T8] device bridge_slave_0 left promiscuous mode [ 67.928306][ T8] bridge0: port 1(bridge_slave_0) entered disabled state [ 67.939205][ T8] device veth1_macvtap left promiscuous mode [ 67.946292][ T8] device veth0_macvtap left promiscuous mode [ 67.952362][ T8] device veth1_vlan left promiscuous mode [ 67.959295][ T8] device veth0_vlan left promiscuous mode executing program [ 69.157202][ T8] team0 (unregistering): Port device team_slave_1 removed [ 69.168421][ T8] team0 (unregistering): Port device team_slave_0 removed [ 69.179874][ T8] bond0 (unregistering): (slave bond_slave_1): Releasing backup interface [ 69.191131][ T8] bond0 (unregistering): (slave bond_slave_0): Releasing backup interface [ 69.218664][ T8] bond0 (unregistering): Released all slaves [ 69.366982][ T8525] can: request_module (can-proto-0) failed. [ 69.717445][ T8525] can: request_module (can-proto-0) failed. [ 69.728294][ T8525] can: request_module (can-proto-0) failed.