plan9-amd64-0intro at b158ca9ae35fd98e383411633469819fdbc65eca :: Running /tmp/workdir-gnot/go/src/make.rc with args ["/tmp/workdir-gnot/go/src/make.rc" "-force"] and env ["home=/usr/glenda" "path=.\x00/bin" "*=" "type=host-plan9-amd64-0intro" "rcname=gobuildlet" "pid=258" "fn#term%=fn term% {$*}\n" "fn#newworkdir=fn newworkdir {if(test -d $workdir){for(i in `{du -a $workdir|awk '{print $2}'})chmod u+w $i;rm -rf $workdir};mkdir $workdir}\n" "status=" "fn#cd=fn cd {builtin cd $* && awd}\n" "GO_TEST_TIMEOUT_SCALE=2" "workdir=/tmp/workdir-gnot" "objtype=amd64" "fn#sigexit=" "cflag=" "0=/bin/gobuildlet" "WORKDIR=/tmp/workdir-gnot" "GOROOT_BOOTSTRAP=/tmp/workdir-gnot/go1.4" "GO_BUILDER_NAME=plan9-amd64-0intro" "GOBIN=" "PWD=/tmp/workdir-gnot/go/src"] in dir /tmp/workdir-gnot/go/src Building Go cmd/dist using /tmp/workdir-gnot/go1.4. (go1.20.6 plan9/amd64) Building Go toolchain1 using /tmp/workdir-gnot/go1.4. Building Go bootstrap cmd/go (go_bootstrap) using Go toolchain1. Building Go toolchain2 using go_bootstrap and Go toolchain1. Building Go toolchain3 using go_bootstrap and Go toolchain2. Building packages and commands for plan9/amd64. --- Installed Go for plan9/amd64 in /tmp/workdir-gnot/go Installed commands in /tmp/workdir-gnot/go/bin *** You need to bind /tmp/workdir-gnot/go/bin before /bin. ##### Test execution environment. # GOARCH: amd64 # CPU: Intel Core Processor (Broadwell) # GOOS: plan9 # OS Version: 2000 ##### Testing packages. ok archive/tar 0.216s ok archive/zip 0.338s ok bufio 0.114s ok bytes 0.191s ok cmp 0.083s ok compress/bzip2 0.119s ok compress/flate 0.566s ok compress/gzip 2.675s ok compress/lzw 0.130s ok compress/zlib 0.322s ok container/heap 0.083s ok container/list 0.084s ok container/ring 0.084s ok context 0.285s ok crypto 0.093s ok crypto/aes 0.097s ok crypto/cipher 1.207s ok crypto/des 0.091s ok crypto/dsa 0.567s ok crypto/ecdh 0.253s ok crypto/ecdsa 0.392s ok crypto/ed25519 0.512s ok crypto/elliptic 0.206s ok crypto/hmac 0.083s ok crypto/internal/alias 0.081s ok crypto/internal/bigmod 0.126s ok crypto/internal/boring 0.093s ok crypto/internal/boring/bcache 0.232s ok crypto/internal/edwards25519 0.140s ok crypto/internal/edwards25519/field 0.140s ok crypto/internal/nistec 0.169s ok crypto/internal/nistec/fiat 0.080s [no tests to run] ok crypto/md5 0.121s ok crypto/rand 0.391s ok crypto/rc4 0.095s ok crypto/rsa 0.726s ok crypto/sha1 0.488s ok crypto/sha256 0.219s ok crypto/sha512 0.274s ok crypto/subtle 0.541s ok crypto/tls 21.690s ok crypto/x509 0.966s ok database/sql 0.865s ok database/sql/driver 0.083s ok debug/buildinfo 0.087s ok debug/dwarf 0.145s ok debug/elf 0.233s ok debug/gosym 0.195s ok debug/macho 0.107s ok debug/pe 0.215s ok debug/plan9obj 0.082s ok embed 0.801s [no tests to run] ok embed/internal/embedtest 0.084s ok encoding/ascii85 0.083s ok encoding/asn1 0.086s ok encoding/base32 0.090s ok encoding/base64 0.085s ok encoding/binary 0.087s ok encoding/csv 0.089s ok encoding/gob 2.224s ok encoding/hex 0.090s ok encoding/json 0.329s ok encoding/pem 0.313s ok encoding/xml 0.124s ok errors 0.085s ok expvar 0.085s ok flag 0.519s ok fmt 0.122s ok go/ast 0.106s ok go/build 2.379s ok go/build/constraint 0.085s ok go/constant 0.087s ok go/doc 0.152s ok go/doc/comment 1.775s ok go/format 0.089s ok go/importer 1.502s ok go/internal/gccgoimporter 0.100s ok go/internal/gcimporter 10.205s ok go/internal/srcimporter 3.381s ok go/parser 0.193s ok go/printer 0.224s ok go/scanner 0.084s ok go/token 0.094s ok go/types 37.856s ok go/version 0.084s ok hash 0.085s ok hash/adler32 0.085s ok hash/crc32 0.088s ok hash/crc64 0.084s ok hash/fnv 0.084s ok hash/maphash 0.123s ok html 0.085s ok html/template 0.146s ok image 0.121s ok image/color 0.093s ok image/draw 0.130s ok image/gif 0.196s ok image/jpeg 0.195s ok image/png 0.272s ok index/suffixarray 0.190s ok internal/abi 1.023s ok internal/buildcfg 0.082s ok internal/chacha8rand 0.092s ok internal/coverage/cformat 0.083s ok internal/coverage/cmerge 0.083s ok internal/coverage/pods 0.091s ok internal/coverage/slicereader 0.083s ok internal/coverage/slicewriter 0.083s ok internal/coverage/test 0.095s ok internal/cpu 0.094s ok internal/dag 0.097s ok internal/diff 0.088s ok internal/fmtsort 0.082s ok internal/fuzz 0.093s ok internal/godebug 4.331s ok internal/godebugs 0.085s ok internal/gover 0.083s ok internal/intern 0.135s ok internal/itoa 0.085s ok internal/platform 2.634s ok internal/poll 0.113s ok internal/profile 0.082s ok internal/reflectlite 0.092s ok internal/safefilepath 0.083s ok internal/saferio 0.103s ok internal/singleflight 0.104s ok internal/testenv 1.038s ok internal/trace 0.153s --- FAIL: TestTraceAnnotationsStress (1.26s) --- FAIL: TestTraceAnnotationsStress/Default (1.26s) trace_test.go:560: stderr: fatal error: unexpected signal during runtime execution [signal sys: trap: code=0x0 addr=0x0 pc=0x25528a] runtime stack: runtime.throw({0x2b076a?, 0x466ac0?}) /tmp/workdir-gnot/go/src/runtime/panic.go:1011 +0x65 fp=0x7fffffffe928 sp=0x7fffffffe8f8 pc=0x232ba5 runtime.sigpanic() /tmp/workdir-gnot/go/src/runtime/os_plan9.go:75 +0x4a5 fp=0x7fffffffe9a8 sp=0x7fffffffe928 pc=0x22fac5 runtime.fpTracebackPCs(...) /tmp/workdir-gnot/go/src/runtime/trace2stack.go:219 pc=0x25528b runtime.traceStack(0x409ce0?, 0x10?, 0x1) /tmp/workdir-gnot/go/src/runtime/trace2stack.go:70 +0x8f fp=0x7fffffffedf0 sp=0x7fffffffe9a8 pc=0x25514f runtime.traceLocker.stack(...) /tmp/workdir-gnot/go/src/runtime/trace2event.go:166 pc=0x25473b runtime.traceLocker.GoPark({0x409ce0?, 0x400000002?}, 0xe, 0x1) /tmp/workdir-gnot/go/src/runtime/trace2runtime.go:438 +0x20 fp=0x7fffffffee80 sp=0x7fffffffedf0 pc=0x2546c0 runtime.park_m(0x48007a40) /tmp/workdir-gnot/go/src/runtime/proc.go:4017 +0x85 fp=0x7fffffffeed8 sp=0x7fffffffee80 pc=0x23c6e5 runtime.mcall() /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:458 +0x53 fp=0x7fffffffeef0 sp=0x7fffffffeed8 pc=0x260f93 goroutine 11 gp=0x48007a40 m=0 mp=0x409ce0 [sleep]: runtime.gopark(0x4808edb0?, 0x17b2422f5647c66e?, 0x0?, 0xd4?, 0x6?) /tmp/workdir-gnot/go/src/runtime/proc.go:402 +0xce fp=0x4808ed90 sp=0x4808ed70 pc=0x2356ae time.Sleep(0x989680) /tmp/workdir-gnot/go/src/runtime/time.go:195 +0x131 fp=0x4808edd8 sp=0x4808ed90 pc=0x25f791 main.do({0x2cd538, 0x48082150}, 0x0) /tmp/workdir-gnot/go/src/internal/trace/v2/testdata/testprog/annotations-stress.go:83 +0x145 fp=0x4808ee68 sp=0x4808edd8 pc=0x28db45 main.do.func1.1.1() /tmp/workdir-gnot/go/src/internal/trace/v2/testdata/testprog/annotations-stress.go:73 +0xa8 fp=0x4808eee8 sp=0x4808ee68 pc=0x28dec8 runtime/trace.WithRegion({0x2cd538?, 0x48082150?}, {0x4801c390, 0x7}, 0x4808ef88) /tmp/workdir-gnot/go/src/runtime/trace/annotation.go:141 +0xf5 fp=0x4808ef50 sp=0x4808eee8 pc=0x28d395 main.do.func1.1(0x2) /tmp/workdir-gnot/go/src/internal/trace/v2/testdata/testprog/annotations-stress.go:70 +0xdb fp=0x4808efc8 sp=0x4808ef50 pc=0x28ddfb main.do.func1.gowrap1() /tmp/workdir-gnot/go/src/internal/trace/v2/testdata/testprog/annotations-stress.go:77 +0x24 fp=0x4808efe0 sp=0x4808efc8 pc=0x28dce4 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x4808efe8 sp=0x4808efe0 pc=0x262e81 created by main.do.func1 in goroutine 1 /tmp/workdir-gnot/go/src/internal/trace/v2/testdata/testprog/annotations-stress.go:69 +0x45 goroutine 1 gp=0x480061c0 m=nil [sleep]: runtime.gopark(0x48054de0?, 0x17b2422f56444df0?, 0x0?, 0xd4?, 0x5?) /tmp/workdir-gnot/go/src/runtime/proc.go:402 +0xce fp=0x48054dc0 sp=0x48054da0 pc=0x2356ae time.Sleep(0x989680) /tmp/workdir-gnot/go/src/runtime/time.go:195 +0x131 fp=0x48054e08 sp=0x48054dc0 pc=0x25f791 main.do({0x2cd500, 0x466be0}, 0x4) /tmp/workdir-gnot/go/src/internal/trace/v2/testdata/testprog/annotations-stress.go:83 +0x145 fp=0x48054e98 sp=0x48054e08 pc=0x28db45 main.main() /tmp/workdir-gnot/go/src/internal/trace/v2/testdata/testprog/annotations-stress.go:43 +0x166 fp=0x48054f48 sp=0x48054e98 pc=0x28d946 runtime.main() /tmp/workdir-gnot/go/src/runtime/proc.go:271 +0x2cb fp=0x48054fe0 sp=0x48054f48 pc=0x23526b runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x48054fe8 sp=0x48054fe0 pc=0x262e81 goroutine 2 gp=0x48006700 m=nil [force gc (idle)]: runtime.gopark(0x0?, 0x0?, 0x0?, 0x0?, 0x0?) /tmp/workdir-gnot/go/src/runtime/proc.go:402 +0xce fp=0x48055fa0 sp=0x48055f80 pc=0x2356ae runtime.goparkunlock(...) /tmp/workdir-gnot/go/src/runtime/proc.go:408 pc=0x235507 runtime.forcegchelper() /tmp/workdir-gnot/go/src/runtime/proc.go:326 +0x85 fp=0x48055fe0 sp=0x48055fa0 pc=0x2354e5 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x48055fe8 sp=0x48055fe0 pc=0x262e81 created by runtime.init.6 in goroutine 1 /tmp/workdir-gnot/go/src/runtime/proc.go:314 +0x1a goroutine 3 gp=0x480068c0 m=nil [GC sweep wait]: runtime.gopark(0x0?, 0x0?, 0x0?, 0x0?, 0x0?) /tmp/workdir-gnot/go/src/runtime/proc.go:402 +0xce fp=0x48056f80 sp=0x48056f60 pc=0x2356ae runtime.goparkunlock(...) /tmp/workdir-gnot/go/src/runtime/proc.go:408 pc=0x221f54 runtime.bgsweep(0x4806a000) /tmp/workdir-gnot/go/src/runtime/mgcsweep.go:278 +0x72 fp=0x48056fc8 sp=0x48056f80 pc=0x221f32 runtime.gcenable.gowrap1() /tmp/workdir-gnot/go/src/runtime/mgc.go:203 +0x25 fp=0x48056fe0 sp=0x48056fc8 pc=0x216645 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x48056fe8 sp=0x48056fe0 pc=0x262e81 created by runtime.gcenable in goroutine 1 /tmp/workdir-gnot/go/src/runtime/mgc.go:203 +0x66 goroutine 4 gp=0x48006a80 m=nil [GC scavenge wait]: runtime.gopark(0x4806a000?, 0x2cc238?, 0x1?, 0x0?, 0x48006a80?) /tmp/workdir-gnot/go/src/runtime/proc.go:402 +0xce fp=0x48057f78 sp=0x48057f58 pc=0x2356ae runtime.goparkunlock(...) /tmp/workdir-gnot/go/src/runtime/proc.go:408 pc=0x21f8e9 runtime.(*scavengerState).park(0x409680) /tmp/workdir-gnot/go/src/runtime/mgcscavenge.go:425 +0x2e fp=0x48057fa8 sp=0x48057f78 pc=0x21f8ce runtime.bgscavenge(0x4806a000) /tmp/workdir-gnot/go/src/runtime/mgcscavenge.go:653 +0x3c fp=0x48057fc8 sp=0x48057fa8 pc=0x21fedc runtime.gcenable.gowrap2() /tmp/workdir-gnot/go/src/runtime/mgc.go:204 +0x25 fp=0x48057fe0 sp=0x48057fc8 pc=0x2165e5 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x48057fe8 sp=0x48057fe0 pc=0x262e81 created by runtime.gcenable in goroutine 1 /tmp/workdir-gnot/go/src/runtime/mgc.go:204 +0xa5 goroutine 5 gp=0x48006fc0 m=nil [finalizer wait]: runtime.gopark(0x0?, 0x0?, 0x0?, 0x0?, 0x0?) /tmp/workdir-gnot/go/src/runtime/proc.go:402 +0xce fp=0x48050e20 sp=0x48050e00 pc=0x2356ae runtime.runfinq() /tmp/workdir-gnot/go/src/runtime/mfinal.go:194 +0x107 fp=0x48050fe0 sp=0x48050e20 pc=0x215647 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x48050fe8 sp=0x48050fe0 pc=0x262e81 created by runtime.createfing in goroutine 1 /tmp/workdir-gnot/go/src/runtime/mfinal.go:164 +0x3d goroutine 6 gp=0x48007180 m=nil [chan receive]: runtime.gopark(0x24dcc5?, 0x4801e0b0?, 0x2?, 0x0?, 0x48051ef8?) /tmp/workdir-gnot/go/src/runtime/proc.go:402 +0xce fp=0x48051ea8 sp=0x48051e88 pc=0x2356ae runtime.chanrecv(0x480800c0, 0x0, 0x1) /tmp/workdir-gnot/go/src/runtime/chan.go:583 +0x3bf fp=0x48051f20 sp=0x48051ea8 pc=0x2050ff runtime.chanrecv1(0x4807e050?, 0x17b2422f5c3cf9cd?) /tmp/workdir-gnot/go/src/runtime/chan.go:442 +0x12 fp=0x48051f48 sp=0x48051f20 pc=0x204d32 runtime.(*wakeableSleep).sleep(0x4801a018, 0x5f5e100) /tmp/workdir-gnot/go/src/runtime/trace2.go:943 +0xb8 fp=0x48051fa8 sp=0x48051f48 pc=0x251818 runtime.traceStartReadCPU.func1() /tmp/workdir-gnot/go/src/runtime/trace2cpu.go:56 +0x45 fp=0x48051fe0 sp=0x48051fa8 pc=0x252365 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x48051fe8 sp=0x48051fe0 pc=0x262e81 created by runtime.traceStartReadCPU in goroutine 1 /tmp/workdir-gnot/go/src/runtime/trace2cpu.go:44 +0x156 goroutine 7 gp=0x48007340 m=nil [chan receive]: runtime.gopark(0x24dcc5?, 0x48022040?, 0x3?, 0x0?, 0x48052f00?) /tmp/workdir-gnot/go/src/runtime/proc.go:402 +0xce fp=0x48052eb0 sp=0x48052e90 pc=0x2356ae runtime.chanrecv(0x480801e0, 0x0, 0x1) /tmp/workdir-gnot/go/src/runtime/chan.go:583 +0x3bf fp=0x48052f28 sp=0x48052eb0 pc=0x2050ff runtime.chanrecv1(0x4807e0a0?, 0x17b2422f91e1e9f4?) /tmp/workdir-gnot/go/src/runtime/chan.go:442 +0x12 fp=0x48052f50 sp=0x48052f28 pc=0x204d32 runtime.(*wakeableSleep).sleep(0x4801a030, 0x3b9aca00) /tmp/workdir-gnot/go/src/runtime/trace2.go:943 +0xb8 fp=0x48052fb0 sp=0x48052f50 pc=0x251818 runtime.(*traceAdvancerState).start.func1() /tmp/workdir-gnot/go/src/runtime/trace2.go:880 +0x28 fp=0x48052fe0 sp=0x48052fb0 pc=0x251688 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x48052fe8 sp=0x48052fe0 pc=0x262e81 created by runtime.(*traceAdvancerState).start in goroutine 1 /tmp/workdir-gnot/go/src/runtime/trace2.go:877 +0x165 goroutine 8 gp=0x48007500 m=nil [trace reader (blocked)]: runtime.gopark(0x48053f78?, 0x480260c0?, 0x38?, 0x3f?, 0x48053f90?) /tmp/workdir-gnot/go/src/runtime/proc.go:402 +0xce fp=0x48053f38 sp=0x48053f18 pc=0x2356ae runtime.ReadTrace() /tmp/workdir-gnot/go/src/runtime/trace2.go:678 +0x31 fp=0x48053fa0 sp=0x48053f38 pc=0x251091 runtime/trace.Start.func1() /tmp/workdir-gnot/go/src/runtime/trace/trace.go:130 +0x45 fp=0x48053fe0 sp=0x48053fa0 pc=0x28d645 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x48053fe8 sp=0x48053fe0 pc=0x262e81 created by runtime/trace.Start in goroutine 1 /tmp/workdir-gnot/go/src/runtime/trace/trace.go:128 +0xf6 exit status: 'annotations-stress 17207: 2' trace_test.go:562: exit status: 'go 17186: 1' --- FAIL: TestTraceCPUProfile (1.82s) --- FAIL: TestTraceCPUProfile/Default (1.82s) trace_test.go:560: stderr: fatal error: unexpected signal during runtime execution [signal sys: trap: code=0x0 addr=0x0 pc=0x256d0a] runtime stack: runtime.throw({0x2e6d38?, 0x46a8c0?}) /tmp/workdir-gnot/go/src/runtime/panic.go:1011 +0x65 fp=0x7fffffffe928 sp=0x7fffffffe8f8 pc=0x233945 runtime.sigpanic() /tmp/workdir-gnot/go/src/runtime/os_plan9.go:75 +0x4a5 fp=0x7fffffffe9a8 sp=0x7fffffffe928 pc=0x2306e5 runtime.fpTracebackPCs(...) /tmp/workdir-gnot/go/src/runtime/trace2stack.go:219 pc=0x256d0b runtime.traceStack(0x40b320?, 0x7fffffffee40?, 0x1) /tmp/workdir-gnot/go/src/runtime/trace2stack.go:70 +0x8f fp=0x7fffffffedf0 sp=0x7fffffffe9a8 pc=0x256bcf runtime.traceLocker.stack(...) /tmp/workdir-gnot/go/src/runtime/trace2event.go:166 pc=0x2561bb runtime.traceLocker.GoPark({0x40b320?, 0x400000002?}, 0xe, 0x1) /tmp/workdir-gnot/go/src/runtime/trace2runtime.go:438 +0x20 fp=0x7fffffffee80 sp=0x7fffffffedf0 pc=0x256140 runtime.park_m(0x48007180) /tmp/workdir-gnot/go/src/runtime/proc.go:4017 +0x85 fp=0x7fffffffeed8 sp=0x7fffffffee80 pc=0x23d485 runtime.mcall() /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:458 +0x53 fp=0x7fffffffeef0 sp=0x7fffffffeed8 pc=0x2628b3 goroutine 6 gp=0x48007180 m=0 mp=0x40b320 [sleep]: runtime.gopark(0x48051f30?, 0x17b2422fc7f342f9?, 0xe9?, 0x54?, 0x48088210?) /tmp/workdir-gnot/go/src/runtime/proc.go:402 +0xce fp=0x48051f10 sp=0x48051ef0 pc=0x23644e time.Sleep(0x5f5e100) /tmp/workdir-gnot/go/src/runtime/time.go:195 +0x131 fp=0x48051f58 sp=0x48051f10 pc=0x261671 runtime/pprof.profileWriter({0x308568?, 0x48084090?}) /tmp/workdir-gnot/go/src/runtime/pprof/pprof.go:850 +0x4a fp=0x48051fc0 sp=0x48051f58 pc=0x2b094a runtime/pprof.StartCPUProfile.gowrap2() /tmp/workdir-gnot/go/src/runtime/pprof/pprof.go:835 +0x25 fp=0x48051fe0 sp=0x48051fc0 pc=0x2b0865 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x48051fe8 sp=0x48051fe0 pc=0x2647a1 created by runtime/pprof.StartCPUProfile in goroutine 1 /tmp/workdir-gnot/go/src/runtime/pprof/pprof.go:835 +0x156 goroutine 1 gp=0x480061c0 m=nil [runnable]: runtime.Gosched(...) /tmp/workdir-gnot/go/src/runtime/proc.go:342 pc=0x2ba845 main.cpuHog0(0x48054b00?, 0x186a0) /tmp/workdir-gnot/go/src/internal/trace/v2/testdata/testprog/cpu-profile.go:128 +0x54 fp=0x48054af0 sp=0x48054ac8 pc=0x2ba834 main.cpuHog1(0x0?) /tmp/workdir-gnot/go/src/internal/trace/v2/testdata/testprog/cpu-profile.go:120 +0x18 fp=0x48054b10 sp=0x48054af0 pc=0x2ba7b8 main.cpuHogger(0x2e8cd8, 0x46aa60, 0x5f5e100) /tmp/workdir-gnot/go/src/internal/trace/v2/testdata/testprog/cpu-profile.go:107 +0x4f fp=0x48054b60 sp=0x48054b10 pc=0x2ba70f main.main.func1.1({0x308a78?, 0x480840f0?}) /tmp/workdir-gnot/go/src/internal/trace/v2/testdata/testprog/cpu-profile.go:44 +0x25 fp=0x48054b88 sp=0x48054b60 pc=0x2ba645 runtime/pprof.Do({0x308a40?, 0x46a9e0?}, {{0x48022040?, 0x9?, 0x4801a060?}}, 0x48054c58) /tmp/workdir-gnot/go/src/runtime/pprof/runtime.go:51 +0xa4 fp=0x48054bf8 sp=0x48054b88 pc=0x2b91a4 main.main.func1(0x5f5e100) /tmp/workdir-gnot/go/src/internal/trace/v2/testdata/testprog/cpu-profile.go:43 +0x251 fp=0x48054cc0 sp=0x48054bf8 pc=0x2ba5b1 main.main() /tmp/workdir-gnot/go/src/internal/trace/v2/testdata/testprog/cpu-profile.go:50 +0x10f fp=0x48054f48 sp=0x48054cc0 pc=0x2b9d8f runtime.main() /tmp/workdir-gnot/go/src/runtime/proc.go:271 +0x2cb fp=0x48054fe0 sp=0x48054f48 pc=0x23600b runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x48054fe8 sp=0x48054fe0 pc=0x2647a1 goroutine 2 gp=0x48006700 m=nil [force gc (idle)]: runtime.gopark(0x0?, 0x0?, 0x0?, 0x0?, 0x0?) /tmp/workdir-gnot/go/src/runtime/proc.go:402 +0xce fp=0x48055fa0 sp=0x48055f80 pc=0x23644e runtime.goparkunlock(...) /tmp/workdir-gnot/go/src/runtime/proc.go:408 pc=0x2362a7 runtime.forcegchelper() /tmp/workdir-gnot/go/src/runtime/proc.go:326 +0x85 fp=0x48055fe0 sp=0x48055fa0 pc=0x236285 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x48055fe8 sp=0x48055fe0 pc=0x2647a1 created by runtime.init.6 in goroutine 1 /tmp/workdir-gnot/go/src/runtime/proc.go:314 +0x1a goroutine 3 gp=0x480068c0 m=nil [GC sweep wait]: runtime.gopark(0x0?, 0x0?, 0x0?, 0x0?, 0x0?) /tmp/workdir-gnot/go/src/runtime/proc.go:402 +0xce fp=0x48056f80 sp=0x48056f60 pc=0x23644e runtime.goparkunlock(...) /tmp/workdir-gnot/go/src/runtime/proc.go:408 pc=0x222b74 runtime.bgsweep(0x4806a000) /tmp/workdir-gnot/go/src/runtime/mgcsweep.go:278 +0x72 fp=0x48056fc8 sp=0x48056f80 pc=0x222b52 runtime.gcenable.gowrap1() /tmp/workdir-gnot/go/src/runtime/mgc.go:203 +0x25 fp=0x48056fe0 sp=0x48056fc8 pc=0x217265 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x48056fe8 sp=0x48056fe0 pc=0x2647a1 created by runtime.gcenable in goroutine 1 /tmp/workdir-gnot/go/src/runtime/mgc.go:203 +0x66 goroutine 4 gp=0x48006a80 m=nil [GC scavenge wait]: runtime.gopark(0x4806a000?, 0x306f80?, 0x1?, 0x0?, 0x48006a80?) /tmp/workdir-gnot/go/src/runtime/proc.go:402 +0xce fp=0x48057f78 sp=0x48057f58 pc=0x23644e runtime.goparkunlock(...) /tmp/workdir-gnot/go/src/runtime/proc.go:408 pc=0x220509 runtime.(*scavengerState).park(0x40acc0) /tmp/workdir-gnot/go/src/runtime/mgcscavenge.go:425 +0x2e fp=0x48057fa8 sp=0x48057f78 pc=0x2204ee runtime.bgscavenge(0x4806a000) /tmp/workdir-gnot/go/src/runtime/mgcscavenge.go:653 +0x3c fp=0x48057fc8 sp=0x48057fa8 pc=0x220afc runtime.gcenable.gowrap2() /tmp/workdir-gnot/go/src/runtime/mgc.go:204 +0x25 fp=0x48057fe0 sp=0x48057fc8 pc=0x217205 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x48057fe8 sp=0x48057fe0 pc=0x2647a1 created by runtime.gcenable in goroutine 1 /tmp/workdir-gnot/go/src/runtime/mgc.go:204 +0xa5 goroutine 5 gp=0x48006fc0 m=nil [finalizer wait]: runtime.gopark(0x0?, 0x0?, 0x0?, 0x0?, 0x0?) /tmp/workdir-gnot/go/src/runtime/proc.go:402 +0xce fp=0x48050e20 sp=0x48050e00 pc=0x23644e runtime.runfinq() /tmp/workdir-gnot/go/src/runtime/mfinal.go:194 +0x107 fp=0x48050fe0 sp=0x48050e20 pc=0x216267 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x48050fe8 sp=0x48050fe0 pc=0x2647a1 created by runtime.createfing in goroutine 1 /tmp/workdir-gnot/go/src/runtime/mfinal.go:164 +0x3d goroutine 7 gp=0x48007340 m=nil [runnable]: runtime.traceStartReadCPU.func1() /tmp/workdir-gnot/go/src/runtime/trace2cpu.go:44 +0x1 fp=0x48052fe0 sp=0x48052fd8 pc=0x253da1 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x48052fe8 sp=0x48052fe0 pc=0x2647a1 created by runtime.traceStartReadCPU in goroutine 1 /tmp/workdir-gnot/go/src/runtime/trace2cpu.go:44 +0x156 goroutine 8 gp=0x48007500 m=nil [runnable]: runtime.(*traceAdvancerState).start.func1() /tmp/workdir-gnot/go/src/runtime/trace2.go:877 +0x1 fp=0x48053fe0 sp=0x48053fd8 pc=0x2530e1 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x48053fe8 sp=0x48053fe0 pc=0x2647a1 created by runtime.(*traceAdvancerState).start in goroutine 1 /tmp/workdir-gnot/go/src/runtime/trace2.go:877 +0x165 goroutine 9 gp=0x480076c0 m=nil [trace reader (blocked)]: runtime.gopark(0x48096f78?, 0x480260c0?, 0x38?, 0x6f?, 0x48096f90?) /tmp/workdir-gnot/go/src/runtime/proc.go:402 +0xce fp=0x48096f38 sp=0x48096f18 pc=0x23644e runtime.ReadTrace() /tmp/workdir-gnot/go/src/runtime/trace2.go:678 +0x31 fp=0x48096fa0 sp=0x48096f38 pc=0x252b11 runtime/trace.Start.func1() /tmp/workdir-gnot/go/src/runtime/trace/trace.go:130 +0x45 fp=0x48096fe0 sp=0x48096fa0 pc=0x2b9a85 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x48096fe8 sp=0x48096fe0 pc=0x2647a1 created by runtime/trace.Start in goroutine 1 /tmp/workdir-gnot/go/src/runtime/trace/trace.go:128 +0xf6 exit status: 'cpu-profile 17237: 2' trace_test.go:562: exit status: 'go 17213: 1' --- FAIL: TestTraceGCStress (1.42s) --- FAIL: TestTraceGCStress/Default (1.42s) trace_test.go:560: stderr: fatal error: unexpected signal during runtime execution [signal sys: trap: fault read code=0x0 addr=0x0 pc=0x2574aa] runtime stack: runtime.throw({0x2b2e7d?, 0x468440?}) /tmp/workdir-gnot/go/src/runtime/panic.go:1011 +0x65 fp=0x7fffffffe928 sp=0x7fffffffe8f8 pc=0x234bc5 runtime.sigpanic() /tmp/workdir-gnot/go/src/runtime/os_plan9.go:75 +0x4a5 fp=0x7fffffffe9a8 sp=0x7fffffffe928 pc=0x231ae5 runtime.fpTracebackPCs(...) /tmp/workdir-gnot/go/src/runtime/trace2stack.go:219 pc=0x2574ab runtime.traceStack(0x40b660?, 0x23c5b2?, 0x1) /tmp/workdir-gnot/go/src/runtime/trace2stack.go:70 +0x8f fp=0x7fffffffedf0 sp=0x7fffffffe9a8 pc=0x25736f runtime.traceLocker.stack(...) /tmp/workdir-gnot/go/src/runtime/trace2event.go:166 pc=0x25695b runtime.traceLocker.GoPark({0x40b660?, 0x400000002?}, 0x7, 0x2) /tmp/workdir-gnot/go/src/runtime/trace2runtime.go:438 +0x20 fp=0x7fffffffee80 sp=0x7fffffffedf0 pc=0x2568e0 runtime.park_m(0x48007500) /tmp/workdir-gnot/go/src/runtime/proc.go:4017 +0x85 fp=0x7fffffffeed8 sp=0x7fffffffee80 pc=0x23e705 runtime.mcall() /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:458 +0x53 fp=0x7fffffffeef0 sp=0x7fffffffeed8 pc=0x263713 goroutine 8 gp=0x48007500 m=0 mp=0x40b660 [chan receive]: runtime.gopark(0x24fee5?, 0x4801e0a0?, 0x2?, 0x0?, 0x4a3b7ef8?) /tmp/workdir-gnot/go/src/runtime/proc.go:402 +0xce fp=0x4a3b7ea8 sp=0x4a3b7e88 pc=0x2376ce runtime.chanrecv(0x48080600, 0x0, 0x1) /tmp/workdir-gnot/go/src/runtime/chan.go:583 +0x3bf fp=0x4a3b7f20 sp=0x4a3b7ea8 pc=0x2050ff runtime.chanrecv1(0x4807e0a0?, 0x17b242306e4dd06f?) /tmp/workdir-gnot/go/src/runtime/chan.go:442 +0x12 fp=0x4a3b7f48 sp=0x4a3b7f20 pc=0x204d32 runtime.(*wakeableSleep).sleep(0x4801a018, 0x5f5e100) /tmp/workdir-gnot/go/src/runtime/trace2.go:943 +0xb8 fp=0x4a3b7fa8 sp=0x4a3b7f48 pc=0x253a38 runtime.traceStartReadCPU.func1() /tmp/workdir-gnot/go/src/runtime/trace2cpu.go:56 +0x45 fp=0x4a3b7fe0 sp=0x4a3b7fa8 pc=0x254585 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x4a3b7fe8 sp=0x4a3b7fe0 pc=0x265601 created by runtime.traceStartReadCPU in goroutine 1 /tmp/workdir-gnot/go/src/runtime/trace2cpu.go:44 +0x156 goroutine 1 gp=0x480061c0 m=nil [sleep]: runtime.gopark(0x48054ea8?, 0x17b24230685700ef?, 0x0?, 0x0?, 0x0?) /tmp/workdir-gnot/go/src/runtime/proc.go:402 +0xce fp=0x48054e88 sp=0x48054e68 pc=0x2376ce time.Sleep(0x17d78400) /tmp/workdir-gnot/go/src/runtime/time.go:195 +0x131 fp=0x48054ed0 sp=0x48054e88 pc=0x2626f1 main.main() /tmp/workdir-gnot/go/src/internal/trace/v2/testdata/testprog/gc-stress.go:75 +0x1b8 fp=0x48054f48 sp=0x48054ed0 pc=0x28e1f8 runtime.main() /tmp/workdir-gnot/go/src/runtime/proc.go:271 +0x2cb fp=0x48054fe0 sp=0x48054f48 pc=0x23728b runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x48054fe8 sp=0x48054fe0 pc=0x265601 goroutine 2 gp=0x48006700 m=nil [force gc (idle)]: runtime.gopark(0x0?, 0x0?, 0x0?, 0x0?, 0x0?) /tmp/workdir-gnot/go/src/runtime/proc.go:402 +0xce fp=0x48055fa0 sp=0x48055f80 pc=0x2376ce runtime.goparkunlock(...) /tmp/workdir-gnot/go/src/runtime/proc.go:408 pc=0x237527 runtime.forcegchelper() /tmp/workdir-gnot/go/src/runtime/proc.go:326 +0x85 fp=0x48055fe0 sp=0x48055fa0 pc=0x237505 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x48055fe8 sp=0x48055fe0 pc=0x265601 created by runtime.init.6 in goroutine 1 /tmp/workdir-gnot/go/src/runtime/proc.go:314 +0x1a goroutine 3 gp=0x480068c0 m=nil [runnable]: runtime.goschedIfBusy() /tmp/workdir-gnot/go/src/runtime/proc.go:365 +0x28 fp=0x48056f80 sp=0x48056f68 pc=0x2375e8 runtime.bgsweep(0x4806a000) /tmp/workdir-gnot/go/src/runtime/mgcsweep.go:302 +0x14f fp=0x48056fc8 sp=0x48056f80 pc=0x22402f runtime.gcenable.gowrap1() /tmp/workdir-gnot/go/src/runtime/mgc.go:203 +0x25 fp=0x48056fe0 sp=0x48056fc8 pc=0x218665 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x48056fe8 sp=0x48056fe0 pc=0x265601 created by runtime.gcenable in goroutine 1 /tmp/workdir-gnot/go/src/runtime/mgc.go:203 +0x66 goroutine 4 gp=0x48006a80 m=nil [GC scavenge wait]: runtime.gopark(0x4806a000?, 0x2cf2d8?, 0x0?, 0x0?, 0x0?) /tmp/workdir-gnot/go/src/runtime/proc.go:402 +0xce fp=0x48057f78 sp=0x48057f58 pc=0x2376ce runtime.goparkunlock(...) /tmp/workdir-gnot/go/src/runtime/proc.go:408 pc=0x221909 runtime.(*scavengerState).park(0x40b000) /tmp/workdir-gnot/go/src/runtime/mgcscavenge.go:425 +0x2e fp=0x48057fa8 sp=0x48057f78 pc=0x2218ee runtime.bgscavenge(0x4806a000) /tmp/workdir-gnot/go/src/runtime/mgcscavenge.go:658 +0x59 fp=0x48057fc8 sp=0x48057fa8 pc=0x221f19 runtime.gcenable.gowrap2() /tmp/workdir-gnot/go/src/runtime/mgc.go:204 +0x25 fp=0x48057fe0 sp=0x48057fc8 pc=0x218605 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x48057fe8 sp=0x48057fe0 pc=0x265601 created by runtime.gcenable in goroutine 1 /tmp/workdir-gnot/go/src/runtime/mgc.go:204 +0xa5 goroutine 5 gp=0x48006fc0 m=nil [finalizer wait]: runtime.gopark(0x0?, 0x0?, 0x0?, 0x0?, 0x0?) /tmp/workdir-gnot/go/src/runtime/proc.go:402 +0xce fp=0x48050e20 sp=0x48050e00 pc=0x2376ce runtime.runfinq() /tmp/workdir-gnot/go/src/runtime/mfinal.go:194 +0x107 fp=0x48050fe0 sp=0x48050e20 pc=0x217667 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x48050fe8 sp=0x48050fe0 pc=0x265601 created by runtime.createfing in goroutine 1 /tmp/workdir-gnot/go/src/runtime/mfinal.go:164 +0x3d goroutine 6 gp=0x48007180 m=nil [GC worker (idle)]: runtime.gopark(0x48051f68?, 0x17b24230658c11c2?, 0x0?, 0x0?, 0x0?) /tmp/workdir-gnot/go/src/runtime/proc.go:402 +0xce fp=0x48051f28 sp=0x48051f08 pc=0x2376ce runtime.gcBgMarkWorker(0x480800c0) /tmp/workdir-gnot/go/src/runtime/mgc.go:1333 +0xec fp=0x48051fc8 sp=0x48051f28 pc=0x21a82c runtime.gcBgMarkStartWorkers.gowrap1() /tmp/workdir-gnot/go/src/runtime/mgc.go:1249 +0x25 fp=0x48051fe0 sp=0x48051fc8 pc=0x21a705 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x48051fe8 sp=0x48051fe0 pc=0x265601 created by runtime.gcBgMarkStartWorkers in goroutine 1 /tmp/workdir-gnot/go/src/runtime/mgc.go:1249 +0x105 goroutine 7 gp=0x48007340 m=nil [runnable]: runtime.gcTrigger.test({0x0?, 0x0?, 0x0?}) /tmp/workdir-gnot/go/src/runtime/mgc.go:567 +0xdc fp=0x4a3b8f00 sp=0x4a3b8ef8 pc=0x21885c runtime.mallocgc(0x435d, 0x296940, 0x1) /tmp/workdir-gnot/go/src/runtime/malloc.go:1307 +0x825 fp=0x4a3b8f88 sp=0x4a3b8f00 pc=0x20cc85 runtime.makeslice(0x8000?, 0x0?, 0x0?) /tmp/workdir-gnot/go/src/runtime/slice.go:107 +0x49 fp=0x4a3b8fb0 sp=0x4a3b8f88 pc=0x248a49 main.main.func1() /tmp/workdir-gnot/go/src/internal/trace/v2/testdata/testprog/gc-stress.go:60 +0x3c fp=0x4a3b8fe0 sp=0x4a3b8fb0 pc=0x28e2dc runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x4a3b8fe8 sp=0x4a3b8fe0 pc=0x265601 created by main.main in goroutine 1 /tmp/workdir-gnot/go/src/internal/trace/v2/testdata/testprog/gc-stress.go:58 +0x115 goroutine 9 gp=0x480076c0 m=nil [runnable]: runtime.(*traceAdvancerState).start.func1() /tmp/workdir-gnot/go/src/runtime/trace2.go:877 +0x1 fp=0x4a3b9fe0 sp=0x4a3b9fd8 pc=0x253881 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x4a3b9fe8 sp=0x4a3b9fe0 pc=0x265601 created by runtime.(*traceAdvancerState).start in goroutine 1 /tmp/workdir-gnot/go/src/runtime/trace2.go:877 +0x165 goroutine 10 gp=0x48007880 m=nil [trace reader (blocked)]: runtime.gopark(0x48052f78?, 0x480260c0?, 0x38?, 0x2f?, 0x48052f90?) /tmp/workdir-gnot/go/src/runtime/proc.go:402 +0xce fp=0x48052f38 sp=0x48052f18 pc=0x2376ce runtime.ReadTrace() /tmp/workdir-gnot/go/src/runtime/trace2.go:678 +0x31 fp=0x48052fa0 sp=0x48052f38 pc=0x2532b1 runtime/trace.Start.func1() /tmp/workdir-gnot/go/src/runtime/trace/trace.go:130 +0x45 fp=0x48052fe0 sp=0x48052fa0 pc=0x28dda5 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x48052fe8 sp=0x48052fe0 pc=0x265601 created by runtime/trace.Start in goroutine 1 /tmp/workdir-gnot/go/src/runtime/trace/trace.go:128 +0xf6 exit status: 'gc-stress 17287: 2' trace_test.go:562: exit status: 'go 17267: 1' --- FAIL: TestTraceGOMAXPROCS (1.24s) --- FAIL: TestTraceGOMAXPROCS/Default (1.24s) trace_test.go:560: stderr: fatal error: unexpected signal during runtime execution [signal sys: trap: fault read code=0x0 addr=0x0 pc=0x2553ca] runtime stack: runtime.throw({0x2a73ee?, 0x4668c0?}) /tmp/workdir-gnot/go/src/runtime/panic.go:1011 +0x65 fp=0x7fffffffe928 sp=0x7fffffffe8f8 pc=0x232de5 runtime.sigpanic() /tmp/workdir-gnot/go/src/runtime/os_plan9.go:75 +0x4a5 fp=0x7fffffffe9a8 sp=0x7fffffffe928 pc=0x22fd05 runtime.fpTracebackPCs(...) /tmp/workdir-gnot/go/src/runtime/trace2stack.go:219 pc=0x2553cb runtime.traceStack(0x409ae0?, 0x8?, 0x1) /tmp/workdir-gnot/go/src/runtime/trace2stack.go:70 +0x8f fp=0x7fffffffedf0 sp=0x7fffffffe9a8 pc=0x25528f runtime.traceLocker.stack(...) /tmp/workdir-gnot/go/src/runtime/trace2event.go:166 pc=0x25487b runtime.traceLocker.GoPark({0x409ae0?, 0x400000002?}, 0xe, 0x1) /tmp/workdir-gnot/go/src/runtime/trace2runtime.go:438 +0x20 fp=0x7fffffffee80 sp=0x7fffffffedf0 pc=0x254800 runtime.park_m(0x480061c0) /tmp/workdir-gnot/go/src/runtime/proc.go:4017 +0x85 fp=0x7fffffffeed8 sp=0x7fffffffee80 pc=0x23c925 runtime.mcall() /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:458 +0x53 fp=0x7fffffffeef0 sp=0x7fffffffeed8 pc=0x260693 goroutine 1 gp=0x480061c0 m=0 mp=0x409ae0 [sleep]: runtime.gopark(0x48054ec8?, 0x17b24230b276443a?, 0xe0?, 0x4e?, 0x2056fe?) /tmp/workdir-gnot/go/src/runtime/proc.go:402 +0xce fp=0x48054ea8 sp=0x48054e88 pc=0x2358ee time.Sleep(0xf4240) /tmp/workdir-gnot/go/src/runtime/time.go:195 +0x131 fp=0x48054ef0 sp=0x48054ea8 pc=0x25f671 main.main() /tmp/workdir-gnot/go/src/internal/trace/v2/testdata/testprog/gomaxprocs.go:38 +0x91 fp=0x48054f48 sp=0x48054ef0 pc=0x2870f1 runtime.main() /tmp/workdir-gnot/go/src/runtime/proc.go:271 +0x2cb fp=0x48054fe0 sp=0x48054f48 pc=0x2354ab runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x48054fe8 sp=0x48054fe0 pc=0x262581 goroutine 2 gp=0x48006700 m=nil [force gc (idle)]: runtime.gopark(0x0?, 0x0?, 0x0?, 0x0?, 0x0?) /tmp/workdir-gnot/go/src/runtime/proc.go:402 +0xce fp=0x48055fa0 sp=0x48055f80 pc=0x2358ee runtime.goparkunlock(...) /tmp/workdir-gnot/go/src/runtime/proc.go:408 pc=0x235747 runtime.forcegchelper() /tmp/workdir-gnot/go/src/runtime/proc.go:326 +0x85 fp=0x48055fe0 sp=0x48055fa0 pc=0x235725 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x48055fe8 sp=0x48055fe0 pc=0x262581 created by runtime.init.6 in goroutine 1 /tmp/workdir-gnot/go/src/runtime/proc.go:314 +0x1a goroutine 3 gp=0x480068c0 m=nil [GC sweep wait]: runtime.gopark(0x0?, 0x0?, 0x0?, 0x0?, 0x0?) /tmp/workdir-gnot/go/src/runtime/proc.go:402 +0xce fp=0x48056f80 sp=0x48056f60 pc=0x2358ee runtime.goparkunlock(...) /tmp/workdir-gnot/go/src/runtime/proc.go:408 pc=0x2220d4 runtime.bgsweep(0x4806a000) /tmp/workdir-gnot/go/src/runtime/mgcsweep.go:278 +0x72 fp=0x48056fc8 sp=0x48056f80 pc=0x2220b2 runtime.gcenable.gowrap1() /tmp/workdir-gnot/go/src/runtime/mgc.go:203 +0x25 fp=0x48056fe0 sp=0x48056fc8 pc=0x2165c5 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x48056fe8 sp=0x48056fe0 pc=0x262581 created by runtime.gcenable in goroutine 1 /tmp/workdir-gnot/go/src/runtime/mgc.go:203 +0x66 goroutine 4 gp=0x48006a80 m=nil [GC scavenge wait]: runtime.gopark(0x4806a000?, 0x2c2910?, 0x1?, 0x0?, 0x48006a80?) /tmp/workdir-gnot/go/src/runtime/proc.go:402 +0xce fp=0x48057f78 sp=0x48057f58 pc=0x2358ee runtime.goparkunlock(...) /tmp/workdir-gnot/go/src/runtime/proc.go:408 pc=0x21fa69 runtime.(*scavengerState).park(0x409480) /tmp/workdir-gnot/go/src/runtime/mgcscavenge.go:425 +0x2e fp=0x48057fa8 sp=0x48057f78 pc=0x21fa4e runtime.bgscavenge(0x4806a000) /tmp/workdir-gnot/go/src/runtime/mgcscavenge.go:653 +0x3c fp=0x48057fc8 sp=0x48057fa8 pc=0x22005c runtime.gcenable.gowrap2() /tmp/workdir-gnot/go/src/runtime/mgc.go:204 +0x25 fp=0x48057fe0 sp=0x48057fc8 pc=0x216565 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x48057fe8 sp=0x48057fe0 pc=0x262581 created by runtime.gcenable in goroutine 1 /tmp/workdir-gnot/go/src/runtime/mgc.go:204 +0xa5 goroutine 5 gp=0x48006fc0 m=nil [runnable]: runtime.runfinq() /tmp/workdir-gnot/go/src/runtime/mfinal.go:177 +0x1 fp=0x48050fe0 sp=0x48050fd8 pc=0x2154c1 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x48050fe8 sp=0x48050fe0 pc=0x262581 created by runtime.createfing in goroutine 1 /tmp/workdir-gnot/go/src/runtime/mfinal.go:164 +0x3d goroutine 6 gp=0x48007180 m=nil [runnable]: main.main.func1() /tmp/workdir-gnot/go/src/internal/trace/v2/testdata/testprog/gomaxprocs.go:24 +0x1 fp=0x48051fe0 sp=0x48051fd8 pc=0x287161 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x48051fe8 sp=0x48051fe0 pc=0x262581 created by main.main in goroutine 1 /tmp/workdir-gnot/go/src/internal/trace/v2/testdata/testprog/gomaxprocs.go:24 +0x1e goroutine 7 gp=0x48007340 m=nil [runnable]: runtime.traceStartReadCPU.func1() /tmp/workdir-gnot/go/src/runtime/trace2cpu.go:44 +0x1 fp=0x48052fe0 sp=0x48052fd8 pc=0x252461 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x48052fe8 sp=0x48052fe0 pc=0x262581 created by runtime.traceStartReadCPU in goroutine 1 /tmp/workdir-gnot/go/src/runtime/trace2cpu.go:44 +0x156 goroutine 8 gp=0x48007500 m=nil [runnable]: runtime.(*traceAdvancerState).start.func1() /tmp/workdir-gnot/go/src/runtime/trace2.go:877 +0x1 fp=0x48053fe0 sp=0x48053fd8 pc=0x2517a1 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x48053fe8 sp=0x48053fe0 pc=0x262581 created by runtime.(*traceAdvancerState).start in goroutine 1 /tmp/workdir-gnot/go/src/runtime/trace2.go:877 +0x165 goroutine 9 gp=0x480076c0 m=nil [runnable]: runtime/trace.Start.func1() /tmp/workdir-gnot/go/src/runtime/trace/trace.go:128 +0x1 fp=0x4808cfe0 sp=0x4808cfd8 pc=0x286e81 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x4808cfe8 sp=0x4808cfe0 pc=0x262581 created by runtime/trace.Start in goroutine 1 /tmp/workdir-gnot/go/src/runtime/trace/trace.go:128 +0xf6 exit status: 'gomaxprocs 17310: 2' trace_test.go:562: exit status: 'go 17290: 1' --- FAIL: TestTraceStress (2.91s) --- FAIL: TestTraceStress/Default (2.91s) trace_test.go:560: stderr: fatal error: unexpected signal during runtime execution [signal sys: trap: code=0x0 addr=0x0 pc=0x25a6ca] runtime stack: runtime.throw({0x2fae57?, 0x467fb0?}) /tmp/workdir-gnot/go/src/runtime/panic.go:1011 +0x65 fp=0x7fffffffe568 sp=0x7fffffffe538 pc=0x236045 runtime.sigpanic() /tmp/workdir-gnot/go/src/runtime/os_plan9.go:75 +0x4a5 fp=0x7fffffffe5e8 sp=0x7fffffffe568 pc=0x232ae5 runtime.fpTracebackPCs(...) /tmp/workdir-gnot/go/src/runtime/trace2stack.go:219 pc=0x25a6cb runtime.traceStack(0x48058808?, 0x48058808?, 0x1) /tmp/workdir-gnot/go/src/runtime/trace2stack.go:70 +0x8f fp=0x7fffffffea30 sp=0x7fffffffe5e8 pc=0x25a58f runtime.traceLocker.stack(...) /tmp/workdir-gnot/go/src/runtime/trace2event.go:166 pc=0x259a31 runtime.traceLocker.GoStop({0x48058808?, 0x100000002?}, 0x2) /tmp/workdir-gnot/go/src/runtime/trace2runtime.go:430 +0x20 fp=0x7fffffffeac0 sp=0x7fffffffea30 pc=0x2599c0 runtime.traceLocker.GoPreempt(...) /tmp/workdir-gnot/go/src/runtime/trace2runtime.go:425 pc=0x23fdb3 runtime.goschedImpl(0x48502a80, 0x1) /tmp/workdir-gnot/go/src/runtime/proc.go:4050 +0x94 fp=0x7fffffffeb10 sp=0x7fffffffeac0 pc=0x23fdb4 runtime.gopreempt_m(...) /tmp/workdir-gnot/go/src/runtime/proc.go:4083 pc=0x24da71 runtime.newstack() /tmp/workdir-gnot/go/src/runtime/stack.go:1070 +0x3a7 fp=0x7fffffffecb8 sp=0x7fffffffeb10 pc=0x24da67 runtime.morestack() /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:616 +0x7d fp=0x7fffffffecc0 sp=0x7fffffffecb8 pc=0x266d9d goroutine 23 gp=0x48502a80 m=2 mp=0x48058808 [runnable]: runtime.gopark(0x2fd280?, 0x485080a0?, 0x1a?, 0xa?, 0x0?) /tmp/workdir-gnot/go/src/runtime/proc.go:385 +0x105 fp=0x48510f28 sp=0x48510f20 pc=0x238b85 runtime.gcBgMarkWorker(0x48504000) /tmp/workdir-gnot/go/src/runtime/mgc.go:1333 +0xec fp=0x48510fc8 sp=0x48510f28 pc=0x21b76c runtime.gcBgMarkStartWorkers.gowrap1() /tmp/workdir-gnot/go/src/runtime/mgc.go:1249 +0x25 fp=0x48510fe0 sp=0x48510fc8 pc=0x21b645 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x48510fe8 sp=0x48510fe0 pc=0x268b01 created by runtime.gcBgMarkStartWorkers in goroutine 1 /tmp/workdir-gnot/go/src/runtime/mgc.go:1249 +0x105 goroutine 1 gp=0x480061c0 m=8 mp=0x48400808 [running]: goroutine running on other thread; stack unavailable goroutine 2 gp=0x48006700 m=nil [force gc (idle)]: runtime.gopark(0x0?, 0x0?, 0x0?, 0x0?, 0x0?) /tmp/workdir-gnot/go/src/runtime/proc.go:402 +0xce fp=0x48055fa0 sp=0x48055f80 pc=0x238b4e runtime.goparkunlock(...) /tmp/workdir-gnot/go/src/runtime/proc.go:408 pc=0x2389a7 runtime.forcegchelper() /tmp/workdir-gnot/go/src/runtime/proc.go:326 +0x85 fp=0x48055fe0 sp=0x48055fa0 pc=0x238985 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x48055fe8 sp=0x48055fe0 pc=0x268b01 created by runtime.init.6 in goroutine 1 /tmp/workdir-gnot/go/src/runtime/proc.go:314 +0x1a goroutine 3 gp=0x480068c0 m=nil [runnable]: runtime.gopark(0x0?, 0x0?, 0x0?, 0x0?, 0x0?) /tmp/workdir-gnot/go/src/runtime/proc.go:402 +0xce fp=0x48056f80 sp=0x48056f60 pc=0x238b4e runtime.goparkunlock(...) /tmp/workdir-gnot/go/src/runtime/proc.go:408 pc=0x224eb4 runtime.bgsweep(0x4806a000) /tmp/workdir-gnot/go/src/runtime/mgcsweep.go:278 +0x72 fp=0x48056fc8 sp=0x48056f80 pc=0x224e92 runtime.gcenable.gowrap1() /tmp/workdir-gnot/go/src/runtime/mgc.go:203 +0x25 fp=0x48056fe0 sp=0x48056fc8 pc=0x2193a5 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x48056fe8 sp=0x48056fe0 pc=0x268b01 created by runtime.gcenable in goroutine 1 /tmp/workdir-gnot/go/src/runtime/mgc.go:203 +0x66 goroutine 4 gp=0x48006a80 m=nil [GC scavenge wait]: runtime.gopark(0x10000?, 0x31cf98?, 0x0?, 0x0?, 0x0?) /tmp/workdir-gnot/go/src/runtime/proc.go:402 +0xce fp=0x48057f78 sp=0x48057f58 pc=0x238b4e runtime.goparkunlock(...) /tmp/workdir-gnot/go/src/runtime/proc.go:408 pc=0x222849 runtime.(*scavengerState).park(0x40aba0) /tmp/workdir-gnot/go/src/runtime/mgcscavenge.go:425 +0x2e fp=0x48057fa8 sp=0x48057f78 pc=0x22282e runtime.bgscavenge(0x4806a000) /tmp/workdir-gnot/go/src/runtime/mgcscavenge.go:658 +0x59 fp=0x48057fc8 sp=0x48057fa8 pc=0x222e59 runtime.gcenable.gowrap2() /tmp/workdir-gnot/go/src/runtime/mgc.go:204 +0x25 fp=0x48057fe0 sp=0x48057fc8 pc=0x219345 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x48057fe8 sp=0x48057fe0 pc=0x268b01 created by runtime.gcenable in goroutine 1 /tmp/workdir-gnot/go/src/runtime/mgc.go:204 +0xa5 goroutine 5 gp=0x48006fc0 m=nil [finalizer wait]: runtime.gopark(0x0?, 0x0?, 0x0?, 0x0?, 0x0?) /tmp/workdir-gnot/go/src/runtime/proc.go:402 +0xce fp=0x48050e20 sp=0x48050e00 pc=0x238b4e runtime.runfinq() /tmp/workdir-gnot/go/src/runtime/mfinal.go:194 +0x107 fp=0x48050fe0 sp=0x48050e20 pc=0x2183a7 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x48050fe8 sp=0x48050fe0 pc=0x268b01 created by runtime.createfing in goroutine 1 /tmp/workdir-gnot/go/src/runtime/mfinal.go:164 +0x3d goroutine 6 gp=0x48007180 m=nil [chan receive]: runtime.gopark(0x0?, 0x0?, 0x0?, 0x0?, 0x0?) /tmp/workdir-gnot/go/src/runtime/proc.go:402 +0xce fp=0x48051f18 sp=0x48051ef8 pc=0x238b4e runtime.chanrecv(0x480800c0, 0x0, 0x1) /tmp/workdir-gnot/go/src/runtime/chan.go:583 +0x3bf fp=0x48051f90 sp=0x48051f18 pc=0x20545f runtime.chanrecv1(0x0?, 0x0?) /tmp/workdir-gnot/go/src/runtime/chan.go:442 +0x12 fp=0x48051fb8 sp=0x48051f90 pc=0x205092 main.main.func1() /tmp/workdir-gnot/go/src/internal/trace/v2/testdata/testprog/stress.go:29 +0x25 fp=0x48051fe0 sp=0x48051fb8 pc=0x2c6a05 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x48051fe8 sp=0x48051fe0 pc=0x268b01 created by main.main in goroutine 1 /tmp/workdir-gnot/go/src/internal/trace/v2/testdata/testprog/stress.go:28 +0xd2 goroutine 7 gp=0x48007340 m=0 mp=0x40b200 [syscall]: syscall.Syscall6(0x32, 0x3, 0x48052fbf, 0x1, 0xffffffffffffffff, 0xffffffffffffffff, 0x0) /tmp/workdir-gnot/go/src/syscall/asm_plan9_amd64.s:63 +0x10 fp=0x48052e70 sp=0x48052db8 pc=0x27f310 syscall.Pread(0x48026140?, {0x48052fbf?, 0x0?, 0x0?}, 0x0?) /tmp/workdir-gnot/go/src/syscall/zsyscall_plan9_amd64.go:218 +0x5e fp=0x48052ee8 sp=0x48052e70 pc=0x27ef3e syscall.Read(...) /tmp/workdir-gnot/go/src/syscall/syscall_plan9.go:170 pc=0x28ceab os.(*File).read(0x48040040, {0x48052fbf, 0x1, 0x1}) /tmp/workdir-gnot/go/src/os/file_plan9.go:287 +0xc4 fp=0x48052f58 sp=0x48052ee8 pc=0x28ce84 os.(*File).Read(0x48040040, {0x48052fbf, 0x1, 0x1}) /tmp/workdir-gnot/go/src/os/file.go:118 +0x65 fp=0x48052f98 sp=0x48052f58 pc=0x28bc85 main.main.func3() /tmp/workdir-gnot/go/src/internal/trace/v2/testdata/testprog/stress.go:45 +0x3b fp=0x48052fe0 sp=0x48052f98 pc=0x2c693b runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x48052fe8 sp=0x48052fe0 pc=0x268b01 created by main.main in goroutine 1 /tmp/workdir-gnot/go/src/internal/trace/v2/testdata/testprog/stress.go:43 +0x213 goroutine 8 gp=0x48007500 m=nil [chan receive]: runtime.gopark(0x252f65?, 0x4839e000?, 0x1?, 0x0?, 0x48053ef8?) /tmp/workdir-gnot/go/src/runtime/proc.go:402 +0xce fp=0x48053ea8 sp=0x48053e88 pc=0x238b4e runtime.chanrecv(0x48080120, 0x0, 0x1) /tmp/workdir-gnot/go/src/runtime/chan.go:583 +0x3bf fp=0x48053f20 sp=0x48053ea8 pc=0x20545f runtime.chanrecv1(0x4807e0a0?, 0x17b24231fe3a71a0?) /tmp/workdir-gnot/go/src/runtime/chan.go:442 +0x12 fp=0x48053f48 sp=0x48053f20 pc=0x205092 runtime.(*wakeableSleep).sleep(0x4801a060, 0x5f5e100) /tmp/workdir-gnot/go/src/runtime/trace2.go:943 +0xb8 fp=0x48053fa8 sp=0x48053f48 pc=0x256c58 runtime.traceStartReadCPU.func1() /tmp/workdir-gnot/go/src/runtime/trace2cpu.go:56 +0x45 fp=0x48053fe0 sp=0x48053fa8 pc=0x2577a5 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x48053fe8 sp=0x48053fe0 pc=0x268b01 created by runtime.traceStartReadCPU in goroutine 1 /tmp/workdir-gnot/go/src/runtime/trace2cpu.go:44 +0x156 goroutine 9 gp=0x480076c0 m=nil [chan receive]: runtime.gopark(0x252f65?, 0x48496000?, 0x1?, 0x0?, 0x4808ef00?) /tmp/workdir-gnot/go/src/runtime/proc.go:402 +0xce fp=0x4808eeb0 sp=0x4808ee90 pc=0x238b4e runtime.chanrecv(0x48080240, 0x0, 0x1) /tmp/workdir-gnot/go/src/runtime/chan.go:583 +0x3bf fp=0x4808ef28 sp=0x4808eeb0 pc=0x20545f runtime.chanrecv1(0x4807e0f0?, 0x17b24232187e5158?) /tmp/workdir-gnot/go/src/runtime/chan.go:442 +0x12 fp=0x4808ef50 sp=0x4808ef28 pc=0x205092 runtime.(*wakeableSleep).sleep(0x4801a078, 0x3b9aca00) /tmp/workdir-gnot/go/src/runtime/trace2.go:943 +0xb8 fp=0x4808efb0 sp=0x4808ef50 pc=0x256c58 runtime.(*traceAdvancerState).start.func1() /tmp/workdir-gnot/go/src/runtime/trace2.go:880 +0x28 fp=0x4808efe0 sp=0x4808efb0 pc=0x256ac8 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x4808efe8 sp=0x4808efe0 pc=0x268b01 created by runtime.(*traceAdvancerState).start in goroutine 1 /tmp/workdir-gnot/go/src/runtime/trace2.go:877 +0x165 goroutine 10 gp=0x48007880 m=nil [runnable]: syscall.Syscall6(0x33, 0x1, 0x45b4f020, 0xffc4, 0xffffffffffffffff, 0xffffffffffffffff, 0x0) /tmp/workdir-gnot/go/src/syscall/asm_plan9_amd64.s:63 +0x10 fp=0x4808fe78 sp=0x4808fdc0 pc=0x27f310 syscall.Pwrite(0x480260c0?, {0x45b4f020?, 0x7fffffffe7b0?, 0x4808ff28?}, 0x238b4e?) /tmp/workdir-gnot/go/src/syscall/zsyscall_plan9_amd64.go:235 +0x5e fp=0x4808fef0 sp=0x4808fe78 pc=0x27f03e syscall.Write(...) /tmp/workdir-gnot/go/src/syscall/syscall_plan9.go:182 pc=0x28d14f os.(*File).write(0x48040030, {0x45b4f020, 0xffc4, 0xffe0}) /tmp/workdir-gnot/go/src/os/file_plan9.go:321 +0x110 fp=0x4808ff60 sp=0x4808fef0 pc=0x28d130 os.(*File).Write(0x48040030, {0x45b4f020, 0xffc4, 0xffe0}) /tmp/workdir-gnot/go/src/os/file.go:189 +0x65 fp=0x4808ffa0 sp=0x4808ff60 pc=0x28bd65 runtime/trace.Start.func1() /tmp/workdir-gnot/go/src/runtime/trace/trace.go:134 +0x3b fp=0x4808ffe0 sp=0x4808ffa0 pc=0x2c5cdb runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x4808ffe8 sp=0x4808ffe0 pc=0x268b01 created by runtime/trace.Start in goroutine 1 /tmp/workdir-gnot/go/src/runtime/trace/trace.go:128 +0xf6 goroutine 17 gp=0x48502000 m=nil [runnable, locked to thread]: runtime.Gosched(...) /tmp/workdir-gnot/go/src/runtime/proc.go:342 pc=0x2c68a5 main.main.func4() /tmp/workdir-gnot/go/src/internal/trace/v2/testdata/testprog/stress.go:66 +0x56 fp=0x4808afe0 sp=0x4808afb8 pc=0x2c6896 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x4808afe8 sp=0x4808afe0 pc=0x268b01 created by main.main in goroutine 1 /tmp/workdir-gnot/go/src/internal/trace/v2/testdata/testprog/stress.go:59 +0x2f6 goroutine 18 gp=0x485021c0 m=nil [GC worker (idle)]: runtime.gopark(0x0?, 0x0?, 0x0?, 0x0?, 0x0?) /tmp/workdir-gnot/go/src/runtime/proc.go:402 +0xce fp=0x4808bf28 sp=0x4808bf08 pc=0x238b4e runtime.gcBgMarkWorker(0x48504000) /tmp/workdir-gnot/go/src/runtime/mgc.go:1333 +0xec fp=0x4808bfc8 sp=0x4808bf28 pc=0x21b76c runtime.gcBgMarkStartWorkers.gowrap1() /tmp/workdir-gnot/go/src/runtime/mgc.go:1249 +0x25 fp=0x4808bfe0 sp=0x4808bfc8 pc=0x21b645 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x4808bfe8 sp=0x4808bfe0 pc=0x268b01 created by runtime.gcBgMarkStartWorkers in goroutine 1 /tmp/workdir-gnot/go/src/runtime/mgc.go:1249 +0x105 goroutine 19 gp=0x48502380 m=nil [GC worker (idle)]: runtime.gopark(0x468a80?, 0x3?, 0xed?, 0xd2?, 0x0?) /tmp/workdir-gnot/go/src/runtime/proc.go:402 +0xce fp=0x4808cf28 sp=0x4808cf08 pc=0x238b4e runtime.gcBgMarkWorker(0x48504000) /tmp/workdir-gnot/go/src/runtime/mgc.go:1333 +0xec fp=0x4808cfc8 sp=0x4808cf28 pc=0x21b76c runtime.gcBgMarkStartWorkers.gowrap1() /tmp/workdir-gnot/go/src/runtime/mgc.go:1249 +0x25 fp=0x4808cfe0 sp=0x4808cfc8 pc=0x21b645 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x4808cfe8 sp=0x4808cfe0 pc=0x268b01 created by runtime.gcBgMarkStartWorkers in goroutine 1 /tmp/workdir-gnot/go/src/runtime/mgc.go:1249 +0x105 goroutine 20 gp=0x48502540 m=nil [GC worker (idle)]: runtime.gopark(0x4808df68?, 0x17b24231f2ca4c2f?, 0x44?, 0xb5?, 0x0?) /tmp/workdir-gnot/go/src/runtime/proc.go:402 +0xce fp=0x4808df28 sp=0x4808df08 pc=0x238b4e runtime.gcBgMarkWorker(0x48504000) /tmp/workdir-gnot/go/src/runtime/mgc.go:1333 +0xec fp=0x4808dfc8 sp=0x4808df28 pc=0x21b76c runtime.gcBgMarkStartWorkers.gowrap1() /tmp/workdir-gnot/go/src/runtime/mgc.go:1249 +0x25 fp=0x4808dfe0 sp=0x4808dfc8 pc=0x21b645 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x4808dfe8 sp=0x4808dfe0 pc=0x268b01 created by runtime.gcBgMarkStartWorkers in goroutine 1 /tmp/workdir-gnot/go/src/runtime/mgc.go:1249 +0x105 goroutine 21 gp=0x48502700 m=nil [GC worker (idle)]: runtime.gopark(0x4850ef68?, 0x17b24231f2db974b?, 0xf4?, 0xb8?, 0x0?) /tmp/workdir-gnot/go/src/runtime/proc.go:402 +0xce fp=0x4850ef28 sp=0x4850ef08 pc=0x238b4e runtime.gcBgMarkWorker(0x48504000) /tmp/workdir-gnot/go/src/runtime/mgc.go:1333 +0xec fp=0x4850efc8 sp=0x4850ef28 pc=0x21b76c runtime.gcBgMarkStartWorkers.gowrap1() /tmp/workdir-gnot/go/src/runtime/mgc.go:1249 +0x25 fp=0x4850efe0 sp=0x4850efc8 pc=0x21b645 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x4850efe8 sp=0x4850efe0 pc=0x268b01 created by runtime.gcBgMarkStartWorkers in goroutine 1 /tmp/workdir-gnot/go/src/runtime/mgc.go:1249 +0x105 goroutine 22 gp=0x485028c0 m=nil [GC worker (idle)]: runtime.gopark(0x468a80?, 0x3?, 0xdf?, 0xf0?, 0x0?) /tmp/workdir-gnot/go/src/runtime/proc.go:402 +0xce fp=0x4850ff28 sp=0x4850ff08 pc=0x238b4e runtime.gcBgMarkWorker(0x48504000) /tmp/workdir-gnot/go/src/runtime/mgc.go:1333 +0xec fp=0x4850ffc8 sp=0x4850ff28 pc=0x21b76c runtime.gcBgMarkStartWorkers.gowrap1() /tmp/workdir-gnot/go/src/runtime/mgc.go:1249 +0x25 fp=0x4850ffe0 sp=0x4850ffc8 pc=0x21b645 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x4850ffe8 sp=0x4850ffe0 pc=0x268b01 created by runtime.gcBgMarkStartWorkers in goroutine 1 /tmp/workdir-gnot/go/src/runtime/mgc.go:1249 +0x105 goroutine 24 gp=0x48502c40 m=nil [GC worker (idle)]: runtime.gopark(0x48511f68?, 0x17b24231f2e8e20f?, 0x8f?, 0x6f?, 0x0?) /tmp/workdir-gnot/go/src/runtime/proc.go:402 +0xce fp=0x48511f28 sp=0x48511f08 pc=0x238b4e runtime.gcBgMarkWorker(0x48504000) /tmp/workdir-gnot/go/src/runtime/mgc.go:1333 +0xec fp=0x48511fc8 sp=0x48511f28 pc=0x21b76c runtime.gcBgMarkStartWorkers.gowrap1() /tmp/workdir-gnot/go/src/runtime/mgc.go:1249 +0x25 fp=0x48511fe0 sp=0x48511fc8 pc=0x21b645 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x48511fe8 sp=0x48511fe0 pc=0x268b01 created by runtime.gcBgMarkStartWorkers in goroutine 1 /tmp/workdir-gnot/go/src/runtime/mgc.go:1249 +0x105 goroutine 25 gp=0x48502e00 m=nil [GC worker (idle)]: runtime.gopark(0x4850af68?, 0x17b24231f2b2ea65?, 0x0?, 0x0?, 0x0?) /tmp/workdir-gnot/go/src/runtime/proc.go:402 +0xce fp=0x4850af28 sp=0x4850af08 pc=0x238b4e runtime.gcBgMarkWorker(0x48504000) /tmp/workdir-gnot/go/src/runtime/mgc.go:1333 +0xec fp=0x4850afc8 sp=0x4850af28 pc=0x21b76c runtime.gcBgMarkStartWorkers.gowrap1() /tmp/workdir-gnot/go/src/runtime/mgc.go:1249 +0x25 fp=0x4850afe0 sp=0x4850afc8 pc=0x21b645 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x4850afe8 sp=0x4850afe0 pc=0x268b01 created by runtime.gcBgMarkStartWorkers in goroutine 1 /tmp/workdir-gnot/go/src/runtime/mgc.go:1249 +0x105 goroutine 26 gp=0x48502fc0 m=nil [GC worker (idle)]: runtime.gopark(0x4850bf68?, 0x17b24231f2b054b7?, 0x0?, 0x0?, 0x0?) /tmp/workdir-gnot/go/src/runtime/proc.go:402 +0xce fp=0x4850bf28 sp=0x4850bf08 pc=0x238b4e runtime.gcBgMarkWorker(0x48504000) /tmp/workdir-gnot/go/src/runtime/mgc.go:1333 +0xec fp=0x4850bfc8 sp=0x4850bf28 pc=0x21b76c runtime.gcBgMarkStartWorkers.gowrap1() /tmp/workdir-gnot/go/src/runtime/mgc.go:1249 +0x25 fp=0x4850bfe0 sp=0x4850bfc8 pc=0x21b645 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x4850bfe8 sp=0x4850bfe0 pc=0x268b01 created by runtime.gcBgMarkStartWorkers in goroutine 1 /tmp/workdir-gnot/go/src/runtime/mgc.go:1249 +0x105 goroutine 27 gp=0x48503180 m=nil [GC worker (idle)]: runtime.gopark(0x468a80?, 0x1?, 0x22?, 0xaa?, 0x0?) /tmp/workdir-gnot/go/src/runtime/proc.go:402 +0xce fp=0x4850cf28 sp=0x4850cf08 pc=0x238b4e runtime.gcBgMarkWorker(0x48504000) /tmp/workdir-gnot/go/src/runtime/mgc.go:1333 +0xec fp=0x4850cfc8 sp=0x4850cf28 pc=0x21b76c runtime.gcBgMarkStartWorkers.gowrap1() /tmp/workdir-gnot/go/src/runtime/mgc.go:1249 +0x25 fp=0x4850cfe0 sp=0x4850cfc8 pc=0x21b645 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x4850cfe8 sp=0x4850cfe0 pc=0x268b01 created by runtime.gcBgMarkStartWorkers in goroutine 1 /tmp/workdir-gnot/go/src/runtime/mgc.go:1249 +0x105 exit status: 'stress 17358: 2' trace_test.go:562: exit status: 'go 17338: 1' --- FAIL: TestTraceStressStartStop (1.90s) --- FAIL: TestTraceStressStartStop/Default (1.90s) trace_test.go:560: stderr: fatal error: unexpected signal during runtime execution [signal sys: trap: fault read code=0x0 addr=0x0 pc=0x25a6ca] runtime stack: runtime.throw({0x2fbc0e?, 0x468000?}) /tmp/workdir-gnot/go/src/runtime/panic.go:1011 +0x65 fp=0x7fffffffda08 sp=0x7fffffffd9d8 pc=0x236045 runtime.sigpanic() /tmp/workdir-gnot/go/src/runtime/os_plan9.go:75 +0x4a5 fp=0x7fffffffda88 sp=0x7fffffffda08 pc=0x232ae5 runtime.fpTracebackPCs(...) /tmp/workdir-gnot/go/src/runtime/trace2stack.go:219 pc=0x25a6cb runtime.traceStack(0x48500808?, 0x48088008?, 0x1) /tmp/workdir-gnot/go/src/runtime/trace2stack.go:70 +0x8f fp=0x7fffffffded0 sp=0x7fffffffda88 pc=0x25a58f runtime.traceLocker.stack(...) /tmp/workdir-gnot/go/src/runtime/trace2event.go:166 pc=0x259b7b runtime.traceLocker.GoPark({0x48500808?, 0x400000002?}, 0xa, 0x0) /tmp/workdir-gnot/go/src/runtime/trace2runtime.go:438 +0x20 fp=0x7fffffffdf60 sp=0x7fffffffded0 pc=0x259b00 runtime.park_m(0x48482a80) /tmp/workdir-gnot/go/src/runtime/proc.go:4017 +0x85 fp=0x7fffffffdfb8 sp=0x7fffffffdf60 pc=0x23fb85 runtime.mcall() /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:458 +0x53 fp=0x7fffffffdfd0 sp=0x7fffffffdfb8 pc=0x266c13 goroutine 21 gp=0x48482a80 m=9 mp=0x48500808 [GC worker (idle)]: runtime.gopark(0x484a2f68?, 0x17b2423269c3819d?, 0xbb?, 0x2b?, 0x0?) /tmp/workdir-gnot/go/src/runtime/proc.go:402 +0xce fp=0x484a2f28 sp=0x484a2f08 pc=0x238b4e runtime.gcBgMarkWorker(0x48498000) /tmp/workdir-gnot/go/src/runtime/mgc.go:1333 +0xec fp=0x484a2fc8 sp=0x484a2f28 pc=0x21b76c runtime.gcBgMarkStartWorkers.gowrap1() /tmp/workdir-gnot/go/src/runtime/mgc.go:1249 +0x25 fp=0x484a2fe0 sp=0x484a2fc8 pc=0x21b645 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x484a2fe8 sp=0x484a2fe0 pc=0x268b01 created by runtime.gcBgMarkStartWorkers in goroutine 6 /tmp/workdir-gnot/go/src/runtime/mgc.go:1249 +0x105 goroutine 1 gp=0x480061c0 m=nil [runnable]: runtime.Gosched(...) /tmp/workdir-gnot/go/src/runtime/proc.go:342 pc=0x21e1a8 runtime.gcAssistAlloc(0x480061c0) /tmp/workdir-gnot/go/src/runtime/mgcmark.go:574 +0x27c fp=0x4835fb70 sp=0x4835fb10 pc=0x21e19c runtime.deductAssistCredit(0x0?) /tmp/workdir-gnot/go/src/runtime/malloc.go:1353 +0x54 fp=0x4835fb98 sp=0x4835fb70 pc=0x20d174 runtime.mallocgc(0x20, 0x2eb2a0, 0x1) /tmp/workdir-gnot/go/src/runtime/malloc.go:1025 +0xcc fp=0x4835fc20 sp=0x4835fb98 pc=0x20c8cc runtime.growslice(0x0, 0x48054cc8?, 0x256fca?, 0x48054cb8?, 0x2eb2a0) /tmp/workdir-gnot/go/src/runtime/slice.go:250 +0x5b0 fp=0x4835fc90 sp=0x4835fc20 pc=0x24bc90 runtime.traceAdvance.func1(0x0?) /tmp/workdir-gnot/go/src/runtime/trace2.go:348 +0x176 fp=0x4835fd30 sp=0x4835fc90 pc=0x256156 runtime.forEachGRace(0x4835fe68) /tmp/workdir-gnot/go/src/runtime/proc.go:677 +0x49 fp=0x4835fd60 sp=0x4835fd30 pc=0x239749 runtime.traceAdvance(0x1) /tmp/workdir-gnot/go/src/runtime/trace2.go:305 +0xd8 fp=0x4835fe98 sp=0x4835fd60 pc=0x255418 runtime.StopTrace(...) /tmp/workdir-gnot/go/src/runtime/trace2.go:268 pc=0x2c6515 runtime/trace.Stop() /tmp/workdir-gnot/go/src/runtime/trace/trace.go:148 +0x8b fp=0x4835fed0 sp=0x4835fe98 pc=0x2c650b main.main() /tmp/workdir-gnot/go/src/internal/trace/v2/testdata/testprog/stress-start-stop.go:163 +0xbc fp=0x4835ff48 sp=0x4835fed0 pc=0x2c665c runtime.main() /tmp/workdir-gnot/go/src/runtime/proc.go:271 +0x2cb fp=0x4835ffe0 sp=0x4835ff48 pc=0x23870b runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x4835ffe8 sp=0x4835ffe0 pc=0x268b01 goroutine 2 gp=0x48006700 m=nil [force gc (idle)]: runtime.gopark(0x0?, 0x0?, 0x0?, 0x0?, 0x0?) /tmp/workdir-gnot/go/src/runtime/proc.go:402 +0xce fp=0x48055fa0 sp=0x48055f80 pc=0x238b4e runtime.goparkunlock(...) /tmp/workdir-gnot/go/src/runtime/proc.go:408 pc=0x2389a7 runtime.forcegchelper() /tmp/workdir-gnot/go/src/runtime/proc.go:326 +0x85 fp=0x48055fe0 sp=0x48055fa0 pc=0x238985 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x48055fe8 sp=0x48055fe0 pc=0x268b01 created by runtime.init.6 in goroutine 1 /tmp/workdir-gnot/go/src/runtime/proc.go:314 +0x1a goroutine 3 gp=0x480068c0 m=nil [GC sweep wait]: runtime.gopark(0x0?, 0x0?, 0x0?, 0x0?, 0x0?) /tmp/workdir-gnot/go/src/runtime/proc.go:402 +0xce fp=0x48056f80 sp=0x48056f60 pc=0x238b4e runtime.goparkunlock(...) /tmp/workdir-gnot/go/src/runtime/proc.go:408 pc=0x224eb4 runtime.bgsweep(0x4806a000) /tmp/workdir-gnot/go/src/runtime/mgcsweep.go:278 +0x72 fp=0x48056fc8 sp=0x48056f80 pc=0x224e92 runtime.gcenable.gowrap1() /tmp/workdir-gnot/go/src/runtime/mgc.go:203 +0x25 fp=0x48056fe0 sp=0x48056fc8 pc=0x2193a5 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x48056fe8 sp=0x48056fe0 pc=0x268b01 created by runtime.gcenable in goroutine 1 /tmp/workdir-gnot/go/src/runtime/mgc.go:203 +0x66 goroutine 4 gp=0x48006a80 m=nil [GC scavenge wait]: runtime.gopark(0x10000?, 0x31ddd0?, 0x0?, 0x0?, 0x0?) /tmp/workdir-gnot/go/src/runtime/proc.go:402 +0xce fp=0x48057f78 sp=0x48057f58 pc=0x238b4e runtime.goparkunlock(...) /tmp/workdir-gnot/go/src/runtime/proc.go:408 pc=0x222849 runtime.(*scavengerState).park(0x40abc0) /tmp/workdir-gnot/go/src/runtime/mgcscavenge.go:425 +0x2e fp=0x48057fa8 sp=0x48057f78 pc=0x22282e runtime.bgscavenge(0x4806a000) /tmp/workdir-gnot/go/src/runtime/mgcscavenge.go:658 +0x59 fp=0x48057fc8 sp=0x48057fa8 pc=0x222e59 runtime.gcenable.gowrap2() /tmp/workdir-gnot/go/src/runtime/mgc.go:204 +0x25 fp=0x48057fe0 sp=0x48057fc8 pc=0x219345 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x48057fe8 sp=0x48057fe0 pc=0x268b01 created by runtime.gcenable in goroutine 1 /tmp/workdir-gnot/go/src/runtime/mgc.go:204 +0xa5 goroutine 5 gp=0x48006fc0 m=nil [finalizer wait]: runtime.gopark(0x0?, 0x0?, 0x0?, 0x0?, 0x0?) /tmp/workdir-gnot/go/src/runtime/proc.go:402 +0xce fp=0x48050e20 sp=0x48050e00 pc=0x238b4e runtime.runfinq() /tmp/workdir-gnot/go/src/runtime/mfinal.go:194 +0x107 fp=0x48050fe0 sp=0x48050e20 pc=0x2183a7 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x48050fe8 sp=0x48050fe0 pc=0x268b01 created by runtime.createfing in goroutine 1 /tmp/workdir-gnot/go/src/runtime/mfinal.go:164 +0x3d goroutine 6 gp=0x48007180 m=nil [wait for GC cycle]: runtime.gopark(0x48051e28?, 0x48051e10?, 0x80?, 0x9e?, 0x48051e10?) /tmp/workdir-gnot/go/src/runtime/proc.go:402 +0xce fp=0x48051e70 sp=0x48051e50 pc=0x238b4e runtime.goparkunlock(...) /tmp/workdir-gnot/go/src/runtime/proc.go:408 pc=0x219655 runtime.gcWaitOnMark(0x1) /tmp/workdir-gnot/go/src/runtime/mgc.go:524 +0x33 fp=0x48051ea0 sp=0x48051e70 pc=0x219633 runtime.GC() /tmp/workdir-gnot/go/src/runtime/mgc.go:468 +0x47 fp=0x48051ed8 sp=0x48051ea0 pc=0x219507 main.main.func1() /tmp/workdir-gnot/go/src/internal/trace/v2/testdata/testprog/stress-start-stop.go:72 +0x250 fp=0x48051fe0 sp=0x48051ed8 pc=0x2c6990 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x48051fe8 sp=0x48051fe0 pc=0x268b01 created by main.main in goroutine 1 /tmp/workdir-gnot/go/src/internal/trace/v2/testdata/testprog/stress-start-stop.go:28 +0xa9 goroutine 7 gp=0x48007340 m=nil [chan receive]: runtime.gopark(0x252f65?, 0x48416000?, 0x1?, 0x0?, 0x48052ef8?) /tmp/workdir-gnot/go/src/runtime/proc.go:402 +0xce fp=0x48052ea8 sp=0x48052e88 pc=0x238b4e runtime.chanrecv(0x48080120, 0x0, 0x1) /tmp/workdir-gnot/go/src/runtime/chan.go:583 +0x3bf fp=0x48052f20 sp=0x48052ea8 pc=0x20545f runtime.chanrecv1(0x4807e050?, 0x17b242326fa5d906?) /tmp/workdir-gnot/go/src/runtime/chan.go:442 +0x12 fp=0x48052f48 sp=0x48052f20 pc=0x205092 runtime.(*wakeableSleep).sleep(0x4801a048, 0x5f5e100) /tmp/workdir-gnot/go/src/runtime/trace2.go:943 +0xb8 fp=0x48052fa8 sp=0x48052f48 pc=0x256c58 runtime.traceStartReadCPU.func1() /tmp/workdir-gnot/go/src/runtime/trace2cpu.go:56 +0x45 fp=0x48052fe0 sp=0x48052fa8 pc=0x2577a5 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x48052fe8 sp=0x48052fe0 pc=0x268b01 created by runtime.traceStartReadCPU in goroutine 1 /tmp/workdir-gnot/go/src/runtime/trace2cpu.go:44 +0x156 goroutine 8 gp=0x48007500 m=nil [chan receive]: runtime.gopark(0x252f65?, 0x48356000?, 0x1?, 0x0?, 0x48053f00?) /tmp/workdir-gnot/go/src/runtime/proc.go:402 +0xce fp=0x48053eb0 sp=0x48053e90 pc=0x238b4e runtime.chanrecv(0x48080240, 0x0, 0x1) /tmp/workdir-gnot/go/src/runtime/chan.go:583 +0x3bf fp=0x48053f28 sp=0x48053eb0 pc=0x20545f runtime.chanrecv1(0x4807e0a0?, 0x17b242328cbf04ab?) /tmp/workdir-gnot/go/src/runtime/chan.go:442 +0x12 fp=0x48053f50 sp=0x48053f28 pc=0x205092 runtime.(*wakeableSleep).sleep(0x4801a060, 0x3b9aca00) /tmp/workdir-gnot/go/src/runtime/trace2.go:943 +0xb8 fp=0x48053fb0 sp=0x48053f50 pc=0x256c58 runtime.(*traceAdvancerState).start.func1() /tmp/workdir-gnot/go/src/runtime/trace2.go:880 +0x28 fp=0x48053fe0 sp=0x48053fb0 pc=0x256ac8 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x48053fe8 sp=0x48053fe0 pc=0x268b01 created by runtime.(*traceAdvancerState).start in goroutine 1 /tmp/workdir-gnot/go/src/runtime/trace2.go:877 +0x165 goroutine 9 gp=0x480076c0 m=nil [runnable]: runtime.gcMarkDone() /tmp/workdir-gnot/go/src/runtime/mgc.go:803 +0x37c fp=0x4809cd38 sp=0x4809cd30 pc=0x21a23c runtime.gcAssistAlloc(0x480076c0) /tmp/workdir-gnot/go/src/runtime/mgcmark.go:562 +0x25f fp=0x4809cd98 sp=0x4809cd38 pc=0x21e17f runtime.deductAssistCredit(0x0?) /tmp/workdir-gnot/go/src/runtime/malloc.go:1353 +0x54 fp=0x4809cdc0 sp=0x4809cd98 pc=0x20d174 runtime.mallocgc(0x10000, 0x0, 0x0) /tmp/workdir-gnot/go/src/runtime/malloc.go:1025 +0xcc fp=0x4809ce48 sp=0x4809cdc0 pc=0x20c8cc runtime.growslice(0x0, 0x40?, 0x46e108?, 0x40?, 0x40b220?) /tmp/workdir-gnot/go/src/runtime/slice.go:242 +0x55b fp=0x4809ceb8 sp=0x4809ce48 pc=0x24bc3b bytes.growSlice({0x480341c0, 0x33, 0x480341d0?}, 0x45d1f020?) /tmp/workdir-gnot/go/src/bytes/buffer.go:249 +0x9b fp=0x4809cf38 sp=0x4809ceb8 pc=0x26f09b bytes.(*Buffer).grow(0x48082270, 0xffc6) /tmp/workdir-gnot/go/src/bytes/buffer.go:151 +0x13d fp=0x4809cf70 sp=0x4809cf38 pc=0x26eddd bytes.(*Buffer).Write(0x48082270, {0x45e3f020, 0xffc6, 0x0?}) /tmp/workdir-gnot/go/src/bytes/buffer.go:179 +0x59 fp=0x4809cfa0 sp=0x4809cf70 pc=0x26ef39 runtime/trace.Start.func1() /tmp/workdir-gnot/go/src/runtime/trace/trace.go:134 +0x3b fp=0x4809cfe0 sp=0x4809cfa0 pc=0x2c63fb runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x4809cfe8 sp=0x4809cfe0 pc=0x268b01 created by runtime/trace.Start in goroutine 1 /tmp/workdir-gnot/go/src/runtime/trace/trace.go:128 +0xf6 goroutine 10 gp=0x48007880 m=nil [chan receive]: runtime.gopark(0x0?, 0x0?, 0x0?, 0x0?, 0x0?) /tmp/workdir-gnot/go/src/runtime/proc.go:402 +0xce fp=0x4809df18 sp=0x4809def8 pc=0x238b4e runtime.chanrecv(0x480802a0, 0x0, 0x1) /tmp/workdir-gnot/go/src/runtime/chan.go:583 +0x3bf fp=0x4809df90 sp=0x4809df18 pc=0x20545f runtime.chanrecv1(0x0?, 0x0?) /tmp/workdir-gnot/go/src/runtime/chan.go:442 +0x12 fp=0x4809dfb8 sp=0x4809df90 pc=0x205092 main.main.func1.2() /tmp/workdir-gnot/go/src/internal/trace/v2/testdata/testprog/stress-start-stop.go:38 +0x25 fp=0x4809dfe0 sp=0x4809dfb8 pc=0x2c7305 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x4809dfe8 sp=0x4809dfe0 pc=0x268b01 created by main.main.func1 in goroutine 6 /tmp/workdir-gnot/go/src/internal/trace/v2/testdata/testprog/stress-start-stop.go:37 +0x11a goroutine 11 gp=0x48007a40 m=0 mp=0x40b220 [syscall]: syscall.Syscall6(0x32, 0x3, 0x4809efbf, 0x1, 0xffffffffffffffff, 0xffffffffffffffff, 0x0) /tmp/workdir-gnot/go/src/syscall/asm_plan9_amd64.s:63 +0x10 fp=0x4809ee70 sp=0x4809edb8 pc=0x27fa30 syscall.Pread(0x48026180?, {0x4809efbf?, 0x0?, 0x0?}, 0x0?) /tmp/workdir-gnot/go/src/syscall/zsyscall_plan9_amd64.go:218 +0x5e fp=0x4809eee8 sp=0x4809ee70 pc=0x27f65e syscall.Read(...) /tmp/workdir-gnot/go/src/syscall/syscall_plan9.go:170 pc=0x28d5cb os.(*File).read(0x48040048, {0x4809efbf, 0x1, 0x1}) /tmp/workdir-gnot/go/src/os/file_plan9.go:287 +0xc4 fp=0x4809ef58 sp=0x4809eee8 pc=0x28d5a4 os.(*File).Read(0x48040048, {0x4809efbf, 0x1, 0x1}) /tmp/workdir-gnot/go/src/os/file.go:118 +0x65 fp=0x4809ef98 sp=0x4809ef58 pc=0x28c3a5 main.main.func1.4() /tmp/workdir-gnot/go/src/internal/trace/v2/testdata/testprog/stress-start-stop.go:54 +0x3b fp=0x4809efe0 sp=0x4809ef98 pc=0x2c723b runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x4809efe8 sp=0x4809efe0 pc=0x268b01 created by main.main.func1 in goroutine 6 /tmp/workdir-gnot/go/src/internal/trace/v2/testdata/testprog/stress-start-stop.go:52 +0x205 goroutine 17 gp=0x48482380 m=nil [runnable, locked to thread]: runtime.Gosched(...) /tmp/workdir-gnot/go/src/runtime/proc.go:342 pc=0x2c71a5 main.main.func1.5() /tmp/workdir-gnot/go/src/internal/trace/v2/testdata/testprog/stress-start-stop.go:67 +0x56 fp=0x48098fe0 sp=0x48098fb8 pc=0x2c7196 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x48098fe8 sp=0x48098fe0 pc=0x268b01 created by main.main.func1 in goroutine 6 /tmp/workdir-gnot/go/src/internal/trace/v2/testdata/testprog/stress-start-stop.go:60 +0x24b goroutine 18 gp=0x48482540 m=nil [GC worker (idle)]: runtime.gopark(0x0?, 0x0?, 0x0?, 0x0?, 0x0?) /tmp/workdir-gnot/go/src/runtime/proc.go:402 +0xce fp=0x48099f28 sp=0x48099f08 pc=0x238b4e runtime.gcBgMarkWorker(0x48498000) /tmp/workdir-gnot/go/src/runtime/mgc.go:1333 +0xec fp=0x48099fc8 sp=0x48099f28 pc=0x21b76c runtime.gcBgMarkStartWorkers.gowrap1() /tmp/workdir-gnot/go/src/runtime/mgc.go:1249 +0x25 fp=0x48099fe0 sp=0x48099fc8 pc=0x21b645 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x48099fe8 sp=0x48099fe0 pc=0x268b01 created by runtime.gcBgMarkStartWorkers in goroutine 6 /tmp/workdir-gnot/go/src/runtime/mgc.go:1249 +0x105 goroutine 19 gp=0x48482700 m=nil [GC worker (idle)]: runtime.gopark(0x0?, 0x0?, 0x0?, 0x0?, 0x0?) /tmp/workdir-gnot/go/src/runtime/proc.go:402 +0xce fp=0x4809af28 sp=0x4809af08 pc=0x238b4e runtime.gcBgMarkWorker(0x48498000) /tmp/workdir-gnot/go/src/runtime/mgc.go:1333 +0xec fp=0x4809afc8 sp=0x4809af28 pc=0x21b76c runtime.gcBgMarkStartWorkers.gowrap1() /tmp/workdir-gnot/go/src/runtime/mgc.go:1249 +0x25 fp=0x4809afe0 sp=0x4809afc8 pc=0x21b645 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x4809afe8 sp=0x4809afe0 pc=0x268b01 created by runtime.gcBgMarkStartWorkers in goroutine 6 /tmp/workdir-gnot/go/src/runtime/mgc.go:1249 +0x105 goroutine 20 gp=0x484828c0 m=nil [GC worker (idle)]: runtime.gopark(0x0?, 0x0?, 0x0?, 0x0?, 0x0?) /tmp/workdir-gnot/go/src/runtime/proc.go:402 +0xce fp=0x4809bf28 sp=0x4809bf08 pc=0x238b4e runtime.gcBgMarkWorker(0x48498000) /tmp/workdir-gnot/go/src/runtime/mgc.go:1333 +0xec fp=0x4809bfc8 sp=0x4809bf28 pc=0x21b76c runtime.gcBgMarkStartWorkers.gowrap1() /tmp/workdir-gnot/go/src/runtime/mgc.go:1249 +0x25 fp=0x4809bfe0 sp=0x4809bfc8 pc=0x21b645 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x4809bfe8 sp=0x4809bfe0 pc=0x268b01 created by runtime.gcBgMarkStartWorkers in goroutine 6 /tmp/workdir-gnot/go/src/runtime/mgc.go:1249 +0x105 goroutine 22 gp=0x48482c40 m=nil [GC worker (idle)]: runtime.gopark(0x484a3f68?, 0x17b2423269ccd342?, 0xfc?, 0xf0?, 0x0?) /tmp/workdir-gnot/go/src/runtime/proc.go:402 +0xce fp=0x484a3f28 sp=0x484a3f08 pc=0x238b4e runtime.gcBgMarkWorker(0x48498000) /tmp/workdir-gnot/go/src/runtime/mgc.go:1333 +0xec fp=0x484a3fc8 sp=0x484a3f28 pc=0x21b76c runtime.gcBgMarkStartWorkers.gowrap1() /tmp/workdir-gnot/go/src/runtime/mgc.go:1249 +0x25 fp=0x484a3fe0 sp=0x484a3fc8 pc=0x21b645 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x484a3fe8 sp=0x484a3fe0 pc=0x268b01 created by runtime.gcBgMarkStartWorkers in goroutine 6 /tmp/workdir-gnot/go/src/runtime/mgc.go:1249 +0x105 goroutine 23 gp=0x48482e00 m=nil [GC worker (idle)]: runtime.gopark(0x484a4f68?, 0x17b2423269d78453?, 0xc5?, 0x39?, 0x0?) /tmp/workdir-gnot/go/src/runtime/proc.go:402 +0xce fp=0x484a4f28 sp=0x484a4f08 pc=0x238b4e runtime.gcBgMarkWorker(0x48498000) /tmp/workdir-gnot/go/src/runtime/mgc.go:1333 +0xec fp=0x484a4fc8 sp=0x484a4f28 pc=0x21b76c runtime.gcBgMarkStartWorkers.gowrap1() /tmp/workdir-gnot/go/src/runtime/mgc.go:1249 +0x25 fp=0x484a4fe0 sp=0x484a4fc8 pc=0x21b645 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x484a4fe8 sp=0x484a4fe0 pc=0x268b01 created by runtime.gcBgMarkStartWorkers in goroutine 6 /tmp/workdir-gnot/go/src/runtime/mgc.go:1249 +0x105 goroutine 24 gp=0x48482fc0 m=nil [GC worker (idle)]: runtime.gopark(0x468aa0?, 0x1?, 0xce?, 0x96?, 0x0?) /tmp/workdir-gnot/go/src/runtime/proc.go:402 +0xce fp=0x484a5f28 sp=0x484a5f08 pc=0x238b4e runtime.gcBgMarkWorker(0x48498000) /tmp/workdir-gnot/go/src/runtime/mgc.go:1333 +0xec fp=0x484a5fc8 sp=0x484a5f28 pc=0x21b76c runtime.gcBgMarkStartWorkers.gowrap1() /tmp/workdir-gnot/go/src/runtime/mgc.go:1249 +0x25 fp=0x484a5fe0 sp=0x484a5fc8 pc=0x21b645 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x484a5fe8 sp=0x484a5fe0 pc=0x268b01 created by runtime.gcBgMarkStartWorkers in goroutine 6 /tmp/workdir-gnot/go/src/runtime/mgc.go:1249 +0x105 goroutine 25 gp=0x48483180 m=nil [GC worker (idle)]: runtime.gopark(0x4849ef68?, 0x17b242326be31a92?, 0x0?, 0x0?, 0x0?) /tmp/workdir-gnot/go/src/runtime/proc.go:402 +0xce fp=0x4849ef28 sp=0x4849ef08 pc=0x238b4e runtime.gcBgMarkWorker(0x48498000) /tmp/workdir-gnot/go/src/runtime/mgc.go:1333 +0xec fp=0x4849efc8 sp=0x4849ef28 pc=0x21b76c runtime.gcBgMarkStartWorkers.gowrap1() /tmp/workdir-gnot/go/src/runtime/mgc.go:1249 +0x25 fp=0x4849efe0 sp=0x4849efc8 pc=0x21b645 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x4849efe8 sp=0x4849efe0 pc=0x268b01 created by runtime.gcBgMarkStartWorkers in goroutine 6 /tmp/workdir-gnot/go/src/runtime/mgc.go:1249 +0x105 exit status: 'stress-start-stop 17393: 2' trace_test.go:562: exit status: 'go 17372: 1' --- FAIL: TestTraceManyStartStop (1.31s) --- FAIL: TestTraceManyStartStop/Default (1.31s) trace_test.go:560: stderr: fatal error: unexpected signal during runtime execution [signal sys: trap: fault read code=0x0 addr=0x0 pc=0x2552aa] runtime stack: runtime.throw({0x2a7b65?, 0x0?}) /tmp/workdir-gnot/go/src/runtime/panic.go:1011 +0x65 fp=0x7fffffffe8c0 sp=0x7fffffffe890 pc=0x232de5 runtime.sigpanic() /tmp/workdir-gnot/go/src/runtime/os_plan9.go:75 +0x4a5 fp=0x7fffffffe940 sp=0x7fffffffe8c0 pc=0x22fd05 runtime.fpTracebackPCs(...) /tmp/workdir-gnot/go/src/runtime/trace2stack.go:219 pc=0x2552ab runtime.traceStack(0x4467c0?, 0x2?, 0x2) /tmp/workdir-gnot/go/src/runtime/trace2stack.go:70 +0x8f fp=0x7fffffffed88 sp=0x7fffffffe940 pc=0x25516f runtime.traceLocker.stack(...) /tmp/workdir-gnot/go/src/runtime/trace2event.go:166 pc=0x253dad runtime.traceLocker.STWStart({0x409b00?, 0xc?}, 0x2) /tmp/workdir-gnot/go/src/runtime/trace2runtime.go:318 +0x2c fp=0x7fffffffee10 sp=0x7fffffffed88 pc=0x253d2c runtime.stopTheWorldWithSema(0x2) /tmp/workdir-gnot/go/src/runtime/proc.go:1453 +0x59 fp=0x7fffffffeec0 sp=0x7fffffffee10 pc=0x237e39 runtime.gcStart.func1() /tmp/workdir-gnot/go/src/runtime/mgc.go:680 +0x25 fp=0x7fffffffeee0 sp=0x7fffffffeec0 pc=0x2170c5 runtime.systemstack(0x409540) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:509 +0x4d fp=0x7fffffffeef0 sp=0x7fffffffeee0 pc=0x26048d goroutine 1 gp=0x480061c0 m=0 mp=0x409b00 [running]: runtime.systemstack_switch() /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:474 +0x8 fp=0x48054df8 sp=0x48054de8 pc=0x260428 runtime.gcStart({0x1?, 0x0?, 0x287260?}) /tmp/workdir-gnot/go/src/runtime/mgc.go:679 +0x355 fp=0x48054ec0 sp=0x48054df8 pc=0x216d35 runtime.GC() /tmp/workdir-gnot/go/src/runtime/mgc.go:465 +0x3e fp=0x48054ef8 sp=0x48054ec0 pc=0x21671e main.main() /tmp/workdir-gnot/go/src/internal/trace/v2/testdata/testprog/many-start-stop.go:28 +0x1b fp=0x48054f48 sp=0x48054ef8 pc=0x2873fb runtime.main() /tmp/workdir-gnot/go/src/runtime/proc.go:271 +0x2cb fp=0x48054fe0 sp=0x48054f48 pc=0x2354ab runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x48054fe8 sp=0x48054fe0 pc=0x262301 goroutine 2 gp=0x48006700 m=nil [force gc (idle)]: runtime.gopark(0x0?, 0x0?, 0x0?, 0x0?, 0x0?) /tmp/workdir-gnot/go/src/runtime/proc.go:402 +0xce fp=0x48055fa0 sp=0x48055f80 pc=0x2358ee runtime.goparkunlock(...) /tmp/workdir-gnot/go/src/runtime/proc.go:408 pc=0x235747 runtime.forcegchelper() /tmp/workdir-gnot/go/src/runtime/proc.go:326 +0x85 fp=0x48055fe0 sp=0x48055fa0 pc=0x235725 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x48055fe8 sp=0x48055fe0 pc=0x262301 created by runtime.init.6 in goroutine 1 /tmp/workdir-gnot/go/src/runtime/proc.go:314 +0x1a goroutine 3 gp=0x480068c0 m=nil [GC sweep wait]: runtime.gopark(0x1?, 0x0?, 0x0?, 0x0?, 0x0?) /tmp/workdir-gnot/go/src/runtime/proc.go:402 +0xce fp=0x48056f80 sp=0x48056f60 pc=0x2358ee runtime.goparkunlock(...) /tmp/workdir-gnot/go/src/runtime/proc.go:408 pc=0x22211f runtime.bgsweep(0x4806a000) /tmp/workdir-gnot/go/src/runtime/mgcsweep.go:318 +0xbd fp=0x48056fc8 sp=0x48056f80 pc=0x2220fd runtime.gcenable.gowrap1() /tmp/workdir-gnot/go/src/runtime/mgc.go:203 +0x25 fp=0x48056fe0 sp=0x48056fc8 pc=0x2165c5 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x48056fe8 sp=0x48056fe0 pc=0x262301 created by runtime.gcenable in goroutine 1 /tmp/workdir-gnot/go/src/runtime/mgc.go:203 +0x66 goroutine 4 gp=0x48006a80 m=nil [GC scavenge wait]: runtime.gopark(0x10000?, 0x2c3080?, 0x0?, 0x0?, 0x0?) /tmp/workdir-gnot/go/src/runtime/proc.go:402 +0xce fp=0x48057f78 sp=0x48057f58 pc=0x2358ee runtime.goparkunlock(...) /tmp/workdir-gnot/go/src/runtime/proc.go:408 pc=0x21fa69 runtime.(*scavengerState).park(0x4094a0) /tmp/workdir-gnot/go/src/runtime/mgcscavenge.go:425 +0x2e fp=0x48057fa8 sp=0x48057f78 pc=0x21fa4e runtime.bgscavenge(0x4806a000) /tmp/workdir-gnot/go/src/runtime/mgcscavenge.go:658 +0x59 fp=0x48057fc8 sp=0x48057fa8 pc=0x220079 runtime.gcenable.gowrap2() /tmp/workdir-gnot/go/src/runtime/mgc.go:204 +0x25 fp=0x48057fe0 sp=0x48057fc8 pc=0x216565 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x48057fe8 sp=0x48057fe0 pc=0x262301 created by runtime.gcenable in goroutine 1 /tmp/workdir-gnot/go/src/runtime/mgc.go:204 +0xa5 goroutine 5 gp=0x48006fc0 m=nil [finalizer wait]: runtime.gopark(0x0?, 0x0?, 0x0?, 0x0?, 0x0?) /tmp/workdir-gnot/go/src/runtime/proc.go:402 +0xce fp=0x48050e20 sp=0x48050e00 pc=0x2358ee runtime.runfinq() /tmp/workdir-gnot/go/src/runtime/mfinal.go:194 +0x107 fp=0x48050fe0 sp=0x48050e20 pc=0x2155c7 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x48050fe8 sp=0x48050fe0 pc=0x262301 created by runtime.createfing in goroutine 1 /tmp/workdir-gnot/go/src/runtime/mfinal.go:164 +0x3d goroutine 11 gp=0x48007180 m=nil [runnable]: runtime.(*traceAdvancerState).start.func1() /tmp/workdir-gnot/go/src/runtime/trace2.go:877 +0x1 fp=0x48051fe0 sp=0x48051fd8 pc=0x251681 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x48051fe8 sp=0x48051fe0 pc=0x262301 created by runtime.(*traceAdvancerState).start in goroutine 1 /tmp/workdir-gnot/go/src/runtime/trace2.go:877 +0x165 goroutine 10 gp=0x48007340 m=nil [runnable]: runtime.traceStartReadCPU.func1() /tmp/workdir-gnot/go/src/runtime/trace2cpu.go:44 +0x1 fp=0x48052fe0 sp=0x48052fd8 pc=0x252341 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x48052fe8 sp=0x48052fe0 pc=0x262301 created by runtime.traceStartReadCPU in goroutine 1 /tmp/workdir-gnot/go/src/runtime/trace2cpu.go:44 +0x156 goroutine 12 gp=0x48007500 m=nil [runnable]: runtime/trace.Start.func1() /tmp/workdir-gnot/go/src/runtime/trace/trace.go:128 +0x1 fp=0x48053fe0 sp=0x48053fd8 pc=0x287201 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x48053fe8 sp=0x48053fe0 pc=0x262301 created by runtime/trace.Start in goroutine 1 /tmp/workdir-gnot/go/src/runtime/trace/trace.go:128 +0xf6 goroutine 9 gp=0x480076c0 m=nil [GC worker (idle)]: runtime.gopark(0x4808cf68?, 0x17b24232bcd4eef1?, 0x0?, 0x0?, 0x0?) /tmp/workdir-gnot/go/src/runtime/proc.go:402 +0xce fp=0x4808cf28 sp=0x4808cf08 pc=0x2358ee runtime.gcBgMarkWorker(0x48080240) /tmp/workdir-gnot/go/src/runtime/mgc.go:1333 +0xec fp=0x4808cfc8 sp=0x4808cf28 pc=0x21898c runtime.gcBgMarkStartWorkers.gowrap1() /tmp/workdir-gnot/go/src/runtime/mgc.go:1249 +0x25 fp=0x4808cfe0 sp=0x4808cfc8 pc=0x218865 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_amd64.s:1695 +0x1 fp=0x4808cfe8 sp=0x4808cfe0 pc=0x262301 created by runtime.gcBgMarkStartWorkers in goroutine 1 /tmp/workdir-gnot/go/src/runtime/mgc.go:1249 +0x105 exit status: 'many-start-stop 17427: 2' trace_test.go:562: exit status: 'go 17406: 1' FAIL FAIL internal/trace/v2 17.298s FAIL go tool dist: Failed: exit status: 'go 17018: 1'