plan9-386-0intro at e53d10dc0435d69138bcce6375a5ff454d56f687 :: 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-386-0intro" "rcname=gobuildlet" "pid=201" "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=386" "fn#sigexit=" "cflag=" "0=/bin/gobuildlet" "WORKDIR=/tmp/workdir-gnot" "GOROOT_BOOTSTRAP=/tmp/workdir-gnot/go1.4" "GO_BUILDER_NAME=plan9-386-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/386) 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/386. --- Installed Go for plan9/386 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: 386 # CPU: QEMU Virtual CPU version 2.4.0 # GOOS: plan9 # OS Version: 2000 ##### Testing packages. ok archive/tar 0.083s ok archive/zip 0.217s ok bufio 0.038s ok bytes 0.128s ok cmp 0.013s ok compress/bzip2 0.040s ok compress/flate 0.456s ok compress/gzip 1.245s ok compress/lzw 0.054s ok compress/zlib 0.291s ok container/heap 0.013s ok container/list 0.013s ok container/ring 0.014s ok context 0.190s ok crypto 1.582s ok crypto/aes 0.024s ok crypto/cipher 0.059s ok crypto/des 0.022s ok crypto/dsa 0.014s ok crypto/ecdh 0.167s ok crypto/ecdsa 0.117s ok crypto/ed25519 0.152s ok crypto/elliptic 0.037s ok crypto/hmac 0.012s ok crypto/internal/alias 0.012s ok crypto/internal/bigmod 0.036s ok crypto/internal/boring 0.012s ok crypto/internal/boring/bcache 0.091s ok crypto/internal/edwards25519 0.229s ok crypto/internal/edwards25519/field 0.042s ok crypto/internal/hpke 0.016s ok crypto/internal/mlkem768 0.142s ok crypto/internal/nistec 0.603s ok crypto/internal/nistec/fiat 0.012s [no tests to run] ok crypto/md5 0.015s ok crypto/rand 0.025s ok crypto/rc4 0.037s ok crypto/rsa 0.542s ok crypto/sha1 0.015s ok crypto/sha256 0.017s ok crypto/sha512 0.015s ok crypto/subtle 0.133s ok crypto/tls 13.393s ok crypto/x509 1.395s ok database/sql 0.643s ok database/sql/driver 0.013s ok debug/buildinfo 0.021s ok debug/dwarf 0.051s ok debug/elf 0.093s ok debug/gosym 0.028s ok debug/macho 0.019s ok debug/pe 0.065s ok debug/plan9obj 0.014s ok embed 0.015s [no tests to run] ok embed/internal/embedtest 0.016s ok encoding/ascii85 0.014s ok encoding/asn1 0.018s ok encoding/base32 0.023s ok encoding/base64 0.016s ok encoding/binary 0.020s ok encoding/csv 0.020s ok encoding/gob 1.468s ok encoding/hex 0.014s ok encoding/json 0.195s ok encoding/pem 0.248s ok encoding/xml 0.044s ok errors 0.017s ok expvar 0.017s ok flag 0.050s ok fmt 0.041s ok go/ast 0.031s ok go/build 4.021s ok go/build/constraint 0.016s ok go/constant 0.016s ok go/doc 0.052s ok go/doc/comment 1.597s ok go/format 0.018s ok go/importer 0.735s ok go/internal/gccgoimporter 0.028s ok go/internal/gcimporter 4.696s ok go/internal/srcimporter 6.334s ok go/parser 0.087s ok go/printer 0.109s ok go/scanner 0.015s ok go/token 0.023s ok go/types 29.463s ok go/version 0.013s ok hash 0.016s ok hash/adler32 0.015s ok hash/crc32 0.016s ok hash/crc64 0.014s ok hash/fnv 0.015s ok hash/maphash 0.046s ok html 0.015s ok html/template 0.068s ok image 0.041s ok image/color 0.021s ok image/draw 0.050s ok image/gif 0.084s ok image/jpeg 0.118s ok image/png 0.181s ok index/suffixarray 0.121s ok internal/abi 0.244s ok internal/buildcfg 0.035s ok internal/chacha8rand 0.037s ok internal/concurrent 0.063s ok internal/coverage/cfile 0.035s ok internal/coverage/cformat 0.032s ok internal/coverage/cmerge 0.031s ok internal/coverage/pods 0.048s ok internal/coverage/slicereader 0.032s ok internal/coverage/slicewriter 0.032s ok internal/coverage/test 0.049s ok internal/cpu 0.039s ok internal/dag 0.037s ok internal/diff 0.034s ok internal/fmtsort 0.036s ok internal/fuzz 0.040s ok internal/godebug 1.048s ok internal/godebugs 5.592s ok internal/gover 0.033s ok internal/itoa 0.032s ok internal/platform 1.912s ok internal/poll 0.052s ok internal/profile 0.034s ok internal/reflectlite 0.041s ok internal/runtime/atomic 0.060s ok internal/saferio 0.049s ok internal/singleflight 0.079s ok internal/sysinfo 0.037s ok internal/testenv 0.385s ok internal/trace 61.130s ok internal/trace/internal/oldtrace 0.104s ok internal/types/errors 1.189s ok internal/unsafeheader 0.016s ok internal/weak 0.019s ok internal/xcoff 0.051s ok internal/zstd 0.047s ok io 0.183s ok io/fs 0.239s ok io/ioutil 2.053s ok iter 0.018s ok log 0.020s ok log/slog 0.048s ok log/slog/internal/benchmarks 0.015s ok log/slog/internal/buffer 0.014s ok maps 0.016s ok math 0.020s ok math/big 0.795s ok math/bits 0.021s ok math/cmplx 0.039s ok math/rand 0.333s ok math/rand/v2 0.317s ok mime 0.039s ok mime/multipart 1.684s ok mime/quotedprintable 0.044s ok net 19.461s ok net/http 151.766s ok net/http/cgi 0.351s ok net/http/cookiejar 0.250s ok net/http/fcgi 0.250s ok net/http/httptest 3.665s ok net/http/httptrace 0.040s ok net/http/httputil 12.433s ok net/http/internal 0.129s ok net/http/internal/ascii 0.039s ok net/http/pprof 4.157s ok net/internal/cgotest 0.033s ok net/mail 0.041s ok net/netip 0.787s ok net/rpc 1.326s ok net/rpc/jsonrpc 0.044s ok net/smtp 1.781s ok net/textproto 0.044s ok net/url 0.040s ok os 3.066s ok os/exec 0.759s ok os/exec/internal/fdtest 0.033s signal.test 22667: suicide: sys: floating point in note handler pc=0x00073c00 panic: test timed out after 6m0s running tests: TestStress (6m0s) goroutine 17 gp=0x980008 m=2 mp=0x84e508 [running]: panic({0x11e520, 0x982020}) /tmp/workdir-gnot/go/src/runtime/panic.go:804 +0x139 fp=0x8baf84 sp=0x8baf30 pc=0x6b5e9 testing.(*M).startAlarm.func1() /tmp/workdir-gnot/go/src/testing/testing.go:2373 +0x38b fp=0x8baff0 sp=0x8baf84 pc=0xcba5b runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_386.s:1393 +0x1 fp=0x8baff4 sp=0x8baff0 pc=0x719b1 created by time.goFunc /tmp/workdir-gnot/go/src/time/sleep.go:214 +0x2e goroutine 1 gp=0x806248 m=nil [chan receive]: runtime.gopark(0x144f78, 0x8325f4, 0xe, 0x7, 0x2) /tmp/workdir-gnot/go/src/runtime/proc.go:424 +0x100 fp=0x84ac4c sp=0x84ac38 pc=0x6b9b0 runtime.chanrecv(0x8325c0, 0x84acbf, 0x1) /tmp/workdir-gnot/go/src/runtime/chan.go:639 +0x3c7 fp=0x84ac88 sp=0x84ac4c pc=0x5977 runtime.chanrecv1(0x8325c0, 0x84acbf) /tmp/workdir-gnot/go/src/runtime/chan.go:489 +0x1c fp=0x84ac9c sp=0x84ac88 pc=0x55ac testing.(*T).Run(0x892008, {0x13b52b, 0xa}, 0x144e80) /tmp/workdir-gnot/go/src/testing/testing.go:1751 +0x3ef fp=0x84ad14 sp=0x84ac9c pc=0xc856f testing.runTests.func1(0x892008) /tmp/workdir-gnot/go/src/testing/testing.go:2168 +0x44 fp=0x84ad34 sp=0x84ad14 pc=0xca634 testing.tRunner(0x892008, 0x84adec) /tmp/workdir-gnot/go/src/testing/testing.go:1690 +0x118 fp=0x84ad94 sp=0x84ad34 pc=0xc7698 testing.runTests(0x81a050, {0x22b5e0, 0x3, 0x3}, {0xc190eb540c23f819, 0x53d1c65549, 0x22d7c0}) /tmp/workdir-gnot/go/src/testing/testing.go:2166 +0x37e fp=0x84ae00 sp=0x84ad94 pc=0xca54e testing.(*M).Run(0x872050) /tmp/workdir-gnot/go/src/testing/testing.go:2034 +0x639 fp=0x84af4c sp=0x84ae00 pc=0xc8f69 main.main() _testmain.go:51 +0xe4 fp=0x84afa4 sp=0x84af4c pc=0x10e454 runtime.main() /tmp/workdir-gnot/go/src/runtime/proc.go:272 +0x2d1 fp=0x84aff0 sp=0x84afa4 pc=0x39b91 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_386.s:1393 +0x1 fp=0x84aff4 sp=0x84aff0 pc=0x719b1 goroutine 2 gp=0x8065a8 m=nil [force gc (idle)]: runtime.gopark(0x1450d8, 0x22d568, 0x11, 0xa, 0x1) /tmp/workdir-gnot/go/src/runtime/proc.go:424 +0x100 fp=0x84bfd4 sp=0x84bfc0 pc=0x6b9b0 runtime.goparkunlock(...) /tmp/workdir-gnot/go/src/runtime/proc.go:430 runtime.forcegchelper() /tmp/workdir-gnot/go/src/runtime/proc.go:337 +0xc9 fp=0x84bff0 sp=0x84bfd4 pc=0x39ee9 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_386.s:1393 +0x1 fp=0x84bff4 sp=0x84bff0 pc=0x719b1 created by runtime.init.6 in goroutine 1 /tmp/workdir-gnot/go/src/runtime/proc.go:325 +0x22 goroutine 3 gp=0x8066c8 m=nil [GC sweep wait]: runtime.gopark(0x1450d8, 0x22d6d0, 0xc, 0x9, 0x1) /tmp/workdir-gnot/go/src/runtime/proc.go:424 +0x100 fp=0x84cfcc sp=0x84cfb8 pc=0x6b9b0 runtime.goparkunlock(...) /tmp/workdir-gnot/go/src/runtime/proc.go:430 runtime.bgsweep(0x8321c0) /tmp/workdir-gnot/go/src/runtime/mgcsweep.go:277 +0x99 fp=0x84cfe8 sp=0x84cfcc pc=0x23679 runtime.gcenable.gowrap1() /tmp/workdir-gnot/go/src/runtime/mgc.go:203 +0x26 fp=0x84cff0 sp=0x84cfe8 pc=0x14bb6 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_386.s:1393 +0x1 fp=0x84cff4 sp=0x84cff0 pc=0x719b1 created by runtime.gcenable in goroutine 1 /tmp/workdir-gnot/go/src/runtime/mgc.go:203 +0x76 goroutine 4 gp=0x8067e8 m=nil [GC scavenge wait]: runtime.gopark(0x1450d8, 0x22d8e0, 0xd, 0xa, 0x2) /tmp/workdir-gnot/go/src/runtime/proc.go:424 +0x100 fp=0x84dfb8 sp=0x84dfa4 pc=0x6b9b0 runtime.goparkunlock(...) /tmp/workdir-gnot/go/src/runtime/proc.go:430 runtime.(*scavengerState).park(0x22d8e0) /tmp/workdir-gnot/go/src/runtime/mgcscavenge.go:425 +0x5e fp=0x84dfcc sp=0x84dfb8 pc=0x20b9e runtime.bgscavenge(0x8321c0) /tmp/workdir-gnot/go/src/runtime/mgcscavenge.go:653 +0x4a fp=0x84dfe8 sp=0x84dfcc pc=0x2123a runtime.gcenable.gowrap2() /tmp/workdir-gnot/go/src/runtime/mgc.go:204 +0x26 fp=0x84dff0 sp=0x84dfe8 pc=0x14b76 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_386.s:1393 +0x1 fp=0x84dff4 sp=0x84dff0 pc=0x719b1 created by runtime.gcenable in goroutine 1 /tmp/workdir-gnot/go/src/runtime/mgc.go:204 +0xb6 goroutine 5 gp=0x806b48 m=nil [finalizer wait]: runtime.gopark(0x144f94, 0x239ffc, 0x10, 0xa, 0x1) /tmp/workdir-gnot/go/src/runtime/proc.go:424 +0x100 fp=0x846f98 sp=0x846f84 pc=0x6b9b0 runtime.runfinq() /tmp/workdir-gnot/go/src/runtime/mfinal.go:193 +0xfa fp=0x846ff0 sp=0x846f98 pc=0x13cda runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_386.s:1393 +0x1 fp=0x846ff4 sp=0x846ff0 pc=0x719b1 created by runtime.createfing in goroutine 1 /tmp/workdir-gnot/go/src/runtime/mfinal.go:163 +0x5f goroutine 8 gp=0x806c68 m=nil [chan receive]: runtime.gopark(0x144f78, 0x832674, 0xe, 0x7, 0x2) /tmp/workdir-gnot/go/src/runtime/proc.go:424 +0x100 fp=0x847f08 sp=0x847ef4 pc=0x6b9b0 runtime.chanrecv(0x832640, 0x0, 0x1) /tmp/workdir-gnot/go/src/runtime/chan.go:639 +0x3c7 fp=0x847f44 sp=0x847f08 pc=0x5977 runtime.chanrecv1(0x832640, 0x0) /tmp/workdir-gnot/go/src/runtime/chan.go:489 +0x1c fp=0x847f58 sp=0x847f44 pc=0x55ac os/signal.TestStress(0x892208) /tmp/workdir-gnot/go/src/os/signal/signal_plan9_test.go:100 +0x1ae fp=0x847f84 sp=0x847f58 pc=0xd3dae testing.tRunner(0x892208, 0x144e80) /tmp/workdir-gnot/go/src/testing/testing.go:1690 +0x118 fp=0x847fe4 sp=0x847f84 pc=0xc7698 testing.(*T).Run.gowrap1() /tmp/workdir-gnot/go/src/testing/testing.go:1743 +0x2d fp=0x847ff0 sp=0x847fe4 pc=0xc86bd runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_386.s:1393 +0x1 fp=0x847ff4 sp=0x847ff0 pc=0x719b1 created by testing.(*T).Run in goroutine 1 /tmp/workdir-gnot/go/src/testing/testing.go:1743 +0x3d0 goroutine 7 gp=0x806d88 m=0 mp=0x22dd80 [syscall]: runtime.notetsleepg(0x242538, 0xffffffffffffffff) /tmp/workdir-gnot/go/src/runtime/lock_sema.go:296 +0x30 fp=0x848fcc sp=0x848fa8 pc=0xae40 os/signal.signal_recv() /tmp/workdir-gnot/go/src/runtime/sigqueue_plan9.go:110 +0x66 fp=0x848fe0 sp=0x848fcc pc=0x6cdf6 os/signal.loop() /tmp/workdir-gnot/go/src/os/signal/signal_plan9.go:27 +0x19 fp=0x848ff0 sp=0x848fe0 pc=0xd3639 runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_386.s:1393 +0x1 fp=0x848ff4 sp=0x848ff0 pc=0x719b1 created by os/signal.Notify.func1.1 in goroutine 6 /tmp/workdir-gnot/go/src/os/signal/signal.go:151 +0x26 goroutine 10 gp=0x807448 m=3 mp=0x84ea08 [syscall]: syscall.Syscall6(0x33, 0x3, 0x8bef9c, 0x5, 0xffffffff, 0xffffffff, 0x0) /tmp/workdir-gnot/go/src/syscall/asm_plan9_386.s:64 +0xb fp=0x8beee0 sp=0x8bee48 pc=0x7dfeb syscall.Pwrite(0x3, {0x8bef9c, 0x5, 0x20}, 0xffffffffffffffff) /tmp/workdir-gnot/go/src/syscall/zsyscall_plan9_386.go:235 +0x64 fp=0x8bef18 sp=0x8beee0 pc=0x7ddd4 syscall.Write(...) /tmp/workdir-gnot/go/src/syscall/syscall_plan9.go:182 os.(*File).write(0x823358, {0x8bef9c, 0x5, 0x20}) /tmp/workdir-gnot/go/src/os/file_plan9.go:329 +0xd0 fp=0x8bef50 sp=0x8bef18 pc=0x8e990 os.(*File).Write(0x823358, {0x8bef9c, 0x5, 0x20}) /tmp/workdir-gnot/go/src/os/file.go:195 +0x66 fp=0x8bef74 sp=0x8bef50 pc=0x8d096 os/signal.postNote(0x588b, {0x13a725, 0x5}) /tmp/workdir-gnot/go/src/os/signal/signal_plan9_test.go:165 +0x121 fp=0x8befd0 sp=0x8bef74 pc=0xd4761 os/signal.TestStress.func2() /tmp/workdir-gnot/go/src/os/signal/signal_plan9_test.go:91 +0x5c fp=0x8beff0 sp=0x8befd0 pc=0xd3e7c runtime.goexit({}) /tmp/workdir-gnot/go/src/runtime/asm_386.s:1393 +0x1 fp=0x8beff4 sp=0x8beff0 pc=0x719b1 created by os/signal.TestStress in goroutine 8 /tmp/workdir-gnot/go/src/os/signal/signal_plan9_test.go:84 +0x166 FAIL os/signal 360.543s ok os/user 0.031s FAIL go tool dist: Failed: exit status: 'go 22604: 1'