plan9-arm at 300ed43795f48bbc5b37b33f392caa8b8b1d9a7a :: Running /boot/glenda/workdir-pi3plus3/go/src/make.rc with args ["/boot/glenda/workdir-pi3plus3/go/src/make.rc"] and env ["home=/usr/glenda" "path=.\x00/bin" "type=host-plan9-arm-0intro" "GOARM=7" "GO_BUILD_KEY_DELETE_AFTER_READ=false" "status=" "GO_TEST_TIMEOUT_SCALE=6" "GOROOT_BOOTSTRAP=/boot/glenda/workdir-pi3plus3/go1.4" "objtype=arm" "*=" "i=" "WORKDIR=/boot/glenda/workdir-pi3plus3" "GO_BUILDER_NAME=plan9-arm" "GOBIN=" "GOROOT_BOOTSTRAP=/usr/glenda/go"] in dir /boot/glenda/workdir-pi3plus3/go/src Building Go cmd/dist using /usr/glenda/go Building Go toolchain1 using /usr/glenda/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 plan9/arm. --- Installed Go for plan9/arm in /boot/glenda/workdir-pi3plus3/go Installed commands in /boot/glenda/workdir-pi3plus3/go/bin *** You need to bind /boot/glenda/workdir-pi3plus3/go/bin before /bin. ##### Testing packages. ok archive/tar 0.431s ok archive/zip 1.708s ok bufio 0.371s ok bytes 23.355s ok compress/bzip2 0.301s ok compress/flate 3.350s ok compress/gzip 14.943s ok compress/lzw 0.425s ok compress/zlib 3.355s ok container/heap 0.091s ok container/list 0.057s ok container/ring 0.075s ok context 0.103s ok crypto 0.061s ok crypto/aes 0.122s ok crypto/cipher 0.064s ok crypto/des 0.091s ok crypto/dsa 0.085s ok crypto/ecdsa 2.088s ok crypto/ed25519 0.931s ok crypto/elliptic 0.210s ok crypto/hmac 0.062s ok crypto/internal/subtle 0.060s ok crypto/md5 0.059s ok crypto/rand 0.216s ok crypto/rc4 0.211s ok crypto/rsa 0.957s ok crypto/sha1 0.108s ok crypto/sha256 0.067s ok crypto/sha512 0.101s ok crypto/subtle 0.074s ok crypto/tls 14.552s ok crypto/x509 7.311s ok database/sql 0.894s ok database/sql/driver 0.058s ok debug/dwarf 0.117s ok debug/elf 0.156s ok debug/gosym 0.057s ok debug/macho 0.087s ok debug/pe 0.085s ok debug/plan9obj 0.061s ok encoding/ascii85 0.088s ok encoding/asn1 0.065s ok encoding/base32 0.129s ok encoding/base64 0.087s ok encoding/binary 0.062s ok encoding/csv 0.066s ok encoding/gob 0.131s ok encoding/hex 0.066s ok encoding/json 0.959s ok encoding/pem 0.111s ok encoding/xml 0.118s ok errors 0.080s ok expvar 0.086s ok flag 0.228s ok fmt 0.357s ok go/ast 0.072s ok go/build 5.324s ok go/constant 0.094s ok go/doc 0.465s ok go/format 0.144s ok go/importer 1.834s ok go/internal/gccgoimporter 0.200s ok go/internal/gcimporter 28.952s ok go/internal/srcimporter 13.390s ok go/parser 0.210s ok go/printer 1.243s ok go/scanner 0.076s ok go/token 0.137s ok go/types 13.905s ok hash 0.075s ok hash/adler32 0.073s ok hash/crc32 0.063s ok hash/crc64 0.064s ok hash/fnv 0.054s ok hash/maphash 0.332s ok html 0.059s ok html/template 0.267s ok image 0.394s ok image/color 0.151s ok image/draw 0.327s ok image/gif 2.137s ok image/jpeg 0.975s ok image/png 0.244s ok index/suffixarray 4.695s ok internal/cpu 0.048s ok internal/fmtsort 0.051s ok internal/poll 0.180s ok internal/reflectlite 0.257s ok internal/singleflight 0.064s ok internal/trace 0.381s ok internal/xcoff 2.216s ok io 0.169s ok io/ioutil 13.689s ok log 0.060s ok math 0.067s ok math/big 7.617s ok math/bits 0.066s ok math/cmplx 0.053s ok math/rand 1.632s ok mime 0.117s ok mime/multipart 0.952s ok mime/quotedprintable 0.078s ok net 39.494s ok net/http 54.684s ok net/http/cgi 0.282s ok net/http/cookiejar 0.139s ok net/http/fcgi 0.067s ok net/http/httptest 0.986s ok net/http/httptrace 0.059s panic: test timed out after 18m0s goroutine 1071 [running]: testing.(*M).startAlarm.func1() /boot/glenda/workdir-pi3plus3/go/src/testing/testing.go:1521 +0xbc created by time.goFunc /boot/glenda/workdir-pi3plus3/go/src/time/sleep.go:167 +0x34 goroutine 1 [chan receive, 17 minutes]: testing.(*T).Run(0x108c0600, 0x2dc3cf, 0x1f, 0x2ed790, 0x301) /boot/glenda/workdir-pi3plus3/go/src/testing/testing.go:1074 +0x2d0 testing.runTests.func1(0x108c0000) /boot/glenda/workdir-pi3plus3/go/src/testing/testing.go:1342 +0x68 testing.tRunner(0x108c0000, 0x10828ec8) /boot/glenda/workdir-pi3plus3/go/src/testing/testing.go:1022 +0xbc testing.runTests(0x10816100, 0x510660, 0x1a, 0x1a, 0x80b8427e, 0xbf9d5802, 0x7646780f, 0xfb, 0x512d40, 0x1088e190) /boot/glenda/workdir-pi3plus3/go/src/testing/testing.go:1340 +0x258 testing.(*M).Run(0x1088e190, 0x0) /boot/glenda/workdir-pi3plus3/go/src/testing/testing.go:1250 +0x16c main.main() _testmain.go:105 +0x120 goroutine 1049 [chan receive, 17 minutes]: internal/poll.(*asyncIO).Wait(...) /boot/glenda/workdir-pi3plus3/go/src/internal/poll/fd_io_plan9.go:84 internal/poll.(*FD).Read(0x10988d20, 0x10818f98, 0x10b70000, 0x1000, 0x1000, 0x0, 0x0, 0x0) /boot/glenda/workdir-pi3plus3/go/src/internal/poll/fd_plan9.go:73 +0x124 net.(*netFD).Read(0x10988d20, 0x10b70000, 0x1000, 0x1000, 0x42, 0x5abfff, 0x2000) /boot/glenda/workdir-pi3plus3/go/src/net/fd_plan9.go:86 +0xb0 net.(*conn).Read(0x10818f58, 0x10b70000, 0x1000, 0x1000, 0x0, 0x0, 0x0) /boot/glenda/workdir-pi3plus3/go/src/net/net.go:184 +0x6c net/http.(*persistConn).Read(0x10a4a1e0, 0x10b70000, 0x1000, 0x1000, 0x40, 0x4, 0x4) /boot/glenda/workdir-pi3plus3/go/src/net/http/transport.go:1827 +0x16c bufio.(*Reader).Read(0x10a24b70, 0x10b72000, 0x29, 0x8000, 0x54, 0x0, 0x40) /boot/glenda/workdir-pi3plus3/go/src/bufio/bufio.go:226 +0x228 io.(*LimitedReader).Read(0x10816560, 0x10b72000, 0x8000, 0x8000, 0x0, 0x22f394, 0x10a24bb8) /boot/glenda/workdir-pi3plus3/go/src/io/io.go:455 +0xc0 net/http.(*body).readLocked(0x10a24ba0, 0x10b72000, 0x8000, 0x8000, 0x0, 0x28e201, 0x0) /boot/glenda/workdir-pi3plus3/go/src/net/http/transfer.go:847 +0x4c net/http.(*body).Read(0x10a24ba0, 0x10b72000, 0x8000, 0x8000, 0x0, 0x0, 0x0) /boot/glenda/workdir-pi3plus3/go/src/net/http/transfer.go:839 +0xd4 net/http.(*bodyEOFSignal).Read(0x10a24bd0, 0x10b72000, 0x8000, 0x8000, 0x0, 0x0, 0x0) /boot/glenda/workdir-pi3plus3/go/src/net/http/transport.go:2651 +0xc4 net/http/httputil.(*ReverseProxy).copyBuffer(0x10994630, 0x10c04f40, 0x10983500, 0x347898, 0x10a24bd0, 0x10b72000, 0x8000, 0x8000, 0x1ff, 0x1, ...) /boot/glenda/workdir-pi3plus3/go/src/net/http/httputil/reverseproxy.go:416 +0x78 net/http/httputil.(*ReverseProxy).copyResponse(0x10994630, 0x10c04f40, 0x10983500, 0x347898, 0x10a24bd0, 0x0, 0x0, 0x0, 0x0) /boot/glenda/workdir-pi3plus3/go/src/net/http/httputil/reverseproxy.go:404 +0xbc net/http/httputil.(*ReverseProxy).ServeHTTP(0x10994630, 0x349f50, 0x10983500, 0x1087c700) /boot/glenda/workdir-pi3plus3/go/src/net/http/httputil/reverseproxy.go:297 +0x6c4 net/http/httputil.TestReverseProxy_PanicBodyError(0x108c0600) /boot/glenda/workdir-pi3plus3/go/src/net/http/httputil/reverseproxy_test.go:1030 +0x1f8 testing.tRunner(0x108c0600, 0x2ed790) /boot/glenda/workdir-pi3plus3/go/src/testing/testing.go:1022 +0xbc created by testing.(*T).Run /boot/glenda/workdir-pi3plus3/go/src/testing/testing.go:1073 +0x2b0 goroutine 1097 [syscall, 17 minutes, locked to thread]: syscall.Syscall6(0x32, 0x9, 0x10b70000, 0x1000, 0xffffffff, 0xffffffff, 0x0, 0xe, 0x10822b30, 0x0, ...) /boot/glenda/workdir-pi3plus3/go/src/syscall/asm_plan9_arm.s:51 +0x8 syscall.Pread(0x9, 0x10b70000, 0x1000, 0x1000, 0xffffffff, 0xffffffff, 0x4, 0xa, 0x0) /boot/glenda/workdir-pi3plus3/go/src/syscall/zsyscall_plan9_arm.go:218 +0x58 syscall.Read(...) /boot/glenda/workdir-pi3plus3/go/src/syscall/syscall_plan9.go:166 os.(*File).read(0x10818f40, 0x10b70000, 0x1000, 0x1000, 0x81f18, 0xa, 0x0) /boot/glenda/workdir-pi3plus3/go/src/os/file_plan9.go:248 +0x50 os.(*File).Read(0x10818f40, 0x10b70000, 0x1000, 0x1000, 0x10816594, 0xffffffff, 0x0) /boot/glenda/workdir-pi3plus3/go/src/os/file.go:116 +0x60 internal/poll.newAsyncIO.func1(0x10816590, 0x10818f98, 0x10b70000, 0x1000, 0x1000) /boot/glenda/workdir-pi3plus3/go/src/internal/poll/fd_io_plan9.go:54 +0x6c created by internal/poll.newAsyncIO /boot/glenda/workdir-pi3plus3/go/src/internal/poll/fd_io_plan9.go:43 +0xa0 goroutine 1054 [sync.Cond.Wait, 17 minutes]: runtime.goparkunlock(...) /boot/glenda/workdir-pi3plus3/go/src/runtime/proc.go:312 sync.runtime_notifyListWait(0x10aa69a8, 0x0) /boot/glenda/workdir-pi3plus3/go/src/runtime/sema.go:513 +0x154 sync.(*Cond).Wait(0x10aa69a0) /boot/glenda/workdir-pi3plus3/go/src/sync/cond.go:56 +0x6c net/http.(*connReader).abortPendingRead(0x10aa6980) /boot/glenda/workdir-pi3plus3/go/src/net/http/server.go:726 +0x90 net/http.(*response).finishRequest(0x10aa0870) /boot/glenda/workdir-pi3plus3/go/src/net/http/server.go:1596 +0x90 net/http.(*conn).serve(0x10a42360, 0x34a470, 0x10aa6960) /boot/glenda/workdir-pi3plus3/go/src/net/http/server.go:1900 +0x7f4 created by net/http.(*Server).Serve /boot/glenda/workdir-pi3plus3/go/src/net/http/server.go:2934 +0x2d0 goroutine 1079 [syscall, 17 minutes, locked to thread]: syscall.Syscall6(0x32, 0x8, 0x10aa698d, 0x1, 0xffffffff, 0xffffffff, 0x0, 0xe, 0x10a8a4c7, 0x0, ...) /boot/glenda/workdir-pi3plus3/go/src/syscall/asm_plan9_arm.s:51 +0x8 syscall.Pread(0x8, 0x10aa698d, 0x1, 0x1, 0xffffffff, 0xffffffff, 0x4, 0xa, 0x0) /boot/glenda/workdir-pi3plus3/go/src/syscall/zsyscall_plan9_arm.go:218 +0x58 syscall.Read(...) /boot/glenda/workdir-pi3plus3/go/src/syscall/syscall_plan9.go:166 os.(*File).read(0x10980610, 0x10aa698d, 0x1, 0x1, 0x81f18, 0xa, 0x0) /boot/glenda/workdir-pi3plus3/go/src/os/file_plan9.go:248 +0x50 os.(*File).Read(0x10980610, 0x10aa698d, 0x1, 0x1, 0x10a842b4, 0xffffffff, 0x0) /boot/glenda/workdir-pi3plus3/go/src/os/file.go:116 +0x60 internal/poll.newAsyncIO.func1(0x10a842b0, 0x10a80470, 0x10aa698d, 0x1, 0x1) /boot/glenda/workdir-pi3plus3/go/src/internal/poll/fd_io_plan9.go:54 +0x6c created by internal/poll.newAsyncIO /boot/glenda/workdir-pi3plus3/go/src/internal/poll/fd_io_plan9.go:43 +0xa0 goroutine 1095 [select, 17 minutes]: net/http.(*persistConn).writeLoop(0x10a4a1e0) /boot/glenda/workdir-pi3plus3/go/src/net/http/transport.go:2279 +0xc4 created by net/http.(*Transport).dialConn /boot/glenda/workdir-pi3plus3/go/src/net/http/transport.go:1650 +0x9d4 goroutine 1069 [chan receive, 17 minutes]: internal/poll.(*asyncIO).Wait(...) /boot/glenda/workdir-pi3plus3/go/src/internal/poll/fd_io_plan9.go:84 internal/poll.(*FD).Read(0x10aaac40, 0x10a80470, 0x10aa698d, 0x1, 0x1, 0x0, 0x0, 0x0) /boot/glenda/workdir-pi3plus3/go/src/internal/poll/fd_plan9.go:73 +0x124 net.(*netFD).Read(0x10aaac40, 0x10aa698d, 0x1, 0x1, 0x10b8b440, 0x10b57fc8, 0x1000) /boot/glenda/workdir-pi3plus3/go/src/net/fd_plan9.go:86 +0xb0 net.(*conn).Read(0x10980628, 0x10aa698d, 0x1, 0x1, 0x0, 0x0, 0x0) /boot/glenda/workdir-pi3plus3/go/src/net/net.go:184 +0x6c net/http.(*connReader).backgroundRead(0x10aa6980) /boot/glenda/workdir-pi3plus3/go/src/net/http/server.go:678 +0x44 created by net/http.(*connReader).startBackgroundRead /boot/glenda/workdir-pi3plus3/go/src/net/http/server.go:674 +0xc0 goroutine 1051 [syscall, 17 minutes]: syscall.Syscall(0xe, 0x10986880, 0x0, 0x0, 0x12, 0x0, 0x0, 0x6b0a4) /boot/glenda/workdir-pi3plus3/go/src/syscall/asm_plan9_arm.s:16 +0x8 syscall.open(0x10986860, 0x11, 0x0, 0x0, 0x10bc20, 0x512a18) /boot/glenda/workdir-pi3plus3/go/src/syscall/zsyscall_plan9_arm.go:61 +0x78 syscall.Open(0x10986860, 0x11, 0x0, 0x512a18, 0x2eda2c, 0x72a0c) /boot/glenda/workdir-pi3plus3/go/src/syscall/syscall_plan9.go:382 +0x64 os.openFileNolog(0x10986860, 0x11, 0x0, 0x0, 0x2, 0x10986860, 0x11) /boot/glenda/workdir-pi3plus3/go/src/os/file_plan9.go:113 +0x28c os.OpenFile(0x10986860, 0x11, 0x0, 0x0, 0x7, 0x10986860, 0x11) /boot/glenda/workdir-pi3plus3/go/src/os/file.go:307 +0x48 os.Open(...) /boot/glenda/workdir-pi3plus3/go/src/os/file.go:287 net.(*netFD).acceptPlan9(0x10aaab60, 0x0, 0x0, 0x0) /boot/glenda/workdir-pi3plus3/go/src/net/ipsock_plan9.go:250 +0xe0 net.(*TCPListener).accept(0x1098a310, 0x34b1c8, 0x10980628, 0x3e9ec) /boot/glenda/workdir-pi3plus3/go/src/net/tcpsock_plan9.go:48 +0x20 net.(*TCPListener).Accept(0x1098a310, 0x10b53f40, 0xc, 0x10a86700, 0x227508) /boot/glenda/workdir-pi3plus3/go/src/net/tcpsock.go:261 +0x68 net/http.(*Server).Serve(0x10864ab0, 0x349e30, 0x1098a310, 0x0, 0x0) /boot/glenda/workdir-pi3plus3/go/src/net/http/server.go:2902 +0x1fc net/http/httptest.(*Server).goServe.func1(0x10a88b40) /boot/glenda/workdir-pi3plus3/go/src/net/http/httptest/server.go:308 +0x60 created by net/http/httptest.(*Server).goServe /boot/glenda/workdir-pi3plus3/go/src/net/http/httptest/server.go:306 +0x48 goroutine 1094 [select, 17 minutes]: net/http.(*persistConn).readLoop(0x10a4a1e0) /boot/glenda/workdir-pi3plus3/go/src/net/http/transport.go:2101 +0x778 created by net/http.(*Transport).dialConn /boot/glenda/workdir-pi3plus3/go/src/net/http/transport.go:1649 +0x9b8 FAIL net/http/httputil 1080.101s FAIL go tool dist: Failed: exit status: 'go 21744: 1'