openbsd-386-72 at 327074551a2f22f2c0b8e444d1673c86f77ca745 :: Running /tmp/workdir/go/src/make.bash with args ["/tmp/workdir/go/src/make.bash" "-force"] and env ["HOME=/" "INRC=1" "_=/bin/sh" "WORKDIR=/tmp/workdir" "GO_BUILDER_NAME=openbsd-386-72" "GOBIN=" "GOROOT_BOOTSTRAP=" "TMPDIR=/tmp/workdir/tmp" "GOCACHE=/tmp/workdir/gocache" "GOPLSCACHE=/tmp/workdir/goplscache" "PATH=/tmp/workdir/go1.4/go/bin:/sbin:/bin:/usr/sbin:/usr/bin:/usr/local/bin" "PWD=/tmp/workdir/go/src"] in dir /tmp/workdir/go/src WARNING: //go1.4/bin/go does not exist, found /tmp/workdir/go1.4/go/bin/go from env WARNING: set /tmp/workdir/go1.4/go as GOROOT_BOOTSTRAP Building Go cmd/dist using /tmp/workdir/go1.4/go. (go1.22.6 openbsd/386) Building Go toolchain1 using /tmp/workdir/go1.4/go. 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 openbsd/386. --- Installed Go for openbsd/386 in /tmp/workdir/go Installed commands in /tmp/workdir/go/bin *** You need to add /tmp/workdir/go/bin to your PATH. ##### Test execution environment. # GOARCH: 386 # CPU: Intel(R) Xeon(R) CPU @ 2.80GHz # GOOS: openbsd # OS Version: OpenBSD 7.2 OpenBSD 7.2 (GENERIC) #5: Tue Jul 25 16:20:24 CEST 2023 root@syspatch-72-i386.openbsd.org:/usr/src/sys/arch/i386/compile/GENERIC i386 ##### Testing packages. ok archive/tar 0.159s ok archive/zip 0.390s ok bufio 0.069s ok bytes 0.391s ok cmp 0.015s ok compress/bzip2 0.085s ok compress/flate 0.681s ok compress/gzip 1.424s ok compress/lzw 0.076s ok compress/zlib 0.416s ok container/heap 0.016s ok container/list 0.015s ok container/ring 0.016s ok context 0.299s ok crypto 1.057s ok crypto/aes 0.034s ok crypto/cipher 1.802s ok crypto/des 0.029s ok crypto/dsa 0.020s ok crypto/ecdh 0.261s ok crypto/ecdsa 0.175s ok crypto/ed25519 0.263s ok crypto/elliptic 0.063s ok crypto/hmac 0.029s ok crypto/internal/alias 0.020s ok crypto/internal/bigmod 0.055s ok crypto/internal/boring 0.015s ok crypto/internal/boring/bcache 0.169s ok crypto/internal/edwards25519 0.411s ok crypto/internal/edwards25519/field 0.073s ok crypto/internal/hpke 0.020s ok crypto/internal/mlkem768 0.254s ok crypto/internal/nistec 0.930s ok crypto/internal/nistec/fiat 0.015s [no tests to run] ok crypto/md5 0.019s ok crypto/rand 0.117s ok crypto/rc4 0.059s ok crypto/rsa 0.900s ok crypto/sha1 0.019s ok crypto/sha256 0.019s ok crypto/sha512 0.021s ok crypto/subtle 0.253s ok crypto/tls 1.798s ok crypto/x509 2.001s ok database/sql 0.761s ok database/sql/driver 0.016s ok debug/buildinfo 0.085s ok debug/dwarf 0.059s ok debug/elf 0.172s ok debug/gosym 0.058s ok debug/macho 0.026s ok debug/pe 0.072s ok debug/plan9obj 0.017s ok embed 0.016s [no tests to run] ok embed/internal/embedtest 0.017s ok encoding/ascii85 0.017s ok encoding/asn1 0.022s ok encoding/base32 0.037s ok encoding/base64 0.018s ok encoding/binary 0.024s ok encoding/csv 0.027s ok encoding/gob 3.386s ok encoding/hex 0.018s ok encoding/json 0.431s ok encoding/pem 1.011s ok encoding/xml 0.088s ok errors 0.021s ok expvar 0.019s ok flag 0.071s ok fmt 0.102s ok go/ast 0.022s ok go/build 3.195s ok go/build/constraint 0.066s ok go/constant 0.019s ok go/doc 0.098s ok go/doc/comment 1.326s ok go/format 0.021s ok go/importer 0.522s ok go/internal/gccgoimporter 0.037s ok go/internal/gcimporter 3.489s ok go/internal/srcimporter 16.066s ok go/parser 0.457s ok go/printer 0.178s ok go/scanner 0.017s ok go/token 0.030s ok go/types 21.879s ok go/version 0.015s ok hash 0.017s ok hash/adler32 0.022s ok hash/crc32 0.020s ok hash/crc64 0.017s ok hash/fnv 0.016s ok hash/maphash 0.063s ok html 0.017s ok html/template 0.084s ok image 0.076s ok image/color 0.027s ok image/draw 0.083s ok image/gif 0.151s ok image/jpeg 0.191s ok image/png 0.274s ok index/suffixarray 0.171s ok internal/abi 0.159s ok internal/buildcfg 0.016s ok internal/chacha8rand 0.015s ok internal/concurrent 0.075s ok internal/coverage/cfile 1.436s ok internal/coverage/cformat 0.016s ok internal/coverage/cmerge 0.015s ok internal/coverage/pods 0.018s ok internal/coverage/slicereader 0.015s ok internal/coverage/slicewriter 0.015s ok internal/coverage/test 0.023s ok internal/cpu 0.036s ok internal/dag 0.016s ok internal/diff 0.021s ok internal/fmtsort 0.016s ok internal/fuzz 0.022s ok internal/godebug 0.990s ok internal/godebugs 6.153s ok internal/gover 0.015s ok internal/itoa 0.019s ok internal/pkgbits 0.016s ok internal/platform 1.449s ok internal/poll 0.068s ok internal/profile 0.015s ok internal/reflectlite 0.018s ok internal/runtime/atomic 0.050s ok internal/runtime/math 0.015s ok internal/runtime/sys 0.015s ok internal/saferio 0.108s ok internal/singleflight 0.081s ok internal/sysinfo 0.016s ok internal/testenv 0.372s fatal error: runtime: out of memory runtime stack: runtime.throw({0x8273ff4, 0x16}) /tmp/workdir/go/src/runtime/panic.go:1069 +0x35 fp=0x2ad6b390 sp=0x2ad6b37c pc=0x80b7a65 runtime.sysMapOS(0xaa400000, 0x6000000) /tmp/workdir/go/src/runtime/mem_bsd.go:81 +0x142 fp=0x2ad6b3bc sp=0x2ad6b390 pc=0x805a252 runtime.sysMap(0xaa400000, 0x6000000, 0x8403618) /tmp/workdir/go/src/runtime/mem.go:155 +0x3f fp=0x2ad6b3cc sp=0x2ad6b3bc pc=0x805a02f runtime.(*mheap).grow(0x83fe2c0, 0x2ef9) /tmp/workdir/go/src/runtime/mheap.go:1539 +0x2a2 fp=0x2ad6b41c sp=0x2ad6b3cc pc=0x806f982 runtime.(*mheap).allocSpan(0x83fe2c0, 0x2ef9, 0x0, 0x0) /tmp/workdir/go/src/runtime/mheap.go:1244 +0x2f9 fp=0x2ad6b4ac sp=0x2ad6b41c pc=0x806eec9 runtime.(*mheap).alloc.func1() /tmp/workdir/go/src/runtime/mheap.go:962 +0x7c fp=0x2ad6b4d0 sp=0x2ad6b4ac pc=0x806e8ac runtime.systemstack(0x40000) /tmp/workdir/go/src/runtime/asm_386.s:374 +0x35 fp=0x2ad6b4d4 sp=0x2ad6b4d0 pc=0x80bbec5 goroutine 113 gp=0x6cc078c8 m=3 mp=0x6cc3ca08 [running]: runtime.systemstack_switch() /tmp/workdir/go/src/runtime/asm_386.s:341 fp=0x6cc64b80 sp=0x6cc64b7c pc=0x80bbe80 runtime.(*mheap).alloc(0x83fe2c0, 0x2ef9, 0x0) /tmp/workdir/go/src/runtime/mheap.go:956 +0x59 fp=0x6cc64ba0 sp=0x6cc64b80 pc=0x806e819 runtime.(*mcache).allocLarge(0x17ef5088, 0x5df1fc8, 0x0) /tmp/workdir/go/src/runtime/mcache.go:234 +0x6d fp=0x6cc64bcc sp=0x6cc64ba0 pc=0x805904d runtime.mallocgc(0x5df1fc8, 0x8266240, 0x1) /tmp/workdir/go/src/runtime/malloc.go:1177 +0x62b fp=0x6cc64c44 sp=0x6cc64bcc pc=0x80b39db runtime.growslice(0x8354a000, 0x10b2ab, 0x10b2aa, 0x1, 0x8266240) /tmp/workdir/go/src/runtime/slice.go:272 +0x464 fp=0x6cc64c84 sp=0x6cc64c44 pc=0x80b9cb4 internal/trace_test.checkReaderDeterminism.func1() /tmp/workdir/go/src/internal/trace/trace_test.go:548 +0x246 fp=0x6cc64da8 sp=0x6cc64c84 pc=0x821a146 internal/trace_test.checkReaderDeterminism(0x6cc97448, {0x6f294000, 0x1986d40, 0x2000000}, {0x6d30f800, 0x0, 0x200}, 0x0) /tmp/workdir/go/src/internal/trace/trace_test.go:555 +0x9f fp=0x6cc64ef0 sp=0x6cc64da8 pc=0x8219c7f internal/trace_test.testTraceProg.func1(0x6cc97448, 0x0, {0x0, 0x0}) /tmp/workdir/go/src/internal/trace/trace_test.go:619 +0x617 fp=0x6cc64f70 sp=0x6cc64ef0 pc=0x821acf7 internal/trace_test.testTraceProg.func2(0x6cc97448) /tmp/workdir/go/src/internal/trace/trace_test.go:646 +0x32 fp=0x6cc64f84 sp=0x6cc64f70 pc=0x821a6d2 testing.tRunner(0x6cc97448, 0x6d4463f8) /tmp/workdir/go/src/testing/testing.go:1764 +0x113 fp=0x6cc64fe4 sp=0x6cc64f84 pc=0x813e7f3 testing.(*T).Run.gowrap1() /tmp/workdir/go/src/testing/testing.go:1823 +0x28 fp=0x6cc64ff0 sp=0x6cc64fe4 pc=0x813f878 runtime.goexit({}) /tmp/workdir/go/src/runtime/asm_386.s:1393 +0x1 fp=0x6cc64ff4 sp=0x6cc64ff0 pc=0x80bd201 created by testing.(*T).Run in goroutine 112 /tmp/workdir/go/src/testing/testing.go:1823 +0x447 goroutine 1 gp=0x6cc06128 m=nil [chan receive, 2 minutes]: runtime.gopark(0x8283458, 0x6cc1f2f4, 0xe, 0x7, 0x2) /tmp/workdir/go/src/runtime/proc.go:435 +0xfa fp=0x6cc66c3c sp=0x6cc66c28 pc=0x80b7b9a runtime.chanrecv(0x6cc1f2c0, 0x6cc66caf, 0x1) /tmp/workdir/go/src/runtime/chan.go:640 +0x3bd fp=0x6cc66c78 sp=0x6cc66c3c pc=0x804db4d runtime.chanrecv1(0x6cc1f2c0, 0x6cc66caf) /tmp/workdir/go/src/runtime/chan.go:490 +0x1c fp=0x6cc66c8c sp=0x6cc66c78 pc=0x804d75c testing.(*T).Run(0x6cc06d88, {0x8270bc6, 0xf}, 0x82832b4) /tmp/workdir/go/src/testing/testing.go:1831 +0x466 fp=0x6cc66d10 sp=0x6cc66c8c pc=0x813f736 testing.runTests.func1(0x6cc06d88) /tmp/workdir/go/src/testing/testing.go:2251 +0x3f fp=0x6cc66d30 sp=0x6cc66d10 pc=0x81418af testing.tRunner(0x6cc06d88, 0x6cc66df4) /tmp/workdir/go/src/testing/testing.go:1764 +0x113 fp=0x6cc66d90 sp=0x6cc66d30 pc=0x813e7f3 testing.runTests(0x6cc10060, {0x83eeae0, 0x1a, 0x1a}, {0xc1b6cecc39f06a16, 0x29e8f80822, 0x83f67c0}) /tmp/workdir/go/src/testing/testing.go:2249 +0x3de fp=0x6cc66e08 sp=0x6cc66d90 pc=0x81417ce testing.(*M).Run(0x6cc58050) /tmp/workdir/go/src/testing/testing.go:2114 +0x632 fp=0x6cc66f54 sp=0x6cc66e08 pc=0x81401b2 main.main() _testmain.go:99 +0xdf fp=0x6cc66fac sp=0x6cc66f54 pc=0x821ff9f runtime.main() /tmp/workdir/go/src/runtime/proc.go:283 +0x288 fp=0x6cc66ff0 sp=0x6cc66fac pc=0x80817c8 runtime.goexit({}) /tmp/workdir/go/src/runtime/asm_386.s:1393 +0x1 fp=0x6cc66ff4 sp=0x6cc66ff0 pc=0x80bd201 goroutine 2 gp=0x6cc06488 m=nil [force gc (idle), 2 minutes]: runtime.gopark(0x82835c4, 0x83f6480, 0x11, 0xa, 0x1) /tmp/workdir/go/src/runtime/proc.go:435 +0xfa fp=0x6cc38fdc sp=0x6cc38fc8 pc=0x80b7b9a runtime.goparkunlock(...) /tmp/workdir/go/src/runtime/proc.go:441 runtime.forcegchelper() /tmp/workdir/go/src/runtime/proc.go:348 +0xc7 fp=0x6cc38ff0 sp=0x6cc38fdc pc=0x8081b27 runtime.goexit({}) /tmp/workdir/go/src/runtime/asm_386.s:1393 +0x1 fp=0x6cc38ff4 sp=0x6cc38ff0 pc=0x80bd201 created by runtime.init.6 in goroutine 1 /tmp/workdir/go/src/runtime/proc.go:336 +0x1d goroutine 3 gp=0x6cc065a8 m=nil [GC sweep wait]: runtime.gopark(0x82835c4, 0x83f6620, 0xc, 0x9, 0x1) /tmp/workdir/go/src/runtime/proc.go:435 +0xfa fp=0x6cc397cc sp=0x6cc397b8 pc=0x80b7b9a runtime.goparkunlock(...) /tmp/workdir/go/src/runtime/proc.go:441 runtime.bgsweep(0x6cc1e040) /tmp/workdir/go/src/runtime/mgcsweep.go:317 +0xec fp=0x6cc397e8 sp=0x6cc397cc pc=0x806b5ec runtime.gcenable.gowrap1() /tmp/workdir/go/src/runtime/mgc.go:203 +0x21 fp=0x6cc397f0 sp=0x6cc397e8 pc=0x805d0c1 runtime.goexit({}) /tmp/workdir/go/src/runtime/asm_386.s:1393 +0x1 fp=0x6cc397f4 sp=0x6cc397f0 pc=0x80bd201 created by runtime.gcenable in goroutine 1 /tmp/workdir/go/src/runtime/mgc.go:203 +0x71 goroutine 4 gp=0x6cc066c8 m=nil [GC scavenge wait]: runtime.gopark(0x82835c4, 0x83f68e0, 0xd, 0xa, 0x2) /tmp/workdir/go/src/runtime/proc.go:435 +0xfa fp=0x6cc39fb8 sp=0x6cc39fa4 pc=0x80b7b9a runtime.goparkunlock(...) /tmp/workdir/go/src/runtime/proc.go:441 runtime.(*scavengerState).park(0x83f68e0) /tmp/workdir/go/src/runtime/mgcscavenge.go:425 +0x54 fp=0x6cc39fcc sp=0x6cc39fb8 pc=0x8068c34 runtime.bgscavenge(0x6cc1e040) /tmp/workdir/go/src/runtime/mgcscavenge.go:658 +0x69 fp=0x6cc39fe8 sp=0x6cc39fcc pc=0x8069289 runtime.gcenable.gowrap2() /tmp/workdir/go/src/runtime/mgc.go:204 +0x21 fp=0x6cc39ff0 sp=0x6cc39fe8 pc=0x805d081 runtime.goexit({}) /tmp/workdir/go/src/runtime/asm_386.s:1393 +0x1 fp=0x6cc39ff4 sp=0x6cc39ff0 pc=0x80bd201 created by runtime.gcenable in goroutine 1 /tmp/workdir/go/src/runtime/mgc.go:204 +0xb1 goroutine 5 gp=0x6cc06c68 m=nil [finalizer wait, 1 minutes]: runtime.gopark(0x8283478, 0x8402a10, 0x10, 0xa, 0x1) /tmp/workdir/go/src/runtime/proc.go:435 +0xfa fp=0x6cc3a798 sp=0x6cc3a784 pc=0x80b7b9a runtime.runfinq() /tmp/workdir/go/src/runtime/mfinal.go:193 +0xf0 fp=0x6cc3a7f0 sp=0x6cc3a798 pc=0x805c220 runtime.goexit({}) /tmp/workdir/go/src/runtime/asm_386.s:1393 +0x1 fp=0x6cc3a7f4 sp=0x6cc3a7f0 pc=0x80bd201 created by runtime.createfing in goroutine 1 /tmp/workdir/go/src/runtime/mfinal.go:163 +0x5a goroutine 12 gp=0x6cc06fc8 m=nil [chan receive, 2 minutes]: runtime.gopark(0x8283458, 0x6cc1e274, 0xe, 0x7, 0x2) /tmp/workdir/go/src/runtime/proc.go:435 +0xfa fp=0x6cc65d3c sp=0x6cc65d28 pc=0x80b7b9a runtime.chanrecv(0x6cc1e240, 0x0, 0x1) /tmp/workdir/go/src/runtime/chan.go:640 +0x3bd fp=0x6cc65d78 sp=0x6cc65d3c pc=0x804db4d runtime.chanrecv1(0x6cc1e240, 0x0) /tmp/workdir/go/src/runtime/chan.go:490 +0x1c fp=0x6cc65d8c sp=0x6cc65d78 pc=0x804d75c testing.(*T).Parallel(0x6cc070e8) /tmp/workdir/go/src/testing/testing.go:1549 +0x244 fp=0x6cc65e08 sp=0x6cc65d8c pc=0x813e4d4 internal/trace_test.TestMMU(0x6cc070e8) /tmp/workdir/go/src/internal/trace/gc_test.go:28 +0x2c fp=0x6cc65f84 sp=0x6cc65e08 pc=0x821271c testing.tRunner(0x6cc070e8, 0x828326c) /tmp/workdir/go/src/testing/testing.go:1764 +0x113 fp=0x6cc65fe4 sp=0x6cc65f84 pc=0x813e7f3 testing.(*T).Run.gowrap1() /tmp/workdir/go/src/testing/testing.go:1823 +0x28 fp=0x6cc65ff0 sp=0x6cc65fe4 pc=0x813f878 runtime.goexit({}) /tmp/workdir/go/src/runtime/asm_386.s:1393 +0x1 fp=0x6cc65ff4 sp=0x6cc65ff0 pc=0x80bd201 created by testing.(*T).Run in goroutine 1 /tmp/workdir/go/src/testing/testing.go:1823 +0x447 goroutine 10 gp=0x6cc07688 m=nil [GC worker (idle)]: runtime.gopark(0x8283488, 0x6cc18c48, 0x1a, 0xa, 0x0) /tmp/workdir/go/src/runtime/proc.go:435 +0xfa fp=0x6cc3878c sp=0x6cc38778 pc=0x80b7b9a runtime.gcBgMarkWorker(0x6cc1fd80) /tmp/workdir/go/src/runtime/mgc.go:1362 +0xeb fp=0x6cc387e8 sp=0x6cc3878c pc=0x805f9eb runtime.gcBgMarkStartWorkers.gowrap1() /tmp/workdir/go/src/runtime/mgc.go:1278 +0x21 fp=0x6cc387f0 sp=0x6cc387e8 pc=0x805f8e1 runtime.goexit({}) /tmp/workdir/go/src/runtime/asm_386.s:1393 +0x1 fp=0x6cc387f4 sp=0x6cc387f0 pc=0x80bd201 created by runtime.gcBgMarkStartWorkers in goroutine 9 /tmp/workdir/go/src/runtime/mgc.go:1278 +0x114 goroutine 112 gp=0x6cc07328 m=nil [chan receive, 2 minutes]: runtime.gopark(0x8283458, 0x6cc1f374, 0xe, 0x7, 0x2) /tmp/workdir/go/src/runtime/proc.go:435 +0xfa fp=0x6cc35e60 sp=0x6cc35e4c pc=0x80b7b9a runtime.chanrecv(0x6cc1f340, 0x6cc35ed3, 0x1) /tmp/workdir/go/src/runtime/chan.go:640 +0x3bd fp=0x6cc35e9c sp=0x6cc35e60 pc=0x804db4d runtime.chanrecv1(0x6cc1f340, 0x6cc35ed3) /tmp/workdir/go/src/runtime/chan.go:490 +0x1c fp=0x6cc35eb0 sp=0x6cc35e9c pc=0x804d75c testing.(*T).Run(0x6cc97328, {0x826df13, 0x7}, 0x6d4463f8) /tmp/workdir/go/src/testing/testing.go:1831 +0x466 fp=0x6cc35f34 sp=0x6cc35eb0 pc=0x813f736 internal/trace_test.testTraceProg(0x6cc97328, {0x826e7c3, 0x9}, 0x82833f4) /tmp/workdir/go/src/internal/trace/trace_test.go:645 +0x22b fp=0x6cc35f70 sp=0x6cc35f34 pc=0x821a41b internal/trace_test.TestTraceStress(0x6cc97328) /tmp/workdir/go/src/internal/trace/trace_test.go:504 +0x37 fp=0x6cc35f84 sp=0x6cc35f70 pc=0x8219ac7 testing.tRunner(0x6cc97328, 0x82832b4) /tmp/workdir/go/src/testing/testing.go:1764 +0x113 fp=0x6cc35fe4 sp=0x6cc35f84 pc=0x813e7f3 testing.(*T).Run.gowrap1() /tmp/workdir/go/src/testing/testing.go:1823 +0x28 fp=0x6cc35ff0 sp=0x6cc35fe4 pc=0x813f878 runtime.goexit({}) /tmp/workdir/go/src/runtime/asm_386.s:1393 +0x1 fp=0x6cc35ff4 sp=0x6cc35ff0 pc=0x80bd201 created by testing.(*T).Run in goroutine 1 /tmp/workdir/go/src/testing/testing.go:1823 +0x447 FAIL internal/trace 150.340s FAIL go tool dist: Failed: exit status 1