binder: 8062:8063 transaction failed 29201/-71, size 2-1144397507205 line 2923 BUG: using __this_cpu_read() in preemptible [00000000] code: syz-executor6/8091 caller is __this_cpu_preempt_check+0x1c/0x20 lib/smp_processor_id.c:62 binder: 8062:8082 Acquire 1 refcount change on invalid ref 1 ret -22 binder: 8062:8082 got transaction to invalid handle binder: 8062:8082 transaction failed 29201/-22, size 64-32 line 3007 binder: send failed reply for transaction 62 to 8062:8082 binder: 8062:8063 ioctl c0306201 2000efd0 returned -14 CPU: 1 PID: 8091 Comm: syz-executor6 Not tainted 4.9.68-gfb66dc2 #107 Hardware name: Google Google Compute Engine/Google Compute Engine, BIOS Google 01/01/2011 binder: 8062:8082 BC_CLEAR_DEATH_NOTIFICATION invalid ref 2 binder: 8062:8082 BC_FREE_BUFFER u000000002000c000 matched unreturned buffer ffff8801d073f6d8 ffffffff81d90889 0000000000000001[ 116.429577] binder: 8062:8082 got reply transaction with no transaction stack binder: 8062:8082 transaction failed 29201/-71, size 2-1144397507205 line 2923 binder: BINDER_SET_CONTEXT_MGR already set binder: 8062:8115 ioctl 40046207 0 returned -16 ?: renamed from tunl0 binder: 8062:8115 Acquire 1 refcount change on invalid ref 1 ret -22 binder: 8062:8115 got transaction to invalid handle binder: 8062:8115 transaction failed 29201/-22, size 64-32 line 3007 binder: 8062:8120 BC_INCREFS_DONE uffffffffffffffff no match binder: 8062:8120 got transaction to invalid handle binder: 8062:8120 transaction failed 29201/-22, size 40-16 line 3007 binder_alloc: 8062: binder_alloc_buf, no vma binder: 8062:8120 transaction failed 29189/-3, size 0-0 line 3130 binder: undelivered TRANSACTION_ERROR: 29189 binder: undelivered TRANSACTION_COMPLETE binder: undelivered TRANSACTION_ERROR: 29201 ffffffff83c17800 ffffffff83f42ec0 ffff8801d0730000 0000000000000003 ffff8801d073f718 ffffffff81df7854 ffff8801d073f730 ffffffff83f42ec0 dffffc0000000000 Call Trace: [] __dump_stack lib/dump_stack.c:15 [inline] [] dump_stack+0xc1/0x128 lib/dump_stack.c:51 [] check_preemption_disabled+0x1d4/0x200 lib/smp_processor_id.c:46 [] __this_cpu_preempt_check+0x1c/0x20 lib/smp_processor_id.c:62 [] ipcomp_alloc_tfms net/xfrm/xfrm_ipcomp.c:286 [inline] [] ipcomp_init_state+0x188/0x930 net/xfrm/xfrm_ipcomp.c:363 [] ipcomp4_init_state+0xb0/0x7d0 net/ipv4/ipcomp.c:137 [] __xfrm_init_state+0x3e7/0xb30 net/xfrm/xfrm_state.c:2096 [] xfrm_init_state+0x1a/0x20 net/xfrm/xfrm_state.c:2122 [] pfkey_msg2xfrm_state net/key/af_key.c:1281 [inline] [] pfkey_add+0x1fb9/0x3470 net/key/af_key.c:1498 [] pfkey_process+0x61e/0x730 net/key/af_key.c:2826 [] pfkey_sendmsg+0x3a9/0x760 net/key/af_key.c:3670 [] sock_sendmsg_nosec net/socket.c:635 [inline] [] sock_sendmsg+0xca/0x110 net/socket.c:645 [] ___sys_sendmsg+0x6d1/0x7e0 net/socket.c:1968 [] __sys_sendmsg+0xd6/0x190 net/socket.c:2002 [] SYSC_sendmsg net/socket.c:2013 [inline] [] SyS_sendmsg+0x2d/0x50 net/socket.c:2009 [] entry_SYSCALL_64_fastpath+0x23/0xc6 binder: 8162:8168 not enough space to store 0 fds in buffer binder: 8162:8168 transaction failed 29201/-22, size 72-32 line 3272 binder: BINDER_SET_CONTEXT_MGR already set SELinux: unrecognized netlink message: protocol=0 nlmsg_type=7456 sclass=netlink_route_socket pig=8206 comm=syz-executor6 binder: 8162:8194 ioctl 40046207 0 returned -16 binder_alloc: 8162: binder_alloc_buf, no vma binder: 8162:8168 transaction failed 29189/-3, size 72-32 line 3130 device gre0 entered promiscuous mode binder: 8239:8240 ERROR: BC_REGISTER_LOOPER called without request binder: 8239:8240 BC_DEAD_BINDER_DONE 0000000000000000 not found binder: 8239:8240 got transaction with invalid offset (0, min 48 max 48) or object. binder: 8239:8240 transaction failed 29201/-22, size 48-16 line 3193 binder: send failed reply for transaction 71 to 8239:8242 binder: undelivered TRANSACTION_COMPLETE binder: undelivered TRANSACTION_ERROR: 29201 binder: 8239:8242 ERROR: BC_REGISTER_LOOPER called without request binder_alloc: 8239: binder_alloc_buf, no vma binder: 8239:8242 BC_DEAD_BINDER_DONE 0000000000000000 not found binder: 8239:8242 got reply transaction with no transaction stack binder: 8239:8242 transaction failed 29201/-71, size 48-16 line 2923 binder: 8239:8240 transaction failed 29189/-3, size 0-0 line 3130 binder: undelivered TRANSACTION_ERROR: 29189 netlink: 2 bytes leftover after parsing attributes in process `syz-executor5'. FAULT_FLAG_ALLOW_RETRY missing 30 CPU: 0 PID: 8269 Comm: syz-executor1 Not tainted 4.9.68-gfb66dc2 #107 Hardware name: Google Google Compute Engine/Google Compute Engine, BIOS Google 01/01/2011 ffff8801a8257480 ffffffff81d90889 ffff8801a8257760 0000000000000000 ffff8801a5dbe110 ffff8801a8257650 ffff8801a5dbe000 ffff8801a8257678 ffffffff8165e497 000000000000091a ffff8801a8116918 ffff8801a81168a0 Call Trace: [] __dump_stack lib/dump_stack.c:15 [inline] [] dump_stack+0xc1/0x128 lib/dump_stack.c:51 [] handle_userfault+0xa37/0x1300 fs/userfaultfd.c:323 [] do_anonymous_page mm/memory.c:2747 [inline] [] handle_pte_fault mm/memory.c:3488 [inline] [] __handle_mm_fault mm/memory.c:3577 [inline] [] handle_mm_fault+0x1fd1/0x2530 mm/memory.c:3614 [] __do_page_fault+0x5c2/0xd40 arch/x86/mm/fault.c:1406 [] do_page_fault+0x27/0x30 arch/x86/mm/fault.c:1469 [] page_fault+0x28/0x30 arch/x86/entry/entry_64.S:1012 [] do_ip_setsockopt.isra.12+0x1977/0x2960 net/ipv4/ip_sockglue.c:1151 [] ip_setsockopt+0x3a/0xb0 net/ipv4/ip_sockglue.c:1240 [] tcp_setsockopt+0x82/0xd0 net/ipv4/tcp.c:2736 [] sock_common_setsockopt+0x95/0xd0 net/core/sock.c:2706 [] SYSC_setsockopt net/socket.c:1771 [inline] [] SyS_setsockopt+0x160/0x250 net/socket.c:1750 [] entry_SYSCALL_64_fastpath+0x23/0xc6 SELinux: unrecognized netlink message: protocol=0 nlmsg_type=31526 sclass=netlink_route_socket pig=8328 comm=syz-executor2 SELinux: unrecognized netlink message: protocol=0 nlmsg_type=31526 sclass=netlink_route_socket pig=8338 comm=syz-executor2 netlink: 2 bytes leftover after parsing attributes in process `syz-executor5'. binder: BINDER_SET_CONTEXT_MGR already set binder: 8365:8368 ioctl 40046207 0 returned -16 netlink: 5 bytes leftover after parsing attributes in process `syz-executor5'. device gre0 left promiscuous mode netlink: 5 bytes leftover after parsing attributes in process `syz-executor5'. loop: Write error at byte offset 0, length 512. blk_update_request: I/O error, dev loop4, sector 0 Buffer I/O error on dev loop4, logical block 0, lost async page write device gre0 entered promiscuous mode loop: Write error at byte offset 0, length 512. blk_update_request: I/O error, dev loop4, sector 0 device gre0 entered promiscuous mode Buffer I/O error on dev loop4, logical block 0, lost async page write VFS: Dirty inode writeback failed for block device loop4 (err=-5). device gre0 entered promiscuous mode binder_alloc: 8603: binder_alloc_buf, no vma binder: 8603:8607 transaction failed 29189/-3, size 0-8 line 3130 binder_alloc: 8603: binder_alloc_buf, no vma binder: 8603:8615 transaction failed 29189/-3, size 24-16 line 3130 binder: undelivered TRANSACTION_ERROR: 29189 device gre0 entered promiscuous mode audit: type=1400 audit(1513074583.797:46): avc: denied { ioctl } for pid=8609 comm="syz-executor6" path="socket:[24465]" dev="sockfs" ino=24465 ioctlcmd=0x4b4d scontext=unconfined_u:system_r:insmod_t:s0-s0:c0.c1023 tcontext=unconfined_u:system_r:insmod_t:s0-s0:c0.c1023 tclass=netlink_fib_lookup_socket permissive=1 device gre0 entered promiscuous mode device gre0 entered promiscuous mode audit: type=1400 audit(1513074583.967:47): avc: denied { net_broadcast } for pid=8668 comm="syz-executor5" capability=11 scontext=unconfined_u:system_r:insmod_t:s0-s0:c0.c1023 tcontext=unconfined_u:system_r:insmod_t:s0-s0:c0.c1023 tclass=cap_userns permissive=1 SELinux: unrecognized netlink message: protocol=0 nlmsg_type=257 sclass=netlink_route_socket pig=8671 comm=syz-executor5 SELinux: unrecognized netlink message: protocol=0 nlmsg_type=257 sclass=netlink_route_socket pig=8671 comm=syz-executor5 binder: 8732:8733 got transaction with invalid parent offset or type binder: 8732:8733 transaction failed 29201/-22, size 72-16 line 3253 binder_alloc: binder_alloc_mmap_handler: 8732 20000000-20002000 already mapped failed -16 binder: BINDER_SET_CONTEXT_MGR already set binder: 8732:8733 ioctl 40046207 0 returned -16 binder_alloc: 8732: binder_alloc_buf, no vma binder: 8732:8741 transaction failed 29189/-3, size 72-16 line 3130 netlink: 5 bytes leftover after parsing attributes in process `syz-executor6'. netlink: 5 bytes leftover after parsing attributes in process `syz-executor6'. IPVS: Creating netns size=2536 id=16 IPVS: Creating netns size=2536 id=17 binder: undelivered TRANSACTION_ERROR: 29189 binder: undelivered TRANSACTION_ERROR: 29201 binder: 8804:8809 got transaction to invalid handle binder: 8804:8809 transaction failed 29201/-22, size 80-8 line 3007 binder: BINDER_SET_CONTEXT_MGR already set binder: 8804:8816 ioctl 40046207 0 returned -16 binder: 8804:8816 transaction failed 29201/-28, size 0-4629809268588045068 line 3130 binder_alloc: binder_alloc_mmap_handler: 8804 20000000-20002000 already mapped failed -16 binder_alloc: binder_alloc_mmap_handler: 8804 20000000-20002000 already mapped failed -16 binder: BINDER_SET_CONTEXT_MGR already set binder: 8804:8816 ioctl 40046207 0 returned -16 binder: BINDER_SET_CONTEXT_MGR already set binder: 8804:8809 got transaction to invalid handle binder: 8804:8809 transaction failed 29201/-22, size 80-8 line 3007 binder: 8804:8816 ioctl 40046207 0 returned -16 binder_alloc: 8804: binder_alloc_buf, no vma binder: 8804:8809 transaction failed 29189/-3, size 0-4629809268588045068 line 3130 binder: undelivered TRANSACTION_ERROR: 29201 binder: undelivered TRANSACTION_ERROR: 29201 binder: undelivered TRANSACTION_ERROR: 29201 binder: undelivered TRANSACTION_ERROR: 29189 device gre0 entered promiscuous mode device lo entered promiscuous mode device lo left promiscuous mode device lo entered promiscuous mode device lo entered promiscuous mode Can not set IPV6_FL_F_REFLECT if flowlabel_consistency sysctl is enable Can not set IPV6_FL_F_REFLECT if flowlabel_consistency sysctl is enable audit: type=1400 audit(1513074585.037:48): avc: denied { setattr } for pid=8984 comm="syz-executor4" name="NETLINK" dev="sockfs" ino=23034 scontext=unconfined_u:system_r:insmod_t:s0-s0:c0.c1023 tcontext=unconfined_u:system_r:insmod_t:s0-s0:c0.c1023 tclass=netlink_netfilter_socket permissive=1 netlink: 1 bytes leftover after parsing attributes in process `syz-executor4'. netlink: 1 bytes leftover after parsing attributes in process `syz-executor4'. blk_update_request: I/O error, dev loop7, sector 0 Buffer I/O error on dev loop7, logical block 0, lost async page write blk_update_request: I/O error, dev loop7, sector 8 Buffer I/O error on dev loop7, logical block 1, lost async page write blk_update_request: I/O error, dev loop7, sector 16 Buffer I/O error on dev loop7, logical block 2, lost async page write blk_update_request: I/O error, dev loop7, sector 24 Buffer I/O error on dev loop7, logical block 3, lost async page write blk_update_request: I/O error, dev loop7, sector 32 Buffer I/O error on dev loop7, logical block 4, lost async page write blk_update_request: I/O error, dev loop7, sector 40 Buffer I/O error on dev loop7, logical block 5, lost async page write blk_update_request: I/O error, dev loop7, sector 48 Buffer I/O error on dev loop7, logical block 6, lost async page write blk_update_request: I/O error, dev loop7, sector 56 Buffer I/O error on dev loop7, logical block 7, lost async page write pktgen: kernel_thread() failed for cpu 0 pktgen: Cannot create thread for cpu 0 (-4) pktgen: kernel_thread() failed for cpu 1 pktgen: Cannot create thread for cpu 1 (-4) pktgen: Initialization failed for all threads pktgen: kernel_thread() failed for cpu 0 pktgen: Cannot create thread for cpu 0 (-4) pktgen: kernel_thread() failed for cpu 1 pktgen: Cannot create thread for cpu 1 (-4) pktgen: Initialization failed for all threads audit: type=1400 audit(1513074585.657:49): avc: denied { write } for pid=9051 comm="syz-executor5" path="socket:[25122]" dev="sockfs" ino=25122 scontext=unconfined_u:system_r:insmod_t:s0-s0:c0.c1023 tcontext=unconfined_u:system_r:insmod_t:s0-s0:c0.c1023 tclass=netlink_fib_lookup_socket permissive=1 ALSA: seq fatal error: cannot create timer (-19) netlink: 16 bytes leftover after parsing attributes in process `syz-executor2'. netlink: 16 bytes leftover after parsing attributes in process `syz-executor2'. keychord: Insufficient bytes present for keycount 67 keychord: Insufficient bytes present for keycount 67 ?: renamed from tunl0 SELinux: unrecognized netlink message: protocol=4 nlmsg_type=770 sclass=netlink_tcpdiag_socket pig=9236 comm=syz-executor7 SELinux: unrecognized netlink message: protocol=4 nlmsg_type=770 sclass=netlink_tcpdiag_socket pig=9260 comm=syz-executor7 SELinux: unrecognized netlink message: protocol=6 nlmsg_type=20080 sclass=netlink_xfrm_socket pig=9312 comm=syz-executor3 BUG: using __this_cpu_read() in preemptible [00000000] code: syz-executor0/9307 caller is __this_cpu_preempt_check+0x1c/0x20 lib/smp_processor_id.c:62 CPU: 1 PID: 9307 Comm: syz-executor0 Not tainted 4.9.68-gfb66dc2 #107 Hardware name: Google Google Compute Engine/Google Compute Engine, BIOS Google 01/01/2011 ffff8801cf3476d8 ffffffff81d90889 0000000000000001 ffffffff83c17800 ffffffff83f42ec0 ffff8801d9bc8000 0000000000000003 ffff8801cf347718 ffffffff81df7854 ffff8801cf347730 ffffffff83f42ec0 dffffc0000000000 Call Trace: [] __dump_stack lib/dump_stack.c:15 [inline] [] dump_stack+0xc1/0x128 lib/dump_stack.c:51 [] check_preemption_disabled+0x1d4/0x200 lib/smp_processor_id.c:46 [] __this_cpu_preempt_check+0x1c/0x20 lib/smp_processor_id.c:62 [] ipcomp_alloc_tfms net/xfrm/xfrm_ipcomp.c:286 [inline] [] ipcomp_init_state+0x188/0x930 net/xfrm/xfrm_ipcomp.c:363 [] ipcomp4_init_state+0xb0/0x7d0 net/ipv4/ipcomp.c:137 [] __xfrm_init_state+0x3e7/0xb30 net/xfrm/xfrm_state.c:2096 [] xfrm_init_state+0x1a/0x20 net/xfrm/xfrm_state.c:2122 [] pfkey_msg2xfrm_state net/key/af_key.c:1281 [inline] [] pfkey_add+0x1fb9/0x3470 net/key/af_key.c:1498 [] pfkey_process+0x61e/0x730 net/key/af_key.c:2826 [] pfkey_sendmsg+0x3a9/0x760 net/key/af_key.c:3670 [] sock_sendmsg_nosec net/socket.c:635 [inline] [] sock_sendmsg+0xca/0x110 net/socket.c:645 [] ___sys_sendmsg+0x6d1/0x7e0 net/socket.c:1968 [] __sys_sendmsg+0xd6/0x190 net/socket.c:2002 [] SYSC_sendmsg net/socket.c:2013 [inline] [] SyS_sendmsg+0x2d/0x50 net/socket.c:2009 [] entry_SYSCALL_64_fastpath+0x23/0xc6 SELinux: unrecognized netlink message: protocol=6 nlmsg_type=20080 sclass=netlink_xfrm_socket pig=9330 comm=syz-executor3 IPv6: ADDRCONF(NETDEV_CHANGE): lo: link becomes ready tc_dump_action: action bad kind tc_dump_action: action bad kind binder: BINDER_SET_CONTEXT_MGR already set binder: 9462:9464 ioctl 40046207 0 returned -16 nla_parse: 2 callbacks suppressed netlink: 16 bytes leftover after parsing attributes in process `syz-executor0'. device gre0 entered promiscuous mode netlink: 16 bytes leftover after parsing attributes in process `syz-executor0'. audit: type=1400 audit(1513074588.177:50): avc: denied { getopt } for pid=9620 comm="syz-executor4" scontext=unconfined_u:system_r:insmod_t:s0-s0:c0.c1023 tcontext=unconfined_u:system_r:insmod_t:s0-s0:c0.c1023 tclass=netlink_fib_lookup_socket permissive=1 binder: 9678:9681 unknown command 0 binder: 9678:9681 ioctl c0306201 2000a000 returned -22 binder: 9678:9681 BC_FREE_BUFFER u0000000000000000 no match binder: 9678:9681 ERROR: BC_REGISTER_LOOPER called without request binder: BINDER_SET_CONTEXT_MGR already set binder: 9678:9681 ioctl 40046207 0 returned -16 binder_alloc: 9678: binder_alloc_buf, no vma binder: 9678:9697 transaction failed 29189/-3, size 24-8 line 3130 binder: 9678:9681 unknown command 0 binder: 9678:9681 ioctl c0306201 2000a000 returned -22 binder: undelivered transaction 97, process died. netlink: 5 bytes leftover after parsing attributes in process `syz-executor7'. netlink: 5 bytes leftover after parsing attributes in process `syz-executor7'. SELinux: unrecognized netlink message: protocol=0 nlmsg_type=44123 sclass=netlink_route_socket pig=9737 comm=syz-executor1 SELinux: unrecognized netlink message: protocol=0 nlmsg_type=44123 sclass=netlink_route_socket pig=9737 comm=syz-executor1 device syz0 entered promiscuous mode program syz-executor0 is using a deprecated SCSI ioctl, please convert it to SG_IO sd 0:0:1:0: ioctl_internal_command: ILLEGAL REQUEST asc=0x20 ascq=0x0 program syz-executor0 is using a deprecated SCSI ioctl, please convert it to SG_IO sd 0:0:1:0: ioctl_internal_command: ILLEGAL REQUEST asc=0x20 ascq=0x0 SELinux: unrecognized netlink message: protocol=0 nlmsg_type=2 sclass=netlink_route_socket pig=9912 comm=syz-executor2 SELinux: unrecognized netlink message: protocol=0 nlmsg_type=2 sclass=netlink_route_socket pig=9912 comm=syz-executor2 netlink: 8 bytes leftover after parsing attributes in process `syz-executor4'. netlink: 8 bytes leftover after parsing attributes in process `syz-executor4'. IPVS: Creating netns size=2536 id=18 netlink: 3 bytes leftover after parsing attributes in process `syz-executor4'. device gre0 entered promiscuous mode netlink: 3 bytes leftover after parsing attributes in process `syz-executor4'. device lo left promiscuous mode audit: type=1400 audit(1513074589.937:51): avc: denied { connect } for pid=10066 comm="syz-executor6" scontext=unconfined_u:system_r:insmod_t:s0-s0:c0.c1023 tcontext=unconfined_u:system_r:insmod_t:s0-s0:c0.c1023 tclass=netlink_connector_socket permissive=1 audit: type=1400 audit(1513074589.967:52): avc: denied { getopt } for pid=10066 comm="syz-executor6" scontext=unconfined_u:system_r:insmod_t:s0-s0:c0.c1023 tcontext=unconfined_u:system_r:insmod_t:s0-s0:c0.c1023 tclass=netlink_connector_socket permissive=1 audit: type=1400 audit(1513074589.997:53): avc: denied { getattr } for pid=10066 comm="syz-executor6" path="socket:[27063]" dev="sockfs" ino=27063 scontext=unconfined_u:system_r:insmod_t:s0-s0:c0.c1023 tcontext=unconfined_u:system_r:insmod_t:s0-s0:c0.c1023 tclass=netlink_connector_socket permissive=1 device lo entered promiscuous mode device lo left promiscuous mode pktgen: kernel_thread() failed for cpu 0 pktgen: Cannot create thread for cpu 0 (-4) pktgen: kernel_thread() failed for cpu 1 pktgen: Cannot create thread for cpu 1 (-4) pktgen: Initialization failed for all threads IPVS: set_ctl: invalid protocol: 64680 1.136.255.255:0 gw_# device gre0 entered promiscuous mode device lo entered promiscuous mode netlink: 3 bytes leftover after parsing attributes in process `syz-executor1'. qtaguid: iface_stat: create(lo): no inet dev qtaguid: iface_stat: create6(lo): no inet dev IPv6: ADDRCONF(NETDEV_CHANGE): lo: link becomes ready netlink: 3 bytes leftover after parsing attributes in process `syz-executor1'. qtaguid: iface_stat: create6(lo): no inet dev device lo left promiscuous mode device lo entered promiscuous mode qtaguid: iface_stat: create(lo): no inet dev qtaguid: iface_stat: create6(lo): no inet dev SELinux: unrecognized netlink message: protocol=6 nlmsg_type=3131 sclass=netlink_xfrm_socket pig=10185 comm=syz-executor6 IPv6: ADDRCONF(NETDEV_CHANGE): lo: link becomes ready qtaguid: iface_stat: create6(lo): no inet dev device lo left promiscuous mode SELinux: unrecognized netlink message: protocol=6 nlmsg_type=3131 sclass=netlink_xfrm_socket pig=10188 comm=syz-executor6 binder: 10229:10240 DecRefs 0 refcount change on invalid ref 4 ret -22 binder: 10229:10240 unknown command 0 binder: 10229:10240 ioctl c0306201 20001fd0 returned -22 binder: 10232:10238 IncRefs 0 refcount change on invalid ref 0 ret -22 binder: 10229:10240 Release 1 refcount change on invalid ref 2 ret -22 binder: 10229:10240 BC_DEAD_BINDER_DONE 0000000000000000 not found binder: 10229:10240 BC_REQUEST_DEATH_NOTIFICATION invalid ref 2 binder: 10229:10240 BC_DEAD_BINDER_DONE 0000000000000001 not found binder: 10229:10240 IncRefs 0 refcount change on invalid ref 3 ret -22 binder: 10229:10240 BC_FREE_BUFFER u0000000020000000 no match