Diff of the two buildlogs: -- --- b1/build.log 2024-09-12 23:00:54.348961799 +0000 +++ b2/build.log 2024-09-12 23:03:16.522926046 +0000 @@ -1,6 +1,6 @@ I: pbuilder: network access will be disabled during build -I: Current time: Wed Oct 15 17:21:23 -12 2025 -I: pbuilder-time-stamp: 1760592083 +I: Current time: Fri Sep 13 13:00:56 +14 2024 +I: pbuilder-time-stamp: 1726182056 I: Building the build Environment I: extracting base tarball [/var/cache/pbuilder/unstable-reproducible-base.tgz] I: copying local configuration @@ -29,51 +29,83 @@ dpkg-source: info: applying 0002-use-plugins-from-packages.patch I: Not using root during the build. I: Installing the build-deps -I: user script /srv/workspace/pbuilder/2720236/tmp/hooks/D02_print_environment starting +I: user script /srv/workspace/pbuilder/2538533/tmp/hooks/D01_modify_environment starting +debug: Running on infom01-amd64. +I: Changing host+domainname to test build reproducibility +I: Adding a custom variable just for the fun of it... +I: Changing /bin/sh to bash +'/bin/sh' -> '/bin/bash' +lrwxrwxrwx 1 root root 9 Sep 12 23:01 /bin/sh -> /bin/bash +I: Setting pbuilder2's login shell to /bin/bash +I: Setting pbuilder2's GECOS to second user,second room,second work-phone,second home-phone,second other +I: user script /srv/workspace/pbuilder/2538533/tmp/hooks/D01_modify_environment finished +I: user script /srv/workspace/pbuilder/2538533/tmp/hooks/D02_print_environment starting I: set - BUILDDIR='/build/reproducible-path' - BUILDUSERGECOS='first user,first room,first work-phone,first home-phone,first other' - BUILDUSERNAME='pbuilder1' - BUILD_ARCH='amd64' - DEBIAN_FRONTEND='noninteractive' + BASH=/bin/sh + BASHOPTS=checkwinsize:cmdhist:complete_fullquote:extquote:force_fignore:globasciiranges:globskipdots:hostcomplete:interactive_comments:patsub_replacement:progcomp:promptvars:sourcepath + BASH_ALIASES=() + BASH_ARGC=() + BASH_ARGV=() + BASH_CMDS=() + BASH_LINENO=([0]="12" [1]="0") + BASH_LOADABLES_PATH=/usr/local/lib/bash:/usr/lib/bash:/opt/local/lib/bash:/usr/pkg/lib/bash:/opt/pkg/lib/bash:. + BASH_SOURCE=([0]="/tmp/hooks/D02_print_environment" [1]="/tmp/hooks/D02_print_environment") + BASH_VERSINFO=([0]="5" [1]="2" [2]="32" [3]="1" [4]="release" [5]="x86_64-pc-linux-gnu") + BASH_VERSION='5.2.32(1)-release' + BUILDDIR=/build/reproducible-path + BUILDUSERGECOS='second user,second room,second work-phone,second home-phone,second other' + BUILDUSERNAME=pbuilder2 + BUILD_ARCH=amd64 + DEBIAN_FRONTEND=noninteractive DEB_BUILD_OPTIONS='buildinfo=+all reproducible=+all parallel=12 ' - DISTRIBUTION='unstable' - HOME='/root' - HOST_ARCH='amd64' + DIRSTACK=() + DISTRIBUTION=unstable + EUID=0 + FUNCNAME=([0]="Echo" [1]="main") + GROUPS=() + HOME=/root + HOSTNAME=i-capture-the-hostname + HOSTTYPE=x86_64 + HOST_ARCH=amd64 IFS=' ' - INVOCATION_ID='50903bd946db4a67ab6df981db09ca72' - LANG='C' - LANGUAGE='en_US:en' - LC_ALL='C' - MAIL='/var/mail/root' - OPTIND='1' - PATH='/usr/sbin:/usr/bin:/sbin:/bin:/usr/games' - PBCURRENTCOMMANDLINEOPERATION='build' - PBUILDER_OPERATION='build' - PBUILDER_PKGDATADIR='/usr/share/pbuilder' - PBUILDER_PKGLIBDIR='/usr/lib/pbuilder' - PBUILDER_SYSCONFDIR='/etc' - PPID='2720236' - PS1='# ' - PS2='> ' + INVOCATION_ID=281eefcf61eb47c2860e3010ce98f557 + LANG=C + LANGUAGE=et_EE:et + LC_ALL=C + MACHTYPE=x86_64-pc-linux-gnu + MAIL=/var/mail/root + OPTERR=1 + OPTIND=1 + OSTYPE=linux-gnu + PATH=/usr/sbin:/usr/bin:/sbin:/bin:/usr/games:/i/capture/the/path + PBCURRENTCOMMANDLINEOPERATION=build + PBUILDER_OPERATION=build + PBUILDER_PKGDATADIR=/usr/share/pbuilder + PBUILDER_PKGLIBDIR=/usr/lib/pbuilder + PBUILDER_SYSCONFDIR=/etc + PIPESTATUS=([0]="0") + POSIXLY_CORRECT=y + PPID=2538533 PS4='+ ' - PWD='/' - SHELL='/bin/bash' - SHLVL='2' - SUDO_COMMAND='/usr/bin/timeout -k 18.1h 18h /usr/bin/ionice -c 3 /usr/bin/nice /usr/sbin/pbuilder --build --configfile /srv/reproducible-results/rbuild-debian/r-b-build.neYfhmsi/pbuilderrc_X32x --distribution unstable --hookdir /etc/pbuilder/first-build-hooks --debbuildopts -b --basetgz /var/cache/pbuilder/unstable-reproducible-base.tgz --buildresult /srv/reproducible-results/rbuild-debian/r-b-build.neYfhmsi/b1 --logfile b1/build.log golang-github-google-s2a-go_0.1.7-3.dsc' - SUDO_GID='109' - SUDO_UID='104' - SUDO_USER='jenkins' - TERM='unknown' - TZ='/usr/share/zoneinfo/Etc/GMT+12' - USER='root' - _='/usr/bin/systemd-run' + PWD=/ + SHELL=/bin/bash + SHELLOPTS=braceexpand:errexit:hashall:interactive-comments:posix + SHLVL=3 + SUDO_COMMAND='/usr/bin/timeout -k 24.1h 24h /usr/bin/ionice -c 3 /usr/bin/nice -n 11 /usr/bin/unshare --uts -- /usr/sbin/pbuilder --build --configfile /srv/reproducible-results/rbuild-debian/r-b-build.neYfhmsi/pbuilderrc_hvsA --distribution unstable --hookdir /etc/pbuilder/rebuild-hooks --debbuildopts -b --basetgz /var/cache/pbuilder/unstable-reproducible-base.tgz --buildresult /srv/reproducible-results/rbuild-debian/r-b-build.neYfhmsi/b2 --logfile b2/build.log golang-github-google-s2a-go_0.1.7-3.dsc' + SUDO_GID=109 + SUDO_UID=104 + SUDO_USER=jenkins + TERM=unknown + TZ=/usr/share/zoneinfo/Etc/GMT-14 + UID=0 + USER=root + _='I: set' I: uname -a - Linux infom02-amd64 6.10.6+bpo-amd64 #1 SMP PREEMPT_DYNAMIC Debian 6.10.6-1~bpo12+1 (2024-08-26) x86_64 GNU/Linux + Linux i-capture-the-hostname 6.1.0-25-cloud-amd64 #1 SMP PREEMPT_DYNAMIC Debian 6.1.106-3 (2024-08-26) x86_64 GNU/Linux I: ls -l /bin - lrwxrwxrwx 1 root root 7 Aug 4 2024 /bin -> usr/bin -I: user script /srv/workspace/pbuilder/2720236/tmp/hooks/D02_print_environment finished + lrwxrwxrwx 1 root root 7 Aug 4 21:30 /bin -> usr/bin +I: user script /srv/workspace/pbuilder/2538533/tmp/hooks/D02_print_environment finished -> Attempting to satisfy build-dependencies -> Creating pbuilder-satisfydepends-dummy package Package: pbuilder-satisfydepends-dummy @@ -211,7 +243,7 @@ Get: 80 http://deb.debian.org/debian unstable/main amd64 protobuf-compiler amd64 3.21.12-9 [84.5 kB] Get: 81 http://deb.debian.org/debian unstable/main amd64 protoc-gen-go amd64 1.33.0-1 [1427 kB] Get: 82 http://deb.debian.org/debian unstable/main amd64 protoc-gen-go-grpc amd64 1.64.0-6+b1 [1385 kB] -Fetched 94.2 MB in 3s (34.8 MB/s) +Fetched 94.2 MB in 1s (107 MB/s) debconf: delaying package configuration, since apt-utils is not installed Selecting previously unselected package sensible-utils. (Reading database ... (Reading database ... 5% (Reading database ... 10% (Reading database ... 15% (Reading database ... 20% (Reading database ... 25% (Reading database ... 30% (Reading database ... 35% (Reading database ... 40% (Reading database ... 45% (Reading database ... 50% (Reading database ... 55% (Reading database ... 60% (Reading database ... 65% (Reading database ... 70% (Reading database ... 75% (Reading database ... 80% (Reading database ... 85% (Reading database ... 90% (Reading database ... 95% (Reading database ... 100% (Reading database ... 19781 files and directories currently installed.) @@ -554,7 +586,11 @@ Building tag database... -> Finished parsing the build-deps I: Building the package -I: Running cd /build/reproducible-path/golang-github-google-s2a-go-0.1.7/ && env PATH="/usr/sbin:/usr/bin:/sbin:/bin:/usr/games" HOME="/nonexistent/first-build" dpkg-buildpackage -us -uc -b && env PATH="/usr/sbin:/usr/bin:/sbin:/bin:/usr/games" HOME="/nonexistent/first-build" dpkg-genchanges -S > ../golang-github-google-s2a-go_0.1.7-3_source.changes +I: user script /srv/workspace/pbuilder/2538533/tmp/hooks/A99_set_merged_usr starting +Not re-configuring usrmerge for unstable +I: user script /srv/workspace/pbuilder/2538533/tmp/hooks/A99_set_merged_usr finished +hostname: Name or service not known +I: Running cd /build/reproducible-path/golang-github-google-s2a-go-0.1.7/ && env PATH="/usr/sbin:/usr/bin:/sbin:/bin:/usr/games:/i/capture/the/path" HOME="/nonexistent/second-build" dpkg-buildpackage -us -uc -b && env PATH="/usr/sbin:/usr/bin:/sbin:/bin:/usr/games:/i/capture/the/path" HOME="/nonexistent/second-build" dpkg-genchanges -S > ../golang-github-google-s2a-go_0.1.7-3_source.changes dpkg-buildpackage: info: source package golang-github-google-s2a-go dpkg-buildpackage: info: source version 0.1.7-3 dpkg-buildpackage: info: source distribution unstable @@ -576,25 +612,25 @@ /build/reproducible-path/golang-github-google-s2a-go-0.1.7/tools/proto/regenerate_proto.sh dh_auto_build -O--builddirectory=_build -O--buildsystem=golang cd _build && go install -trimpath -v -p 12 github.com/google/s2a-go github.com/google/s2a-go/fallback github.com/google/s2a-go/internal/authinfo github.com/google/s2a-go/internal/fakehandshaker/service github.com/google/s2a-go/internal/handshaker github.com/google/s2a-go/internal/handshaker/service github.com/google/s2a-go/internal/proto/common_go_proto github.com/google/s2a-go/internal/proto/s2a_context_go_proto github.com/google/s2a-go/internal/proto/s2a_go_proto github.com/google/s2a-go/internal/proto/v2/common_go_proto github.com/google/s2a-go/internal/proto/v2/s2a_context_go_proto github.com/google/s2a-go/internal/proto/v2/s2a_go_proto github.com/google/s2a-go/internal/record github.com/google/s2a-go/internal/record/internal/aeadcrypter github.com/google/s2a-go/internal/record/internal/aeadcrypter/testutil github.com/google/s2a-go/internal/record/internal/halfconn github.com/google/s2a-go/internal/tokenmanager github.com/google/s2a-go/internal/v2 github.com/google/s2a-go/internal/v2/certverifier github.com/google/s2a-go/internal/v2/fakes2av2 github.com/google/s2a-go/internal/v2/remotesigner github.com/google/s2a-go/internal/v2/tlsconfigstore github.com/google/s2a-go/retry github.com/google/s2a-go/stream -internal/goarch -internal/goos +internal/race internal/coverage/rtcov -internal/unsafeheader internal/goexperiment -unicode/utf8 -internal/cpu -internal/race -runtime/internal/syscall -container/list -runtime/internal/atomic -unicode -internal/abi internal/itoa internal/godebugs +internal/goarch +internal/unsafeheader +internal/goos +runtime/internal/atomic +runtime/internal/syscall +internal/cpu sync/atomic +internal/abi internal/chacha8rand runtime/internal/math +unicode/utf8 +unicode runtime/internal/sys +container/list math/bits crypto/internal/alias crypto/subtle @@ -603,17 +639,17 @@ unicode/utf16 vendor/golang.org/x/crypto/cryptobyte/asn1 internal/nettrace +slices vendor/golang.org/x/crypto/internal/alias encoding google.golang.org/protobuf/internal/flags google.golang.org/protobuf/internal/set -slices +internal/bytealg +math log/internal google.golang.org/grpc/serviceconfig golang.org/x/crypto/internal/alias -internal/bytealg golang.org/x/crypto/cryptobyte/asn1 -math runtime internal/reflectlite sync @@ -625,209 +661,209 @@ errors sort internal/oserror -path -strconv -internal/safefilepath -crypto/internal/nistec/fiat io internal/godebug vendor/golang.org/x/net/dns/dnsmessage -google.golang.org/grpc/internal/buffer -hash -crypto/internal/randutil -bytes syscall -text/tabwriter -hash/fnv +strconv +path +internal/safefilepath +google.golang.org/grpc/internal/buffer +crypto/internal/nistec/fiat math/rand internal/intern +bytes +hash +crypto/internal/randutil strings +text/tabwriter +google.golang.org/grpc/internal/grpcrand hash/crc32 +hash/fnv crypto -reflect crypto/rc4 +reflect net/netip -google.golang.org/grpc/internal/grpcrand -golang.org/x/text/transform vendor/golang.org/x/text/transform +golang.org/x/text/transform bufio html regexp/syntax net/http/internal/ascii -regexp time internal/syscall/unix internal/syscall/execenv +regexp context -google.golang.org/grpc/backoff io/fs -google.golang.org/grpc/keepalive internal/poll -encoding/binary -internal/fmtsort -embed +google.golang.org/grpc/backoff +google.golang.org/grpc/keepalive google.golang.org/grpc/internal/backoff +embed google.golang.org/grpc/internal/grpcsync +encoding/binary +internal/fmtsort google.golang.org/protobuf/internal/editiondefaults os -vendor/golang.org/x/crypto/internal/poly1305 -crypto/internal/nistec -golang.org/x/crypto/internal/poly1305 -crypto/md5 crypto/cipher crypto/internal/edwards25519/field +golang.org/x/crypto/internal/poly1305 +crypto/internal/nistec +crypto/md5 encoding/base64 +vendor/golang.org/x/crypto/internal/poly1305 golang.org/x/sys/unix -crypto/internal/edwards25519 -encoding/pem +crypto/internal/boring crypto/des vendor/golang.org/x/crypto/chacha20 +encoding/pem golang.org/x/crypto/chacha20 -crypto/internal/boring +crypto/internal/edwards25519 crypto/aes -crypto/sha256 -crypto/hmac crypto/sha512 +crypto/hmac crypto/sha1 +crypto/sha256 +fmt +path/filepath +vendor/golang.org/x/sys/cpu vendor/golang.org/x/crypto/hkdf -golang.org/x/crypto/hkdf +google.golang.org/protobuf/internal/detrand crypto/ecdh -fmt +io/ioutil google.golang.org/grpc/internal/envconfig -google.golang.org/protobuf/internal/detrand -internal/sysinfo -path/filepath golang.org/x/sys/cpu -io/ioutil -vendor/golang.org/x/sys/cpu net -golang.org/x/crypto/chacha20poly1305 +golang.org/x/crypto/hkdf +internal/sysinfo vendor/golang.org/x/crypto/chacha20poly1305 -encoding/hex +golang.org/x/crypto/chacha20poly1305 net/url -google.golang.org/protobuf/internal/errors +encoding/hex +math/big encoding/json -google.golang.org/grpc/attributes -go/token +google.golang.org/protobuf/internal/errors +compress/flate google.golang.org/protobuf/internal/version +go/token +google.golang.org/grpc/attributes google.golang.org/grpc/internal/grpclog -compress/flate -math/big google.golang.org/protobuf/encoding/protowire log text/template/parse vendor/golang.org/x/text/unicode/norm +compress/gzip vendor/golang.org/x/net/http2/hpack -google.golang.org/protobuf/reflect/protoreflect mime -mime/quotedprintable +google.golang.org/protobuf/reflect/protoreflect golang.org/x/net/internal/timeseries vendor/golang.org/x/text/unicode/bidi +mime/quotedprintable net/http/internal -compress/gzip google.golang.org/grpc/internal/idle golang.org/x/text/unicode/bidi golang.org/x/text/unicode/norm golang.org/x/net/http2/hpack github.com/google/s2a-go/internal/record/internal/aeadcrypter -flag google.golang.org/protobuf/internal/encoding/messageset google.golang.org/protobuf/internal/strs -google.golang.org/protobuf/internal/genid google.golang.org/protobuf/internal/order +google.golang.org/protobuf/internal/genid +google.golang.org/protobuf/internal/encoding/text google.golang.org/protobuf/reflect/protoregistry google.golang.org/protobuf/runtime/protoiface -google.golang.org/protobuf/internal/encoding/text google.golang.org/protobuf/internal/descfmt google.golang.org/protobuf/internal/descopts -google.golang.org/grpc/grpclog text/template vendor/golang.org/x/text/secure/bidirule google.golang.org/protobuf/internal/encoding/json -runtime/debug golang.org/x/text/secure/bidirule -runtime/trace +flag +google.golang.org/grpc/grpclog vendor/golang.org/x/net/idna +runtime/debug +runtime/trace google.golang.org/protobuf/proto google.golang.org/grpc/connectivity github.com/google/s2a-go/retry -testing google.golang.org/protobuf/internal/encoding/defval crypto/elliptic -crypto/internal/boring/bbig crypto/internal/bigmod -crypto/rand -crypto/dsa +crypto/internal/boring/bbig encoding/asn1 +crypto/dsa +crypto/rand +testing +golang.org/x/net/idna google.golang.org/protobuf/encoding/prototext google.golang.org/protobuf/internal/filedesc -golang.org/x/net/idna crypto/ed25519 -crypto/rsa html/template +vendor/golang.org/x/crypto/cryptobyte crypto/x509/pkix golang.org/x/crypto/cryptobyte -vendor/golang.org/x/crypto/cryptobyte -github.com/google/s2a-go/internal/record/internal/aeadcrypter/testutil +crypto/rsa crypto/ecdsa +github.com/google/s2a-go/internal/record/internal/aeadcrypter/testutil google.golang.org/protobuf/internal/encoding/tag google.golang.org/protobuf/encoding/protojson google.golang.org/protobuf/internal/impl +google.golang.org/protobuf/internal/filetype +google.golang.org/protobuf/runtime/protoimpl vendor/golang.org/x/net/http/httpproxy -google.golang.org/grpc/internal/syscall google.golang.org/grpc/internal crypto/x509 net/textproto +google.golang.org/grpc/internal/syscall google.golang.org/grpc/internal/resolver/dns/internal -google.golang.org/protobuf/internal/filetype -google.golang.org/grpc/metadata -google.golang.org/grpc/codes -vendor/golang.org/x/net/http/httpguts -golang.org/x/net/http/httpguts -mime/multipart -google.golang.org/grpc/internal/balancerload -google.golang.org/grpc/internal/grpcutil -google.golang.org/grpc/stats -google.golang.org/grpc/tap -google.golang.org/protobuf/runtime/protoimpl -google.golang.org/grpc/encoding github.com/google/s2a-go/internal/proto/common_go_proto +google.golang.org/protobuf/types/descriptorpb google.golang.org/protobuf/protoadapt google.golang.org/protobuf/types/known/durationpb google.golang.org/protobuf/types/known/timestamppb -google.golang.org/protobuf/types/descriptorpb google.golang.org/protobuf/types/known/anypb github.com/google/s2a-go/internal/proto/v2/common_go_proto -google.golang.org/grpc/encoding/proto +google.golang.org/grpc/metadata +google.golang.org/grpc/codes +github.com/google/s2a-go/internal/proto/s2a_context_go_proto google.golang.org/grpc/internal/pretty +google.golang.org/genproto/googleapis/rpc/status github.com/golang/protobuf/ptypes/duration -github.com/google/s2a-go/internal/proto/s2a_context_go_proto +github.com/golang/protobuf/ptypes/timestamp github.com/google/s2a-go/internal/record/internal/halfconn github.com/google/s2a-go/internal/tokenmanager -google.golang.org/genproto/googleapis/rpc/status github.com/google/s2a-go/internal/proto/v2/s2a_context_go_proto -github.com/golang/protobuf/ptypes/timestamp +vendor/golang.org/x/net/http/httpguts +mime/multipart +google.golang.org/grpc/internal/grpcutil +google.golang.org/grpc/internal/balancerload google.golang.org/grpc/internal/status +google.golang.org/grpc/stats +golang.org/x/net/http/httpguts google.golang.org/grpc/binarylog/grpc_binarylog_v1 +google.golang.org/grpc/tap +google.golang.org/grpc/encoding google.golang.org/grpc/status +google.golang.org/grpc/encoding/proto google.golang.org/grpc/internal/binarylog -crypto/tls google.golang.org/protobuf/types/gofeaturespb google.golang.org/protobuf/reflect/protodesc +crypto/tls github.com/golang/protobuf/proto google.golang.org/grpc/internal/credentials net/http/httptrace -net/http google.golang.org/grpc/credentials -google.golang.org/grpc/credentials/insecure +net/http +github.com/google/s2a-go/fallback google.golang.org/grpc/resolver +google.golang.org/grpc/credentials/insecure google.golang.org/grpc/peer -github.com/google/s2a-go/fallback google.golang.org/grpc/internal/channelz google.golang.org/grpc/internal/metadata -google.golang.org/grpc/internal/transport/networktype -google.golang.org/grpc/balancer/grpclb/state google.golang.org/grpc/internal/resolver/passthrough +google.golang.org/grpc/balancer/grpclb/state +google.golang.org/grpc/internal/transport/networktype google.golang.org/grpc/internal/resolver/dns google.golang.org/grpc/internal/resolver/unix google.golang.org/grpc/resolver/dns @@ -843,17 +879,17 @@ golang.org/x/net/http2 google.golang.org/grpc/internal/transport google.golang.org/grpc -github.com/google/s2a-go/internal/proto/s2a_go_proto github.com/google/s2a-go/internal/handshaker/service github.com/google/s2a-go/internal/proto/v2/s2a_go_proto +github.com/google/s2a-go/internal/proto/s2a_go_proto github.com/google/s2a-go/internal/authinfo github.com/google/s2a-go/internal/fakehandshaker/service github.com/google/s2a-go/internal/record github.com/google/s2a-go/stream github.com/google/s2a-go/internal/v2/fakes2av2 -github.com/google/s2a-go/internal/handshaker -github.com/google/s2a-go/internal/v2/certverifier github.com/google/s2a-go/internal/v2/remotesigner +github.com/google/s2a-go/internal/v2/certverifier +github.com/google/s2a-go/internal/handshaker github.com/google/s2a-go/internal/v2/tlsconfigstore github.com/google/s2a-go/internal/v2 github.com/google/s2a-go @@ -913,13 +949,13 @@ === RUN TestAuthInfoFromPeer --- PASS: TestAuthInfoFromPeer (0.00s) PASS -ok github.com/google/s2a-go 0.011s +ok github.com/google/s2a-go 0.008s === RUN TestDefaultFallbackClientHandshakeFunc --- PASS: TestDefaultFallbackClientHandshakeFunc (0.00s) === RUN TestDefaultFallbackDialerAndAddress --- PASS: TestDefaultFallbackDialerAndAddress (0.00s) PASS -ok github.com/google/s2a-go/fallback 0.004s +ok github.com/google/s2a-go/fallback 0.002s === RUN TestS2AAuthInfo === RUN TestS2AAuthInfo/basic_1 === RUN TestS2AAuthInfo/basic_2 @@ -931,7 +967,7 @@ --- PASS: TestS2AAuthInfo/nil_identities_and_fingerprints (0.00s) --- PASS: TestS2AAuthInfo/nil_session_result (0.00s) PASS -ok github.com/google/s2a-go/internal/authinfo 0.006s +ok github.com/google/s2a-go/internal/authinfo 0.004s === RUN TestSetupSession === RUN TestSetupSession/client_failure_no_app_protocols === RUN TestSetupSession/client_failure_non_initial_state @@ -959,7 +995,7 @@ --- PASS: TestAuthenticateRequest/request_contains_invalid_token (0.00s) --- PASS: TestAuthenticateRequest/request_contains_valid_and_invalid_tokens (0.00s) PASS -ok github.com/google/s2a-go/internal/fakehandshaker/service 0.010s +ok github.com/google/s2a-go/internal/fakehandshaker/service 0.006s ? github.com/google/s2a-go/internal/proto/common_go_proto [no test files] ? github.com/google/s2a-go/internal/proto/s2a_context_go_proto [no test files] ? github.com/google/s2a-go/internal/proto/s2a_go_proto [no test files] @@ -987,7 +1023,7 @@ === RUN TestServerHandshakeSuccess/full_server_options_with_no_local_identities === RUN TestServerHandshakeSuccess/full_server_options,_sending_tokens === RUN TestServerHandshakeSuccess/full_server_options_with_no_local_identity,_sending_tokens ---- PASS: TestServerHandshakeSuccess (0.01s) +--- PASS: TestServerHandshakeSuccess (0.00s) --- PASS: TestServerHandshakeSuccess/full_server_options (0.00s) --- PASS: TestServerHandshakeSuccess/full_server_options_with_no_local_identities (0.00s) --- PASS: TestServerHandshakeSuccess/full_server_options,_sending_tokens (0.00s) @@ -1027,11 +1063,11 @@ --- PASS: TestGetAuthMechanismsForServer/token_manager_expects_2_SPIFFE_IDs (0.00s) --- PASS: TestGetAuthMechanismsForServer/token_manager_expects_a_SPIFFE_ID_but_does_not_expect_hostname (0.00s) PASS -ok github.com/google/s2a-go/internal/handshaker 0.021s +ok github.com/google/s2a-go/internal/handshaker 0.016s === RUN TestDial --- PASS: TestDial (0.00s) PASS -ok github.com/google/s2a-go/internal/handshaker/service 0.007s +ok github.com/google/s2a-go/internal/handshaker/service 0.008s ? github.com/google/s2a-go/internal/record/internal/aeadcrypter/testutil [no test files] ? github.com/google/s2a-go/stream [no test files] === RUN TestNewS2ARecordConn @@ -1252,19 +1288,19 @@ === RUN TestConnHandshakeWithHandshakeBuilder/AES-128-GCM-SHA256_key_update_between_session_tickets_in_a_single_record === RUN TestConnHandshakeWithHandshakeBuilder/AES-256-GCM-SHA384_key_update_between_session_tickets_in_a_single_record === RUN TestConnHandshakeWithHandshakeBuilder/CHACHA20-POLY1305-SHA256_key_update_between_session_tickets_in_a_single_record ---- PASS: TestConnHandshakeWithHandshakeBuilder (0.42s) +--- PASS: TestConnHandshakeWithHandshakeBuilder (0.27s) --- PASS: TestConnHandshakeWithHandshakeBuilder/AES-128-GCM-SHA256_consecutive_tickets (0.00s) --- PASS: TestConnHandshakeWithHandshakeBuilder/AES-256-GCM-SHA384_consecutive_tickets (0.00s) --- PASS: TestConnHandshakeWithHandshakeBuilder/CHACHA20-POLY1305-SHA256_consecutive_tickets (0.00s) --- PASS: TestConnHandshakeWithHandshakeBuilder/AES-128-GCM-SHA256_multiple_tickets_in_one_record (0.00s) --- PASS: TestConnHandshakeWithHandshakeBuilder/AES-256-GCM-SHA384_multiple_tickets_in_one_record (0.00s) --- PASS: TestConnHandshakeWithHandshakeBuilder/CHACHA20-POLY1305-SHA256_multiple_tickets_in_one_record (0.00s) - --- PASS: TestConnHandshakeWithHandshakeBuilder/AES-128-GCM-SHA256_fragmented_tickets (0.08s) - --- PASS: TestConnHandshakeWithHandshakeBuilder/AES-256-GCM-SHA384_fragmented_tickets (0.05s) - --- PASS: TestConnHandshakeWithHandshakeBuilder/CHACHA20-POLY1305-SHA256_fragmented_tickets (0.05s) - --- PASS: TestConnHandshakeWithHandshakeBuilder/AES-128-GCM-SHA256_large_ticket (0.08s) - --- PASS: TestConnHandshakeWithHandshakeBuilder/AES-256-GCM-SHA384_large_ticket (0.07s) - --- PASS: TestConnHandshakeWithHandshakeBuilder/CHACHA20-POLY1305-SHA256_large_ticket (0.07s) + --- PASS: TestConnHandshakeWithHandshakeBuilder/AES-128-GCM-SHA256_fragmented_tickets (0.04s) + --- PASS: TestConnHandshakeWithHandshakeBuilder/AES-256-GCM-SHA384_fragmented_tickets (0.04s) + --- PASS: TestConnHandshakeWithHandshakeBuilder/CHACHA20-POLY1305-SHA256_fragmented_tickets (0.04s) + --- PASS: TestConnHandshakeWithHandshakeBuilder/AES-128-GCM-SHA256_large_ticket (0.06s) + --- PASS: TestConnHandshakeWithHandshakeBuilder/AES-256-GCM-SHA384_large_ticket (0.05s) + --- PASS: TestConnHandshakeWithHandshakeBuilder/CHACHA20-POLY1305-SHA256_large_ticket (0.05s) --- PASS: TestConnHandshakeWithHandshakeBuilder/AES-128-GCM-SHA256_split_in_header (0.00s) --- PASS: TestConnHandshakeWithHandshakeBuilder/AES-256-GCM-SHA384_split_in_header (0.00s) --- PASS: TestConnHandshakeWithHandshakeBuilder/CHACHA20-POLY1305-SHA256_split_in_header (0.00s) @@ -1363,7 +1399,7 @@ --- PASS: TestGetAuthMechanism/token_manager_expects_SPIFFE_ID (0.00s) --- PASS: TestGetAuthMechanism/token_manager_does_not_expect_hostname (0.00s) PASS -ok github.com/google/s2a-go/internal/record 0.464s +ok github.com/google/s2a-go/internal/record 0.295s === RUN TestAESGCMInvalidKeySize --- PASS: TestAESGCMInvalidKeySize (0.00s) === RUN TestAESGCMEncryptRoundtrip @@ -1488,7 +1524,7 @@ === RUN TestWycheProofTestVectors/118/tag_changed_to_all_1 === RUN TestWycheProofTestVectors/119/msbs_changed_in_tag === RUN TestWycheProofTestVectors/120/lsbs_changed_in_tag ---- PASS: TestWycheProofTestVectors (0.01s) +--- PASS: TestWycheProofTestVectors (0.00s) --- PASS: TestWycheProofTestVectors/1/ (0.00s) --- PASS: TestWycheProofTestVectors/2/ (0.00s) --- PASS: TestWycheProofTestVectors/3/ (0.00s) @@ -2247,7 +2283,7 @@ === RUN TestDecrypt --- PASS: TestDecrypt (0.00s) PASS -ok github.com/google/s2a-go/internal/record/internal/aeadcrypter 0.025s +ok github.com/google/s2a-go/internal/record/internal/aeadcrypter 0.014s === RUN TestCiphersuites === RUN TestCiphersuites/AES_128_GCM_SHA256 === RUN TestCiphersuites/AES_256_GCM_SHA384 @@ -2349,7 +2385,7 @@ --- PASS: TestS2AHalfConnectionTagSize/AES_256_GCM_SHA384 (0.00s) --- PASS: TestS2AHalfConnectionTagSize/CHACHA20_POLY1305_SHA256 (0.00s) PASS -ok github.com/google/s2a-go/internal/record/internal/halfconn 0.004s +ok github.com/google/s2a-go/internal/record/internal/halfconn 0.002s === RUN TestNewSingleTokenAccessTokenManagerFailure --- PASS: TestNewSingleTokenAccessTokenManagerFailure (0.00s) === RUN TestNewSingleTokenAccessTokenManagerDefaultTokenSuccess @@ -2357,39 +2393,39 @@ === RUN TestNewSingleTokenAccessTokenManagerTokenSuccess --- PASS: TestNewSingleTokenAccessTokenManagerTokenSuccess (0.00s) PASS -ok github.com/google/s2a-go/internal/tokenmanager 0.003s +ok github.com/google/s2a-go/internal/tokenmanager 0.002s === RUN TestEndToEndUsingFakeS2AOverTCP -2025/10/16 05:23:40 Fake S2A Service: failed to receive SessionReq: EOF -2025/10/16 05:23:40 Fake S2A Service: failed to receive SessionReq: EOF ---- PASS: TestEndToEndUsingFakeS2AOverTCP (0.02s) +2024/09/12 23:03:09 Fake S2A Service: failed to receive SessionReq: EOF +2024/09/12 23:03:09 Fake S2A Service: failed to receive SessionReq: EOF +--- PASS: TestEndToEndUsingFakeS2AOverTCP (0.01s) === RUN TestEndToEndUsingFakeS2AOverTCPEmptyId -2025/10/16 05:23:40 Fake S2A Service: failed to receive SessionReq: EOF -2025/10/16 05:23:40 Fake S2A Service: failed to receive SessionReq: EOF +2024/09/12 23:03:09 Fake S2A Service: failed to receive SessionReq: EOF +2024/09/12 23:03:09 Fake S2A Service: failed to receive SessionReq: EOF --- PASS: TestEndToEndUsingFakeS2AOverTCPEmptyId (0.01s) === RUN TestEndToEndUsingFakeS2AOnUDS -2025/10/16 05:23:40 Fake S2A Service: failed to receive SessionReq: EOF -2025/10/16 05:23:40 Fake S2A Service: failed to receive SessionReq: EOF +2024/09/12 23:03:09 Fake S2A Service: failed to receive SessionReq: EOF +2024/09/12 23:03:09 Fake S2A Service: failed to receive SessionReq: EOF --- PASS: TestEndToEndUsingFakeS2AOnUDS (0.01s) === RUN TestEndToEndUsingFakeS2AOnUDSEmptyId -2025/10/16 05:23:40 Fake S2A Service: failed to receive SessionReq: EOF -2025/10/16 05:23:40 Fake S2A Service: failed to receive SessionReq: EOF +2024/09/12 23:03:09 Fake S2A Service: failed to receive SessionReq: EOF +2024/09/12 23:03:09 Fake S2A Service: failed to receive SessionReq: EOF --- PASS: TestEndToEndUsingFakeS2AOnUDSEmptyId (0.01s) === RUN TestGRPCFallbackEndToEndUsingFakeS2AOverTCP - s2av2_e2e_test.go:318: Fake handshaker for server running at address: [::]:37519 - s2av2_e2e_test.go:330: server running at address: [::]:38809 - s2av2_e2e_test.go:331: fallback server running at address: [::]:34621 -2025/10/16 05:23:42 Fake S2A Service: failed to receive SessionReq: EOF ---- PASS: TestGRPCFallbackEndToEndUsingFakeS2AOverTCP (1.84s) + s2av2_e2e_test.go:318: Fake handshaker for server running at address: [::]:39059 + s2av2_e2e_test.go:330: server running at address: [::]:44043 + s2av2_e2e_test.go:331: fallback server running at address: [::]:36633 +2024/09/12 23:03:09 Fake S2A Service: failed to receive SessionReq: EOF +--- PASS: TestGRPCFallbackEndToEndUsingFakeS2AOverTCP (0.43s) === RUN TestGRPCRetryAndFallbackEndToEndUsingFakeS2AOverTCP - s2av2_e2e_test.go:387: server running at address: [::]:38111 - s2av2_e2e_test.go:388: fallback server running at address: [::]:38585 -2025/10/16 05:23:42 Fake S2A Service: authentication error: SessionReq has no AuthenticationMechanism with a valid token -2025/10/16 05:23:44 Fake S2A Service: failed to receive SessionReq: EOF ---- PASS: TestGRPCRetryAndFallbackEndToEndUsingFakeS2AOverTCP (1.75s) + s2av2_e2e_test.go:387: server running at address: [::]:46025 + s2av2_e2e_test.go:388: fallback server running at address: [::]:37349 +2024/09/12 23:03:09 Fake S2A Service: authentication error: SessionReq has no AuthenticationMechanism with a valid token +2024/09/12 23:03:12 Fake S2A Service: failed to receive SessionReq: EOF +--- PASS: TestGRPCRetryAndFallbackEndToEndUsingFakeS2AOverTCP (2.16s) === RUN TestNewClientTlsConfigWithTokenManager --- PASS: TestNewClientTlsConfigWithTokenManager (0.00s) === RUN TestNewClientTlsConfigWithoutTokenManager -2025/10/16 05:23:44 Fake S2A Service: failed to receive SessionReq: rpc error: code = Canceled desc = context canceled +2024/09/12 23:03:12 Fake S2A Service: failed to receive SessionReq: rpc error: code = Canceled desc = context canceled --- PASS: TestNewClientTlsConfigWithoutTokenManager (0.00s) === RUN TestNewClientCreds === RUN TestNewClientCreds/static @@ -2401,12 +2437,12 @@ --- PASS: TestNewServerCreds/static (0.00s) === RUN TestClientHandshakeFail --- PASS: TestClientHandshakeFail (0.00s) -2025/10/16 05:23:44 Fake S2A Service: failed to receive SessionReq: rpc error: code = Canceled desc = context canceled === RUN TestServerHandshakeFail --- PASS: TestServerHandshakeFail (0.00s) === RUN TestInfo --- PASS: TestInfo (0.00s) === RUN TestCloneClient +2024/09/12 23:03:12 Fake S2A Service: failed to receive SessionReq: rpc error: code = Canceled desc = context canceled --- PASS: TestCloneClient (0.00s) === RUN TestCloneServer --- PASS: TestCloneServer (0.00s) @@ -2427,132 +2463,132 @@ === RUN TestGetS2ATimeout --- PASS: TestGetS2ATimeout (0.00s) PASS -ok github.com/google/s2a-go/internal/v2 3.658s +ok github.com/google/s2a-go/internal/v2 2.632s === RUN TestVerifyClientCertChain -2025/10/16 05:23:40 Server: started gRPC fake S2Av2 Server on address: [::]:41001 +2024/09/12 23:03:09 Server: started gRPC fake S2Av2 Server on address: [::]:37249 === RUN TestVerifyClientCertChain/empty_chain -2025/10/16 05:23:40 Client: connected to: [::]:41001 -2025/10/16 05:23:40 Client: set up bidirectional streaming RPC session. -2025/10/16 05:23:40 Fake S2A Service: failed to receive SessionReq: rpc error: code = Canceled desc = context canceled +2024/09/12 23:03:09 Client: connected to: [::]:37249 +2024/09/12 23:03:09 Client: set up bidirectional streaming RPC session. === RUN TestVerifyClientCertChain/chain_of_length_1 -2025/10/16 05:23:40 Client: connected to: [::]:41001 -2025/10/16 05:23:40 Client: set up bidirectional streaming RPC session. +2024/09/12 23:03:09 Fake S2A Service: failed to receive SessionReq: rpc error: code = Canceled desc = context canceled +2024/09/12 23:03:09 Client: connected to: [::]:37249 +2024/09/12 23:03:09 Client: set up bidirectional streaming RPC session. === RUN TestVerifyClientCertChain/chain_of_length_2_correct -2025/10/16 05:23:40 Fake S2A Service: failed to receive SessionReq: rpc error: code = Canceled desc = context canceled -2025/10/16 05:23:40 Client: connected to: [::]:41001 -2025/10/16 05:23:40 Client: set up bidirectional streaming RPC session. -2025/10/16 05:23:40 Fake S2A Service: failed to receive SessionReq: rpc error: code = Canceled desc = context canceled +2024/09/12 23:03:09 Fake S2A Service: failed to receive SessionReq: rpc error: code = Canceled desc = context canceled +2024/09/12 23:03:09 Client: connected to: [::]:37249 +2024/09/12 23:03:09 Client: set up bidirectional streaming RPC session. === RUN TestVerifyClientCertChain/chain_of_length_2_error:_missing_intermediate -2025/10/16 05:23:40 Client: connected to: [::]:41001 -2025/10/16 05:23:40 Client: set up bidirectional streaming RPC session. -2025/10/16 05:23:40 Fake S2A Service: failed to receive SessionReq: rpc error: code = Canceled desc = context canceled ---- PASS: TestVerifyClientCertChain (0.01s) +2024/09/12 23:03:09 Fake S2A Service: failed to receive SessionReq: rpc error: code = Canceled desc = context canceled +2024/09/12 23:03:09 Client: connected to: [::]:37249 +2024/09/12 23:03:09 Client: set up bidirectional streaming RPC session. +2024/09/12 23:03:09 Fake S2A Service: failed to receive SessionReq: rpc error: code = Canceled desc = context canceled +--- PASS: TestVerifyClientCertChain (0.00s) --- PASS: TestVerifyClientCertChain/empty_chain (0.00s) --- PASS: TestVerifyClientCertChain/chain_of_length_1 (0.00s) --- PASS: TestVerifyClientCertChain/chain_of_length_2_correct (0.00s) --- PASS: TestVerifyClientCertChain/chain_of_length_2_error:_missing_intermediate (0.00s) === RUN TestVerifyServerCertChainWithServerAuthorizationPolicy -2025/10/16 05:23:40 Server: started gRPC fake S2Av2 Server on address: [::]:33187 +2024/09/12 23:03:09 Server: started gRPC fake S2Av2 Server on address: [::]:45271 === RUN TestVerifyServerCertChainWithServerAuthorizationPolicy/empty_chain -2025/10/16 05:23:40 Client: connected to: [::]:33187 -2025/10/16 05:23:40 Client: set up bidirectional streaming RPC session. -2025/10/16 05:23:40 Fake S2A Service: failed to receive SessionReq: rpc error: code = Canceled desc = context canceled +2024/09/12 23:03:09 Client: connected to: [::]:45271 +2024/09/12 23:03:09 Client: set up bidirectional streaming RPC session. === RUN TestVerifyServerCertChainWithServerAuthorizationPolicy/invalid_server_authorization_policy -2025/10/16 05:23:40 Client: connected to: [::]:33187 -2025/10/16 05:23:40 Client: set up bidirectional streaming RPC session. -2025/10/16 05:23:40 Fake S2A Service: failed to build SessionResp with ValidatePeerCertificateChainResp: server peer verification failed: invalid server authorization policy, expected: fake server authorization policy, got: +2024/09/12 23:03:09 Fake S2A Service: failed to receive SessionReq: rpc error: code = Canceled desc = context canceled +2024/09/12 23:03:09 Client: connected to: [::]:45271 +2024/09/12 23:03:09 Client: set up bidirectional streaming RPC session. +2024/09/12 23:03:09 Fake S2A Service: failed to build SessionResp with ValidatePeerCertificateChainResp: server peer verification failed: invalid server authorization policy, expected: fake server authorization policy, got: === RUN TestVerifyServerCertChainWithServerAuthorizationPolicy/chain_of_length_1 -2025/10/16 05:23:40 Client: connected to: [::]:33187 -2025/10/16 05:23:40 Client: set up bidirectional streaming RPC session. -2025/10/16 05:23:40 Fake S2A Service: failed to receive SessionReq: rpc error: code = Canceled desc = context canceled +2024/09/12 23:03:09 Client: connected to: [::]:45271 +2024/09/12 23:03:09 Client: set up bidirectional streaming RPC session. +2024/09/12 23:03:09 Fake S2A Service: failed to receive SessionReq: rpc error: code = Canceled desc = context canceled === RUN TestVerifyServerCertChainWithServerAuthorizationPolicy/chain_of_length_2_correct -2025/10/16 05:23:40 Client: connected to: [::]:33187 -2025/10/16 05:23:40 Client: set up bidirectional streaming RPC session. -2025/10/16 05:23:40 Fake S2A Service: failed to receive SessionReq: rpc error: code = Canceled desc = context canceled +2024/09/12 23:03:09 Client: connected to: [::]:45271 +2024/09/12 23:03:09 Client: set up bidirectional streaming RPC session. +2024/09/12 23:03:09 Fake S2A Service: failed to receive SessionReq: rpc error: code = Canceled desc = context canceled --- PASS: TestVerifyServerCertChainWithServerAuthorizationPolicy (0.01s) --- PASS: TestVerifyServerCertChainWithServerAuthorizationPolicy/empty_chain (0.00s) --- PASS: TestVerifyServerCertChainWithServerAuthorizationPolicy/invalid_server_authorization_policy (0.00s) --- PASS: TestVerifyServerCertChainWithServerAuthorizationPolicy/chain_of_length_1 (0.00s) --- PASS: TestVerifyServerCertChainWithServerAuthorizationPolicy/chain_of_length_2_correct (0.00s) === RUN TestVerifyServerCertChainWithoutServerAuthorizationPolicy -2025/10/16 05:23:40 Server: started gRPC fake S2Av2 Server on address: [::]:37553 +2024/09/12 23:03:09 Server: started gRPC fake S2Av2 Server on address: [::]:33825 === RUN TestVerifyServerCertChainWithoutServerAuthorizationPolicy/empty_chain -2025/10/16 05:23:40 Client: connected to: [::]:37553 -2025/10/16 05:23:40 Client: set up bidirectional streaming RPC session. +2024/09/12 23:03:09 Client: connected to: [::]:33825 +2024/09/12 23:03:09 Client: set up bidirectional streaming RPC session. === RUN TestVerifyServerCertChainWithoutServerAuthorizationPolicy/chain_of_length_1 -2025/10/16 05:23:40 Fake S2A Service: failed to receive SessionReq: rpc error: code = Canceled desc = context canceled -2025/10/16 05:23:40 Client: connected to: [::]:37553 -2025/10/16 05:23:40 Client: set up bidirectional streaming RPC session. -2025/10/16 05:23:40 Fake S2A Service: failed to receive SessionReq: rpc error: code = Canceled desc = context canceled +2024/09/12 23:03:09 Fake S2A Service: failed to receive SessionReq: rpc error: code = Canceled desc = context canceled +2024/09/12 23:03:09 Client: connected to: [::]:33825 +2024/09/12 23:03:09 Client: set up bidirectional streaming RPC session. === RUN TestVerifyServerCertChainWithoutServerAuthorizationPolicy/chain_of_length_2_correct -2025/10/16 05:23:40 Client: connected to: [::]:37553 -2025/10/16 05:23:40 Client: set up bidirectional streaming RPC session. -2025/10/16 05:23:40 Fake S2A Service: failed to receive SessionReq: rpc error: code = Canceled desc = context canceled +2024/09/12 23:03:09 Fake S2A Service: failed to receive SessionReq: rpc error: code = Canceled desc = context canceled +2024/09/12 23:03:09 Client: connected to: [::]:33825 +2024/09/12 23:03:09 Client: set up bidirectional streaming RPC session. +2024/09/12 23:03:09 Fake S2A Service: failed to receive SessionReq: rpc error: code = Canceled desc = context canceled --- PASS: TestVerifyServerCertChainWithoutServerAuthorizationPolicy (0.00s) --- PASS: TestVerifyServerCertChainWithoutServerAuthorizationPolicy/empty_chain (0.00s) --- PASS: TestVerifyServerCertChainWithoutServerAuthorizationPolicy/chain_of_length_1 (0.00s) --- PASS: TestVerifyServerCertChainWithoutServerAuthorizationPolicy/chain_of_length_2_correct (0.00s) PASS -ok github.com/google/s2a-go/internal/v2/certverifier 0.027s +ok github.com/google/s2a-go/internal/v2/certverifier 0.018s === RUN TestSetUpSession -2025/10/16 05:23:40 Server: started gRPC Fake S2Av2 Server on address: [::]:33429 +2024/09/12 23:03:09 Server: started gRPC Fake S2Av2 Server on address: [::]:37251 === RUN TestSetUpSession/Get_TLS_config_for_client. -2025/10/16 05:23:40 Client: connected to: [::]:33429 -2025/10/16 05:23:40 Client: set up bidirectional streaming RPC session. -2025/10/16 05:23:40 Client: sent SessionReq -2025/10/16 05:23:40 Client: received SessionResp -2025/10/16 05:23:40 resp matches tc.expectedResponse +2024/09/12 23:03:09 Client: connected to: [::]:37251 +2024/09/12 23:03:09 Client: set up bidirectional streaming RPC session. +2024/09/12 23:03:09 Client: sent SessionReq +2024/09/12 23:03:09 Client: received SessionResp +2024/09/12 23:03:09 resp matches tc.expectedResponse === RUN TestSetUpSession/Get_TLS_config_for_server. -2025/10/16 05:23:40 Fake S2A Service: failed to receive SessionReq: rpc error: code = Canceled desc = context canceled -2025/10/16 05:23:40 Client: connected to: [::]:33429 -2025/10/16 05:23:40 Client: set up bidirectional streaming RPC session. -2025/10/16 05:23:40 Client: sent SessionReq -2025/10/16 05:23:40 Client: received SessionResp -2025/10/16 05:23:40 resp matches tc.expectedResponse -2025/10/16 05:23:40 Fake S2A Service: failed to receive SessionReq: rpc error: code = Canceled desc = context canceled +2024/09/12 23:03:09 Client: connected to: [::]:37251 +2024/09/12 23:03:09 Client: set up bidirectional streaming RPC session. +2024/09/12 23:03:09 Client: sent SessionReq +2024/09/12 23:03:09 Fake S2A Service: failed to receive SessionReq: rpc error: code = Canceled desc = context canceled +2024/09/12 23:03:09 Client: received SessionResp +2024/09/12 23:03:09 resp matches tc.expectedResponse === RUN TestSetUpSession/Get_TLS_config_error_--_invalid_connection_side -2025/10/16 05:23:40 Client: connected to: [::]:33429 -2025/10/16 05:23:40 Client: set up bidirectional streaming RPC session. -2025/10/16 05:23:40 Client: sent SessionReq -2025/10/16 05:23:40 Client: received SessionResp -2025/10/16 05:23:40 resp matches tc.expectedResponse +2024/09/12 23:03:09 Fake S2A Service: failed to receive SessionReq: rpc error: code = Canceled desc = context canceled +2024/09/12 23:03:09 Client: connected to: [::]:37251 +2024/09/12 23:03:09 Client: set up bidirectional streaming RPC session. +2024/09/12 23:03:09 Client: sent SessionReq +2024/09/12 23:03:09 Client: received SessionResp +2024/09/12 23:03:09 resp matches tc.expectedResponse === RUN TestSetUpSession/Get_TLS_config_error_--_invalid_token -2025/10/16 05:23:40 Fake S2A Service: failed to receive SessionReq: rpc error: code = Canceled desc = context canceled -2025/10/16 05:23:40 Client: connected to: [::]:33429 -2025/10/16 05:23:40 Client: set up bidirectional streaming RPC session. -2025/10/16 05:23:40 Client: sent SessionReq -2025/10/16 05:23:40 Fake S2A Service: authentication error: SessionReq has no AuthenticationMechanism with a valid token -2025/10/16 05:23:40 Client: received SessionResp -2025/10/16 05:23:40 resp matches tc.expectedResponse +2024/09/12 23:03:09 Fake S2A Service: failed to receive SessionReq: rpc error: code = Canceled desc = context canceled +2024/09/12 23:03:09 Client: connected to: [::]:37251 +2024/09/12 23:03:09 Client: set up bidirectional streaming RPC session. +2024/09/12 23:03:09 Client: sent SessionReq +2024/09/12 23:03:09 Fake S2A Service: authentication error: SessionReq has no AuthenticationMechanism with a valid token +2024/09/12 23:03:09 Client: received SessionResp +2024/09/12 23:03:09 resp matches tc.expectedResponse === RUN TestSetUpSession/Get_server_TLS_config_--_empty_authmechanisms_(S2A_ACCESS_TOKEN_env_var_not_set) -2025/10/16 05:23:40 Client: connected to: [::]:33429 -2025/10/16 05:23:40 Client: set up bidirectional streaming RPC session. -2025/10/16 05:23:40 Client: sent SessionReq -2025/10/16 05:23:40 Client: received SessionResp -2025/10/16 05:23:40 resp matches tc.expectedResponse +2024/09/12 23:03:09 Client: connected to: [::]:37251 +2024/09/12 23:03:09 Client: set up bidirectional streaming RPC session. +2024/09/12 23:03:09 Client: sent SessionReq +2024/09/12 23:03:09 Client: received SessionResp +2024/09/12 23:03:09 resp matches tc.expectedResponse === RUN TestSetUpSession/Client_Peer_Verification -2025/10/16 05:23:40 Fake S2A Service: failed to receive SessionReq: rpc error: code = Canceled desc = context canceled -2025/10/16 05:23:40 Client: connected to: [::]:33429 -2025/10/16 05:23:40 Client: set up bidirectional streaming RPC session. -2025/10/16 05:23:40 Client: sent SessionReq -2025/10/16 05:23:40 Client: received SessionResp -2025/10/16 05:23:40 resp matches tc.expectedResponse +2024/09/12 23:03:09 Fake S2A Service: failed to receive SessionReq: rpc error: code = Canceled desc = context canceled +2024/09/12 23:03:09 Client: connected to: [::]:37251 +2024/09/12 23:03:09 Client: set up bidirectional streaming RPC session. +2024/09/12 23:03:09 Client: sent SessionReq +2024/09/12 23:03:09 Client: received SessionResp +2024/09/12 23:03:09 resp matches tc.expectedResponse === RUN TestSetUpSession/Client_Peer_Verification_--_failure -2025/10/16 05:23:40 Fake S2A Service: failed to receive SessionReq: rpc error: code = Canceled desc = context canceled -2025/10/16 05:23:40 Client: connected to: [::]:33429 -2025/10/16 05:23:40 Client: set up bidirectional streaming RPC session. -2025/10/16 05:23:40 Client: sent SessionReq -2025/10/16 05:23:40 Client: received SessionResp -2025/10/16 05:23:40 resp matches tc.expectedResponse +2024/09/12 23:03:09 Fake S2A Service: failed to receive SessionReq: rpc error: code = Canceled desc = context canceled +2024/09/12 23:03:09 Client: connected to: [::]:37251 +2024/09/12 23:03:09 Client: set up bidirectional streaming RPC session. +2024/09/12 23:03:09 Client: sent SessionReq +2024/09/12 23:03:09 Client: received SessionResp +2024/09/12 23:03:09 resp matches tc.expectedResponse === RUN TestSetUpSession/Server_Peer_Verification -2025/10/16 05:23:40 Fake S2A Service: failed to receive SessionReq: rpc error: code = Canceled desc = context canceled -2025/10/16 05:23:40 Client: connected to: [::]:33429 -2025/10/16 05:23:40 Client: set up bidirectional streaming RPC session. -2025/10/16 05:23:40 Client: sent SessionReq -2025/10/16 05:23:40 Client: received SessionResp -2025/10/16 05:23:40 resp matches tc.expectedResponse -2025/10/16 05:23:40 Fake S2A Service: failed to receive SessionReq: rpc error: code = Canceled desc = context canceled ---- PASS: TestSetUpSession (0.02s) +2024/09/12 23:03:09 Fake S2A Service: failed to receive SessionReq: rpc error: code = Canceled desc = context canceled +2024/09/12 23:03:09 Client: connected to: [::]:37251 +2024/09/12 23:03:09 Client: set up bidirectional streaming RPC session. +2024/09/12 23:03:09 Client: sent SessionReq +2024/09/12 23:03:09 Client: received SessionResp +2024/09/12 23:03:09 resp matches tc.expectedResponse +2024/09/12 23:03:09 Fake S2A Service: failed to receive SessionReq: rpc error: code = Canceled desc = context canceled +--- PASS: TestSetUpSession (0.01s) --- PASS: TestSetUpSession/Get_TLS_config_for_client. (0.00s) --- PASS: TestSetUpSession/Get_TLS_config_for_server. (0.00s) --- PASS: TestSetUpSession/Get_TLS_config_error_--_invalid_connection_side (0.00s) @@ -2562,47 +2598,47 @@ --- PASS: TestSetUpSession/Client_Peer_Verification_--_failure (0.00s) --- PASS: TestSetUpSession/Server_Peer_Verification (0.00s) === RUN TestSetUpSessionPrivateKeyOperation -2025/10/16 05:23:40 Server: started gRPC Fake S2Av2 Server on address: [::]:46131 +2024/09/12 23:03:09 Server: started gRPC Fake S2Av2 Server on address: [::]:39067 === RUN TestSetUpSessionPrivateKeyOperation/client_side_private_key_operation -2025/10/16 05:23:40 Client: connected to: [::]:46131 -2025/10/16 05:23:40 Client: set up bidirectional streaming RPC session. -2025/10/16 05:23:40 Client: sent SessionReq -2025/10/16 05:23:40 Client: received SessionResp -2025/10/16 05:23:40 resp matches tc.expectedResponse +2024/09/12 23:03:09 Client: connected to: [::]:39067 +2024/09/12 23:03:09 Client: set up bidirectional streaming RPC session. +2024/09/12 23:03:09 Client: sent SessionReq +2024/09/12 23:03:09 Client: received SessionResp +2024/09/12 23:03:09 resp matches tc.expectedResponse === RUN TestSetUpSessionPrivateKeyOperation/server_side_private_key_operation -2025/10/16 05:23:40 Fake S2A Service: failed to receive SessionReq: rpc error: code = Canceled desc = context canceled -2025/10/16 05:23:40 Client: connected to: [::]:46131 -2025/10/16 05:23:40 Client: set up bidirectional streaming RPC session. -2025/10/16 05:23:40 Client: sent SessionReq -2025/10/16 05:23:40 Client: received SessionResp -2025/10/16 05:23:40 resp matches tc.expectedResponse +2024/09/12 23:03:09 Fake S2A Service: failed to receive SessionReq: rpc error: code = Canceled desc = context canceled +2024/09/12 23:03:09 Client: connected to: [::]:39067 +2024/09/12 23:03:09 Client: set up bidirectional streaming RPC session. +2024/09/12 23:03:09 Client: sent SessionReq +2024/09/12 23:03:09 Client: received SessionResp +2024/09/12 23:03:09 resp matches tc.expectedResponse === RUN TestSetUpSessionPrivateKeyOperation/client_side_private_key_operation_--_invalid_signature_algorithm -2025/10/16 05:23:40 Fake S2A Service: failed to receive SessionReq: rpc error: code = Canceled desc = context canceled -2025/10/16 05:23:40 Client: connected to: [::]:46131 -2025/10/16 05:23:40 Client: set up bidirectional streaming RPC session. -2025/10/16 05:23:40 Client: sent SessionReq -2025/10/16 05:23:40 Client: received SessionResp -2025/10/16 05:23:40 resp matches tc.expectedResponse -2025/10/16 05:23:40 Fake S2A Service: failed to receive SessionReq: rpc error: code = Canceled desc = context canceled ---- PASS: TestSetUpSessionPrivateKeyOperation (0.02s) +2024/09/12 23:03:09 Fake S2A Service: failed to receive SessionReq: rpc error: code = Canceled desc = context canceled +2024/09/12 23:03:09 Client: connected to: [::]:39067 +2024/09/12 23:03:09 Client: set up bidirectional streaming RPC session. +2024/09/12 23:03:09 Client: sent SessionReq +2024/09/12 23:03:09 Client: received SessionResp +2024/09/12 23:03:09 resp matches tc.expectedResponse +--- PASS: TestSetUpSessionPrivateKeyOperation (0.01s) --- PASS: TestSetUpSessionPrivateKeyOperation/client_side_private_key_operation (0.00s) - --- PASS: TestSetUpSessionPrivateKeyOperation/server_side_private_key_operation (0.01s) + --- PASS: TestSetUpSessionPrivateKeyOperation/server_side_private_key_operation (0.00s) --- PASS: TestSetUpSessionPrivateKeyOperation/client_side_private_key_operation_--_invalid_signature_algorithm (0.00s) PASS -ok github.com/google/s2a-go/internal/v2/fakes2av2 0.043s +2024/09/12 23:03:09 Fake S2A Service: failed to receive SessionReq: rpc error: code = Canceled desc = context canceled +ok github.com/google/s2a-go/internal/v2/fakes2av2 0.027s === RUN TestSign -2025/10/16 05:23:40 Server: started gRPC fake S2Av2 Server on address: [::]:44463 +2024/09/12 23:03:09 Server: started gRPC fake S2Av2 Server on address: [::]:40151 === RUN TestSign/Sign_with_client_key -2025/10/16 05:23:40 Client: connected to: [::]:44463 -2025/10/16 05:23:40 Client: set up bidirectional streaming RPC session. -2025/10/16 05:23:40 Fake S2A Service: failed to receive SessionReq: rpc error: code = Canceled desc = context canceled +2024/09/12 23:03:09 Client: connected to: [::]:40151 +2024/09/12 23:03:09 Client: set up bidirectional streaming RPC session. === RUN TestSign/Sign_with_server_key -2025/10/16 05:23:40 Client: connected to: [::]:44463 -2025/10/16 05:23:40 Client: set up bidirectional streaming RPC session. -2025/10/16 05:23:40 Fake S2A Service: failed to receive SessionReq: rpc error: code = Canceled desc = context canceled ---- PASS: TestSign (0.02s) - --- PASS: TestSign/Sign_with_client_key (0.02s) - --- PASS: TestSign/Sign_with_server_key (0.01s) +2024/09/12 23:03:09 Fake S2A Service: failed to receive SessionReq: rpc error: code = Canceled desc = context canceled +2024/09/12 23:03:09 Client: connected to: [::]:40151 +2024/09/12 23:03:09 Client: set up bidirectional streaming RPC session. +2024/09/12 23:03:09 Fake S2A Service: failed to receive SessionReq: rpc error: code = Canceled desc = context canceled +--- PASS: TestSign (0.01s) + --- PASS: TestSign/Sign_with_client_key (0.01s) + --- PASS: TestSign/Sign_with_server_key (0.00s) === RUN TestNew --- PASS: TestNew (0.00s) === RUN TestGetSignatureAlgorithm @@ -2668,36 +2704,36 @@ --- PASS: TestGetSignReq/ECDSA_SHA512 (0.00s) --- PASS: TestGetSignReq/ED25519 (0.00s) PASS -ok github.com/google/s2a-go/internal/v2/remotesigner 0.033s +ok github.com/google/s2a-go/internal/v2/remotesigner 0.017s === RUN TestTLSConfigStoreClient -2025/10/16 05:23:40 Server: started gRPC fake S2Av2 Server on address: [::]:40873 +2024/09/12 23:03:09 Server: started gRPC fake S2Av2 Server on address: [::]:34255 === RUN TestTLSConfigStoreClient/static_-_nil_tokenManager -2025/10/16 05:23:40 Client: connected to: [::]:40873 -2025/10/16 05:23:40 Client: set up bidirectional streaming RPC session. +2024/09/12 23:03:09 Client: connected to: [::]:34255 +2024/09/12 23:03:09 Client: set up bidirectional streaming RPC session. === RUN TestTLSConfigStoreClient/static_-_non-nil_tokenManager -2025/10/16 05:23:40 Fake S2A Service: failed to receive SessionReq: rpc error: code = Canceled desc = context canceled -2025/10/16 05:23:40 Client: connected to: [::]:40873 -2025/10/16 05:23:40 Client: set up bidirectional streaming RPC session. -2025/10/16 05:23:40 Fake S2A Service: failed to receive SessionReq: rpc error: code = Canceled desc = context canceled ---- PASS: TestTLSConfigStoreClient (0.01s) +2024/09/12 23:03:09 Fake S2A Service: failed to receive SessionReq: rpc error: code = Canceled desc = context canceled +2024/09/12 23:03:09 Client: connected to: [::]:34255 +2024/09/12 23:03:09 Client: set up bidirectional streaming RPC session. +2024/09/12 23:03:09 Fake S2A Service: failed to receive SessionReq: rpc error: code = Canceled desc = context canceled +--- PASS: TestTLSConfigStoreClient (0.00s) --- PASS: TestTLSConfigStoreClient/static_-_nil_tokenManager (0.00s) --- PASS: TestTLSConfigStoreClient/static_-_non-nil_tokenManager (0.00s) === RUN TestTLSConfigStoreClientWithoutCredentials -2025/10/16 05:23:40 Server: started gRPC fake S2Av2 Server on address: [::]:43615 -2025/10/16 05:23:40 Client: connected to: [::]:43615 -2025/10/16 05:23:40 Client: set up bidirectional streaming RPC session. -2025/10/16 05:23:40 Fake S2A Service: failed to receive SessionReq: rpc error: code = Canceled desc = context canceled +2024/09/12 23:03:09 Server: started gRPC fake S2Av2 Server on address: [::]:46151 +2024/09/12 23:03:09 Client: connected to: [::]:46151 +2024/09/12 23:03:09 Client: set up bidirectional streaming RPC session. +2024/09/12 23:03:09 Fake S2A Service: failed to receive SessionReq: rpc error: code = Canceled desc = context canceled --- PASS: TestTLSConfigStoreClientWithoutCredentials (0.00s) === RUN TestTLSConfigStoreServer -2025/10/16 05:23:40 Server: started gRPC fake S2Av2 Server on address: [::]:39549 +2024/09/12 23:03:09 Server: started gRPC fake S2Av2 Server on address: [::]:46301 === RUN TestTLSConfigStoreServer/static_-_nil_tokenManager -2025/10/16 05:23:40 Client: connected to: [::]:39549 -2025/10/16 05:23:40 Client: set up bidirectional streaming RPC session. +2024/09/12 23:03:09 Client: connected to: [::]:46301 +2024/09/12 23:03:09 Client: set up bidirectional streaming RPC session. +2024/09/12 23:03:09 Fake S2A Service: failed to receive SessionReq: rpc error: code = Canceled desc = context canceled === RUN TestTLSConfigStoreServer/static_-_non-nil_tokenManager -2025/10/16 05:23:40 Fake S2A Service: failed to receive SessionReq: rpc error: code = Canceled desc = context canceled -2025/10/16 05:23:40 Client: connected to: [::]:39549 -2025/10/16 05:23:40 Client: set up bidirectional streaming RPC session. -2025/10/16 05:23:40 Fake S2A Service: failed to receive SessionReq: rpc error: code = Canceled desc = context canceled +2024/09/12 23:03:09 Client: connected to: [::]:46301 +2024/09/12 23:03:09 Client: set up bidirectional streaming RPC session. +2024/09/12 23:03:09 Fake S2A Service: failed to receive SessionReq: rpc error: code = Canceled desc = context canceled --- PASS: TestTLSConfigStoreServer (0.00s) --- PASS: TestTLSConfigStoreServer/static_-_nil_tokenManager (0.00s) --- PASS: TestTLSConfigStoreServer/static_-_non-nil_tokenManager (0.00s) @@ -2714,29 +2750,29 @@ --- PASS: TestGetAuthMechanisms/fake_token_manager_allows_empty_identity (0.00s) --- PASS: TestGetAuthMechanisms/fake_token_manager_does_not_allow_empty_identity (0.00s) === RUN TestGetServerConfigFromS2Av2 -2025/10/16 05:23:40 Server: started gRPC fake S2Av2 Server on address: [::]:44051 +2024/09/12 23:03:09 Server: started gRPC fake S2Av2 Server on address: [::]:36551 === RUN TestGetServerConfigFromS2Av2/empty_accessToken_and_empty_localIdentities -2025/10/16 05:23:40 Client: connected to: [::]:44051 -2025/10/16 05:23:40 Client: set up bidirectional streaming RPC session. -2025/10/16 05:23:40 Fake S2A Service: authentication error: SessionReq has no AuthenticationMechanism with a valid token +2024/09/12 23:03:09 Client: connected to: [::]:36551 +2024/09/12 23:03:09 Client: set up bidirectional streaming RPC session. +2024/09/12 23:03:09 Fake S2A Service: authentication error: SessionReq has no AuthenticationMechanism with a valid token === RUN TestGetServerConfigFromS2Av2/invalid_accessToken -2025/10/16 05:23:40 Client: connected to: [::]:44051 -2025/10/16 05:23:40 Client: set up bidirectional streaming RPC session. -2025/10/16 05:23:40 Fake S2A Service: authentication error: SessionReq has no AuthenticationMechanism with a valid token +2024/09/12 23:03:09 Client: connected to: [::]:36551 +2024/09/12 23:03:09 Client: set up bidirectional streaming RPC session. +2024/09/12 23:03:09 Fake S2A Service: authentication error: SessionReq has no AuthenticationMechanism with a valid token === RUN TestGetServerConfigFromS2Av2/correct_accessToken_and_non_-_empty_localIdentities -2025/10/16 05:23:40 Client: connected to: [::]:44051 -2025/10/16 05:23:40 Client: set up bidirectional streaming RPC session. -2025/10/16 05:23:40 Fake S2A Service: failed to receive SessionReq: rpc error: code = Canceled desc = context canceled ---- PASS: TestGetServerConfigFromS2Av2 (0.01s) - --- PASS: TestGetServerConfigFromS2Av2/empty_accessToken_and_empty_localIdentities (0.01s) +2024/09/12 23:03:09 Client: connected to: [::]:36551 +2024/09/12 23:03:09 Client: set up bidirectional streaming RPC session. +2024/09/12 23:03:09 Fake S2A Service: failed to receive SessionReq: rpc error: code = Canceled desc = context canceled +--- PASS: TestGetServerConfigFromS2Av2 (0.00s) + --- PASS: TestGetServerConfigFromS2Av2/empty_accessToken_and_empty_localIdentities (0.00s) --- PASS: TestGetServerConfigFromS2Av2/invalid_accessToken (0.00s) --- PASS: TestGetServerConfigFromS2Av2/correct_accessToken_and_non_-_empty_localIdentities (0.00s) === RUN TestGetClientConfig -2025/10/16 05:23:40 Server: started gRPC fake S2Av2 Server on address: [::]:45895 +2024/09/12 23:03:09 Server: started gRPC fake S2Av2 Server on address: [::]:36121 === RUN TestGetClientConfig/static -2025/10/16 05:23:40 Client: connected to: [::]:45895 -2025/10/16 05:23:40 Client: set up bidirectional streaming RPC session. -2025/10/16 05:23:40 Fake S2A Service: failed to receive SessionReq: rpc error: code = Canceled desc = context canceled +2024/09/12 23:03:09 Client: connected to: [::]:36121 +2024/09/12 23:03:09 Client: set up bidirectional streaming RPC session. +2024/09/12 23:03:09 Fake S2A Service: failed to receive SessionReq: rpc error: code = Canceled desc = context canceled --- PASS: TestGetClientConfig (0.00s) --- PASS: TestGetClientConfig/static (0.00s) === RUN TestGetTLSClientAuthType @@ -2782,7 +2818,7 @@ --- PASS: TestGetCipherSuites/unspecified_array_of_size_1 (0.00s) --- PASS: TestGetCipherSuites/unspecified_array_of_size_2 (0.00s) PASS -ok github.com/google/s2a-go/internal/v2/tlsconfigstore 0.034s +ok github.com/google/s2a-go/internal/v2/tlsconfigstore 0.017s === RUN TestS2ARetryer === RUN TestS2ARetryer/retry_on_err === RUN TestS2ARetryer/don't_retry_if_err_is_nil @@ -2794,9 +2830,9 @@ === RUN TestDefaultBackoff --- PASS: TestDefaultBackoff (0.00s) === RUN TestSuccessAfterRetry ---- PASS: TestSuccessAfterRetry (0.02s) +--- PASS: TestSuccessAfterRetry (0.01s) PASS -ok github.com/google/s2a-go/retry 0.026s +ok github.com/google/s2a-go/retry 0.015s create-stamp debian/debhelper-build-stamp dh_testroot -O--builddirectory=_build -O--buildsystem=golang dh_prep -O--builddirectory=_build -O--buildsystem=golang @@ -2825,12 +2861,14 @@ dpkg-buildpackage: info: binary-only upload (no source included) dpkg-genchanges: info: not including original source code in upload I: copying local configuration +I: user script /srv/workspace/pbuilder/2538533/tmp/hooks/B01_cleanup starting +I: user script /srv/workspace/pbuilder/2538533/tmp/hooks/B01_cleanup finished I: unmounting dev/ptmx filesystem I: unmounting dev/pts filesystem I: unmounting dev/shm filesystem I: unmounting proc filesystem I: unmounting sys filesystem I: cleaning the build env -I: removing directory /srv/workspace/pbuilder/2720236 and its subdirectories -I: Current time: Wed Oct 15 17:23:53 -12 2025 -I: pbuilder-time-stamp: 1760592233 +I: removing directory /srv/workspace/pbuilder/2538533 and its subdirectories +I: Current time: Fri Sep 13 13:03:15 +14 2024 +I: pbuilder-time-stamp: 1726182195