linux-386-longtest at 3d28e0ebb9411e7dbd8032b6071c4f5db823ebe9 :: Running /workdir/go/src/make.bash with args ["/workdir/go/src/make.bash"] and env ["PATH=/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin" "HOSTNAME=buildlet-linux-amd64-bullseye-rn2258e72" "DEBIAN_FRONTEND=noninteractive" "HOME=/root" "USER=root" "GO_STAGE0_NET_DELAY=6s" "GO_STAGE0_DL_DELAY=200ms" "WORKDIR=/workdir" "GOROOT_BOOTSTRAP=/workdir/go1.4" "GO_BUILDER_NAME=linux-386-longtest" "GO_TEST_SHORT=0" "GOARCH=386" "GOHOSTARCH=386" "GO_TEST_TIMEOUT_SCALE=5" "GOBIN=" "TMPDIR=/workdir/tmp" "GOCACHE=/workdir/gocache" "PWD=/workdir/go/src"] in dir /workdir/go/src Building Go cmd/dist using /workdir/go1.4. (go1.17.13 linux/amd64) Building Go toolchain1 using /workdir/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 linux/386. --- Installed Go for linux/386 in /workdir/go Installed commands in /workdir/go/bin ##### Test execution environment. # GOARCH: 386 # CPU: Intel(R) Xeon(R) CPU @ 2.20GHz # GOOS: linux # OS Version: Linux 5.15.89+ #1 SMP Sat Mar 18 09:27:02 UTC 2023 x86_64 ##### Testing packages. ok archive/tar 0.244s ok archive/zip 46.426s ok bufio 0.097s ok bytes 6.535s ok compress/bzip2 0.062s ok compress/flate 34.752s ok compress/gzip 1.541s ok compress/lzw 0.074s ok compress/zlib 0.852s ok container/heap 0.005s ok container/list 0.003s ok container/ring 0.003s ok context 0.011s ok crypto 0.003s ok crypto/aes 0.024s ok crypto/cipher 0.005s ok crypto/des 0.021s ok crypto/dsa 160.322s ok crypto/ecdh 0.716s ok crypto/ecdsa 4.842s ok crypto/ed25519 1.134s ok crypto/elliptic 0.794s ok crypto/hmac 0.005s ok crypto/internal/alias 0.002s ok crypto/internal/bigmod 0.136s ok crypto/internal/boring 0.003s ok crypto/internal/boring/bcache 0.062s ok crypto/internal/edwards25519 21.620s ok crypto/internal/edwards25519/field 24.535s ok crypto/internal/nistec 35.901s ok crypto/internal/nistec/fiat 0.002s [no tests to run] ok crypto/md5 0.006s ok crypto/rand 0.217s ok crypto/rc4 0.046s ok crypto/rsa 10.841s ok crypto/sha1 0.004s ok crypto/sha256 0.004s ok crypto/sha512 0.009s ok crypto/subtle 5.214s ok crypto/tls 3.471s ok crypto/x509 4.051s ok database/sql 0.972s ok database/sql/driver 0.002s ok debug/buildinfo 4.962s ok debug/dwarf 0.018s ok debug/elf 0.196s ok debug/gosym 0.018s ok debug/macho 0.006s ok debug/pe 0.012s ok debug/plan9obj 0.003s ok embed 0.004s [no tests to run] ok embed/internal/embedtest 0.003s ok encoding/ascii85 0.004s ok encoding/asn1 0.004s ok encoding/base32 0.023s ok encoding/base64 0.005s ok encoding/binary 0.004s ok encoding/csv 0.010s ok encoding/gob 1.935s ok encoding/hex 0.004s ok encoding/json 1.112s ok encoding/pem 0.601s ok encoding/xml 9.953s ok errors 0.004s ok expvar 0.004s ok flag 0.018s ok fmt 0.060s ok go/ast 0.005s ok go/build 1.479s ok go/build/constraint 0.004s ok go/constant 0.005s ok go/doc 0.036s ok go/doc/comment 1.044s ok go/format 0.007s ok go/importer 0.197s ok go/internal/gccgoimporter 0.009s ok go/internal/gcimporter 40.824s ok go/internal/srcimporter 7.849s ok go/parser 16.747s ok go/printer 0.156s ok go/scanner 0.003s ok go/token 0.014s ok go/types 29.449s ok hash 0.003s ok hash/adler32 0.007s ok hash/crc32 0.006s ok hash/crc64 0.003s ok hash/fnv 0.003s ok hash/maphash 153.657s ok html 0.004s ok html/template 0.194s ok image 0.157s ok image/color 0.018s ok image/draw 0.100s ok image/gif 17.986s ok image/jpeg 3.149s ok image/png 0.859s ok index/suffixarray 80.252s ok internal/abi 0.038s ok internal/buildcfg 0.003s ok internal/coverage/cformat 0.003s ok internal/coverage/cmerge 0.003s ok internal/coverage/pods 0.003s ok internal/coverage/slicereader 0.002s ok internal/coverage/slicewriter 0.002s ok internal/coverage/test 0.008s ok internal/cpu 0.006s ok internal/dag 0.003s ok internal/diff 0.003s ok internal/fmtsort 0.002s ok internal/fuzz 0.006s ok internal/godebug 0.003s ok internal/intern 2.007s ok internal/itoa 0.003s ok internal/poll 2.786s ok internal/profile 0.003s ok internal/reflectlite 0.049s ok internal/safefilepath 0.002s ok internal/saferio 0.020s ok internal/singleflight 0.020s ok internal/testenv 0.002s ok internal/trace 1.927s ok internal/types/errors 0.303s ok internal/unsafeheader 0.003s ok internal/xcoff 0.008s ok io 0.027s ok io/fs 0.455s ok io/ioutil 0.005s ok log 0.005s ok log/slog 0.011s ok log/slog/internal/buffer 0.003s ok log/syslog 1.212s ok maps 0.003s ok math 0.006s ok math/big 4.410s ok math/bits 0.007s ok math/cmplx 0.003s ok math/rand 5.148s ok mime 0.007s ok mime/multipart 2.065s ok mime/quotedprintable 0.600s ok net 26.624s ok net/http 54.286s ok net/http/cgi 0.210s ok net/http/cookiejar 0.007s ok net/http/fcgi 0.106s ok net/http/httptest 0.160s ok net/http/httptrace 0.004s ok net/http/httputil 0.665s ok net/http/internal 0.003s ok net/http/internal/ascii 0.003s ok net/http/pprof 5.081s ok net/internal/socktest 0.003s ok net/mail 0.006s ok net/netip 0.339s ok net/rpc 0.024s ok net/rpc/jsonrpc 0.005s ok net/smtp 0.033s ok net/textproto 0.011s ok net/url 0.008s ok os 16.913s ok os/exec 0.475s ok os/exec/internal/fdtest 0.004s ok os/signal 13.693s ok os/user 0.005s ok path 0.004s ok path/filepath 0.022s ok plugin 0.003s ok reflect 0.659s ok regexp 16.519s ok regexp/syntax 0.860s ok runtime 165.588s ok runtime/cgo 0.003s ok runtime/coverage 19.001s ok runtime/debug 0.050s ok runtime/internal/atomic 3.080s ok runtime/internal/math 0.004s ok runtime/internal/sys 0.003s ok runtime/internal/syscall 0.002s ok runtime/metrics 0.004s ok runtime/pprof 59.871s ok runtime/trace 10.896s ok slices 0.004s ok sort 0.659s ok strconv 2.337s ok strings 1.713s ok sync 3.284s ok sync/atomic 35.568s ok syscall 1.828s ok testing 1.863s ok testing/fstest 0.003s ok testing/iotest 0.003s ok testing/quick 0.037s ok text/scanner 0.004s ok text/tabwriter 0.004s ok text/template 0.405s ok text/template/parse 0.005s ok time 9.267s ok unicode 0.020s ok unicode/utf16 0.003s ok unicode/utf8 0.006s ok cmd/addr2line 0.513s ok cmd/api 7.655s ok cmd/asm/internal/asm 0.539s ok cmd/asm/internal/lex 0.003s ok cmd/compile/internal/abt 0.006s ok cmd/compile/internal/amd64 0.005s ok cmd/compile/internal/base 0.003s ok cmd/compile/internal/compare 0.003s ok cmd/compile/internal/dwarfgen 0.212s ok cmd/compile/internal/importer 18.803s ok cmd/compile/internal/ir 0.003s ok cmd/compile/internal/logopt 0.035s ok cmd/compile/internal/loopvar 0.003s ok cmd/compile/internal/noder 0.005s ok cmd/compile/internal/reflectdata 0.003s [no tests to run] ok cmd/compile/internal/ssa 303.816s ok cmd/compile/internal/syntax 2.739s ok cmd/compile/internal/test 39.448s ok cmd/compile/internal/typecheck 0.265s ok cmd/compile/internal/types 0.003s ok cmd/compile/internal/types2 59.953s ok cmd/covdata 1.083s ok cmd/cover 0.825s ok cmd/dist 0.015s ok cmd/doc 0.234s ok cmd/fix 0.684s vcs-test.golang.org rerouted to http://127.0.0.1:44363 https://vcs-test.golang.org rerouted to https://127.0.0.1:44571 go test proxy running at GOPROXY=http://127.0.0.1:33183/mod 2023/03/22 21:58:13 http: TLS handshake error from 127.0.0.1:41052: read tcp 127.0.0.1:44571->127.0.0.1:41052: read: connection reset by peer 2023/03/22 21:58:29 http: TLS handshake error from 127.0.0.1:37934: EOF 2023/03/22 21:58:29 http: TLS handshake error from 127.0.0.1:37950: EOF 2023/03/22 21:58:29 http: TLS handshake error from 127.0.0.1:37968: EOF 2023/03/22 21:58:29 http: TLS handshake error from 127.0.0.1:37962: EOF 2023/03/22 21:58:29 http: TLS handshake error from 127.0.0.1:37980: EOF 2023/03/22 21:58:30 http: TLS handshake error from 127.0.0.1:38016: EOF 2023/03/22 21:58:31 http: TLS handshake error from 127.0.0.1:38046: EOF 2023/03/22 21:58:31 http: TLS handshake error from 127.0.0.1:38026: EOF 2023/03/22 21:58:31 http: TLS handshake error from 127.0.0.1:38072: EOF --- FAIL: TestScript (0.06s) --- FAIL: TestScript/get_with_git_trace (61.27s) script_test.go:134: 2023-03-22T21:58:40Z script_test.go:136: $WORK=/workdir/tmp/cmd-go-test-1540161014/tmpdir216108298/get_with_git_trace1312145881 script_test.go:154: > env GO111MODULE=off > env GIT_TRACE=1 > [!net] skip [condition not met] > [!git] skip [condition not met] # go get should be success when GIT_TRACE set (61.270s) > go get golang.org/x/text [stderr] # cd /workdir/tmp/cmd-go-test-1540161014/tmpdir216108298/get_with_git_trace1312145881/gopath/src/golang.org/x; git clone -- https://go.googlesource.com/text /workdir/tmp/cmd-go-test-1540161014/tmpdir216108298/get_with_git_trace1312145881/gopath/src/golang.org/x/text 21:58:40.708135 git.c:444 trace: built-in: git clone -- https://go.googlesource.com/text /workdir/tmp/cmd-go-test-1540161014/tmpdir216108298/get_with_git_trace1312145881/gopath/src/golang.org/x/text Cloning into '/workdir/tmp/cmd-go-test-1540161014/tmpdir216108298/get_with_git_trace1312145881/gopath/src/golang.org/x/text'... 21:58:40.711666 run-command.c:664 trace: run_command: git remote-https origin https://go.googlesource.com/text 21:58:40.717771 git.c:730 trace: exec: git-remote-https origin https://go.googlesource.com/text 21:58:40.717878 run-command.c:664 trace: run_command: git-remote-https origin https://go.googlesource.com/text 21:58:40.740169 http.c:756 == Info: Couldn't find host go.googlesource.com in the .netrc file; using defaults 21:58:40.805271 http.c:756 == Info: Trying 74.125.202.82:443... 21:58:40.806481 http.c:756 == Info: Connected to go.googlesource.com (74.125.202.82) port 443 (#0) 21:58:40.955912 http.c:756 == Info: found 387 certificates in /etc/ssl/certs 21:58:40.956310 http.c:756 == Info: ALPN, offering h2 21:58:40.956457 http.c:756 == Info: ALPN, offering http/1.1 21:58:40.961324 http.c:756 == Info: SSL connection using TLS1.3 / ECDHE_RSA_AES_256_GCM_SHA384 21:58:40.985275 http.c:756 == Info: server certificate verification OK 21:58:40.985354 http.c:756 == Info: server certificate status verification SKIPPED 21:58:40.985658 http.c:756 == Info: common name: *.googlecode.com (matched) 21:58:40.985705 http.c:756 == Info: server certificate expiration date OK 21:58:40.985733 http.c:756 == Info: server certificate activation date OK 21:58:40.985795 http.c:756 == Info: certificate public key: EC/ECDSA 21:58:40.985838 http.c:756 == Info: certificate version: #3 21:58:40.985876 http.c:756 == Info: subject: CN=*.googlecode.com 21:58:40.985920 http.c:756 == Info: start date: Thu, 02 Mar 2023 04:22:16 GMT 21:58:40.985959 http.c:756 == Info: expire date: Thu, 25 May 2023 04:22:15 GMT 21:58:40.986006 http.c:756 == Info: issuer: C=US,O=Google Trust Services LLC,CN=GTS CA 1C3 21:58:40.986060 http.c:756 == Info: ALPN, server accepted to use h2 21:58:40.986135 http.c:756 == Info: Using HTTP2, server supports multi-use 21:58:40.986177 http.c:756 == Info: Connection state changed (HTTP/2 confirmed) 21:58:40.986211 http.c:756 == Info: Copying HTTP/2 data in stream buffer to connection buffer after upgrade: len=0 21:58:40.986362 http.c:756 == Info: Using Stream ID: 1 (easy handle 0x55f23120f2b0) 21:58:40.986450 http.c:703 => Send header, 0000000197 bytes (0x000000c5) 21:58:40.986501 http.c:715 => Send header: GET /text/info/refs?service=git-upload-pack HTTP/2 21:58:40.986578 http.c:715 => Send header: Host: go.googlesource.com 21:58:40.986602 http.c:715 => Send header: user-agent: git/2.30.2 21:58:40.986623 http.c:715 => Send header: accept: */* 21:58:40.986672 http.c:715 => Send header: accept-encoding: deflate, gzip, br 21:58:40.986704 http.c:715 => Send header: pragma: no-cache 21:58:40.986725 http.c:715 => Send header: git-protocol: version=2 21:58:40.986744 http.c:715 => Send header: 21:58:40.986822 http.c:756 == Info: Connection state changed (MAX_CONCURRENT_STREAMS == 100)! 21:58:41.007054 http.c:703 <= Recv header, 0000000013 bytes (0x0000000d) 21:58:41.007073 http.c:715 <= Recv header: HTTP/2 200 21:58:41.007079 http.c:703 <= Recv header, 0000000053 bytes (0x00000035) 21:58:41.007084 http.c:715 <= Recv header: cache-control: no-cache, max-age=0, must-revalidate 21:58:41.007089 http.c:703 <= Recv header, 0000000021 bytes (0x00000015) 21:58:41.007093 http.c:715 <= Recv header: content-length: 137 21:58:41.007097 http.c:703 <= Recv header, 0000000059 bytes (0x0000003b) 21:58:41.007100 http.c:715 <= Recv header: content-type: application/x-git-upload-pack-advertisement 21:58:41.007104 http.c:703 <= Recv header, 0000000040 bytes (0x00000028) 21:58:41.007108 http.c:715 <= Recv header: expires: Fri, 01 Jan 1980 00:00:00 GMT 21:58:41.007112 http.c:703 <= Recv header, 0000000018 bytes (0x00000012) 21:58:41.007115 http.c:715 <= Recv header: pragma: no-cache 21:58:41.007119 http.c:703 <= Recv header, 0000000073 bytes (0x00000049) 21:58:41.007122 http.c:715 <= Recv header: strict-transport-security: max-age=31536000; includeSubDomains; preload 21:58:41.007126 http.c:703 <= Recv header, 0000000033 bytes (0x00000021) 21:58:41.007129 http.c:715 <= Recv header: x-content-type-options: nosniff 21:58:41.007133 http.c:703 <= Recv header, 0000000029 bytes (0x0000001d) 21:58:41.007136 http.c:715 <= Recv header: x-frame-options: SAMEORIGIN 21:58:41.007140 http.c:703 <= Recv header, 0000000021 bytes (0x00000015) 21:58:41.007143 http.c:715 <= Recv header: x-xss-protection: 0 21:58:41.007147 http.c:703 <= Recv header, 0000000037 bytes (0x00000025) 21:58:41.007150 http.c:715 <= Recv header: date: Wed, 22 Mar 2023 21:58:41 GMT 21:58:41.007154 http.c:703 <= Recv header, 0000000002 bytes (0x00000002) 21:58:41.007157 http.c:715 <= Recv header: 21:58:41.007201 http.c:756 == Info: Connection #0 to host go.googlesource.com left intact 21:58:41.007560 http.c:756 == Info: Couldn't find host go.googlesource.com in the .netrc file; using defaults 21:58:41.007578 http.c:756 == Info: Found bundle for host go.googlesource.com: 0x55f231201420 [can multiplex] 21:58:41.007589 http.c:756 == Info: Re-using existing connection! (#0) with host go.googlesource.com 21:58:41.007596 http.c:756 == Info: Connected to go.googlesource.com (74.125.202.82) port 443 (#0) 21:58:41.007623 http.c:756 == Info: Using Stream ID: 3 (easy handle 0x55f23120f2b0) 21:58:41.007674 http.c:703 => Send header, 0000000269 bytes (0x0000010d) 21:58:41.007683 http.c:715 => Send header: POST /text/git-upload-pack HTTP/2 21:58:41.007686 http.c:715 => Send header: Host: go.googlesource.com 21:58:41.007690 http.c:715 => Send header: user-agent: git/2.30.2 21:58:41.007693 http.c:715 => Send header: accept-encoding: deflate, gzip, br 21:58:41.007697 http.c:715 => Send header: content-type: application/x-git-upload-pack-request 21:58:41.007700 http.c:715 => Send header: accept: application/x-git-upload-pack-result 21:58:41.007703 http.c:715 => Send header: git-protocol: version=2 21:58:41.007707 http.c:715 => Send header: content-length: 122 21:58:41.007710 http.c:715 => Send header: 21:58:41.007746 http.c:756 == Info: We are completely uploaded and fine 21:59:41.744673 http.c:703 <= Recv header, 0000000013 bytes (0x0000000d) 21:59:41.744698 http.c:715 <= Recv header: HTTP/2 502 21:59:41.744714 http.c:703 <= Recv header, 0000000022 bytes (0x00000016) 21:59:41.744718 http.c:715 <= Recv header: content-length: 1451 21:59:41.744740 http.c:703 <= Recv header, 0000000040 bytes (0x00000028) 21:59:41.744749 http.c:715 <= Recv header: content-type: text/html; charset=utf-8 21:59:41.744754 http.c:703 <= Recv header, 0000000033 bytes (0x00000021) 21:59:41.744758 http.c:715 <= Recv header: x-content-type-options: nosniff 21:59:41.744762 http.c:703 <= Recv header, 0000000029 bytes (0x0000001d) 21:59:41.744766 http.c:715 <= Recv header: x-frame-options: SAMEORIGIN 21:59:41.744771 http.c:703 <= Recv header, 0000000021 bytes (0x00000015) 21:59:41.744774 http.c:715 <= Recv header: x-xss-protection: 0 21:59:41.744779 http.c:703 <= Recv header, 0000000037 bytes (0x00000025) 21:59:41.744782 http.c:715 <= Recv header: date: Wed, 22 Mar 2023 21:59:41 GMT 21:59:41.744787 http.c:703 <= Recv header, 0000000002 bytes (0x00000002) 21:59:41.744791 http.c:715 <= Recv header: 21:59:41.744849 http.c:756 == Info: Connection #0 to host go.googlesource.com left intact error: RPC failed; HTTP 502 curl 22 The requested URL returned error: 502 fatal: expected flush after ref listing package golang.org/x/text: exit status 128 script_test.go:154: FAIL: get_with_git_trace.txt:9: go get golang.org/x/text: exit status 1 FAIL FAIL cmd/go 201.169s FAIL go tool dist: Failed: exit status 1