I1013 20:31:06.230335 59162 main.go:207] *************************** I1013 20:31:06.230419 59162 main.go:208] Args: [/syzkaller/managers/ptrace-proxy-sandbox-race/latest.tmp/image -root /syzkaller/managers/ptrace-proxy-sandbox-race/latest.tmp/workdir/gvisor_root -watchdog-action=panic -network=none -debug -debug-log=/dev/stderr -platform=ptrace -file-access=shared -network=sandbox -vfs2 -TESTONLY-unsafe-nonroot --panic-log /syzkaller/managers/ptrace-proxy-sandbox-race/latest.tmp/workdir/instance-0/bundle/panic.fifo run -bundle /syzkaller/managers/ptrace-proxy-sandbox-race/latest.tmp/workdir/instance-0/bundle ci-gvisor-ptrace-proxy-sandbox-race-test-2] I1013 20:31:06.230552 59162 main.go:209] Version release-20200928.0-105-g51913ba400cc I1013 20:31:06.230615 59162 main.go:210] PID: 59162 I1013 20:31:06.230722 59162 main.go:211] UID: 0, GID: 0 I1013 20:31:06.230811 59162 main.go:212] Configuration: I1013 20:31:06.230867 59162 main.go:213] RootDir: /syzkaller/managers/ptrace-proxy-sandbox-race/latest.tmp/workdir/gvisor_root I1013 20:31:06.230941 59162 main.go:214] Platform: ptrace I1013 20:31:06.230988 59162 main.go:215] FileAccess: 1, overlay: false I1013 20:31:06.231047 59162 main.go:216] Network: 0, logging: false I1013 20:31:06.231143 59162 main.go:217] Strace: false, max size: 1024, syscalls: I1013 20:31:06.231199 59162 main.go:218] VFS2 enabled: true I1013 20:31:06.231256 59162 main.go:219] *************************** W1013 20:31:06.231307 59162 main.go:224] Block the TERM signal. This is only safe in tests! W1013 20:31:06.237082 59162 specutils.go:111] noNewPrivileges ignored. PR_SET_NO_NEW_PRIVS is assumed to always be set. D1013 20:31:06.238156 59162 specutils.go:73] Spec: { "ociVersion": "", "process": { "user": { "uid": 0, "gid": 0 }, "args": [ "/init" ], "env": [ "SYZ_GVISOR_PROXY=1" ], "cwd": "/tmp" }, "root": { "path": "/syzkaller/managers/ptrace-proxy-sandbox-race/latest.tmp/workdir/instance-0/image", "readonly": true } } D1013 20:31:06.238277 59162 container.go:504] Run container "ci-gvisor-ptrace-proxy-sandbox-race-test-2" in root dir: /syzkaller/managers/ptrace-proxy-sandbox-race/latest.tmp/workdir/gvisor_root D1013 20:31:06.238374 59162 container.go:274] Create container "ci-gvisor-ptrace-proxy-sandbox-race-test-2" in root dir: /syzkaller/managers/ptrace-proxy-sandbox-race/latest.tmp/workdir/gvisor_root D1013 20:31:06.238956 59162 container.go:313] Creating new sandbox for container "ci-gvisor-ptrace-proxy-sandbox-race-test-2" D1013 20:31:06.239628 59162 container.go:986] Starting gofer: /proc/self/exe [--root=/syzkaller/managers/ptrace-proxy-sandbox-race/latest.tmp/workdir/gvisor_root --debug=true --debug-log=/dev/stderr --panic-log=/syzkaller/managers/ptrace-proxy-sandbox-race/latest.tmp/workdir/instance-0/bundle/panic.fifo --file-access=shared --watchdog-action=panic --vfs2=true --TESTONLY-unsafe-nonroot=true --debug-log-fd=3 gofer --bundle /syzkaller/managers/ptrace-proxy-sandbox-race/latest.tmp/workdir/instance-0/bundle --spec-fd=4 --mounts-fd=5 --io-fds=6] I1013 20:31:06.248959 59162 container.go:990] Gofer started, PID: 59216 I1013 20:31:06.249572 59162 sandbox.go:418] Creating sandbox process with addr: runsc-sandbox.ci-gvisor-ptrace-proxy-sandbox-race-test-2 I1013 20:31:06.249717 59162 sandbox.go:542] Sandbox will be started in new mount, IPC and UTS namespaces I1013 20:31:06.249762 59162 sandbox.go:552] Sandbox will be started in the current PID namespace I1013 20:31:06.249797 59162 sandbox.go:568] Sandbox will be started in new network namespace W1013 20:31:06.249890 59162 sandbox.go:603] Running sandbox in test mode as current user (uid=0 gid=0). This is only safe in tests! W1013 20:31:06.249944 59162 sandbox.go:604] Running sandbox in test mode without chroot. This is only safe in tests! D1013 20:31:06.249995 59162 sandbox.go:722] Donating FD 3: "/dev/stderr" D1013 20:31:06.250047 59162 sandbox.go:722] Donating FD 4: "/syzkaller/managers/ptrace-proxy-sandbox-race/latest.tmp/workdir/instance-0/bundle/panic.fifo" D1013 20:31:06.250110 59162 sandbox.go:722] Donating FD 5: "control_server_socket" D1013 20:31:06.250150 59162 sandbox.go:722] Donating FD 6: "|0" D1013 20:31:06.250187 59162 sandbox.go:722] Donating FD 7: "/syzkaller/managers/ptrace-proxy-sandbox-race/latest.tmp/workdir/instance-0/bundle/config.json" D1013 20:31:06.250257 59162 sandbox.go:722] Donating FD 8: "|1" D1013 20:31:06.250301 59162 sandbox.go:722] Donating FD 9: "sandbox IO FD" D1013 20:31:06.250337 59162 sandbox.go:722] Donating FD 10: "/dev/stdin" D1013 20:31:06.250372 59162 sandbox.go:722] Donating FD 11: "/dev/stdout" D1013 20:31:06.250406 59162 sandbox.go:722] Donating FD 12: "/dev/stderr" D1013 20:31:06.250481 59162 sandbox.go:725] Starting sandbox: /proc/self/exe [runsc-sandbox --root=/syzkaller/managers/ptrace-proxy-sandbox-race/latest.tmp/workdir/gvisor_root --debug=true --debug-log=/dev/stderr --panic-log=/syzkaller/managers/ptrace-proxy-sandbox-race/latest.tmp/workdir/instance-0/bundle/panic.fifo --file-access=shared --watchdog-action=panic --vfs2=true --TESTONLY-unsafe-nonroot=true --debug-log-fd=3 --panic-log-fd=4 boot --bundle=/syzkaller/managers/ptrace-proxy-sandbox-race/latest.tmp/workdir/instance-0/bundle --controller-fd=5 --mounts-fd=6 --spec-fd=7 --start-sync-fd=8 --io-fds=9 --stdio-fds=10 --stdio-fds=11 --stdio-fds=12 --attached ci-gvisor-ptrace-proxy-sandbox-race-test-2] D1013 20:31:06.250589 59162 sandbox.go:726] SysProcAttr: &{Chroot: Credential: Ptrace:false Setsid:true Setpgid:false Setctty:false Noctty:false Ctty:0 Foreground:false Pgid:0 Pdeathsig:killed Cloneflags:0 Unshareflags:0 UidMappings:[] GidMappings:[] GidMappingsEnableSetgroups:false AmbientCaps:[]} I1013 20:31:06.266597 59162 sandbox.go:744] Sandbox started, PID: 59222 I1013 20:31:06.431642 1 main.go:207] *************************** I1013 20:31:06.431732 1 main.go:208] Args: [runsc-gofer --root=/syzkaller/managers/ptrace-proxy-sandbox-race/latest.tmp/workdir/gvisor_root --debug=true --debug-log=/dev/stderr --panic-log=/syzkaller/managers/ptrace-proxy-sandbox-race/latest.tmp/workdir/instance-0/bundle/panic.fifo --file-access=shared --watchdog-action=panic --vfs2=true --TESTONLY-unsafe-nonroot=true --debug-log-fd=3 gofer --bundle /syzkaller/managers/ptrace-proxy-sandbox-race/latest.tmp/workdir/instance-0/bundle --spec-fd=4 --mounts-fd=5 --io-fds=6] I1013 20:31:06.431824 1 main.go:209] Version release-20200928.0-105-g51913ba400cc I1013 20:31:06.431870 1 main.go:210] PID: 1 I1013 20:31:06.431903 1 main.go:211] UID: 0, GID: 0 I1013 20:31:06.431958 1 main.go:212] Configuration: I1013 20:31:06.431986 1 main.go:213] RootDir: /syzkaller/managers/ptrace-proxy-sandbox-race/latest.tmp/workdir/gvisor_root I1013 20:31:06.432026 1 main.go:214] Platform: ptrace I1013 20:31:06.432066 1 main.go:215] FileAccess: 1, overlay: false I1013 20:31:06.432100 1 main.go:216] Network: 0, logging: false I1013 20:31:06.432146 1 main.go:217] Strace: false, max size: 1024, syscalls: I1013 20:31:06.432187 1 main.go:218] VFS2 enabled: true I1013 20:31:06.432233 1 main.go:219] *************************** W1013 20:31:06.432273 1 main.go:224] Block the TERM signal. This is only safe in tests! I1013 20:31:06.434950 59222 main.go:207] *************************** I1013 20:31:06.435036 59222 main.go:208] Args: [runsc-sandbox --root=/syzkaller/managers/ptrace-proxy-sandbox-race/latest.tmp/workdir/gvisor_root --debug=true --debug-log=/dev/stderr --panic-log=/syzkaller/managers/ptrace-proxy-sandbox-race/latest.tmp/workdir/instance-0/bundle/panic.fifo --file-access=shared --watchdog-action=panic --vfs2=true --TESTONLY-unsafe-nonroot=true --debug-log-fd=3 --panic-log-fd=4 boot --bundle=/syzkaller/managers/ptrace-proxy-sandbox-race/latest.tmp/workdir/instance-0/bundle --controller-fd=5 --mounts-fd=6 --spec-fd=7 --start-sync-fd=8 --io-fds=9 --stdio-fds=10 --stdio-fds=11 --stdio-fds=12 --attached ci-gvisor-ptrace-proxy-sandbox-race-test-2] I1013 20:31:06.435120 59222 main.go:209] Version release-20200928.0-105-g51913ba400cc I1013 20:31:06.435182 59222 main.go:210] PID: 59222 I1013 20:31:06.435235 59222 main.go:211] UID: 0, GID: 0 I1013 20:31:06.435270 59222 main.go:212] Configuration: I1013 20:31:06.435310 59222 main.go:213] RootDir: /syzkaller/managers/ptrace-proxy-sandbox-race/latest.tmp/workdir/gvisor_root I1013 20:31:06.435343 59222 main.go:214] Platform: ptrace I1013 20:31:06.435381 59222 main.go:215] FileAccess: 1, overlay: false I1013 20:31:06.435427 59222 main.go:216] Network: 0, logging: false I1013 20:31:06.435464 59222 main.go:217] Strace: false, max size: 1024, syscalls: I1013 20:31:06.435510 59222 main.go:218] VFS2 enabled: true I1013 20:31:06.435544 59222 main.go:219] *************************** W1013 20:31:06.435579 59222 main.go:224] Block the TERM signal. This is only safe in tests! W1013 20:31:06.436556 1 specutils.go:111] noNewPrivileges ignored. PR_SET_NO_NEW_PRIVS is assumed to always be set. I1013 20:31:06.436732 1 gofer.go:315] Create working directory "/tmp" if needed I1013 20:31:06.436893 1 gofer.go:325] Remounting root as readonly: "/syzkaller/managers/ptrace-proxy-sandbox-race/latest.tmp/workdir/instance-0/image" I1013 20:31:06.437324 1 capability.go:66] Capabilities applied: { effective="chown, dac_override, dac_read_search, fowner, fsetid, sys_chroot" permitted="chown, dac_override, dac_read_search, fowner, fsetid, sys_chroot" inheritable="empty" bounding="chown, dac_override, dac_read_search, fowner, fsetid, sys_chroot" } I1013 20:31:06.437408 1 cmd.go:73] Execve "/proc/self/exe" again, bye! W1013 20:31:06.439687 59222 specutils.go:111] noNewPrivileges ignored. PR_SET_NO_NEW_PRIVS is assumed to always be set. D1013 20:31:06.440390 59222 specutils.go:73] Spec: { "ociVersion": "", "process": { "user": { "uid": 0, "gid": 0 }, "args": [ "/init" ], "env": [ "SYZ_GVISOR_PROXY=1" ], "cwd": "/tmp" }, "root": { "path": "/syzkaller/managers/ptrace-proxy-sandbox-race/latest.tmp/workdir/instance-0/image", "readonly": true } } I1013 20:31:06.589470 1 main.go:207] *************************** I1013 20:31:06.589565 1 main.go:208] Args: [runsc-gofer --root=/syzkaller/managers/ptrace-proxy-sandbox-race/latest.tmp/workdir/gvisor_root --debug=true --debug-log=/dev/stderr --panic-log=/syzkaller/managers/ptrace-proxy-sandbox-race/latest.tmp/workdir/instance-0/bundle/panic.fifo --file-access=shared --watchdog-action=panic --vfs2=true --TESTONLY-unsafe-nonroot=true --debug-log-fd=3 gofer --bundle /syzkaller/managers/ptrace-proxy-sandbox-race/latest.tmp/workdir/instance-0/bundle --spec-fd=4 --mounts-fd=5 --io-fds=6 --apply-caps=false --setup-root=false] I1013 20:31:06.589663 1 main.go:209] Version release-20200928.0-105-g51913ba400cc I1013 20:31:06.589705 1 main.go:210] PID: 1 I1013 20:31:06.589745 1 main.go:211] UID: 0, GID: 0 I1013 20:31:06.589779 1 main.go:212] Configuration: I1013 20:31:06.589822 1 main.go:213] RootDir: /syzkaller/managers/ptrace-proxy-sandbox-race/latest.tmp/workdir/gvisor_root I1013 20:31:06.589970 1 main.go:214] Platform: ptrace I1013 20:31:06.590023 1 main.go:215] FileAccess: 1, overlay: false I1013 20:31:06.590082 1 main.go:216] Network: 0, logging: false I1013 20:31:06.590131 1 main.go:217] Strace: false, max size: 1024, syscalls: I1013 20:31:06.590169 1 main.go:218] VFS2 enabled: true I1013 20:31:06.590204 1 main.go:219] *************************** W1013 20:31:06.590238 1 main.go:224] Block the TERM signal. This is only safe in tests! W1013 20:31:06.595173 1 specutils.go:111] noNewPrivileges ignored. PR_SET_NO_NEW_PRIVS is assumed to always be set. D1013 20:31:06.595857 1 specutils.go:73] Spec: { "ociVersion": "", "process": { "user": { "uid": 0, "gid": 0 }, "args": [ "/init" ], "env": [ "SYZ_GVISOR_PROXY=1" ], "cwd": "/tmp" }, "root": { "path": "/syzkaller/managers/ptrace-proxy-sandbox-race/latest.tmp/workdir/instance-0/image", "readonly": true } } I1013 20:31:06.595959 1 gofer.go:164] Process chroot'd to "/syzkaller/managers/ptrace-proxy-sandbox-race/latest.tmp/workdir/instance-0/image" I1013 20:31:06.596017 1 gofer.go:175] Serving "/" mapped to "/syzkaller/managers/ptrace-proxy-sandbox-race/latest.tmp/workdir/instance-0/image" on FD 6 (ro: true) W1013 20:31:06.596089 1 extra_filters_race.go:28] *** SECCOMP WARNING: TSAN is enabled: syscall filters less restrictive! I1013 20:31:06.596170 1 seccomp.go:66] Installing seccomp filters for 63 syscalls (action=trap (0)) D1013 20:31:06.596345 1 seccomp.go:210] syscall filter read: [] => 0x616c6c6f77 D1013 20:31:06.596391 1 seccomp.go:210] syscall filter write: [] => 0x616c6c6f77 D1013 20:31:06.596427 1 seccomp.go:210] syscall filter open: [] => 0x616c6c6f77 D1013 20:31:06.596477 1 seccomp.go:210] syscall filter close: [] => 0x616c6c6f77 D1013 20:31:06.596525 1 seccomp.go:210] syscall filter fstat: [] => 0x616c6c6f77 D1013 20:31:06.596556 1 seccomp.go:210] syscall filter lseek: [] => 0x616c6c6f77 I1013 20:31:06.596556 59222 loader.go:495] Platform: ptrace D1013 20:31:06.596607 1 seccomp.go:210] syscall filter mmap: [( * * * == 0x1 ) ( * * * == 0x22 ) ( * * * == 0x32 ) ( )] => 0x616c6c6f77 D1013 20:31:06.596774 1 seccomp.go:210] syscall filter mprotect: [] => 0x616c6c6f77 D1013 20:31:06.596830 1 seccomp.go:210] syscall filter munmap: [] => 0x616c6c6f77 D1013 20:31:06.596903 1 seccomp.go:210] syscall filter brk: [] => 0x616c6c6f77 D1013 20:31:06.596939 1 seccomp.go:210] syscall filter rt_sigprocmask: [] => 0x616c6c6f77 D1013 20:31:06.596975 1 seccomp.go:210] syscall filter rt_sigreturn: [] => 0x616c6c6f77 D1013 20:31:06.597128 59222 seccomp.go:210] syscall filter mmap: [] => 0x616c6c6f77 D1013 20:31:06.597273 59222 seccomp.go:210] syscall filter munmap: [] => 0x616c6c6f77 D1013 20:31:06.597363 59222 seccomp.go:210] syscall filter getpid: [] => 0x616c6c6f77 D1013 20:31:06.597017 1 seccomp.go:210] syscall filter pread64: [] => 0x616c6c6f77 D1013 20:31:06.597524 1 seccomp.go:210] syscall filter pwrite64: [] => 0x616c6c6f77 D1013 20:31:06.597573 1 seccomp.go:210] syscall filter sched_yield: [] => 0x616c6c6f77 D1013 20:31:06.597465 59222 seccomp.go:210] syscall filter clone: [( == 0x409 ) ( == 0x12f00 )] => 0x616c6c6f77 D1013 20:31:06.597634 1 seccomp.go:210] syscall filter madvise: [( ) ( )] => 0x616c6c6f77 D1013 20:31:06.597700 1 seccomp.go:210] syscall filter dup: [] => 0x616c6c6f77 D1013 20:31:06.597688 59222 seccomp.go:210] syscall filter exit: [] => 0x616c6c6f77 D1013 20:31:06.597742 1 seccomp.go:210] syscall filter nanosleep: [( ) ( )] => 0x616c6c6f77 D1013 20:31:06.597762 59222 seccomp.go:210] syscall filter wait4: [] => 0x616c6c6f77 D1013 20:31:06.597787 1 seccomp.go:210] syscall filter getpid: [] => 0x616c6c6f77 D1013 20:31:06.597850 59222 seccomp.go:210] syscall filter kill: [( * == 0x13 )] => 0x616c6c6f77 D1013 20:31:06.597950 1 seccomp.go:210] syscall filter accept: [] => 0x616c6c6f77 D1013 20:31:06.597982 59222 seccomp.go:210] syscall filter gettimeofday: [] => 0x7472617020283029 D1013 20:31:06.598064 59222 seccomp.go:210] syscall filter getppid: [] => 0x616c6c6f77 D1013 20:31:06.598010 1 seccomp.go:210] syscall filter sendmsg: [( * * == 0x0 ) ( * * == 0x4040 )] => 0x616c6c6f77 D1013 20:31:06.598144 59222 seccomp.go:210] syscall filter prctl: [( == 0x1 == 0x9 )] => 0x616c6c6f77 D1013 20:31:06.598173 1 seccomp.go:210] syscall filter recvmsg: [( * * == 0x60 ) ( * * == 0x62 )] => 0x616c6c6f77 D1013 20:31:06.598319 1 seccomp.go:210] syscall filter shutdown: [( * == 0x2 )] => 0x616c6c6f77 D1013 20:31:06.598324 59222 seccomp.go:210] syscall filter arch_prctl: [( == 0x1012 == 0x0 )] => 0x616c6c6f77 D1013 20:31:06.598429 59222 seccomp.go:210] syscall filter time: [] => 0x7472617020283029 D1013 20:31:06.598428 1 seccomp.go:210] syscall filter socketpair: [( == 0x1 == 0x80005 == 0x0 )] => 0x616c6c6f77 D1013 20:31:06.598479 59222 seccomp.go:210] syscall filter getcpu: [] => 0x7472617020283029 D1013 20:31:06.598486 1 seccomp.go:210] syscall filter clone: [( == 0xd0f00 * == 0x0 == 0x0 * ) ( == 0x50f00 * == 0x0 == 0x0 * ) ( )] => 0x616c6c6f77 D1013 20:31:06.598650 1 seccomp.go:210] syscall filter exit: [] => 0x616c6c6f77 D1013 20:31:06.598684 1 seccomp.go:210] syscall filter fcntl: [( * == 0x3 ) ( * == 0x4 ) ( * == 0x1 ) ( * == 0x409 )] => 0x616c6c6f77 D1013 20:31:06.598849 1 seccomp.go:210] syscall filter fsync: [] => 0x616c6c6f77 D1013 20:31:06.598886 1 seccomp.go:210] syscall filter ftruncate: [] => 0x616c6c6f77 D1013 20:31:06.598926 1 seccomp.go:210] syscall filter fchmod: [] => 0x616c6c6f77 D1013 20:31:06.598968 1 seccomp.go:210] syscall filter gettimeofday: [] => 0x616c6c6f77 D1013 20:31:06.599009 1 seccomp.go:210] syscall filter sigaltstack: [] => 0x616c6c6f77 D1013 20:31:06.599050 1 seccomp.go:210] syscall filter fstatfs: [] => 0x616c6c6f77 D1013 20:31:06.599095 1 seccomp.go:210] syscall filter mlock: [( * == 0x1000 )] => 0x616c6c6f77 D1013 20:31:06.599186 1 seccomp.go:210] syscall filter munlock: [] => 0x616c6c6f77 D1013 20:31:06.599222 1 seccomp.go:210] syscall filter arch_prctl: [( == 0x1002 )] => 0x616c6c6f77 D1013 20:31:06.599288 1 seccomp.go:210] syscall filter gettid: [] => 0x616c6c6f77 D1013 20:31:06.599326 1 seccomp.go:210] syscall filter time: [] => 0x616c6c6f77 D1013 20:31:06.599363 1 seccomp.go:210] syscall filter futex: [( * == 0x80 * * == 0x0 ) ( * == 0x81 * * == 0x0 ) ( * == 0x0 * * ) ( * == 0x1 * * ) ( )] => 0x616c6c6f77 D1013 20:31:06.599583 1 seccomp.go:210] syscall filter getdents64: [] => 0x616c6c6f77 D1013 20:31:06.599630 1 seccomp.go:210] syscall filter restart_syscall: [] => 0x616c6c6f77 D1013 20:31:06.599663 1 seccomp.go:210] syscall filter clock_gettime: [] => 0x616c6c6f77 D1013 20:31:06.599708 1 seccomp.go:210] syscall filter exit_group: [] => 0x616c6c6f77 D1013 20:31:06.599759 1 seccomp.go:210] syscall filter epoll_ctl: [] => 0x616c6c6f77 D1013 20:31:06.599810 1 seccomp.go:210] syscall filter tgkill: [( == 0x1 )] => 0x616c6c6f77 D1013 20:31:06.599896 1 seccomp.go:210] syscall filter openat: [( ) ( )] => 0x616c6c6f77 D1013 20:31:06.599950 1 seccomp.go:210] syscall filter mkdirat: [] => 0x616c6c6f77 D1013 20:31:06.599986 1 seccomp.go:210] syscall filter mknodat: [] => 0x616c6c6f77 D1013 20:31:06.600023 1 seccomp.go:210] syscall filter fchownat: [] => 0x616c6c6f77 D1013 20:31:06.600073 1 seccomp.go:210] syscall filter newfstatat: [] => 0x616c6c6f77 D1013 20:31:06.600117 1 seccomp.go:210] syscall filter unlinkat: [] => 0x616c6c6f77 D1013 20:31:06.600170 1 seccomp.go:210] syscall filter renameat: [] => 0x616c6c6f77 D1013 20:31:06.600213 1 seccomp.go:210] syscall filter linkat: [] => 0x616c6c6f77 D1013 20:31:06.600247 1 seccomp.go:210] syscall filter symlinkat: [] => 0x616c6c6f77 D1013 20:31:06.600290 1 seccomp.go:210] syscall filter readlinkat: [] => 0x616c6c6f77 D1013 20:31:06.600326 1 seccomp.go:210] syscall filter ppoll: [] => 0x616c6c6f77 D1013 20:31:06.600367 1 seccomp.go:210] syscall filter set_robust_list: [] => 0x616c6c6f77 D1013 20:31:06.600401 1 seccomp.go:210] syscall filter utimensat: [] => 0x616c6c6f77 D1013 20:31:06.600456 1 seccomp.go:210] syscall filter epoll_pwait: [( * * * * == 0x0 )] => 0x616c6c6f77 D1013 20:31:06.600549 1 seccomp.go:210] syscall filter fallocate: [( * == 0x0 )] => 0x616c6c6f77 D1013 20:31:06.600638 1 seccomp.go:210] syscall filter eventfd2: [( == 0x0 == 0x0 )] => 0x616c6c6f77 D1013 20:31:06.600704 1 seccomp.go:210] syscall filter getrandom: [] => 0x616c6c6f77 D1013 20:31:06.600741 1 seccomp.go:210] syscall filter memfd_create: [] => 0x616c6c6f77 D1013 20:31:06.619252 1 seccomp.go:82] Seccomp program dump: 0: A <- P[4:4] 1: pc += (A == 3221225534) ? 1 [3] : 0 [2] 2: ret 196608 3: A <- P[0:4] 4: pc += (A == 131) ? 3 [8] : 0 [5] 5: pc += (A > 131) ? 0 [6] : 1 [7] 6: pc += 230 [237] 7: pc += 1 [9] 8: ret 2147418112 9: pc += (A == 28) ? 3 [13] : 0 [10] 10: pc += (A > 28) ? 0 [11] : 1 [12] 11: pc += 79 [91] 12: pc += 3 [16] 13: ret 2147418112 14: ret 2147418112 15: pc += 409 [425] 16: pc += (A == 10) ? 3 [20] : 0 [17] 17: pc += (A > 10) ? 0 [18] : 1 [19] 18: pc += 45 [64] 19: pc += 1 [21] 20: ret 2147418112 21: pc += (A == 3) ? 3 [25] : 0 [22] 22: pc += (A > 3) ? 0 [23] : 1 [24] 23: pc += 13 [37] 24: pc += 1 [26] 25: ret 2147418112 26: pc += (A == 1) ? 3 [30] : 0 [27] 27: pc += (A > 1) ? 0 [28] : 1 [29] 28: pc += 5 [34] 29: pc += 1 [31] 30: ret 2147418112 31: pc += (A == 0) ? 1 [33] : 0 [32] 32: pc += 392 [425] 33: ret 2147418112 34: pc += (A == 2) ? 1 [36] : 0 [35] 35: pc += 389 [425] 36: ret 2147418112 37: pc += (A == 8) ? 3 [41] : 0 [38] 38: pc += (A > 8) ? 0 [39] : 1 [40] 39: pc += 5 [45] 40: pc += 1 [42] 41: ret 2147418112 42: pc += (A == 5) ? 1 [44] : 0 [43] 43: pc += 381 [425] 44: ret 2147418112 45: pc += (A == 9) ? 1 [47] : 0 [46] 46: pc += 378 [425] 47: A <- P[40:4] 48: pc += (A == 1) ? 0 [49] : 3 [52] 49: A <- P[44:4] 50: pc += (A == 0) ? 0 [51] : 1 [52] 51: ret 2147418112 52: A <- P[40:4] 53: pc += (A == 34) ? 0 [54] : 3 [57] 54: A <- P[44:4] 55: pc += (A == 0) ? 0 [56] : 1 [57] 56: ret 2147418112 57: A <- P[40:4] 58: pc += (A == 50) ? 0 [59] : 3 [62] 59: A <- P[44:4] 60: pc += (A == 0) ? 0 [61] : 1 [62] 61: ret 2147418112 62: ret 2147418112 63: pc += 361 [425] 64: pc += (A == 15) ? 3 [68] : 0 [65] 65: pc += (A > 15) ? 0 [66] : 1 [67] 66: pc += 13 [80] 67: pc += 1 [69] 68: ret 2147418112 69: pc += (A == 12) ? 3 [73] : 0 [70] 70: pc += (A > 12) ? 0 [71] : 1 [72] 71: pc += 5 [77] 72: pc += 1 [74] 73: ret 2147418112 74: pc += (A == 11) ? 1 [76] : 0 [75] 75: pc += 349 [425] 76: ret 2147418112 77: pc += (A == 14) ? 1 [79] : 0 [78] 78: pc += 346 [425] 79: ret 2147418112 80: pc += (A == 18) ? 3 [84] : 0 [81] 81: pc += (A > 18) ? 0 [82] : 1 [83] 82: pc += 5 [88] 83: pc += 1 [85] 84: ret 2147418112 85: pc += (A == 17) ? 1 [87] : 0 [86] 86: pc += 338 [425] 87: ret 2147418112 88: pc += (A == 24) ? 1 [90] : 0 [89] 89: pc += 335 [425] 90: ret 2147418112 91: pc += (A == 53) ? 3 [95] : 0 [92] 92: pc += (A > 53) ? 0 [93] : 1 [94] 93: pc += 69 [163] 94: pc += 14 [109] 95: A <- P[16:4] 96: pc += (A == 1) ? 0 [97] : 11 [108] 97: A <- P[20:4] 98: pc += (A == 0) ? 0 [99] : 9 [108] 99: A <- P[24:4] 100: pc += (A == 524293) ? 0 [101] : 7 [108] 101: A <- P[28:4] 102: pc += (A == 0) ? 0 [103] : 5 [108] 103: A <- P[32:4] 104: pc += (A == 0) ? 0 [105] : 3 [108] 105: A <- P[36:4] 106: pc += (A == 0) ? 0 [107] : 1 [108] 107: ret 2147418112 108: pc += 316 [425] 109: pc += (A == 43) ? 3 [113] : 0 [110] 110: pc += (A > 43) ? 0 [111] : 1 [112] 111: pc += 15 [127] 112: pc += 1 [114] 113: ret 2147418112 114: pc += (A == 35) ? 3 [118] : 0 [115] 115: pc += (A > 35) ? 0 [116] : 1 [117] 116: pc += 7 [124] 117: pc += 3 [121] 118: ret 2147418112 119: ret 2147418112 120: pc += 304 [425] 121: pc += (A == 32) ? 1 [123] : 0 [122] 122: pc += 302 [425] 123: ret 2147418112 124: pc += (A == 39) ? 1 [126] : 0 [125] 125: pc += 299 [425] 126: ret 2147418112 127: pc += (A == 47) ? 3 [131] : 0 [128] 128: pc += (A > 47) ? 0 [129] : 1 [130] 129: pc += 25 [155] 130: pc += 11 [142] 131: A <- P[32:4] 132: pc += (A == 96) ? 0 [133] : 3 [136] 133: A <- P[36:4] 134: pc += (A == 0) ? 0 [135] : 1 [136] 135: ret 2147418112 136: A <- P[32:4] 137: pc += (A == 98) ? 0 [138] : 3 [141] 138: A <- P[36:4] 139: pc += (A == 0) ? 0 [140] : 1 [141] 140: ret 2147418112 141: pc += 283 [425] 142: pc += (A == 46) ? 1 [144] : 0 [143] 143: pc += 281 [425] 144: A <- P[32:4] 145: pc += (A == 0) ? 0 [146] : 3 [149] 146: A <- P[36:4] 147: pc += (A == 0) ? 0 [148] : 1 [149] 148: ret 2147418112 149: A <- P[32:4] 150: pc += (A == 16448) ? 0 [151] : 3 [154] 151: A <- P[36:4] 152: pc += (A == 0) ? 0 [153] : 1 [154] 153: ret 2147418112 154: pc += 270 [425] 155: pc += (A == 48) ? 1 [157] : 0 [156] 156: pc += 268 [425] 157: A <- P[24:4] 158: pc += (A == 2) ? 0 [159] : 3 [162] 159: A <- P[28:4] 160: pc += (A == 0) ? 0 [161] : 1 [162] 161: ret 2147418112 162: pc += 262 [425] 163: pc += (A == 74) ? 3 [167] : 0 [164] 164: pc += (A > 74) ? 0 [165] : 1 [166] 165: pc += 60 [226] 166: pc += 1 [168] 167: ret 2147418112 168: pc += (A == 60) ? 3 [172] : 0 [169] 169: pc += (A > 60) ? 0 [170] : 1 [171] 170: pc += 32 [203] 171: pc += 1 [173] 172: ret 2147418112 173: pc += (A == 56) ? 1 [175] : 0 [174] 174: pc += 250 [425] 175: A <- P[16:4] 176: pc += (A == 855808) ? 0 [177] : 11 [188] 177: A <- P[20:4] 178: pc += (A == 0) ? 0 [179] : 9 [188] 179: A <- P[32:4] 180: pc += (A == 0) ? 0 [181] : 7 [188] 181: A <- P[36:4] 182: pc += (A == 0) ? 0 [183] : 5 [188] 183: A <- P[40:4] 184: pc += (A == 0) ? 0 [185] : 3 [188] 185: A <- P[44:4] 186: pc += (A == 0) ? 0 [187] : 1 [188] 187: ret 2147418112 188: A <- P[16:4] 189: pc += (A == 331520) ? 0 [190] : 11 [201] 190: A <- P[20:4] 191: pc += (A == 0) ? 0 [192] : 9 [201] 192: A <- P[32:4] 193: pc += (A == 0) ? 0 [194] : 7 [201] 194: A <- P[36:4] 195: pc += (A == 0) ? 0 [196] : 5 [201] 196: A <- P[40:4] 197: pc += (A == 0) ? 0 [198] : 3 [201] 198: A <- P[44:4] 199: pc += (A == 0) ? 0 [200] : 1 [201] 200: ret 2147418112 201: ret 2147418112 202: pc += 222 [425] 203: pc += (A == 72) ? 1 [205] : 0 [204] 204: pc += 220 [425] 205: A <- P[24:4] 206: pc += (A == 3) ? 0 [207] : 3 [210] 207: A <- P[28:4] 208: pc += (A == 0) ? 0 [209] : 1 [210] 209: ret 2147418112 210: A <- P[24:4] 211: pc += (A == 4) ? 0 [212] : 3 [215] 212: A <- P[28:4] 213: pc += (A == 0) ? 0 [214] : 1 [215] 214: ret 2147418112 215: A <- P[24:4] 216: pc += (A == 1) ? 0 [217] : 3 [220] 217: A <- P[28:4] 218: pc += (A == 0) ? 0 [219] : 1 [220] 219: ret 2147418112 220: A <- P[24:4] 221: pc += (A == 1033) ? 0 [222] : 3 [225] 222: A <- P[28:4] 223: pc += (A == 0) ? 0 [224] : 1 [225] 224: ret 2147418112 225: pc += 199 [425] 226: pc += (A == 91) ? 3 [230] : 0 [227] 227: pc += (A > 91) ? 0 [228] : 1 [229] 228: pc += 5 [234] 229: pc += 1 [231] 230: ret 2147418112 231: pc += (A == 77) ? 1 [233] : 0 [232] 232: pc += 192 [425] 233: ret 2147418112 234: pc += (A == 96) ? 1 [236] : 0 [235] 235: pc += 189 [425] 236: ret 2147418112 237: pc += (A == 259) ? 3 [241] : 0 [238] 238: pc += (A > 259) ? 0 [239] : 1 [240] 239: pc += 107 [347] 240: pc += 1 [242] 241: ret 2147418112 242: pc += (A == 217) ? 3 [246] : 0 [243] 243: pc += (A > 217) ? 0 [244] : 1 [245] 244: pc += 68 [313] 245: pc += 1 [247] 246: ret 2147418112 247: pc += (A == 158) ? 3 [251] : 0 [248] 248: pc += (A > 158) ? 0 [249] : 1 [250] 249: pc += 23 [273] 250: pc += 6 [257] 251: A <- P[16:4] 252: pc += (A == 4098) ? 0 [253] : 3 [256] 253: A <- P[20:4] 254: pc += (A == 0) ? 0 [255] : 1 [256] 255: ret 2147418112 256: pc += 168 [425] 257: pc += (A == 149) ? 3 [261] : 0 [258] 258: pc += (A > 149) ? 0 [259] : 1 [260] 259: pc += 10 [270] 260: pc += 6 [267] 261: A <- P[24:4] 262: pc += (A == 4096) ? 0 [263] : 3 [266] 263: A <- P[28:4] 264: pc += (A == 0) ? 0 [265] : 1 [266] 265: ret 2147418112 266: pc += 158 [425] 267: pc += (A == 138) ? 1 [269] : 0 [268] 268: pc += 156 [425] 269: ret 2147418112 270: pc += (A == 150) ? 1 [272] : 0 [271] 271: pc += 153 [425] 272: ret 2147418112 273: pc += (A == 201) ? 3 [277] : 0 [274] 274: pc += (A > 201) ? 0 [275] : 1 [276] 275: pc += 5 [281] 276: pc += 1 [278] 277: ret 2147418112 278: pc += (A == 186) ? 1 [280] : 0 [279] 279: pc += 145 [425] 280: ret 2147418112 281: pc += (A == 202) ? 1 [283] : 0 [282] 282: pc += 142 [425] 283: A <- P[24:4] 284: pc += (A == 128) ? 0 [285] : 7 [292] 285: A <- P[28:4] 286: pc += (A == 0) ? 0 [287] : 5 [292] 287: A <- P[48:4] 288: pc += (A == 0) ? 0 [289] : 3 [292] 289: A <- P[52:4] 290: pc += (A == 0) ? 0 [291] : 1 [292] 291: ret 2147418112 292: A <- P[24:4] 293: pc += (A == 129) ? 0 [294] : 7 [301] 294: A <- P[28:4] 295: pc += (A == 0) ? 0 [296] : 5 [301] 296: A <- P[48:4] 297: pc += (A == 0) ? 0 [298] : 3 [301] 298: A <- P[52:4] 299: pc += (A == 0) ? 0 [300] : 1 [301] 300: ret 2147418112 301: A <- P[24:4] 302: pc += (A == 0) ? 0 [303] : 3 [306] 303: A <- P[28:4] 304: pc += (A == 0) ? 0 [305] : 1 [306] 305: ret 2147418112 306: A <- P[24:4] 307: pc += (A == 1) ? 0 [308] : 3 [311] 308: A <- P[28:4] 309: pc += (A == 0) ? 0 [310] : 1 [311] 310: ret 2147418112 311: ret 2147418112 312: pc += 112 [425] 313: pc += (A == 233) ? 3 [317] : 0 [314] 314: pc += (A > 233) ? 0 [315] : 1 [316] 315: pc += 13 [329] 316: pc += 1 [318] 317: ret 2147418112 318: pc += (A == 228) ? 3 [322] : 0 [319] 319: pc += (A > 228) ? 0 [320] : 1 [321] 320: pc += 5 [326] 321: pc += 1 [323] 322: ret 2147418112 323: pc += (A == 219) ? 1 [325] : 0 [324] 324: pc += 100 [425] 325: ret 2147418112 326: pc += (A == 231) ? 1 [328] : 0 [327] 327: pc += 97 [425] 328: ret 2147418112 329: pc += (A == 257) ? 3 [333] : 0 [330] 330: pc += (A > 257) ? 0 [331] : 1 [332] 331: pc += 12 [344] 332: pc += 3 [336] 333: ret 2147418112 334: ret 2147418112 335: pc += 89 [425] 336: pc += (A == 234) ? 1 [338] : 0 [337] 337: pc += 87 [425] 338: A <- P[16:4] 339: pc += (A == 1) ? 0 [340] : 3 [343] 340: A <- P[20:4] 341: pc += (A == 0) ? 0 [342] : 1 [343] 342: ret 2147418112 343: pc += 81 [425] 344: pc += (A == 258) ? 1 [346] : 0 [345] 345: pc += 79 [425] 346: ret 2147418112 347: pc += (A == 271) ? 3 [351] : 0 [348] 348: pc += (A > 271) ? 0 [349] : 1 [350] 349: pc += 29 [379] 350: pc += 1 [352] 351: ret 2147418112 352: pc += (A == 264) ? 3 [356] : 0 [353] 353: pc += (A > 264) ? 0 [354] : 1 [355] 354: pc += 13 [368] 355: pc += 1 [357] 356: ret 2147418112 357: pc += (A == 262) ? 3 [361] : 0 [358] 358: pc += (A > 262) ? 0 [359] : 1 [360] 359: pc += 5 [365] 360: pc += 1 [362] 361: ret 2147418112 362: pc += (A == 260) ? 1 [364] : 0 [363] 363: pc += 61 [425] 364: ret 2147418112 365: pc += (A == 263) ? 1 [367] : 0 [366] 366: pc += 58 [425] 367: ret 2147418112 368: pc += (A == 266) ? 3 [372] : 0 [369] 369: pc += (A > 266) ? 0 [370] : 1 [371] 370: pc += 5 [376] 371: pc += 1 [373] 372: ret 2147418112 373: pc += (A == 265) ? 1 [375] : 0 [374] 374: pc += 50 [425] 375: ret 2147418112 376: pc += (A == 267) ? 1 [378] : 0 [377] 377: pc += 47 [425] 378: ret 2147418112 379: pc += (A == 285) ? 3 [383] : 0 [380] 380: pc += (A > 285) ? 0 [381] : 1 [382] 381: pc += 23 [405] 382: pc += 6 [389] 383: A <- P[24:4] 384: pc += (A == 0) ? 0 [385] : 3 [388] 385: A <- P[28:4] 386: pc += (A == 0) ? 0 [387] : 1 [388] 387: ret 2147418112 388: pc += 36 [425] 389: pc += (A == 280) ? 3 [393] : 0 [390] 390: pc += (A > 280) ? 0 [391] : 1 [392] 391: pc += 5 [397] 392: pc += 1 [394] 393: ret 2147418112 394: pc += (A == 273) ? 1 [396] : 0 [395] 395: pc += 29 [425] 396: ret 2147418112 397: pc += (A == 281) ? 1 [399] : 0 [398] 398: pc += 26 [425] 399: A <- P[48:4] 400: pc += (A == 0) ? 0 [401] : 3 [404] 401: A <- P[52:4] 402: pc += (A == 0) ? 0 [403] : 1 [404] 403: ret 2147418112 404: pc += 20 [425] 405: pc += (A == 318) ? 3 [409] : 0 [406] 406: pc += (A > 318) ? 0 [407] : 1 [408] 407: pc += 14 [422] 408: pc += 1 [410] 409: ret 2147418112 410: pc += (A == 290) ? 1 [412] : 0 [411] 411: pc += 13 [425] 412: A <- P[16:4] 413: pc += (A == 0) ? 0 [414] : 7 [421] 414: A <- P[20:4] 415: pc += (A == 0) ? 0 [416] : 5 [421] 416: A <- P[24:4] 417: pc += (A == 0) ? 0 [418] : 3 [421] 418: A <- P[28:4] 419: pc += (A == 0) ? 0 [420] : 1 [421] 420: ret 2147418112 421: pc += 3 [425] 422: pc += (A == 319) ? 1 [424] : 0 [423] 423: pc += 1 [425] 424: ret 2147418112 425: ret 196608 I1013 20:31:06.624911 59222 subprocess_linux.go:52] Latest seccomp behavior found (kernel >= 4.8 likely) I1013 20:31:06.624993 1 seccomp.go:98] Seccomp filters installed. D1013 20:31:06.625209 59222 seccomp.go:210] syscall filter mmap: [] => 0x616c6c6f77 D1013 20:31:06.625318 59222 seccomp.go:210] syscall filter munmap: [] => 0x616c6c6f77 D1013 20:31:06.625391 59222 seccomp.go:210] syscall filter getpid: [] => 0x616c6c6f77 D1013 20:31:06.625475 59222 seccomp.go:210] syscall filter clone: [( == 0x409 ) ( == 0x12f00 )] => 0x616c6c6f77 D1013 20:31:06.625743 59222 seccomp.go:210] syscall filter exit: [] => 0x616c6c6f77 D1013 20:31:06.625813 59222 seccomp.go:210] syscall filter wait4: [] => 0x616c6c6f77 D1013 20:31:06.625903 59222 seccomp.go:210] syscall filter kill: [( * == 0x13 )] => 0x616c6c6f77 D1013 20:31:06.626062 59222 seccomp.go:210] syscall filter gettimeofday: [] => 0x7472617020283029 D1013 20:31:06.626180 59222 seccomp.go:210] syscall filter getppid: [] => 0x616c6c6f77 D1013 20:31:06.626283 59222 seccomp.go:210] syscall filter prctl: [( == 0x1 == 0x9 )] => 0x616c6c6f77 D1013 20:31:06.626478 59222 seccomp.go:210] syscall filter arch_prctl: [( == 0x1012 == 0x0 )] => 0x616c6c6f77 D1013 20:31:06.626649 59222 seccomp.go:210] syscall filter time: [] => 0x7472617020283029 D1013 20:31:06.626724 59222 seccomp.go:210] syscall filter getcpu: [] => 0x7472617020283029 ================== WARNING: DATA RACE Write at 0x00000275a7e4 by goroutine 78: gvisor.dev/gvisor/pkg/tcpip/transport/tcp.(*processor).start() pkg/tcpip/transport/tcp/dispatcher.go:103 +0x4f Previous write at 0x00000275a7e4 by goroutine 77: gvisor.dev/gvisor/pkg/tcpip/transport/tcp.(*processor).start() pkg/tcpip/transport/tcp/dispatcher.go:103 +0x4f Goroutine 78 (running) created at: gvisor.dev/gvisor/pkg/tcpip/transport/tcp.(*dispatcher).init() pkg/tcpip/transport/tcp/dispatcher.go:191 +0x1e3 gvisor.dev/gvisor/pkg/tcpip/transport/tcp.NewProtocol() pkg/tcpip/transport/tcp/protocol.go:632 +0x1b7 gvisor.dev/gvisor/pkg/tcpip/stack.New() pkg/tcpip/stack/stack.go:700 +0xed3 gvisor.dev/gvisor/runsc/boot.newEmptySandboxNetworkStack() runsc/boot/loader.go:1072 +0x2eb gvisor.dev/gvisor/runsc/boot.newRootNetworkNamespace() runsc/boot/loader.go:1053 +0xab gvisor.dev/gvisor/runsc/boot.New() runsc/boot/loader.go:256 +0xe65 gvisor.dev/gvisor/runsc/cmd.(*Boot).Execute() runsc/cmd/boot.go:232 +0x7ec github.com/google/subcommands.(*Commander).Execute() external/com_github_google_subcommands/subcommands.go:200 +0x51c github.com/google/subcommands.Execute() external/com_github_google_subcommands/subcommands.go:481 +0x1d23 main.main() runsc/main.go:230 +0x1c42 Goroutine 77 (running) created at: gvisor.dev/gvisor/pkg/tcpip/transport/tcp.(*dispatcher).init() pkg/tcpip/transport/tcp/dispatcher.go:191 +0x1e3 gvisor.dev/gvisor/pkg/tcpip/transport/tcp.NewProtocol() pkg/tcpip/transport/tcp/protocol.go:632 +0x1b7 gvisor.dev/gvisor/pkg/tcpip/stack.New() pkg/tcpip/stack/stack.go:700 +0xed3 gvisor.dev/gvisor/runsc/boot.newEmptySandboxNetworkStack() runsc/boot/loader.go:1072 +0x2eb gvisor.dev/gvisor/runsc/boot.newRootNetworkNamespace() runsc/boot/loader.go:1053 +0xab gvisor.dev/gvisor/runsc/boot.New() runsc/boot/loader.go:256 +0xe65 gvisor.dev/gvisor/runsc/cmd.(*Boot).Execute() runsc/cmd/boot.go:232 +0x7ec github.com/google/subcommands.(*Commander).Execute() external/com_github_google_subcommands/subcommands.go:200 +0x51c github.com/google/subcommands.Execute() external/com_github_google_subcommands/subcommands.go:481 +0x1d23 main.main() runsc/main.go:230 +0x1c42 ================== D1013 20:31:06.826074 1 server.go:630] p9.recv: EOF D1013 20:31:06.826193 59162 sandbox.go:826] Destroy sandbox "ci-gvisor-ptrace-proxy-sandbox-race-test-2" D1013 20:31:06.826258 59162 sandbox.go:828] Killing sandbox "ci-gvisor-ptrace-proxy-sandbox-race-test-2" I1013 20:31:06.826313 1 gofer.go:231] All 9P servers exited. I1013 20:31:06.826378 1 main.go:232] Exiting with status: 0 W1013 20:31:06.838360 59162 sandbox.go:129] error destroying sandbox: D1013 20:31:06.838533 59162 container.go:711] Destroy container "ci-gvisor-ptrace-proxy-sandbox-race-test-2" D1013 20:31:06.838679 59162 container.go:812] Killing gofer for container "ci-gvisor-ptrace-proxy-sandbox-race-test-2", PID: 59216 W1013 20:31:07.049363 59162 error.go:48] FATAL ERROR: running container: creating container: waiting for sandbox to start: EOF running container: creating container: waiting for sandbox to start: EOF