Diff of the two buildlogs: -- --- b1/build.log 2024-05-07 07:13:02.942867690 +0000 +++ b2/build.log 2024-05-07 07:18:02.310124774 +0000 @@ -1,6 +1,6 @@ I: pbuilder: network access will be disabled during build -I: Current time: Mon May 6 19:10:57 -12 2024 -I: pbuilder-time-stamp: 1715065857 +I: Current time: Tue Jun 10 03:36:18 +14 2025 +I: pbuilder-time-stamp: 1749476178 I: Building the build Environment I: extracting base tarball [/var/cache/pbuilder/unstable-reproducible-base.tgz] I: copying local configuration @@ -31,52 +31,84 @@ dpkg-source: info: applying 0004-Use-github.com-golang-protobuf-ptypes-empty.patch I: Not using root during the build. I: Installing the build-deps -I: user script /srv/workspace/pbuilder/3573580/tmp/hooks/D02_print_environment starting +I: user script /srv/workspace/pbuilder/478752/tmp/hooks/D01_modify_environment starting +debug: Running on codethink03-arm64. +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 Jun 9 13:36 /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/478752/tmp/hooks/D01_modify_environment finished +I: user script /srv/workspace/pbuilder/478752/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='arm64' - 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]="21" [3]="1" [4]="release" [5]="aarch64-unknown-linux-gnu") + BASH_VERSION='5.2.21(1)-release' + BUILDDIR=/build/reproducible-path + BUILDUSERGECOS='second user,second room,second work-phone,second home-phone,second other' + BUILDUSERNAME=pbuilder2 + BUILD_ARCH=arm64 + DEBIAN_FRONTEND=noninteractive DEB_BUILD_OPTIONS='buildinfo=+all reproducible=+all parallel=12 ' - DISTRIBUTION='unstable' - HOME='/root' - HOST_ARCH='arm64' + DIRSTACK=() + DISTRIBUTION=unstable + EUID=0 + FUNCNAME=([0]="Echo" [1]="main") + GROUPS=() + HOME=/root + HOSTNAME=i-capture-the-hostname + HOSTTYPE=aarch64 + HOST_ARCH=arm64 IFS=' ' - INVOCATION_ID='a91a4b9c75f04047a136a887d4c127d4' - 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='3573580' - PS1='# ' - PS2='> ' + INVOCATION_ID=2bf7d982a93d4735afda69647782f5e3 + LANG=C + LANGUAGE=nl_BE:nl + LC_ALL=C + MACHTYPE=aarch64-unknown-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=478752 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.6UQihuG8/pbuilderrc_fh8p --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.6UQihuG8/b1 --logfile b1/build.log notary_0.7.0+ds1-2.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' - http_proxy='http://192.168.101.4:3128' + 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.6UQihuG8/pbuilderrc_9R55 --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.6UQihuG8/b2 --logfile b2/build.log notary_0.7.0+ds1-2.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' + http_proxy=http://192.168.101.4:3128 I: uname -a - Linux codethink02-arm64 6.1.0-20-cloud-arm64 #1 SMP Debian 6.1.85-1 (2024-04-11) aarch64 GNU/Linux + Linux i-capture-the-hostname 6.1.0-20-cloud-arm64 #1 SMP Debian 6.1.85-1 (2024-04-11) aarch64 GNU/Linux I: ls -l /bin - lrwxrwxrwx 1 root root 7 May 5 07:42 /bin -> usr/bin -I: user script /srv/workspace/pbuilder/3573580/tmp/hooks/D02_print_environment finished + lrwxrwxrwx 1 root root 7 Jun 7 14:05 /bin -> usr/bin +I: user script /srv/workspace/pbuilder/478752/tmp/hooks/D02_print_environment finished -> Attempting to satisfy build-dependencies -> Creating pbuilder-satisfydepends-dummy package Package: pbuilder-satisfydepends-dummy @@ -355,7 +387,7 @@ Get: 187 http://deb.debian.org/debian unstable/main arm64 golang-goprotobuf-dev arm64 1.3.5-4+b6 [3432 B] Get: 188 http://deb.debian.org/debian unstable/main arm64 golang-gopkg-rethinkdb-rethinkdb-go.v6-dev all 6.2.1-2 [106 kB] Get: 189 http://deb.debian.org/debian unstable/main arm64 openssl arm64 3.2.1-3 [1324 kB] -Fetched 104 MB in 1s (84.7 MB/s) +Fetched 104 MB in 1s (98.4 MB/s) debconf: delaying package configuration, since apt-utils is not installed Selecting previously unselected package golang-golang-x-sys-dev. (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 ... 19744 files and directories currently installed.) @@ -1126,7 +1158,11 @@ Building tag database... -> Finished parsing the build-deps I: Building the package -I: Running cd /build/reproducible-path/notary-0.7.0+ds1/ && 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 > ../notary_0.7.0+ds1-2_source.changes +I: user script /srv/workspace/pbuilder/478752/tmp/hooks/A99_set_merged_usr starting +Not re-configuring usrmerge for unstable +I: user script /srv/workspace/pbuilder/478752/tmp/hooks/A99_set_merged_usr finished +hostname: Name or service not known +I: Running cd /build/reproducible-path/notary-0.7.0+ds1/ && 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 > ../notary_0.7.0+ds1-2_source.changes dpkg-buildpackage: info: source package notary dpkg-buildpackage: info: source version 0.7.0+ds1-2 dpkg-buildpackage: info: source distribution unstable @@ -1407,276 +1443,279 @@ src/github.com/theupdateframework/notary/version/version.go cd _build && go install -trimpath -v -p 12 -tags pkcs11 github.com/theupdateframework/notary github.com/theupdateframework/notary/client github.com/theupdateframework/notary/client/changelist github.com/theupdateframework/notary/cmd/escrow github.com/theupdateframework/notary/cmd/notary github.com/theupdateframework/notary/cmd/notary-server github.com/theupdateframework/notary/cmd/notary-signer github.com/theupdateframework/notary/cryptoservice github.com/theupdateframework/notary/passphrase github.com/theupdateframework/notary/proto github.com/theupdateframework/notary/server github.com/theupdateframework/notary/server/errors github.com/theupdateframework/notary/server/handlers github.com/theupdateframework/notary/server/snapshot github.com/theupdateframework/notary/server/storage github.com/theupdateframework/notary/server/timestamp github.com/theupdateframework/notary/signer github.com/theupdateframework/notary/signer/api github.com/theupdateframework/notary/signer/client github.com/theupdateframework/notary/signer/keydbstore github.com/theupdateframework/notary/storage github.com/theupdateframework/notary/storage/rethinkdb github.com/theupdateframework/notary/trustmanager github.com/theupdateframework/notary/trustmanager/remoteks github.com/theupdateframework/notary/trustmanager/yubikey github.com/theupdateframework/notary/trustpinning github.com/theupdateframework/notary/tuf github.com/theupdateframework/notary/tuf/data github.com/theupdateframework/notary/tuf/signed github.com/theupdateframework/notary/tuf/testutils github.com/theupdateframework/notary/tuf/testutils/interfaces github.com/theupdateframework/notary/tuf/testutils/keys github.com/theupdateframework/notary/tuf/utils github.com/theupdateframework/notary/tuf/validation github.com/theupdateframework/notary/utils github.com/theupdateframework/notary/version internal/godebugs -internal/goexperiment +internal/goarch +runtime/internal/syscall +math/bits +internal/cpu internal/goos -internal/unsafeheader internal/coverage/rtcov -sync/atomic +internal/goexperiment +internal/unsafeheader +unicode/utf8 internal/itoa +internal/race +internal/abi +sync/atomic +internal/chacha8rand +runtime/internal/math +runtime/internal/sys +math unicode cmp encoding unicode/utf16 log/internal -internal/race -internal/cpu crypto/internal/alias -unicode/utf8 -runtime/internal/syscall +slices crypto/subtle -math/bits crypto/internal/boring/sig -internal/goarch vendor/golang.org/x/crypto/cryptobyte/asn1 internal/nettrace container/list vendor/golang.org/x/crypto/internal/alias -internal/abi -internal/chacha8rand -runtime/internal/math -runtime/internal/sys -google.golang.org/grpc/serviceconfig github.com/pelletier/go-toml/v2/internal/characters +google.golang.org/grpc/serviceconfig +internal/bytealg +runtime/internal/atomic google.golang.org/protobuf/internal/flags -slices -math google.golang.org/protobuf/internal/set -github.com/theupdateframework/notary/version github.com/lib/pq/oid -runtime/internal/atomic -internal/bytealg +github.com/theupdateframework/notary/version runtime internal/reflectlite -runtime/metrics sync +runtime/metrics internal/testlog internal/bisect +internal/singleflight github.com/spf13/viper/internal/encoding +google.golang.org/grpc/internal/buffer google.golang.org/grpc/internal/grpcsync google.golang.org/protobuf/internal/pragma -internal/singleflight -google.golang.org/grpc/internal/buffer runtime/cgo internal/godebug +math/rand +internal/intern errors sort +io +strconv internal/oserror -path internal/safefilepath -strconv -math/rand -crypto/internal/nistec/fiat -io +path vendor/golang.org/x/net/dns/dnsmessage -internal/intern -syscall -github.com/beorn7/perks/quantile +crypto/internal/nistec/fiat github.com/hashicorp/hcl/hcl/strconv +syscall hash bytes strings crypto/internal/randutil text/tabwriter +github.com/beorn7/perks/quantile hash/crc32 hash/fnv +vendor/golang.org/x/text/transform +golang.org/x/text/transform +github.com/dvsekhvalnov/jose2go/padding crypto reflect net/netip crypto/rc4 golang.org/x/crypto/blowfish -encoding/base32 -vendor/golang.org/x/text/transform -golang.org/x/text/transform -github.com/dvsekhvalnov/jose2go/padding bufio regexp/syntax net/http/internal/ascii html +golang.org/x/text/runes google.golang.org/grpc/encoding github.com/prometheus/common/internal/bitbucket.org/ww/goautoneg +encoding/base32 net/http/internal/testcert -golang.org/x/text/runes internal/syscall/unix -internal/syscall/execenv time +internal/syscall/execenv regexp github.com/jinzhu/inflection internal/poll -io/fs context google.golang.org/grpc/backoff google.golang.org/grpc/internal/grpcrand google.golang.org/grpc/keepalive github.com/bugsnag/bugsnag-go/headers +io/fs google.golang.org/grpc/internal/backoff embed github.com/spf13/afero/internal/common golang.org/x/net/context google.golang.org/grpc/tap gopkg.in/rethinkdb/rethinkdb-go.v6/vendor/gopkg.in/cenkalti/backoff.v2 -encoding/binary -internal/fmtsort google.golang.org/protobuf/internal/editiondefaults os +encoding/binary +internal/fmtsort crypto/md5 encoding/base64 github.com/cespare/xxhash crypto/cipher +vendor/golang.org/x/crypto/internal/poly1305 crypto/internal/edwards25519/field -crypto/internal/nistec golang.org/x/sys/unix -vendor/golang.org/x/crypto/internal/poly1305 +crypto/internal/nistec encoding/pem github.com/dvsekhvalnov/jose2go/base64url github.com/dvsekhvalnov/jose2go/compact crypto/internal/boring crypto/des vendor/golang.org/x/crypto/chacha20 -crypto/internal/edwards25519 +crypto/aes crypto/sha512 crypto/sha256 crypto/sha1 crypto/hmac -crypto/aes -golang.org/x/crypto/pbkdf2 -vendor/golang.org/x/crypto/hkdf -vendor/golang.org/x/crypto/chacha20poly1305 +crypto/internal/edwards25519 github.com/theupdateframework/notary fmt path/filepath io/ioutil -crypto/ecdh +golang.org/x/crypto/pbkdf2 +vendor/golang.org/x/crypto/hkdf +net +vendor/golang.org/x/crypto/chacha20poly1305 google.golang.org/grpc/internal/envconfig github.com/bugsnag/bugsnag-go/device os/signal google.golang.org/protobuf/internal/detrand +crypto/ecdh github.com/prometheus/procfs/internal/util internal/lazyregexp internal/sysinfo github.com/spf13/afero/mem os/exec -net -github.com/bugsnag/panicwrap -log +encoding/json github.com/docker/go/canonical/json +log +math/big encoding/hex -encoding/json -vendor/golang.org/x/text/unicode/norm net/url mime mime/quotedprintable -math/big compress/flate +vendor/golang.org/x/text/unicode/norm vendor/golang.org/x/net/http2/hpack net/http/internal -vendor/golang.org/x/text/unicode/bidi github.com/miekg/pkcs11 +vendor/golang.org/x/text/unicode/bidi flag encoding/csv golang.org/x/text/unicode/norm -text/template/parse compress/gzip +text/template/parse github.com/spf13/jwalterweatherman github.com/subosito/gotenv vendor/golang.org/x/text/secure/bidirule github.com/hashicorp/hcl/hcl/token gopkg.in/ini.v1 github.com/pelletier/go-toml/v2/internal/danger -gopkg.in/yaml.v3 +github.com/theupdateframework/notary/tuf/validation github.com/hashicorp/hcl/hcl/ast github.com/hashicorp/hcl/hcl/scanner -vendor/golang.org/x/net/idna -github.com/theupdateframework/notary/tuf/validation github.com/hashicorp/hcl/json/token +vendor/golang.org/x/net/idna +github.com/spf13/viper/internal/encoding/json +github.com/pelletier/go-toml/v2/unstable +github.com/hashicorp/hcl/json/scanner +gopkg.in/yaml.v3 github.com/hashicorp/hcl/hcl/parser +github.com/hashicorp/hcl/json/parser +github.com/hashicorp/hcl/hcl/printer +text/template +github.com/hashicorp/hcl +github.com/pelletier/go-toml/v2/internal/tracker +github.com/golang/protobuf/proto +golang.org/x/net/internal/timeseries github.com/sirupsen/logrus github.com/fsnotify/fsnotify -text/template -github.com/hashicorp/hcl/json/scanner -github.com/hashicorp/hcl/hcl/printer -github.com/spf13/viper/internal/encoding/json +github.com/spf13/viper/internal/encoding/hcl +github.com/pelletier/go-toml/v2 +google.golang.org/grpc/internal/grpclog +google.golang.org/grpc/grpclog +google.golang.org/grpc/attributes +google.golang.org/grpc/metadata +google.golang.org/grpc/codes +golang.org/x/text/unicode/bidi crypto/rand crypto/elliptic crypto/internal/bigmod crypto/internal/boring/bbig +github.com/docker/distribution/uuid encoding/asn1 crypto/dsa -github.com/docker/distribution/uuid -crypto/ed25519 -github.com/hashicorp/hcl/json/parser -github.com/pelletier/go-toml/v2/unstable -github.com/golang/protobuf/proto -golang.org/x/net/internal/timeseries -golang.org/x/crypto/ed25519 -google.golang.org/grpc/internal/grpclog -google.golang.org/grpc/attributes crypto/rsa -github.com/hashicorp/hcl -google.golang.org/grpc/grpclog -google.golang.org/grpc/metadata -google.golang.org/grpc/codes -golang.org/x/text/unicode/bidi -google.golang.org/grpc/internal/balancerload -vendor/golang.org/x/crypto/cryptobyte -crypto/x509/pkix -github.com/pelletier/go-toml/v2/internal/tracker +crypto/ed25519 google.golang.org/grpc/connectivity -github.com/spf13/viper/internal/encoding/hcl -golang.org/x/net/http2/hpack +google.golang.org/grpc/internal/balancerload +html/template google.golang.org/grpc/internal -github.com/pelletier/go-toml/v2 +github.com/spf13/viper/internal/encoding/toml +golang.org/x/net/http2/hpack github.com/pkg/errors +golang.org/x/crypto/ed25519 +golang.org/x/text/secure/bidirule +github.com/bugsnag/panicwrap database/sql/driver -github.com/opencontainers/go-digest -html/template +golang.org/x/net/idna github.com/bugsnag/bugsnag-go/errors -crypto/ecdsa -golang.org/x/text/secure/bidirule -github.com/docker/distribution/digestset -database/sql -github.com/spf13/viper/internal/encoding/yaml +github.com/opencontainers/go-digest github.com/opencontainers/image-spec/specs-go -golang.org/x/net/idna -github.com/opencontainers/image-spec/specs-go/v1 google.golang.org/protobuf/internal/errors -github.com/docker/distribution/reference +vendor/golang.org/x/crypto/cryptobyte +crypto/x509/pkix +database/sql +google.golang.org/protobuf/encoding/protowire +github.com/docker/distribution/digestset +github.com/opencontainers/image-spec/specs-go/v1 go/token google.golang.org/protobuf/internal/version -google.golang.org/protobuf/encoding/protowire +github.com/docker/distribution/reference +github.com/spf13/viper/internal/encoding/yaml +google.golang.org/protobuf/reflect/protoreflect github.com/prometheus/procfs/internal/fs runtime/debug golang.org/x/term -google.golang.org/protobuf/reflect/protoreflect golang.org/x/crypto/bcrypt +crypto/ecdsa github.com/lib/pq/scram -github.com/spf13/viper/internal/encoding/toml os/user -github.com/spf13/cast go/scanner github.com/hailocab/go-hostpool -github.com/theupdateframework/notary/passphrase +github.com/spf13/cast +go/ast github.com/opentracing/opentracing-go/log +github.com/theupdateframework/notary/passphrase gopkg.in/rethinkdb/rethinkdb-go.v6/encoding gopkg.in/rethinkdb/rethinkdb-go.v6/types -go/ast internal/profile +runtime/pprof +runtime/trace +github.com/spf13/viper/internal/encoding/dotenv +github.com/spf13/viper/internal/encoding/ini +github.com/dvsekhvalnov/jose2go/arrays google.golang.org/protobuf/internal/descfmt google.golang.org/protobuf/internal/descopts google.golang.org/protobuf/internal/strs google.golang.org/protobuf/internal/encoding/messageset google.golang.org/protobuf/internal/genid -github.com/spf13/viper/internal/encoding/dotenv -github.com/spf13/viper/internal/encoding/ini google.golang.org/protobuf/internal/encoding/text google.golang.org/protobuf/internal/order google.golang.org/protobuf/reflect/protoregistry google.golang.org/protobuf/runtime/protoiface -runtime/pprof -runtime/trace -github.com/dvsekhvalnov/jose2go/arrays +github.com/dvsekhvalnov/jose2go/aes +github.com/dvsekhvalnov/jose2go/kdf github.com/davecgh/go-spew/spew +github.com/jinzhu/gorm github.com/pmezard/go-difflib/difflib -github.com/dvsekhvalnov/jose2go/aes +testing google.golang.org/protobuf/internal/encoding/defval google.golang.org/protobuf/proto github.com/golang/protobuf/ptypes/empty @@ -1685,28 +1724,25 @@ github.com/golang/protobuf/ptypes/duration github.com/golang/protobuf/ptypes/timestamp gopkg.in/rethinkdb/rethinkdb-go.v6/ql2 -github.com/jinzhu/gorm google.golang.org/genproto/googleapis/rpc/status -github.com/dvsekhvalnov/jose2go/kdf -testing github.com/golang/protobuf/ptypes google.golang.org/grpc/binarylog/grpc_binarylog_v1 google.golang.org/grpc/internal/status -google.golang.org/grpc/status google.golang.org/protobuf/internal/filedesc +google.golang.org/grpc/status google.golang.org/protobuf/encoding/prototext google.golang.org/protobuf/encoding/protodelim google.golang.org/protobuf/internal/encoding/tag google.golang.org/protobuf/internal/impl -vendor/golang.org/x/net/http/httpproxy +crypto/x509 net/textproto -google.golang.org/grpc/stats +vendor/golang.org/x/net/http/httpproxy github.com/mitchellh/mapstructure +github.com/prometheus/procfs +github.com/spf13/pflag google.golang.org/grpc/internal/syscall +google.golang.org/grpc/stats github.com/google/uuid -github.com/spf13/pflag -github.com/prometheus/procfs -crypto/x509 mime/multipart vendor/golang.org/x/net/http/httpguts golang.org/x/net/http/httpguts @@ -1725,96 +1761,96 @@ net/http/httptrace google.golang.org/grpc/internal/credentials github.com/docker/go-connections/tlsconfig -github.com/docker/libtrust github.com/go-sql-driver/mysql +github.com/docker/libtrust github.com/lib/pq google.golang.org/grpc/credentials net/http google.golang.org/grpc/resolver -google.golang.org/grpc/peer google.golang.org/grpc/internal/channelz +google.golang.org/grpc/peer github.com/prometheus/client_golang/prometheus/internal google.golang.org/grpc/balancer google.golang.org/grpc/internal/grpcutil -google.golang.org/grpc/internal/resolver/passthrough google.golang.org/grpc/balancer/grpclb/state +google.golang.org/grpc/internal/resolver/passthrough google.golang.org/grpc/internal/binarylog google.golang.org/grpc/internal/resolver/dns google.golang.org/grpc/balancer/base google.golang.org/grpc/internal/serviceconfig google.golang.org/grpc/balancer/roundrobin github.com/theupdateframework/notary/storage +github.com/spf13/afero github.com/magiconair/properties -github.com/docker/distribution/registry/api/errcode +golang.org/x/net/http2 net/http/httputil -github.com/spf13/afero -github.com/gorilla/mux github.com/bugsnag/bugsnag-go/sessions +github.com/gorilla/mux +github.com/docker/distribution/registry/api/errcode github.com/docker/distribution/registry/auth github.com/docker/distribution -golang.org/x/net/http2 golang.org/x/net/trace github.com/docker/distribution/registry/client/auth/challenge github.com/docker/distribution/registry/client/transport expvar github.com/prometheus/common/expfmt -github.com/bugsnag/bugsnag-go github.com/theupdateframework/notary/server/errors -github.com/theupdateframework/notary/trustmanager +github.com/bugsnag/bugsnag-go github.com/opentracing/opentracing-go -github.com/docker/distribution/context -github.com/docker/distribution/registry/api/v2 +github.com/theupdateframework/notary/trustmanager net/http/pprof github.com/spf13/viper/internal/encoding/javaproperties -github.com/docker/distribution/health -github.com/docker/distribution/registry/auth/htpasswd -github.com/docker/distribution/registry/auth/token -github.com/theupdateframework/notary/cryptoservice +github.com/docker/distribution/context +github.com/docker/distribution/registry/api/v2 github.com/opentracing/opentracing-go/ext -github.com/theupdateframework/notary/tuf/signed net/http/httptest +github.com/theupdateframework/notary/cryptoservice +github.com/theupdateframework/notary/tuf/signed gopkg.in/rethinkdb/rethinkdb-go.v6 -github.com/prometheus/client_golang/prometheus -github.com/theupdateframework/notary/vendor/github.com/prometheus/client_golang/prometheus github.com/Shopify/logrus-bugsnag -github.com/theupdateframework/notary/trustmanager/yubikey +github.com/docker/distribution/health +github.com/docker/distribution/registry/auth/htpasswd +github.com/docker/distribution/registry/auth/token +github.com/stretchr/testify/assert github.com/theupdateframework/notary/trustpinning github.com/theupdateframework/notary/tuf/testutils/keys -github.com/spf13/viper -github.com/stretchr/testify/assert +github.com/theupdateframework/notary/vendor/github.com/prometheus/client_golang/prometheus +github.com/prometheus/client_golang/prometheus github.com/theupdateframework/notary/tuf +github.com/spf13/viper +github.com/theupdateframework/notary/trustmanager/yubikey +github.com/theupdateframework/notary/tuf/testutils github.com/theupdateframework/notary/utils github.com/theupdateframework/notary/client -github.com/theupdateframework/notary/tuf/testutils github.com/stretchr/testify/require -github.com/prometheus/client_golang/prometheus/promhttp google.golang.org/grpc/internal/transport +github.com/prometheus/client_golang/prometheus/promhttp github.com/theupdateframework/notary/storage/rethinkdb +github.com/theupdateframework/notary/server/storage github.com/theupdateframework/notary/tuf/testutils/interfaces github.com/theupdateframework/notary/signer/keydbstore -github.com/theupdateframework/notary/server/storage -github.com/docker/go-metrics -github.com/docker/distribution/metrics github.com/theupdateframework/notary/server/snapshot -github.com/docker/distribution/registry/storage/cache +github.com/docker/go-metrics google.golang.org/grpc github.com/theupdateframework/notary/server/timestamp -github.com/docker/distribution/registry/storage/cache/memory github.com/theupdateframework/notary/server/handlers -github.com/docker/distribution/registry/client +github.com/docker/distribution/metrics +github.com/docker/distribution/registry/storage/cache +github.com/docker/distribution/registry/storage/cache/memory github.com/theupdateframework/notary/server +github.com/docker/distribution/registry/client github.com/docker/distribution/registry/client/auth github.com/theupdateframework/notary/cmd/notary github.com/theupdateframework/notary/trustmanager/remoteks -google.golang.org/grpc/health/grpc_health_v1 github.com/theupdateframework/notary/proto +google.golang.org/grpc/health/grpc_health_v1 +github.com/theupdateframework/notary/cmd/escrow google.golang.org/grpc/health github.com/theupdateframework/notary/signer/client github.com/theupdateframework/notary/signer -github.com/theupdateframework/notary/cmd/escrow github.com/theupdateframework/notary/signer/api -github.com/theupdateframework/notary/cmd/notary-signer github.com/theupdateframework/notary/cmd/notary-server +github.com/theupdateframework/notary/cmd/notary-signer make[1]: Leaving directory '/build/reproducible-path/notary-0.7.0+ds1' dh_auto_test -O--builddirectory=/build/reproducible-path/notary-0.7.0\+ds1/_build -O--buildsystem=golang cd _build && go test -vet=off -v -p 12 github.com/theupdateframework/notary github.com/theupdateframework/notary/client github.com/theupdateframework/notary/client/changelist github.com/theupdateframework/notary/cmd/escrow github.com/theupdateframework/notary/cmd/notary github.com/theupdateframework/notary/cmd/notary-server github.com/theupdateframework/notary/cmd/notary-signer github.com/theupdateframework/notary/cryptoservice github.com/theupdateframework/notary/passphrase github.com/theupdateframework/notary/proto github.com/theupdateframework/notary/server github.com/theupdateframework/notary/server/errors github.com/theupdateframework/notary/server/handlers github.com/theupdateframework/notary/server/snapshot github.com/theupdateframework/notary/server/storage github.com/theupdateframework/notary/server/timestamp github.com/theupdateframework/notary/signer github.com/theupdateframework/notary/signer/api github.com/theupdateframework/notary/signer/client github.com/theupdateframework/notary/signer/keydbstore github.com/theupdateframework/notary/storage github.com/theupdateframework/notary/storage/rethinkdb github.com/theupdateframework/notary/trustmanager github.com/theupdateframework/notary/trustmanager/remoteks github.com/theupdateframework/notary/trustmanager/yubikey github.com/theupdateframework/notary/trustpinning github.com/theupdateframework/notary/tuf github.com/theupdateframework/notary/tuf/data github.com/theupdateframework/notary/tuf/signed github.com/theupdateframework/notary/tuf/testutils github.com/theupdateframework/notary/tuf/testutils/interfaces github.com/theupdateframework/notary/tuf/testutils/keys github.com/theupdateframework/notary/tuf/utils github.com/theupdateframework/notary/tuf/validation github.com/theupdateframework/notary/utils github.com/theupdateframework/notary/version @@ -1829,147 +1865,147 @@ ? github.com/theupdateframework/notary/tuf/testutils/keys [no test files] ? github.com/theupdateframework/notary/version [no test files] === RUN Test0Dot1Migration ---- PASS: Test0Dot1Migration (0.01s) +--- PASS: Test0Dot1Migration (0.03s) === RUN Test0Dot3Migration ---- PASS: Test0Dot3Migration (0.01s) +--- PASS: Test0Dot3Migration (0.03s) === RUN Test0Dot1RepoFormat -time="2024-05-07T07:12:04Z" level=warning msg="Error while downloading remote metadata, using cached timestamp - this might not be the latest version available remotely" ---- PASS: Test0Dot1RepoFormat (0.20s) +time="2025-06-09T13:39:16Z" level=warning msg="Error while downloading remote metadata, using cached timestamp - this might not be the latest version available remotely" +--- PASS: Test0Dot1RepoFormat (0.28s) === RUN Test0Dot3RepoFormat -time="2024-05-07T07:12:04Z" level=warning msg="Error while downloading remote metadata, using cached timestamp - this might not be the latest version available remotely" ---- PASS: Test0Dot3RepoFormat (0.24s) +time="2025-06-09T13:39:16Z" level=warning msg="Error while downloading remote metadata, using cached timestamp - this might not be the latest version available remotely" +--- PASS: Test0Dot3RepoFormat (0.31s) === RUN TestDownloading0Dot1RepoFormat ---- PASS: TestDownloading0Dot1RepoFormat (0.01s) +--- PASS: TestDownloading0Dot1RepoFormat (0.00s) === RUN TestDownloading0Dot3RepoFormat ---- PASS: TestDownloading0Dot3RepoFormat (0.01s) +--- PASS: TestDownloading0Dot3RepoFormat (0.02s) === RUN TestInitRepositoryManagedRolesIncludingRoot ---- PASS: TestInitRepositoryManagedRolesIncludingRoot (0.00s) +--- PASS: TestInitRepositoryManagedRolesIncludingRoot (0.01s) === RUN TestInitRepositoryManagedRolesInvalidRole --- PASS: TestInitRepositoryManagedRolesInvalidRole (0.00s) === RUN TestInitRepositoryManagedRolesIncludingTargets --- PASS: TestInitRepositoryManagedRolesIncludingTargets (0.00s) === RUN TestInitRepositoryManagedRolesIncludingTimestamp ---- PASS: TestInitRepositoryManagedRolesIncludingTimestamp (0.02s) +--- PASS: TestInitRepositoryManagedRolesIncludingTimestamp (0.03s) === RUN TestInitRepositoryWithCerts ---- PASS: TestInitRepositoryWithCerts (0.02s) +--- PASS: TestInitRepositoryWithCerts (0.04s) === RUN TestMatchKeyIDsWithPublicKeys --- PASS: TestMatchKeyIDsWithPublicKeys (0.01s) === RUN TestInitRepositoryNeedsRemoteTimestampKey ---- PASS: TestInitRepositoryNeedsRemoteTimestampKey (0.01s) +--- PASS: TestInitRepositoryNeedsRemoteTimestampKey (0.02s) === RUN TestInitRepositoryNeedsRemoteSnapshotKey ---- PASS: TestInitRepositoryNeedsRemoteSnapshotKey (0.01s) +--- PASS: TestInitRepositoryNeedsRemoteSnapshotKey (0.02s) === RUN TestInitRepoServerOnlyManagesTimestampKey ---- PASS: TestInitRepoServerOnlyManagesTimestampKey (0.12s) +--- PASS: TestInitRepoServerOnlyManagesTimestampKey (0.14s) === RUN TestInitRepoServerManagesTimestampAndSnapshotKeys ---- PASS: TestInitRepoServerManagesTimestampAndSnapshotKeys (0.10s) +--- PASS: TestInitRepoServerManagesTimestampAndSnapshotKeys (0.13s) === RUN TestInitRepoAttemptsExceeded ---- PASS: TestInitRepoAttemptsExceeded (0.05s) +--- PASS: TestInitRepoAttemptsExceeded (0.11s) === RUN TestInitRepoPasswordInvalid ---- PASS: TestInitRepoPasswordInvalid (0.01s) +--- PASS: TestInitRepoPasswordInvalid (0.02s) === RUN TestAddTargetToTargetRoleByDefault ---- PASS: TestAddTargetToTargetRoleByDefault (0.02s) +--- PASS: TestAddTargetToTargetRoleByDefault (0.04s) === RUN TestAddTargetToSpecifiedValidRoles --- PASS: TestAddTargetToSpecifiedValidRoles (0.04s) === RUN TestAddTargetToSpecifiedInvalidRoles ---- PASS: TestAddTargetToSpecifiedInvalidRoles (0.04s) +--- PASS: TestAddTargetToSpecifiedInvalidRoles (0.05s) === RUN TestAddTargetWithInvalidTarget ---- PASS: TestAddTargetWithInvalidTarget (0.02s) +--- PASS: TestAddTargetWithInvalidTarget (0.03s) === RUN TestAddTargetErrorWritingChanges --- PASS: TestAddTargetErrorWritingChanges (0.02s) === RUN TestRemoveTargetToTargetRoleByDefault --- PASS: TestRemoveTargetToTargetRoleByDefault (0.03s) === RUN TestRemoveTargetFromSpecifiedValidRoles ---- PASS: TestRemoveTargetFromSpecifiedValidRoles (0.03s) +--- PASS: TestRemoveTargetFromSpecifiedValidRoles (0.05s) === RUN TestRemoveTargetToSpecifiedInvalidRoles --- PASS: TestRemoveTargetToSpecifiedInvalidRoles (0.04s) === RUN TestRemoveTargetErrorWritingChanges --- PASS: TestRemoveTargetErrorWritingChanges (0.02s) === RUN TestListTarget ---- PASS: TestListTarget (0.48s) +--- PASS: TestListTarget (0.69s) === RUN TestListTargetRestrictsDelegationPaths ---- PASS: TestListTargetRestrictsDelegationPaths (0.06s) +--- PASS: TestListTargetRestrictsDelegationPaths (0.12s) === RUN TestValidateRootKey ---- PASS: TestValidateRootKey (0.03s) +--- PASS: TestValidateRootKey (0.05s) === RUN TestGetChangelist ---- PASS: TestGetChangelist (0.03s) +--- PASS: TestGetChangelist (0.07s) === RUN TestPublishBareRepo ---- PASS: TestPublishBareRepo (0.24s) +--- PASS: TestPublishBareRepo (0.56s) === RUN TestPublishUninitializedRepo -time="2024-05-07T07:12:06Z" level=info msg="No TUF data found locally or remotely - initializing repository docker.com/notary for the first time" ---- PASS: TestPublishUninitializedRepo (0.02s) +time="2025-06-09T13:39:19Z" level=info msg="No TUF data found locally or remotely - initializing repository docker.com/notary for the first time" +--- PASS: TestPublishUninitializedRepo (0.04s) === RUN TestPublishClientHasSnapshotKey ---- PASS: TestPublishClientHasSnapshotKey (0.22s) +--- PASS: TestPublishClientHasSnapshotKey (0.53s) === RUN TestPublishAfterInitServerHasSnapshotKey ---- PASS: TestPublishAfterInitServerHasSnapshotKey (0.23s) +--- PASS: TestPublishAfterInitServerHasSnapshotKey (0.42s) === RUN TestPublishAfterPullServerHasSnapshotKey ---- PASS: TestPublishAfterPullServerHasSnapshotKey (0.10s) +--- PASS: TestPublishAfterPullServerHasSnapshotKey (0.15s) === RUN TestPublishNoOneHasSnapshotKey ---- PASS: TestPublishNoOneHasSnapshotKey (0.06s) +--- PASS: TestPublishNoOneHasSnapshotKey (0.13s) === RUN TestPublishSnapshotCorrupt ---- PASS: TestPublishSnapshotCorrupt (0.13s) +--- PASS: TestPublishSnapshotCorrupt (0.32s) === RUN TestPublishTargetsCorrupt ---- PASS: TestPublishTargetsCorrupt (0.06s) +--- PASS: TestPublishTargetsCorrupt (0.15s) === RUN TestPublishRootCorrupt -time="2024-05-07T07:12:06Z" level=error msg="Could not publish Repository since we could not update: invalid character 'h' in literal true (expecting 'r')" -time="2024-05-07T07:12:06Z" level=error msg="Could not publish Repository since we could not update: invalid character 'h' in literal true (expecting 'r')" ---- PASS: TestPublishRootCorrupt (0.04s) +time="2025-06-09T13:39:20Z" level=error msg="Could not publish Repository since we could not update: invalid character 'h' in literal true (expecting 'r')" +time="2025-06-09T13:39:20Z" level=error msg="Could not publish Repository since we could not update: invalid character 'h' in literal true (expecting 'r')" +--- PASS: TestPublishRootCorrupt (0.11s) === RUN TestPublishSnapshotLocalKeysCreatedFirst --- PASS: TestPublishSnapshotLocalKeysCreatedFirst (0.00s) === RUN TestPublishDelegations ---- PASS: TestPublishDelegations (0.07s) +--- PASS: TestPublishDelegations (0.22s) === RUN TestPublishDelegationsX509 ---- PASS: TestPublishDelegationsX509 (0.07s) +--- PASS: TestPublishDelegationsX509 (0.17s) === RUN TestPublishTargetsDelegationScopeFailIfNoKeys -time="2024-05-07T07:12:07Z" level=error msg="couldn't add target to targets/a/b: tuf: invalid role targets/a/b. delegation does not exist" -time="2024-05-07T07:12:07Z" level=error msg="couldn't add target to targets/a/b: tuf: invalid role targets/a/b. delegation does not exist" ---- PASS: TestPublishTargetsDelegationScopeFailIfNoKeys (0.06s) +time="2025-06-09T13:39:21Z" level=error msg="couldn't add target to targets/a/b: tuf: invalid role targets/a/b. delegation does not exist" +time="2025-06-09T13:39:21Z" level=error msg="couldn't add target to targets/a/b: tuf: invalid role targets/a/b. delegation does not exist" +--- PASS: TestPublishTargetsDelegationScopeFailIfNoKeys (0.15s) === RUN TestPublishTargetsDelegationSuccessLocallyHasRoles ---- PASS: TestPublishTargetsDelegationSuccessLocallyHasRoles (0.06s) +--- PASS: TestPublishTargetsDelegationSuccessLocallyHasRoles (0.18s) === RUN TestPublishTargetsDelegationNoTargetsKeyNeeded ---- PASS: TestPublishTargetsDelegationNoTargetsKeyNeeded (0.07s) +--- PASS: TestPublishTargetsDelegationNoTargetsKeyNeeded (0.25s) === RUN TestPublishTargetsDelegationSuccessNeedsToDownloadRoles ---- PASS: TestPublishTargetsDelegationSuccessNeedsToDownloadRoles (0.07s) +--- PASS: TestPublishTargetsDelegationSuccessNeedsToDownloadRoles (0.28s) === RUN TestPublishTargetsDelegationFromTwoRepos ---- PASS: TestPublishTargetsDelegationFromTwoRepos (0.07s) +--- PASS: TestPublishTargetsDelegationFromTwoRepos (0.27s) === RUN TestPublishRemoveDelegationKeyFromDelegationRole -time="2024-05-07T07:12:07Z" level=warning msg="Error getting targets/a: valid signatures did not meet threshold for targets/a" -time="2024-05-07T07:12:07Z" level=error msg="couldn't add target to targets/a: could not find necessary signing keys, at least one of these keys must be available: b5059780b31b11ca26fd5b1e3a976ba160b998f70044f84ea6586e4220a189de" ---- PASS: TestPublishRemoveDelegationKeyFromDelegationRole (0.05s) +time="2025-06-09T13:39:22Z" level=warning msg="Error getting targets/a: valid signatures did not meet threshold for targets/a" +time="2025-06-09T13:39:22Z" level=error msg="couldn't add target to targets/a: could not find necessary signing keys, at least one of these keys must be available: 79d2ce77ea52e8ac3c4e7a6b5c6af69053c949a3cecfb34fa38d059c3adfa7be" +--- PASS: TestPublishRemoveDelegationKeyFromDelegationRole (0.26s) === RUN TestPublishRemoveDelegation -time="2024-05-07T07:12:07Z" level=warning msg="role targets/a has fewer keys than its threshold of 1; it will not be usable until keys are added to it" -time="2024-05-07T07:12:07Z" level=warning msg="role targets/a has fewer keys than its threshold of 1; it will not be usable until keys are added to it" -time="2024-05-07T07:12:07Z" level=warning msg="Error getting targets/a: valid signatures did not meet threshold for targets/a" -time="2024-05-07T07:12:07Z" level=error msg="couldn't add target to targets/a: could not find necessary signing keys, at least one of these keys must be available: " ---- PASS: TestPublishRemoveDelegation (0.05s) +time="2025-06-09T13:39:22Z" level=warning msg="role targets/a has fewer keys than its threshold of 1; it will not be usable until keys are added to it" +time="2025-06-09T13:39:22Z" level=warning msg="role targets/a has fewer keys than its threshold of 1; it will not be usable until keys are added to it" +time="2025-06-09T13:39:22Z" level=warning msg="Error getting targets/a: valid signatures did not meet threshold for targets/a" +time="2025-06-09T13:39:22Z" level=error msg="couldn't add target to targets/a: could not find necessary signing keys, at least one of these keys must be available: " +--- PASS: TestPublishRemoveDelegation (0.20s) === RUN TestPublishSucceedsDespiteDelegationCorrupt ---- PASS: TestPublishSucceedsDespiteDelegationCorrupt (0.07s) +--- PASS: TestPublishSucceedsDespiteDelegationCorrupt (0.26s) === RUN TestRotateKeyInvalidRole ---- PASS: TestRotateKeyInvalidRole (0.03s) +--- PASS: TestRotateKeyInvalidRole (0.06s) === RUN TestRemoteRotationError ---- PASS: TestRemoteRotationError (0.01s) +--- PASS: TestRemoteRotationError (0.02s) === RUN TestRemoteRotationEndpointError ---- PASS: TestRemoteRotationEndpointError (0.03s) +--- PASS: TestRemoteRotationEndpointError (0.05s) === RUN TestRemoteRotationNoRootKey ---- PASS: TestRemoteRotationNoRootKey (0.03s) +--- PASS: TestRemoteRotationNoRootKey (0.09s) === RUN TestRemoteRotationNoInit -time="2024-05-07T07:12:07Z" level=info msg="No TUF data found locally or remotely - initializing repository docker.com/notary for the first time" ---- PASS: TestRemoteRotationNoInit (0.02s) +time="2025-06-09T13:39:23Z" level=info msg="No TUF data found locally or remotely - initializing repository docker.com/notary for the first time" +--- PASS: TestRemoteRotationNoInit (0.07s) === RUN TestRotateBeforePublishFromRemoteKeyToLocalKey ---- PASS: TestRotateBeforePublishFromRemoteKeyToLocalKey (0.08s) +--- PASS: TestRotateBeforePublishFromRemoteKeyToLocalKey (0.24s) === RUN TestRotateKeyAfterPublishNoServerManagementChange ---- PASS: TestRotateKeyAfterPublishNoServerManagementChange (0.25s) +--- PASS: TestRotateKeyAfterPublishNoServerManagementChange (0.81s) === RUN TestRotateKeyAfterPublishServerManagementChange ---- PASS: TestRotateKeyAfterPublishServerManagementChange (0.27s) +--- PASS: TestRotateKeyAfterPublishServerManagementChange (0.53s) === RUN TestRotateRootKey ---- PASS: TestRotateRootKey (0.08s) +--- PASS: TestRotateRootKey (0.20s) === RUN TestRotateRootMultiple ---- PASS: TestRotateRootMultiple (0.14s) +--- PASS: TestRotateRootMultiple (0.30s) === RUN TestRotateRootKeyProvided ---- PASS: TestRotateRootKeyProvided (0.13s) +--- PASS: TestRotateRootKeyProvided (0.20s) === RUN TestRotateRootKeyLegacySupport ---- PASS: TestRotateRootKeyLegacySupport (0.25s) +--- PASS: TestRotateRootKeyLegacySupport (0.28s) === RUN TestRemoteServerUnavailableNoLocalCache -time="2024-05-07T07:12:08Z" level=error msg="Could not publish Repository since we could not update: unable to reach trust server at this time: 500." +time="2025-06-09T13:39:26Z" level=error msg="Could not publish Repository since we could not update: unable to reach trust server at this time: 500." --- PASS: TestRemoteServerUnavailableNoLocalCache (0.00s) === RUN TestAddDelegationChangefileValid --- PASS: TestAddDelegationChangefileValid (0.02s) @@ -1978,15 +2014,15 @@ === RUN TestAddDelegationErrorWritingChanges --- PASS: TestAddDelegationErrorWritingChanges (0.02s) === RUN TestRemoveDelegationChangefileValid ---- PASS: TestRemoveDelegationChangefileValid (0.02s) +--- PASS: TestRemoveDelegationChangefileValid (0.01s) === RUN TestRemoveDelegationChangefileApplicable -time="2024-05-07T07:12:08Z" level=warning msg="role targets/a has fewer keys than its threshold of 1; it will not be usable until keys are added to it" -time="2024-05-07T07:12:08Z" level=warning msg="role targets/a has fewer keys than its threshold of 1; it will not be usable until keys are added to it" +time="2025-06-09T13:39:26Z" level=warning msg="role targets/a has fewer keys than its threshold of 1; it will not be usable until keys are added to it" +time="2025-06-09T13:39:26Z" level=warning msg="role targets/a has fewer keys than its threshold of 1; it will not be usable until keys are added to it" --- PASS: TestRemoveDelegationChangefileApplicable (0.02s) === RUN TestClearAllPathsDelegationChangefileApplicable ---- PASS: TestClearAllPathsDelegationChangefileApplicable (0.02s) +--- PASS: TestClearAllPathsDelegationChangefileApplicable (0.03s) === RUN TestFullAddDelegationChangefileApplicable ---- PASS: TestFullAddDelegationChangefileApplicable (0.02s) +--- PASS: TestFullAddDelegationChangefileApplicable (0.01s) === RUN TestFullRemoveDelegationChangefileApplicable --- PASS: TestFullRemoveDelegationChangefileApplicable (0.02s) === RUN TestRemoveDelegationErrorWritingChanges @@ -1994,171 +2030,171 @@ === RUN TestClientInvalidURL --- PASS: TestClientInvalidURL (0.00s) === RUN TestPublishTargetsDelegationCanUseUserKeyWithArbitraryRole ---- PASS: TestPublishTargetsDelegationCanUseUserKeyWithArbitraryRole (0.32s) +--- PASS: TestPublishTargetsDelegationCanUseUserKeyWithArbitraryRole (0.37s) === RUN TestDeleteRepo ---- PASS: TestDeleteRepo (0.04s) +--- PASS: TestDeleteRepo (0.05s) === RUN TestDeleteRemoteRepo --- PASS: TestDeleteRemoteRepo (0.11s) === RUN TestListRoles ---- PASS: TestListRoles (0.21s) +--- PASS: TestListRoles (0.25s) === RUN TestGetAllTargetInfo ---- PASS: TestGetAllTargetInfo (0.13s) +--- PASS: TestGetAllTargetInfo (0.15s) === RUN TestUpdateSucceedsEvenIfCannotWriteNewRepo -time="2024-05-07T07:12:09Z" level=error msg="could not save root to cache: Non-writable" ---- PASS: TestUpdateSucceedsEvenIfCannotWriteNewRepo (0.10s) +time="2025-06-09T13:39:27Z" level=error msg="could not save root to cache: Non-writable" +--- PASS: TestUpdateSucceedsEvenIfCannotWriteNewRepo (0.14s) === RUN TestUpdateSucceedsEvenIfCannotWriteExistingRepo ---- PASS: TestUpdateSucceedsEvenIfCannotWriteExistingRepo (0.48s) +--- PASS: TestUpdateSucceedsEvenIfCannotWriteExistingRepo (0.53s) === RUN TestUpdateInOfflineMode -time="2024-05-07T07:12:10Z" level=warning msg="Error while downloading remote metadata, using cached timestamp - this might not be the latest version available remotely" -time="2024-05-07T07:12:10Z" level=warning msg="Error while downloading remote metadata, using cached timestamp - this might not be the latest version available remotely" +time="2025-06-09T13:39:27Z" level=warning msg="Error while downloading remote metadata, using cached timestamp - this might not be the latest version available remotely" +time="2025-06-09T13:39:27Z" level=warning msg="Error while downloading remote metadata, using cached timestamp - this might not be the latest version available remotely" --- PASS: TestUpdateInOfflineMode (0.04s) === RUN TestUpdateReplacesCorruptOrMissingMetadata -time="2024-05-07T07:12:10Z" level=error msg="Metadata for root expired" -time="2024-05-07T07:12:10Z" level=error msg="Metadata for root expired" ---- PASS: TestUpdateReplacesCorruptOrMissingMetadata (0.85s) +time="2025-06-09T13:39:28Z" level=error msg="Metadata for root expired" +time="2025-06-09T13:39:28Z" level=error msg="Metadata for root expired" +--- PASS: TestUpdateReplacesCorruptOrMissingMetadata (0.96s) === RUN TestUpdateFailsIfServerRootKeyChangedWithoutMultiSign -time="2024-05-07T07:12:11Z" level=error msg="Metadata for root expired" -time="2024-05-07T07:12:11Z" level=error msg="Metadata for root expired" ---- PASS: TestUpdateFailsIfServerRootKeyChangedWithoutMultiSign (0.09s) +time="2025-06-09T13:39:28Z" level=error msg="Metadata for root expired" +time="2025-06-09T13:39:28Z" level=error msg="Metadata for root expired" +--- PASS: TestUpdateFailsIfServerRootKeyChangedWithoutMultiSign (0.08s) === RUN TestUpdateRemoteRootNotExistNoLocalCache --- PASS: TestUpdateRemoteRootNotExistNoLocalCache (0.03s) === RUN TestUpdateRemoteRootNotExistCanUseLocalCache ---- PASS: TestUpdateRemoteRootNotExistCanUseLocalCache (0.07s) +--- PASS: TestUpdateRemoteRootNotExistCanUseLocalCache (0.06s) === RUN TestUpdateRemoteRootNotExistCannotUseLocalCache ---- PASS: TestUpdateRemoteRootNotExistCannotUseLocalCache (0.08s) +--- PASS: TestUpdateRemoteRootNotExistCannotUseLocalCache (0.04s) === RUN TestUpdateRemoteRoot50XNoLocalCache ---- PASS: TestUpdateRemoteRoot50XNoLocalCache (0.03s) +--- PASS: TestUpdateRemoteRoot50XNoLocalCache (0.01s) === RUN TestUpdateRemoteRoot50XCanUseLocalCache ---- PASS: TestUpdateRemoteRoot50XCanUseLocalCache (0.07s) +--- PASS: TestUpdateRemoteRoot50XCanUseLocalCache (0.03s) === RUN TestUpdateRemoteRoot50XCannotUseLocalCache ---- PASS: TestUpdateRemoteRoot50XCannotUseLocalCache (0.08s) +--- PASS: TestUpdateRemoteRoot50XCannotUseLocalCache (0.04s) === RUN TestUpdateNonRootRemoteMissingMetadataNoLocalCache ---- PASS: TestUpdateNonRootRemoteMissingMetadataNoLocalCache (0.17s) +--- PASS: TestUpdateNonRootRemoteMissingMetadataNoLocalCache (0.08s) === RUN TestUpdateNonRootRemoteMissingMetadataCanUseLocalCache -time="2024-05-07T07:12:11Z" level=warning msg="Error while downloading remote metadata, using cached timestamp - this might not be the latest version available remotely" ---- PASS: TestUpdateNonRootRemoteMissingMetadataCanUseLocalCache (0.23s) +time="2025-06-09T13:39:29Z" level=warning msg="Error while downloading remote metadata, using cached timestamp - this might not be the latest version available remotely" +--- PASS: TestUpdateNonRootRemoteMissingMetadataCanUseLocalCache (0.16s) === RUN TestUpdateNonRootRemoteMissingMetadataCannotUseLocalCache -time="2024-05-07T07:12:12Z" level=warning msg="Error while downloading remote metadata, using cached timestamp - this might not be the latest version available remotely" ---- PASS: TestUpdateNonRootRemoteMissingMetadataCannotUseLocalCache (0.31s) +time="2025-06-09T13:39:29Z" level=warning msg="Error while downloading remote metadata, using cached timestamp - this might not be the latest version available remotely" +--- PASS: TestUpdateNonRootRemoteMissingMetadataCannotUseLocalCache (0.24s) === RUN TestUpdateNonRootRemote50XNoLocalCache ---- PASS: TestUpdateNonRootRemote50XNoLocalCache (0.16s) +--- PASS: TestUpdateNonRootRemote50XNoLocalCache (0.17s) === RUN TestUpdateNonRootRemote50XCanUseLocalCache -time="2024-05-07T07:12:12Z" level=warning msg="Error while downloading remote metadata, using cached timestamp - this might not be the latest version available remotely" ---- PASS: TestUpdateNonRootRemote50XCanUseLocalCache (0.23s) +time="2025-06-09T13:39:29Z" level=warning msg="Error while downloading remote metadata, using cached timestamp - this might not be the latest version available remotely" +--- PASS: TestUpdateNonRootRemote50XCanUseLocalCache (0.19s) === RUN TestUpdateNonRootRemote50XCannotUseLocalCache -time="2024-05-07T07:12:12Z" level=warning msg="Error while downloading remote metadata, using cached timestamp - this might not be the latest version available remotely" ---- PASS: TestUpdateNonRootRemote50XCannotUseLocalCache (0.31s) +time="2025-06-09T13:39:30Z" level=warning msg="Error while downloading remote metadata, using cached timestamp - this might not be the latest version available remotely" +--- PASS: TestUpdateNonRootRemote50XCannotUseLocalCache (0.29s) === RUN TestUpdateRemoteChecksumWrongNoLocalCache ---- PASS: TestUpdateRemoteChecksumWrongNoLocalCache (0.22s) +--- PASS: TestUpdateRemoteChecksumWrongNoLocalCache (0.15s) === RUN TestUpdateRemoteChecksumWrongCanUseLocalCache ---- PASS: TestUpdateRemoteChecksumWrongCanUseLocalCache (0.32s) +--- PASS: TestUpdateRemoteChecksumWrongCanUseLocalCache (0.25s) === RUN TestUpdateRemoteChecksumWrongCannotUseLocalCache ---- PASS: TestUpdateRemoteChecksumWrongCannotUseLocalCache (0.41s) +--- PASS: TestUpdateRemoteChecksumWrongCannotUseLocalCache (0.36s) === RUN TestUpdateRootRemoteCorruptedNoLocalCache -time="2024-05-07T07:12:14Z" level=error msg="Metadata for root expired" -time="2024-05-07T07:12:14Z" level=error msg="Metadata for root expired" ---- PASS: TestUpdateRootRemoteCorruptedNoLocalCache (0.66s) +time="2025-06-09T13:39:31Z" level=error msg="Metadata for root expired" +time="2025-06-09T13:39:31Z" level=error msg="Metadata for root expired" +--- PASS: TestUpdateRootRemoteCorruptedNoLocalCache (0.60s) === RUN TestUpdateRootRemoteCorruptedCanUseLocalCache ---- PASS: TestUpdateRootRemoteCorruptedCanUseLocalCache (1.40s) +--- PASS: TestUpdateRootRemoteCorruptedCanUseLocalCache (1.36s) === RUN TestUpdateRootRemoteCorruptedCannotUseLocalCache -time="2024-05-07T07:12:16Z" level=error msg="Metadata for root expired" -time="2024-05-07T07:12:16Z" level=error msg="Metadata for root expired" ---- PASS: TestUpdateRootRemoteCorruptedCannotUseLocalCache (1.64s) +time="2025-06-09T13:39:33Z" level=error msg="Metadata for root expired" +time="2025-06-09T13:39:34Z" level=error msg="Metadata for root expired" +--- PASS: TestUpdateRootRemoteCorruptedCannotUseLocalCache (1.81s) === RUN TestUpdateNonRootRemoteCorruptedNoLocalCache -time="2024-05-07T07:12:18Z" level=error msg="Metadata for targets expired" -time="2024-05-07T07:12:18Z" level=error msg="Metadata for targets expired" -time="2024-05-07T07:12:18Z" level=error msg="Metadata for snapshot expired" -time="2024-05-07T07:12:18Z" level=error msg="Metadata for snapshot expired" -time="2024-05-07T07:12:18Z" level=error msg="Metadata for timestamp expired" -time="2024-05-07T07:12:18Z" level=error msg="Metadata for timestamp expired" -time="2024-05-07T07:12:18Z" level=warning msg="Error getting targets/a: valid signatures did not meet threshold for targets/a" -time="2024-05-07T07:12:18Z" level=warning msg="Error getting targets/a: valid signatures did not meet threshold for targets/a" -time="2024-05-07T07:12:18Z" level=warning msg="Error getting targets/a: valid signatures did not meet threshold for targets/a" -time="2024-05-07T07:12:18Z" level=error msg="Metadata for targets/a expired" -time="2024-05-07T07:12:18Z" level=warning msg="Error getting targets/a: targets/a expired at Thu Apr 6 07:12:18 UTC 2023" -time="2024-05-07T07:12:18Z" level=warning msg="Error getting targets/a/b: valid signatures did not meet threshold for targets/a/b" -time="2024-05-07T07:12:19Z" level=warning msg="Error getting targets/a/b: valid signatures did not meet threshold for targets/a/b" -time="2024-05-07T07:12:19Z" level=warning msg="Error getting targets/a/b: valid signatures did not meet threshold for targets/a/b" -time="2024-05-07T07:12:19Z" level=error msg="Metadata for targets/a/b expired" -time="2024-05-07T07:12:19Z" level=warning msg="Error getting targets/a/b: targets/a/b expired at Thu Apr 6 07:12:19 UTC 2023" -time="2024-05-07T07:12:19Z" level=warning msg="Error getting targets/b: valid signatures did not meet threshold for targets/b" -time="2024-05-07T07:12:19Z" level=warning msg="Error getting targets/b: valid signatures did not meet threshold for targets/b" -time="2024-05-07T07:12:19Z" level=warning msg="Error getting targets/b: valid signatures did not meet threshold for targets/b" -time="2024-05-07T07:12:19Z" level=error msg="Metadata for targets/b expired" -time="2024-05-07T07:12:19Z" level=warning msg="Error getting targets/b: targets/b expired at Thu Apr 6 07:12:19 UTC 2023" ---- PASS: TestUpdateNonRootRemoteCorruptedNoLocalCache (1.76s) +time="2025-06-09T13:39:35Z" level=error msg="Metadata for targets expired" +time="2025-06-09T13:39:35Z" level=error msg="Metadata for targets expired" +time="2025-06-09T13:39:35Z" level=error msg="Metadata for snapshot expired" +time="2025-06-09T13:39:35Z" level=error msg="Metadata for snapshot expired" +time="2025-06-09T13:39:35Z" level=error msg="Metadata for timestamp expired" +time="2025-06-09T13:39:35Z" level=error msg="Metadata for timestamp expired" +time="2025-06-09T13:39:35Z" level=warning msg="Error getting targets/a: valid signatures did not meet threshold for targets/a" +time="2025-06-09T13:39:35Z" level=warning msg="Error getting targets/a: valid signatures did not meet threshold for targets/a" +time="2025-06-09T13:39:35Z" level=warning msg="Error getting targets/a: valid signatures did not meet threshold for targets/a" +time="2025-06-09T13:39:35Z" level=error msg="Metadata for targets/a expired" +time="2025-06-09T13:39:35Z" level=warning msg="Error getting targets/a: targets/a expired at Wed May 8 13:39:35 UTC 2024" +time="2025-06-09T13:39:36Z" level=warning msg="Error getting targets/a/b: valid signatures did not meet threshold for targets/a/b" +time="2025-06-09T13:39:36Z" level=warning msg="Error getting targets/a/b: valid signatures did not meet threshold for targets/a/b" +time="2025-06-09T13:39:36Z" level=warning msg="Error getting targets/a/b: valid signatures did not meet threshold for targets/a/b" +time="2025-06-09T13:39:36Z" level=error msg="Metadata for targets/a/b expired" +time="2025-06-09T13:39:36Z" level=warning msg="Error getting targets/a/b: targets/a/b expired at Wed May 8 13:39:36 UTC 2024" +time="2025-06-09T13:39:36Z" level=warning msg="Error getting targets/b: valid signatures did not meet threshold for targets/b" +time="2025-06-09T13:39:36Z" level=warning msg="Error getting targets/b: valid signatures did not meet threshold for targets/b" +time="2025-06-09T13:39:36Z" level=warning msg="Error getting targets/b: valid signatures did not meet threshold for targets/b" +time="2025-06-09T13:39:36Z" level=error msg="Metadata for targets/b expired" +time="2025-06-09T13:39:36Z" level=warning msg="Error getting targets/b: targets/b expired at Wed May 8 13:39:36 UTC 2024" +--- PASS: TestUpdateNonRootRemoteCorruptedNoLocalCache (1.94s) === RUN TestUpdateNonRootRemoteCorruptedCanUseLocalCache -time="2024-05-07T07:12:20Z" level=error msg="Metadata for timestamp expired" -time="2024-05-07T07:12:20Z" level=error msg="Metadata for timestamp expired" ---- PASS: TestUpdateNonRootRemoteCorruptedCanUseLocalCache (2.35s) +time="2025-06-09T13:39:38Z" level=error msg="Metadata for timestamp expired" +time="2025-06-09T13:39:38Z" level=error msg="Metadata for timestamp expired" +--- PASS: TestUpdateNonRootRemoteCorruptedCanUseLocalCache (2.52s) === RUN TestUpdateNonRootRemoteCorruptedCannotUseLocalCache -time="2024-05-07T07:12:22Z" level=error msg="Metadata for targets expired" -time="2024-05-07T07:12:22Z" level=error msg="Metadata for snapshot expired" -time="2024-05-07T07:12:22Z" level=error msg="Metadata for snapshot expired" -time="2024-05-07T07:12:23Z" level=error msg="Metadata for timestamp expired" -time="2024-05-07T07:12:23Z" level=error msg="Metadata for timestamp expired" -time="2024-05-07T07:12:23Z" level=warning msg="Error getting targets/a: valid signatures did not meet threshold for targets/a" -time="2024-05-07T07:12:23Z" level=warning msg="Error getting targets/a: valid signatures did not meet threshold for targets/a" -time="2024-05-07T07:12:23Z" level=warning msg="Error getting targets/a: valid signatures did not meet threshold for targets/a" -time="2024-05-07T07:12:23Z" level=error msg="Metadata for targets/a expired" -time="2024-05-07T07:12:23Z" level=warning msg="Error getting targets/a: targets/a expired at Thu Apr 6 07:12:23 UTC 2023" -time="2024-05-07T07:12:24Z" level=warning msg="Error getting targets/a/b: valid signatures did not meet threshold for targets/a/b" -time="2024-05-07T07:12:24Z" level=warning msg="Error getting targets/a/b: valid signatures did not meet threshold for targets/a/b" -time="2024-05-07T07:12:24Z" level=warning msg="Error getting targets/a/b: valid signatures did not meet threshold for targets/a/b" -time="2024-05-07T07:12:24Z" level=error msg="Metadata for targets/a/b expired" -time="2024-05-07T07:12:24Z" level=warning msg="Error getting targets/a/b: targets/a/b expired at Thu Apr 6 07:12:24 UTC 2023" -time="2024-05-07T07:12:24Z" level=warning msg="Error getting targets/b: valid signatures did not meet threshold for targets/b" -time="2024-05-07T07:12:24Z" level=warning msg="Error getting targets/b: valid signatures did not meet threshold for targets/b" -time="2024-05-07T07:12:24Z" level=warning msg="Error getting targets/b: valid signatures did not meet threshold for targets/b" -time="2024-05-07T07:12:24Z" level=error msg="Metadata for targets/b expired" -time="2024-05-07T07:12:24Z" level=warning msg="Error getting targets/b: targets/b expired at Thu Apr 6 07:12:24 UTC 2023" ---- PASS: TestUpdateNonRootRemoteCorruptedCannotUseLocalCache (3.18s) +time="2025-06-09T13:39:39Z" level=error msg="Metadata for targets expired" +time="2025-06-09T13:39:39Z" level=error msg="Metadata for snapshot expired" +time="2025-06-09T13:39:39Z" level=error msg="Metadata for snapshot expired" +time="2025-06-09T13:39:40Z" level=error msg="Metadata for timestamp expired" +time="2025-06-09T13:39:40Z" level=error msg="Metadata for timestamp expired" +time="2025-06-09T13:39:40Z" level=warning msg="Error getting targets/a: valid signatures did not meet threshold for targets/a" +time="2025-06-09T13:39:40Z" level=warning msg="Error getting targets/a: valid signatures did not meet threshold for targets/a" +time="2025-06-09T13:39:40Z" level=warning msg="Error getting targets/a: valid signatures did not meet threshold for targets/a" +time="2025-06-09T13:39:40Z" level=error msg="Metadata for targets/a expired" +time="2025-06-09T13:39:40Z" level=warning msg="Error getting targets/a: targets/a expired at Wed May 8 13:39:40 UTC 2024" +time="2025-06-09T13:39:40Z" level=warning msg="Error getting targets/a/b: valid signatures did not meet threshold for targets/a/b" +time="2025-06-09T13:39:40Z" level=warning msg="Error getting targets/a/b: valid signatures did not meet threshold for targets/a/b" +time="2025-06-09T13:39:40Z" level=warning msg="Error getting targets/a/b: valid signatures did not meet threshold for targets/a/b" +time="2025-06-09T13:39:40Z" level=error msg="Metadata for targets/a/b expired" +time="2025-06-09T13:39:40Z" level=warning msg="Error getting targets/a/b: targets/a/b expired at Wed May 8 13:39:40 UTC 2024" +time="2025-06-09T13:39:41Z" level=warning msg="Error getting targets/b: valid signatures did not meet threshold for targets/b" +time="2025-06-09T13:39:41Z" level=warning msg="Error getting targets/b: valid signatures did not meet threshold for targets/b" +time="2025-06-09T13:39:41Z" level=warning msg="Error getting targets/b: valid signatures did not meet threshold for targets/b" +time="2025-06-09T13:39:41Z" level=error msg="Metadata for targets/b expired" +time="2025-06-09T13:39:41Z" level=warning msg="Error getting targets/b: targets/b expired at Wed May 8 13:39:41 UTC 2024" +--- PASS: TestUpdateNonRootRemoteCorruptedCannotUseLocalCache (2.14s) === RUN TestUpdateLocalAndRemoteRootCorrupt -time="2024-05-07T07:12:25Z" level=error msg="Metadata for root expired" -time="2024-05-07T07:12:26Z" level=error msg="Metadata for root expired" -time="2024-05-07T07:12:27Z" level=error msg="Metadata for root expired" -time="2024-05-07T07:12:27Z" level=error msg="Metadata for root expired" -time="2024-05-07T07:12:27Z" level=error msg="Metadata for root expired" -time="2024-05-07T07:12:27Z" level=error msg="Metadata for root expired" -time="2024-05-07T07:12:27Z" level=error msg="Metadata for root expired" -time="2024-05-07T07:12:27Z" level=error msg="Metadata for root expired" -time="2024-05-07T07:12:27Z" level=error msg="Metadata for root expired" -time="2024-05-07T07:12:27Z" level=error msg="Metadata for root expired" -time="2024-05-07T07:12:27Z" level=error msg="Metadata for root expired" -time="2024-05-07T07:12:27Z" level=error msg="Metadata for root expired" -time="2024-05-07T07:12:27Z" level=error msg="Metadata for root expired" -time="2024-05-07T07:12:27Z" level=error msg="Metadata for root expired" -time="2024-05-07T07:12:27Z" level=error msg="Metadata for root expired" -time="2024-05-07T07:12:27Z" level=error msg="Metadata for root expired" -time="2024-05-07T07:12:28Z" level=error msg="Metadata for root expired" -time="2024-05-07T07:12:28Z" level=error msg="Metadata for root expired" -time="2024-05-07T07:12:28Z" level=error msg="Metadata for root expired" -time="2024-05-07T07:12:28Z" level=error msg="Metadata for root expired" -time="2024-05-07T07:12:28Z" level=error msg="Metadata for root expired" -time="2024-05-07T07:12:28Z" level=error msg="Metadata for root expired" ---- PASS: TestUpdateLocalAndRemoteRootCorrupt (3.11s) +time="2025-06-09T13:39:42Z" level=error msg="Metadata for root expired" +time="2025-06-09T13:39:42Z" level=error msg="Metadata for root expired" +time="2025-06-09T13:39:43Z" level=error msg="Metadata for root expired" +time="2025-06-09T13:39:43Z" level=error msg="Metadata for root expired" +time="2025-06-09T13:39:43Z" level=error msg="Metadata for root expired" +time="2025-06-09T13:39:43Z" level=error msg="Metadata for root expired" +time="2025-06-09T13:39:43Z" level=error msg="Metadata for root expired" +time="2025-06-09T13:39:43Z" level=error msg="Metadata for root expired" +time="2025-06-09T13:39:44Z" level=error msg="Metadata for root expired" +time="2025-06-09T13:39:44Z" level=error msg="Metadata for root expired" +time="2025-06-09T13:39:44Z" level=error msg="Metadata for root expired" +time="2025-06-09T13:39:44Z" level=error msg="Metadata for root expired" +time="2025-06-09T13:39:44Z" level=error msg="Metadata for root expired" +time="2025-06-09T13:39:44Z" level=error msg="Metadata for root expired" +time="2025-06-09T13:39:44Z" level=error msg="Metadata for root expired" +time="2025-06-09T13:39:44Z" level=error msg="Metadata for root expired" +time="2025-06-09T13:39:44Z" level=error msg="Metadata for root expired" +time="2025-06-09T13:39:44Z" level=error msg="Metadata for root expired" +time="2025-06-09T13:39:44Z" level=error msg="Metadata for root expired" +time="2025-06-09T13:39:44Z" level=error msg="Metadata for root expired" +time="2025-06-09T13:39:44Z" level=error msg="Metadata for root expired" +time="2025-06-09T13:39:44Z" level=error msg="Metadata for root expired" +--- PASS: TestUpdateLocalAndRemoteRootCorrupt (3.13s) === RUN TestUpdateRemoteKeyRotated -time="2024-05-07T07:12:28Z" level=warning msg="Error getting targets/a: valid signatures did not meet threshold for targets/a" -time="2024-05-07T07:12:28Z" level=warning msg="Error getting targets/a/b: valid signatures did not meet threshold for targets/a/b" -time="2024-05-07T07:12:28Z" level=warning msg="Error getting targets/b: valid signatures did not meet threshold for targets/b" ---- PASS: TestUpdateRemoteKeyRotated (0.34s) +time="2025-06-09T13:39:44Z" level=warning msg="Error getting targets/a: valid signatures did not meet threshold for targets/a" +time="2025-06-09T13:39:44Z" level=warning msg="Error getting targets/a/b: valid signatures did not meet threshold for targets/a/b" +time="2025-06-09T13:39:44Z" level=warning msg="Error getting targets/b: valid signatures did not meet threshold for targets/b" +--- PASS: TestUpdateRemoteKeyRotated (0.32s) === RUN TestValidateRootRotationWithOldRole ---- PASS: TestValidateRootRotationWithOldRole (0.17s) +--- PASS: TestValidateRootRotationWithOldRole (0.13s) === RUN TestRootRoleInvariant ---- PASS: TestRootRoleInvariant (0.15s) +--- PASS: TestRootRoleInvariant (0.12s) === RUN TestBadIntermediateTransitions --- PASS: TestBadIntermediateTransitions (0.06s) === RUN TestExpiredIntermediateTransitions -time="2024-05-07T07:12:28Z" level=warning msg="root is nearing expiry, you should re-sign the role metadata" ---- PASS: TestExpiredIntermediateTransitions (0.06s) +time="2025-06-09T13:39:45Z" level=warning msg="root is nearing expiry, you should re-sign the role metadata" +--- PASS: TestExpiredIntermediateTransitions (0.09s) === RUN TestDownloadTargetsLarge ---- PASS: TestDownloadTargetsLarge (3.23s) +--- PASS: TestDownloadTargetsLarge (5.92s) === RUN TestDownloadTargetsDeep ---- PASS: TestDownloadTargetsDeep (0.03s) +--- PASS: TestDownloadTargetsDeep (0.04s) === RUN TestDownloadSnapshotLargeDelegationsMany ---- PASS: TestDownloadSnapshotLargeDelegationsMany (2.56s) +--- PASS: TestDownloadSnapshotLargeDelegationsMany (5.28s) === RUN TestRootOnDiskTrustPinning ---- PASS: TestRootOnDiskTrustPinning (0.03s) +--- PASS: TestRootOnDiskTrustPinning (0.02s) === RUN TestLoadTUFRepoBadURL --- PASS: TestLoadTUFRepoBadURL (0.00s) === RUN TestApplyTargetsChange @@ -2166,57 +2202,57 @@ === RUN TestApplyAddTargetTwice --- PASS: TestApplyAddTargetTwice (0.00s) === RUN TestApplyChangelist ---- PASS: TestApplyChangelist (0.00s) +--- PASS: TestApplyChangelist (0.01s) === RUN TestApplyChangelistMulti --- PASS: TestApplyChangelistMulti (0.00s) === RUN TestApplyTargetsDelegationCreateDelete --- PASS: TestApplyTargetsDelegationCreateDelete (0.00s) === RUN TestApplyTargetsDelegationCreate2SharedKey ---- PASS: TestApplyTargetsDelegationCreate2SharedKey (0.00s) +--- PASS: TestApplyTargetsDelegationCreate2SharedKey (0.01s) === RUN TestApplyTargetsDelegationCreateEdit --- PASS: TestApplyTargetsDelegationCreateEdit (0.00s) === RUN TestApplyTargetsDelegationEditNonExisting --- PASS: TestApplyTargetsDelegationEditNonExisting (0.00s) === RUN TestApplyTargetsDelegationCreateAlreadyExisting ---- PASS: TestApplyTargetsDelegationCreateAlreadyExisting (0.00s) +--- PASS: TestApplyTargetsDelegationCreateAlreadyExisting (0.01s) === RUN TestApplyTargetsDelegationAlreadyExistingMergePaths --- PASS: TestApplyTargetsDelegationAlreadyExistingMergePaths (0.00s) === RUN TestApplyTargetsDelegationInvalidRole --- PASS: TestApplyTargetsDelegationInvalidRole (0.00s) === RUN TestApplyTargetsDelegationInvalidJSONContent ---- PASS: TestApplyTargetsDelegationInvalidJSONContent (0.00s) +--- PASS: TestApplyTargetsDelegationInvalidJSONContent (0.01s) === RUN TestApplyTargetsDelegationInvalidAction --- PASS: TestApplyTargetsDelegationInvalidAction (0.00s) === RUN TestApplyTargetsChangeInvalidType --- PASS: TestApplyTargetsChangeInvalidType (0.00s) === RUN TestApplyTargetsDelegationCreate2Deep ---- PASS: TestApplyTargetsDelegationCreate2Deep (0.00s) +--- PASS: TestApplyTargetsDelegationCreate2Deep (0.01s) === RUN TestApplyTargetsDelegationParentDoesntExist --- PASS: TestApplyTargetsDelegationParentDoesntExist (0.00s) === RUN TestApplyChangelistCreatesDelegation --- PASS: TestApplyChangelistCreatesDelegation (0.00s) === RUN TestApplyChangelistTargetsToMultipleRoles ---- PASS: TestApplyChangelistTargetsToMultipleRoles (0.00s) +--- PASS: TestApplyChangelistTargetsToMultipleRoles (0.01s) === RUN TestApplyChangelistTargetsFailsNonexistentRole -time="2024-05-07T07:12:34Z" level=error msg="couldn't add target to targets/level1/level2/level3/level4: tuf: invalid role targets/level1/level2/level3/level4. delegation does not exist" -time="2024-05-07T07:12:34Z" level=error msg="couldn't remove target from targets/level1/level2/level3/level4: tuf: invalid role targets/level1/level2/level3/level4. delegation does not exist" +time="2025-06-09T13:39:56Z" level=error msg="couldn't add target to targets/level1/level2/level3/level4: tuf: invalid role targets/level1/level2/level3/level4. delegation does not exist" +time="2025-06-09T13:39:56Z" level=error msg="couldn't remove target from targets/level1/level2/level3/level4: tuf: invalid role targets/level1/level2/level3/level4. delegation does not exist" --- PASS: TestApplyChangelistTargetsFailsNonexistentRole (0.00s) === RUN TestChangeTargetMetaFailsInvalidRole -time="2024-05-07T07:12:34Z" level=error msg="couldn't add target to ruhroh: tuf: invalid role ruhroh. does not exist" +time="2025-06-09T13:39:56Z" level=error msg="couldn't add target to ruhroh: tuf: invalid role ruhroh. does not exist" --- PASS: TestChangeTargetMetaFailsInvalidRole (0.00s) === RUN TestChangeTargetMetaFailsIfPrefixError -time="2024-05-07T07:12:34Z" level=error msg="couldn't add target to targets/level1: Could not add all targets" ---- PASS: TestChangeTargetMetaFailsIfPrefixError (0.00s) +time="2025-06-09T13:39:56Z" level=error msg="couldn't add target to targets/level1: Could not add all targets" +--- PASS: TestChangeTargetMetaFailsIfPrefixError (0.01s) === RUN TestAllNearExpiry --- PASS: TestAllNearExpiry (0.00s) === RUN TestAllNotNearExpiry --- PASS: TestAllNotNearExpiry (0.00s) === RUN TestRotateRemoteKeyOffline ---- PASS: TestRotateRemoteKeyOffline (0.00s) +--- PASS: TestRotateRemoteKeyOffline (0.01s) PASS -ok github.com/theupdateframework/notary/client 30.834s +ok github.com/theupdateframework/notary/client 40.670s === RUN TestTUFDelegation ---- PASS: TestTUFDelegation (0.01s) +--- PASS: TestTUFDelegation (0.02s) === RUN TestMemChangelist --- PASS: TestMemChangelist (0.00s) === RUN TestMemChangeIterator @@ -2226,14 +2262,14 @@ === RUN TestAdd --- PASS: TestAdd (0.00s) === RUN TestErrorConditions -time="2024-05-07T07:12:04Z" level=warning msg="invalid character '\\x05' looking for beginning of value" +time="2025-06-09T13:39:16Z" level=warning msg="invalid character '\\x05' looking for beginning of value" --- PASS: TestErrorConditions (0.00s) === RUN TestListOrder --- PASS: TestListOrder (0.00s) === RUN TestFileChangeIterator --- PASS: TestFileChangeIterator (0.00s) PASS -ok github.com/theupdateframework/notary/client/changelist 0.035s +ok github.com/theupdateframework/notary/client/changelist 0.112s === RUN TestParseConfigError --- PASS: TestParseConfigError (0.00s) === RUN TestSetupGRPCServer @@ -2243,7 +2279,7 @@ === RUN TestSetupNetListener --- PASS: TestSetupNetListener (0.00s) PASS -ok github.com/theupdateframework/notary/cmd/escrow 0.040s +ok github.com/theupdateframework/notary/cmd/escrow 0.068s === RUN TestPurgeDelegationKeys Usage: delegation [command] @@ -2301,7 +2337,7 @@ remove Remove KeyID(s) from the specified Role delegation. Use "delegation [command] --help" for more information about a command. ---- PASS: TestListInvalidNumArgs (0.00s) +--- PASS: TestListInvalidNumArgs (0.02s) === RUN TestRemoveInvalidNumArgs Usage: delegation [command] @@ -2315,104 +2351,104 @@ Use "delegation [command] --help" for more information about a command. --- PASS: TestRemoveInvalidNumArgs (0.00s) === RUN TestInitWithRootKey ---- PASS: TestInitWithRootKey (0.10s) +--- PASS: TestInitWithRootKey (0.15s) === RUN TestInitWithRootCert ---- PASS: TestInitWithRootCert (0.08s) +--- PASS: TestInitWithRootCert (0.09s) === RUN TestClientTUFInteraction ---- PASS: TestClientTUFInteraction (0.18s) +--- PASS: TestClientTUFInteraction (0.33s) === RUN TestClientDeleteTUFInteraction -time="2024-05-07T07:12:04Z" level=error msg="could not reach https://invalid-server: Get \"https://invalid-server/v2/\": dial tcp: lookup invalid-server on [::1]:53: read udp [::1]:43845->[::1]:53: read: connection refused" ---- PASS: TestClientDeleteTUFInteraction (0.24s) +time="2025-06-09T13:39:16Z" level=error msg="could not reach https://invalid-server: Get \"https://invalid-server/v2/\": dial tcp: lookup invalid-server on [::1]:53: read udp [::1]:42814->[::1]:53: read: connection refused" +--- PASS: TestClientDeleteTUFInteraction (0.22s) === RUN TestClientTUFAddByHashInteraction ---- PASS: TestClientTUFAddByHashInteraction (0.36s) +--- PASS: TestClientTUFAddByHashInteraction (0.34s) === RUN TestClientDelegationsInteraction -time="2024-05-07T07:12:05Z" level=warning msg="role targets/delegation has fewer keys than its threshold of 1; it will not be usable until keys are added to it" -time="2024-05-07T07:12:05Z" level=warning msg="role targets/delegation has fewer keys than its threshold of 1; it will not be usable until keys are added to it" ---- PASS: TestClientDelegationsInteraction (0.73s) +time="2025-06-09T13:39:17Z" level=warning msg="role targets/delegation has fewer keys than its threshold of 1; it will not be usable until keys are added to it" +time="2025-06-09T13:39:17Z" level=warning msg="role targets/delegation has fewer keys than its threshold of 1; it will not be usable until keys are added to it" +--- PASS: TestClientDelegationsInteraction (0.82s) === RUN TestClientDelegationsPublishing ---- PASS: TestClientDelegationsPublishing (0.53s) +--- PASS: TestClientDelegationsPublishing (1.19s) === RUN TestClientKeyGenerationRotation ---- PASS: TestClientKeyGenerationRotation (0.57s) +--- PASS: TestClientKeyGenerationRotation (1.26s) === RUN TestKeyRotation ---- PASS: TestKeyRotation (0.07s) +--- PASS: TestKeyRotation (0.14s) === RUN TestKeyRotationNonRoot ---- PASS: TestKeyRotationNonRoot (0.09s) +--- PASS: TestKeyRotationNonRoot (0.16s) === RUN TestDefaultRootKeyGeneration --- PASS: TestDefaultRootKeyGeneration (0.00s) === RUN TestLogLevelFlags --- PASS: TestLogLevelFlags (0.00s) === RUN TestClientKeyPassphraseChange ---- PASS: TestClientKeyPassphraseChange (0.09s) +--- PASS: TestClientKeyPassphraseChange (0.14s) === RUN TestPurgeSingleKey Removal of the following keys from all delegations in gun staged for next publish: - - 753b658f6ea2b51e804c3a422a6dd5bf7d9823e236d3c4f31b93466cacd1fd4d ---- PASS: TestPurgeSingleKey (0.07s) + - 0e8d36429d9cd826c5e43d00141c3714b07ac49f103f6e5357589b37d7fda673 +--- PASS: TestPurgeSingleKey (0.19s) === RUN TestWitness -time="2024-05-07T07:12:07Z" level=warning msg="Error getting targets/delegation: valid signatures did not meet threshold for targets/delegation" -time="2024-05-07T07:12:07Z" level=warning msg="Error getting targets/delegation: valid signatures did not meet threshold for targets/delegation" -time="2024-05-07T07:12:07Z" level=warning msg="Error getting targets/delegation: valid signatures did not meet threshold for targets/delegation" -time="2024-05-07T07:12:07Z" level=warning msg="Error getting targets/delegation: valid signatures did not meet threshold for targets/delegation" -time="2024-05-07T07:12:07Z" level=warning msg="role targets/delegation has fewer keys than its threshold of 1; it will not be usable until keys are added to it" -time="2024-05-07T07:12:07Z" level=warning msg="role targets/delegation has fewer keys than its threshold of 1; it will not be usable until keys are added to it" -time="2024-05-07T07:12:07Z" level=warning msg="Error getting targets/delegation: valid signatures did not meet threshold for targets/delegation" ---- PASS: TestWitness (0.25s) +time="2025-06-09T13:39:21Z" level=warning msg="Error getting targets/delegation: valid signatures did not meet threshold for targets/delegation" +time="2025-06-09T13:39:21Z" level=warning msg="Error getting targets/delegation: valid signatures did not meet threshold for targets/delegation" +time="2025-06-09T13:39:21Z" level=warning msg="Error getting targets/delegation: valid signatures did not meet threshold for targets/delegation" +time="2025-06-09T13:39:21Z" level=warning msg="Error getting targets/delegation: valid signatures did not meet threshold for targets/delegation" +time="2025-06-09T13:39:21Z" level=warning msg="role targets/delegation has fewer keys than its threshold of 1; it will not be usable until keys are added to it" +time="2025-06-09T13:39:21Z" level=warning msg="role targets/delegation has fewer keys than its threshold of 1; it will not be usable until keys are added to it" +time="2025-06-09T13:39:21Z" level=warning msg="Error getting targets/delegation: valid signatures did not meet threshold for targets/delegation" +--- PASS: TestWitness (0.49s) === RUN TestClientTUFInitWithAutoPublish -time="2024-05-07T07:12:07Z" level=error msg="could not reach https://notary-server-on-the-moon:12306: Get \"https://notary-server-on-the-moon:12306/v2/\": dial tcp: lookup notary-server-on-the-moon on [::1]:53: read udp [::1]:46344->[::1]:53: read: connection refused" ---- PASS: TestClientTUFInitWithAutoPublish (0.05s) +time="2025-06-09T13:39:21Z" level=error msg="could not reach https://notary-server-on-the-moon:12306: Get \"https://notary-server-on-the-moon:12306/v2/\": dial tcp: lookup notary-server-on-the-moon on [::1]:53: read udp [::1]:49032->[::1]:53: read: connection refused" +--- PASS: TestClientTUFInitWithAutoPublish (0.18s) === RUN TestClientTUFAddWithAutoPublish -time="2024-05-07T07:12:07Z" level=error msg="could not reach https://notary-server:4443: Get \"https://notary-server:4443/v2/\": dial tcp: lookup notary-server on [::1]:53: read udp [::1]:36763->[::1]:53: read: connection refused" -time="2024-05-07T07:12:07Z" level=error msg="Could not publish Repository since we could not update: client is offline" -time="2024-05-07T07:12:07Z" level=error msg="could not reach https://notary-server-on-the-moon:12306: Get \"https://notary-server-on-the-moon:12306/v2/\": dial tcp: lookup notary-server-on-the-moon on [::1]:53: read udp [::1]:42354->[::1]:53: read: connection refused" -time="2024-05-07T07:12:07Z" level=error msg="Could not publish Repository since we could not update: client is offline" ---- PASS: TestClientTUFAddWithAutoPublish (0.07s) +time="2025-06-09T13:39:21Z" level=error msg="could not reach https://notary-server:4443: Get \"https://notary-server:4443/v2/\": dial tcp: lookup notary-server on [::1]:53: read udp [::1]:33759->[::1]:53: read: connection refused" +time="2025-06-09T13:39:21Z" level=error msg="Could not publish Repository since we could not update: client is offline" +time="2025-06-09T13:39:21Z" level=error msg="could not reach https://notary-server-on-the-moon:12306: Get \"https://notary-server-on-the-moon:12306/v2/\": dial tcp: lookup notary-server-on-the-moon on [::1]:53: read udp [::1]:33615->[::1]:53: read: connection refused" +time="2025-06-09T13:39:21Z" level=error msg="Could not publish Repository since we could not update: client is offline" +--- PASS: TestClientTUFAddWithAutoPublish (0.15s) === RUN TestClientTUFRemoveWithAutoPublish ---- PASS: TestClientTUFRemoveWithAutoPublish (0.11s) +--- PASS: TestClientTUFRemoveWithAutoPublish (0.27s) === RUN TestClientDelegationAddWithAutoPublish ---- PASS: TestClientDelegationAddWithAutoPublish (0.06s) +--- PASS: TestClientDelegationAddWithAutoPublish (0.09s) === RUN TestClientDelegationRemoveWithAutoPublish -time="2024-05-07T07:12:07Z" level=warning msg="role targets/delegation has fewer keys than its threshold of 1; it will not be usable until keys are added to it" -time="2024-05-07T07:12:07Z" level=warning msg="role targets/delegation has fewer keys than its threshold of 1; it will not be usable until keys are added to it" ---- PASS: TestClientDelegationRemoveWithAutoPublish (0.14s) +time="2025-06-09T13:39:22Z" level=warning msg="role targets/delegation has fewer keys than its threshold of 1; it will not be usable until keys are added to it" +time="2025-06-09T13:39:22Z" level=warning msg="role targets/delegation has fewer keys than its threshold of 1; it will not be usable until keys are added to it" +--- PASS: TestClientDelegationRemoveWithAutoPublish (0.41s) === RUN TestClientTUFAddByHashWithAutoPublish ---- PASS: TestClientTUFAddByHashWithAutoPublish (0.05s) +--- PASS: TestClientTUFAddByHashWithAutoPublish (0.16s) === RUN TestClientKeyImport -time="2024-05-07T07:12:07Z" level=warning msg="failed to import key to store: Invalid key generated, key may be encrypted and does not contain path header" -time="2024-05-07T07:12:07Z" level=warning msg="failed to import key () to store: Cannot have canonical role key without a gun, don't know what gun it belongs to" ---- PASS: TestClientKeyImport (0.02s) +time="2025-06-09T13:39:23Z" level=warning msg="failed to import key to store: Invalid key generated, key may be encrypted and does not contain path header" +time="2025-06-09T13:39:23Z" level=warning msg="failed to import key () to store: Cannot have canonical role key without a gun, don't know what gun it belongs to" +--- PASS: TestClientKeyImport (0.09s) === RUN TestAddDelImportKeyPublishFlow -time="2024-05-07T07:12:08Z" level=error msg="couldn't add target to targets/releases: could not find necessary signing keys, at least one of these keys must be available: 0570f9fdca00bdaf62f3f79bf84e70748ba2c8bff926f20dd996bac49e6164fc" ---- PASS: TestAddDelImportKeyPublishFlow (0.13s) +time="2025-06-09T13:39:23Z" level=error msg="couldn't add target to targets/releases: could not find necessary signing keys, at least one of these keys must be available: 0570f9fdca00bdaf62f3f79bf84e70748ba2c8bff926f20dd996bac49e6164fc" +--- PASS: TestAddDelImportKeyPublishFlow (0.51s) === RUN TestExportImportFlow ---- PASS: TestExportImportFlow (0.04s) +--- PASS: TestExportImportFlow (0.14s) === RUN TestDelegationKeyImportExport ---- PASS: TestDelegationKeyImportExport (0.00s) +--- PASS: TestDelegationKeyImportExport (0.02s) === RUN TestImportKeysNoYubikey --- PASS: TestImportKeysNoYubikey (0.00s) === RUN TestExportImportKeysNoYubikey ---- PASS: TestExportImportKeysNoYubikey (0.00s) +--- PASS: TestExportImportKeysNoYubikey (0.02s) === RUN TestRemoveIfNoKey --- PASS: TestRemoveIfNoKey (0.00s) === RUN TestRemoveOneKeyAbort ---- PASS: TestRemoveOneKeyAbort (0.01s) +--- PASS: TestRemoveOneKeyAbort (0.03s) === RUN TestRemoveOneKeyConfirm ---- PASS: TestRemoveOneKeyConfirm (0.00s) +--- PASS: TestRemoveOneKeyConfirm (0.02s) === RUN TestRemoveMultikeysInvalidInput --- PASS: TestRemoveMultikeysInvalidInput (0.00s) === RUN TestRemoveMultikeysAbortChoice ---- PASS: TestRemoveMultikeysAbortChoice (0.00s) +--- PASS: TestRemoveMultikeysAbortChoice (0.02s) === RUN TestRemoveMultikeysRemoveOnlyChosenKey --- PASS: TestRemoveMultikeysRemoveOnlyChosenKey (0.00s) === RUN TestRotateKeyInvalidRoles -time="2024-05-07T07:12:08Z" level=error msg="could not reach https://notary-server:4443: Get \"https://notary-server:4443/v2/\": dial tcp: lookup notary-server on [::1]:53: read udp [::1]:41641->[::1]:53: read: connection refused" -time="2024-05-07T07:12:08Z" level=error msg="could not reach https://notary-server:4443: Get \"https://notary-server:4443/v2/\": dial tcp: lookup notary-server on [::1]:53: read udp [::1]:56661->[::1]:53: read: connection refused" -time="2024-05-07T07:12:08Z" level=error msg="could not reach https://notary-server:4443: Get \"https://notary-server:4443/v2/\": dial tcp: lookup notary-server on [::1]:53: read udp [::1]:34011->[::1]:53: read: connection refused" -time="2024-05-07T07:12:08Z" level=error msg="could not reach https://notary-server:4443: Get \"https://notary-server:4443/v2/\": dial tcp: lookup notary-server on [::1]:53: read udp [::1]:50787->[::1]:53: read: connection refused" ---- PASS: TestRotateKeyInvalidRoles (0.00s) +time="2025-06-09T13:39:23Z" level=error msg="could not reach https://notary-server:4443: Get \"https://notary-server:4443/v2/\": dial tcp: lookup notary-server on [::1]:53: read udp [::1]:55240->[::1]:53: read: connection refused" +time="2025-06-09T13:39:23Z" level=error msg="could not reach https://notary-server:4443: Get \"https://notary-server:4443/v2/\": dial tcp: lookup notary-server on [::1]:53: read udp [::1]:42607->[::1]:53: read: connection refused" +time="2025-06-09T13:39:23Z" level=error msg="could not reach https://notary-server:4443: Get \"https://notary-server:4443/v2/\": dial tcp: lookup notary-server on [::1]:53: read udp [::1]:42261->[::1]:53: read: connection refused" +time="2025-06-09T13:39:23Z" level=error msg="could not reach https://notary-server:4443: Get \"https://notary-server:4443/v2/\": dial tcp: lookup notary-server on [::1]:53: read udp [::1]:54115->[::1]:53: read: connection refused" +--- PASS: TestRotateKeyInvalidRoles (0.02s) === RUN TestRotateKeyTargetCannotBeServerManaged -time="2024-05-07T07:12:08Z" level=error msg="could not reach https://notary-server:4443: Get \"https://notary-server:4443/v2/\": dial tcp: lookup notary-server on [::1]:53: read udp [::1]:49032->[::1]:53: read: connection refused" +time="2025-06-09T13:39:23Z" level=error msg="could not reach https://notary-server:4443: Get \"https://notary-server:4443/v2/\": dial tcp: lookup notary-server on [::1]:53: read udp [::1]:50940->[::1]:53: read: connection refused" --- PASS: TestRotateKeyTargetCannotBeServerManaged (0.00s) === RUN TestRotateKeyTimestampCannotBeLocallyManaged -time="2024-05-07T07:12:08Z" level=error msg="could not reach https://notary-server:4443: Get \"https://notary-server:4443/v2/\": dial tcp: lookup notary-server on [::1]:53: read udp [::1]:60899->[::1]:53: read: connection refused" +time="2025-06-09T13:39:23Z" level=error msg="could not reach https://notary-server:4443: Get \"https://notary-server:4443/v2/\": dial tcp: lookup notary-server on [::1]:53: read udp [::1]:42336->[::1]:53: read: connection refused" --- PASS: TestRotateKeyTimestampCannotBeLocallyManaged (0.00s) === RUN TestRotateKeyNoGUN Usage: @@ -2420,13 +2456,13 @@ === RUN TestRotateKeyRemoteServerManagesKey Successfully rotated snapshot key for repository docker.com/notary Successfully rotated timestamp key for repository docker.com/notary ---- PASS: TestRotateKeyRemoteServerManagesKey (0.05s) +--- PASS: TestRotateKeyRemoteServerManagesKey (0.23s) === RUN TestRotateKeyBothKeys Successfully rotated targets key for repository docker.com/notary Successfully rotated snapshot key for repository docker.com/notary ---- PASS: TestRotateKeyBothKeys (0.04s) +--- PASS: TestRotateKeyBothKeys (0.21s) === RUN TestRotateKeyRootIsInteractive ---- PASS: TestRotateKeyRootIsInteractive (0.01s) +--- PASS: TestRotateKeyRootIsInteractive (0.04s) === RUN TestChangeKeyPassphraseInvalidID --- PASS: TestChangeKeyPassphraseInvalidID (0.00s) === RUN TestChangeKeyPassphraseInvalidNumArgs @@ -2445,8 +2481,8 @@ === RUN TestImportKeysNonexistentFile --- PASS: TestImportKeysNonexistentFile (0.00s) === RUN TestKeyGeneration -time="2024-05-07T07:12:08Z" level=warning msg="failed to import key () to store: Cannot have canonical role key without a gun, don't know what gun it belongs to" ---- PASS: TestKeyGeneration (0.00s) +time="2025-06-09T13:39:24Z" level=warning msg="failed to import key () to store: Cannot have canonical role key without a gun, don't know what gun it belongs to" +--- PASS: TestKeyGeneration (0.03s) === RUN TestNotaryConfigFileDefault --- PASS: TestNotaryConfigFileDefault (0.00s) === RUN TestRemoteServerDefault @@ -2456,19 +2492,19 @@ === RUN TestRemoteServerCommandLineFlagOverridesConfig --- PASS: TestRemoteServerCommandLineFlagOverridesConfig (0.00s) === RUN TestInvalidAddHashCommands ---- PASS: TestInvalidAddHashCommands (0.00s) +--- PASS: TestInvalidAddHashCommands (0.01s) === RUN TestConfigParsingErrorsPropagatedByCommands ---- PASS: TestConfigParsingErrorsPropagatedByCommands (0.00s) +--- PASS: TestConfigParsingErrorsPropagatedByCommands (0.01s) === RUN TestInsufficientArgumentsReturnsErrorAndPrintsUsage ---- PASS: TestInsufficientArgumentsReturnsErrorAndPrintsUsage (0.01s) +--- PASS: TestInsufficientArgumentsReturnsErrorAndPrintsUsage (0.02s) === RUN TestBareCommandPrintsUsageAndNoError ---- PASS: TestBareCommandPrintsUsageAndNoError (0.00s) +--- PASS: TestBareCommandPrintsUsageAndNoError (0.01s) === RUN TestConfigFileTLSCannotBeRelativeToCWD ---- PASS: TestConfigFileTLSCannotBeRelativeToCWD (0.00s) +--- PASS: TestConfigFileTLSCannotBeRelativeToCWD (0.02s) === RUN TestConfigFileTLSCanBeRelativeToConfigOrAbsolute ---- PASS: TestConfigFileTLSCanBeRelativeToConfigOrAbsolute (0.04s) +--- PASS: TestConfigFileTLSCanBeRelativeToConfigOrAbsolute (0.07s) === RUN TestConfigFileOverridenByCmdLineFlags ---- PASS: TestConfigFileOverridenByCmdLineFlags (0.04s) +--- PASS: TestConfigFileOverridenByCmdLineFlags (0.08s) === RUN TestConfigFileTrustPinning --- PASS: TestConfigFileTrustPinning (0.00s) === RUN TestPassphraseRetrieverCaching @@ -2484,7 +2520,7 @@ === RUN TestPrettyPrintRootAndSigningKeys --- PASS: TestPrettyPrintRootAndSigningKeys (0.01s) === RUN TestPrettyPrintZeroTargets ---- PASS: TestPrettyPrintZeroTargets (0.00s) +--- PASS: TestPrettyPrintZeroTargets (0.01s) === RUN TestPrettyPrintSortedTargets --- PASS: TestPrettyPrintSortedTargets (0.00s) === RUN TestPrettyPrintZeroRoles @@ -2494,10 +2530,10 @@ === RUN TestImportRootCert --- PASS: TestImportRootCert (0.00s) === RUN TestTokenAuth -time="2024-05-07T07:12:08Z" level=error msg="could not reach https://localhost:9999: Get \"https://localhost:9999/v2/\": dial tcp 127.0.0.1:9999: connect: connection refused" +time="2025-06-09T13:39:24Z" level=error msg="could not reach https://localhost:9999: Get \"https://localhost:9999/v2/\": dial tcp 127.0.0.1:9999: connect: connection refused" --- PASS: TestTokenAuth (0.00s) === RUN TestAdminTokenAuth -time="2024-05-07T07:12:08Z" level=error msg="could not reach https://localhost:9999: Get \"https://localhost:9999/v2/\": dial tcp 127.0.0.1:9999: connect: connection refused" +time="2025-06-09T13:39:24Z" level=error msg="could not reach https://localhost:9999: Get \"https://localhost:9999/v2/\": dial tcp 127.0.0.1:9999: connect: connection refused" --- PASS: TestAdminTokenAuth (0.00s) === RUN TestTokenAuth200Status --- PASS: TestTokenAuth200Status (0.00s) @@ -2508,18 +2544,18 @@ === RUN TestAdminTokenAuth401Status --- PASS: TestAdminTokenAuth401Status (0.00s) === RUN TestTokenAuthNon200Non401Status -time="2024-05-07T07:12:08Z" level=error msg="could not reach http://127.0.0.1:40951: 404" +time="2025-06-09T13:39:24Z" level=error msg="could not reach http://127.0.0.1:36471: 404" --- PASS: TestTokenAuthNon200Non401Status (0.00s) === RUN TestAdminTokenAuthNon200Non401Status -time="2024-05-07T07:12:08Z" level=error msg="could not reach http://127.0.0.1:34963: 404" +time="2025-06-09T13:39:24Z" level=error msg="could not reach http://127.0.0.1:44981: 404" --- PASS: TestAdminTokenAuthNon200Non401Status (0.00s) === RUN TestConfigureRepo ---- PASS: TestConfigureRepo (0.00s) +--- PASS: TestConfigureRepo (0.01s) === RUN TestConfigureRepoRW -Enter username: time="2024-05-07T07:12:08Z" level=error msg="error processing username input: EOF" +Enter username: time="2025-06-09T13:39:24Z" level=error msg="error processing username input: EOF" --- PASS: TestConfigureRepoRW (0.00s) === RUN TestConfigureRepoAdmin -Enter username: time="2024-05-07T07:12:08Z" level=error msg="error processing username input: EOF" +Enter username: time="2025-06-09T13:39:24Z" level=error msg="error processing username input: EOF" --- PASS: TestConfigureRepoAdmin (0.00s) === RUN TestStatusUnstageAndReset Successfully reset specified changes for repository gun @@ -2532,11 +2568,11 @@ Pushing changes to gun --- PASS: TestGetTrustPinningErrors (0.00s) === RUN TestPasswordStore -Enter username: time="2024-05-07T07:12:08Z" level=error msg="error processing username input: EOF" +Enter username: time="2025-06-09T13:39:24Z" level=error msg="error processing username input: EOF" --- PASS: TestPasswordStore (0.00s) === RUN TestPasswordStoreWithEnvvar -time="2024-05-07T07:12:08Z" level=error msg="Authentication string with zero-length username" -time="2024-05-07T07:12:08Z" level=error msg="Could not base64-decode authentication string" +time="2025-06-09T13:39:24Z" level=error msg="Authentication string with zero-length username" +time="2025-06-09T13:39:24Z" level=error msg="Could not base64-decode authentication string" --- PASS: TestPasswordStoreWithEnvvar (0.00s) === RUN TestGetPayload --- PASS: TestGetPayload (0.00s) @@ -2545,7 +2581,7 @@ === RUN TestHomeExpand --- PASS: TestHomeExpand (0.00s) PASS -ok github.com/theupdateframework/notary/cmd/notary 4.341s +ok github.com/theupdateframework/notary/cmd/notary 8.604s === RUN TestBootstrap --- PASS: TestBootstrap (0.00s) === RUN TestGetAddrAndTLSConfigInvalidTLS @@ -2561,42 +2597,42 @@ === RUN TestGetInvalidTrustService --- PASS: TestGetInvalidTrustService (0.00s) === RUN TestGetLocalTrustService -time="2024-05-07T07:12:05Z" level=info msg="Using local signing service, which requires ED25519. Ignoring all other trust_service parameters, including keyAlgorithm" ---- PASS: TestGetLocalTrustService (0.00s) +time="2025-06-09T13:39:17Z" level=info msg="Using local signing service, which requires ED25519. Ignoring all other trust_service parameters, including keyAlgorithm" +--- PASS: TestGetLocalTrustService (0.01s) === RUN TestGetTrustServiceInvalidKeyAlgorithm --- PASS: TestGetTrustServiceInvalidKeyAlgorithm (0.00s) === RUN TestGetTrustServiceTLSMissingCertOrKey --- PASS: TestGetTrustServiceTLSMissingCertOrKey (0.00s) === RUN TestGetTrustServiceNoTLSConfig -time="2024-05-07T07:12:05Z" level=info msg="Using remote signing service" +time="2025-06-09T13:39:17Z" level=info msg="Using remote signing service" --- PASS: TestGetTrustServiceNoTLSConfig (0.00s) === RUN TestGetTrustServiceTLSSuccess -time="2024-05-07T07:12:05Z" level=info msg="Using remote signing service" +time="2025-06-09T13:39:17Z" level=info msg="Using remote signing service" --- PASS: TestGetTrustServiceTLSSuccess (0.00s) === RUN TestGetTrustServiceTLSFailure --- PASS: TestGetTrustServiceTLSFailure (0.00s) === RUN TestGetStoreInvalid -time="2024-05-07T07:12:05Z" level=info msg="Using asdf backend" +time="2025-06-09T13:39:17Z" level=info msg="Using asdf backend" --- PASS: TestGetStoreInvalid (0.00s) === RUN TestGetStoreDBStore -time="2024-05-07T07:12:05Z" level=info msg="Using sqlite3 backend" +time="2025-06-09T13:39:17Z" level=info msg="Using sqlite3 backend" --- PASS: TestGetStoreDBStore (0.00s) === RUN TestGetStoreRethinkDBStoreConnectionFails -time="2024-05-07T07:12:05Z" level=info msg="Using rethinkdb backend" +time="2025-06-09T13:39:17Z" level=info msg="Using rethinkdb backend" --- PASS: TestGetStoreRethinkDBStoreConnectionFails (0.00s) === RUN TestGetMemoryStore -time="2024-05-07T07:12:05Z" level=info msg="Using memory backend" +time="2025-06-09T13:39:17Z" level=info msg="Using memory backend" --- PASS: TestGetMemoryStore (0.00s) === RUN TestGetCacheConfig --- PASS: TestGetCacheConfig (0.00s) === RUN TestGetGUNPRefixes --- PASS: TestGetGUNPRefixes (0.00s) === RUN TestSampleConfig -time="2024-05-07T07:12:05Z" level=info msg="Using remote signing service" -time="2024-05-07T07:12:05Z" level=info msg="Using sqlite3 backend" ---- PASS: TestSampleConfig (0.00s) +time="2025-06-09T13:39:17Z" level=info msg="Using remote signing service" +time="2025-06-09T13:39:17Z" level=info msg="Using sqlite3 backend" +--- PASS: TestSampleConfig (0.01s) PASS -ok github.com/theupdateframework/notary/cmd/notary-server 0.044s +ok github.com/theupdateframework/notary/cmd/notary-server 0.139s === RUN TestGetAddrAndTLSConfigInvalidTLS --- PASS: TestGetAddrAndTLSConfigInvalidTLS (0.00s) === RUN TestGetAddrAndTLSConfigNoGRPCAddr @@ -2611,7 +2647,7 @@ main_test.go:121: DM - skipping malfunctioning test, fails on sbuild --- SKIP: TestSetupCryptoServicesRethinkDBStoreConnectionFails (0.00s) === RUN TestSetupCryptoServicesDBStoreSuccess ---- PASS: TestSetupCryptoServicesDBStoreSuccess (0.01s) +--- PASS: TestSetupCryptoServicesDBStoreSuccess (0.02s) === RUN TestSetupCryptoServicesMemoryStore --- PASS: TestSetupCryptoServicesMemoryStore (0.00s) === RUN TestSetupCryptoServicesInvalidStore @@ -2629,17 +2665,17 @@ === RUN TestSampleConfig --- PASS: TestSampleConfig (0.00s) PASS -ok github.com/theupdateframework/notary/cmd/notary-signer 0.059s +ok github.com/theupdateframework/notary/cmd/notary-signer 0.146s === RUN TestGenerateCertificate --- PASS: TestGenerateCertificate (0.00s) === RUN TestCryptoServiceWithNonEmptyGUN ---- PASS: TestCryptoServiceWithNonEmptyGUN (0.26s) +--- PASS: TestCryptoServiceWithNonEmptyGUN (0.83s) === RUN TestCryptoServiceWithEmptyGUN ---- PASS: TestCryptoServiceWithEmptyGUN (0.20s) +--- PASS: TestCryptoServiceWithEmptyGUN (0.66s) === RUN TestCryptoSignerInterfaceBehavior ---- PASS: TestCryptoSignerInterfaceBehavior (0.00s) +--- PASS: TestCryptoSignerInterfaceBehavior (0.01s) PASS -ok github.com/theupdateframework/notary/cryptoservice 0.490s +ok github.com/theupdateframework/notary/cryptoservice 1.563s === RUN TestGetPassphraseForUsingDelegationKey --- PASS: TestGetPassphraseForUsingDelegationKey (0.00s) === RUN TestGetPassphraseLimitsShortPassphrases @@ -2655,251 +2691,251 @@ === RUN TestGetPassphrase --- PASS: TestGetPassphrase (0.00s) PASS -ok github.com/theupdateframework/notary/passphrase 0.022s +ok github.com/theupdateframework/notary/passphrase 0.079s === RUN TestValidationErrorFormat -time="2024-05-07T07:12:05Z" level=info msg="invalid update: Update sent by the client is invalid.: &{ErrBadHierarchy Metadata hierarchy is incomplete: no snapshot was included in update and server does not hold current snapshot key for repository}" go.version=go1.22.2 http.request.contenttype="multipart/form-data; boundary=a3d96ea05fd7d4828335c3f570929eda876e7399a758ca0e120783cffc8b" http.request.host="127.0.0.1:42403" http.request.id=4cc4ee10-a0d8-4b20-a991-f990b509d8f8 http.request.method=POST http.request.remoteaddr="127.0.0.1:58644" http.request.uri=/v2/docker.com/notary/_trust/tuf/ http.request.useragent=Go-http-client/1.1 -time="2024-05-07T07:12:05Z" level=info msg="response completed" go.version=go1.22.2 http.request.contenttype="multipart/form-data; boundary=a3d96ea05fd7d4828335c3f570929eda876e7399a758ca0e120783cffc8b" http.request.host="127.0.0.1:42403" http.request.id=4cc4ee10-a0d8-4b20-a991-f990b509d8f8 http.request.method=POST http.request.remoteaddr="127.0.0.1:58644" http.request.uri=/v2/docker.com/notary/_trust/tuf/ http.request.useragent=Go-http-client/1.1 http.response.contenttype="application/json; charset=utf-8" http.response.duration=2.654576ms http.response.status=400 http.response.written=260 ---- PASS: TestValidationErrorFormat (0.02s) +time="2025-06-09T13:39:17Z" level=info msg="invalid update: Update sent by the client is invalid.: &{ErrBadHierarchy Metadata hierarchy is incomplete: no snapshot was included in update and server does not hold current snapshot key for repository}" go.version=go1.22.2 http.request.contenttype="multipart/form-data; boundary=aed7bef169900048a3c0d9e26cfeb2f12ff3f4520ad462c5b13c24f93b3c" http.request.host="127.0.0.1:45963" http.request.id=76f236cc-543a-4fc9-a5a8-2bdf2ebc0e15 http.request.method=POST http.request.remoteaddr="127.0.0.1:48770" http.request.uri=/v2/docker.com/notary/_trust/tuf/ http.request.useragent=Go-http-client/1.1 +time="2025-06-09T13:39:17Z" level=info msg="response completed" go.version=go1.22.2 http.request.contenttype="multipart/form-data; boundary=aed7bef169900048a3c0d9e26cfeb2f12ff3f4520ad462c5b13c24f93b3c" http.request.host="127.0.0.1:45963" http.request.id=76f236cc-543a-4fc9-a5a8-2bdf2ebc0e15 http.request.method=POST http.request.remoteaddr="127.0.0.1:48770" http.request.uri=/v2/docker.com/notary/_trust/tuf/ http.request.useragent=Go-http-client/1.1 http.response.contenttype="application/json; charset=utf-8" http.response.duration=1.60816ms http.response.status=400 http.response.written=260 +--- PASS: TestValidationErrorFormat (0.04s) === RUN TestRunBadAddr --- PASS: TestRunBadAddr (0.00s) === RUN TestRunReservedPort --- PASS: TestRunReservedPort (0.00s) === RUN TestRepoPrefixMatches -time="2024-05-07T07:12:05Z" level=info msg="updated docker.io/notary to timestamp version 1, checksum 8aa1079ad42a6d4b869f6f914f0d3f42806742444a666ba8b4e97c42ee6727b8" docker.io/notary=gun go.version=go1.22.2 http.request.contenttype="multipart/form-data; boundary=4eacc8a2f14dd58faf1bd7d8430de65e45be575d2feb585c467e8bc6fd8d" http.request.host="127.0.0.1:43617" http.request.id=beedc74c-93cf-4f0c-a9bb-6aa6ab60ba2a http.request.method=POST http.request.remoteaddr="127.0.0.1:58088" http.request.uri=/v2/docker.io/notary/_trust/tuf/ http.request.useragent=Go-http-client/1.1 -time="2024-05-07T07:12:05Z" level=info msg="response completed" go.version=go1.22.2 http.request.contenttype="multipart/form-data; boundary=4eacc8a2f14dd58faf1bd7d8430de65e45be575d2feb585c467e8bc6fd8d" http.request.host="127.0.0.1:43617" http.request.id=beedc74c-93cf-4f0c-a9bb-6aa6ab60ba2a http.request.method=POST http.request.remoteaddr="127.0.0.1:58088" http.request.uri=/v2/docker.io/notary/_trust/tuf/ http.request.useragent=Go-http-client/1.1 http.response.duration=2.725696ms http.response.status=0 http.response.written=0 -time="2024-05-07T07:12:05Z" level=info msg="response completed" go.version=go1.22.2 http.request.host="127.0.0.1:43617" http.request.id=22d9e452-40a8-450f-838f-0c2313abc695 http.request.method=GET http.request.remoteaddr="127.0.0.1:58088" http.request.uri=/v2/docker.io/notary/_trust/tuf/snapshot.json http.request.useragent=Go-http-client/1.1 http.response.duration="378.122µs" http.response.status=200 http.response.written=683 -time="2024-05-07T07:12:05Z" level=info msg="response completed" go.version=go1.22.2 http.request.host="127.0.0.1:43617" http.request.id=cdc08706-4838-4aa7-877d-b7fc598a7389 http.request.method=GET http.request.remoteaddr="127.0.0.1:58088" http.request.uri=/v2/docker.io/notary/_trust/tuf/snapshot.2fdc01f20eb1b45ef273bb0c8197ce854056e5d8ec98c887b4884a3e9a3654dc.json http.request.useragent=Go-http-client/1.1 http.response.duration="26.041µs" http.response.status=200 http.response.written=683 -time="2024-05-07T07:12:05Z" level=info msg="response completed" go.version=go1.22.2 http.request.host="127.0.0.1:43617" http.request.id=a0b64ade-92ef-4f6e-9901-8ab5e3d6d169 http.request.method=GET http.request.remoteaddr="127.0.0.1:58088" http.request.uri=/v2/docker.io/notary/_trust/tuf/timestamp.key http.request.useragent=Go-http-client/1.1 http.response.duration="352.483µs" http.response.status=200 http.response.written=181 -time="2024-05-07T07:12:05Z" level=info msg="trust data deleted for docker.io/notary" docker.io/notary=gun go.version=go1.22.2 http.request.host="127.0.0.1:43617" http.request.id=2595e8c8-210f-4d92-9948-e4813fd15b52 http.request.method=DELETE http.request.remoteaddr="127.0.0.1:58088" http.request.uri=/v2/docker.io/notary/_trust/tuf/ http.request.useragent=Go-http-client/1.1 -time="2024-05-07T07:12:05Z" level=info msg="response completed" go.version=go1.22.2 http.request.host="127.0.0.1:43617" http.request.id=2595e8c8-210f-4d92-9948-e4813fd15b52 http.request.method=DELETE http.request.remoteaddr="127.0.0.1:58088" http.request.uri=/v2/docker.io/notary/_trust/tuf/ http.request.useragent=Go-http-client/1.1 http.response.duration="47.92µs" http.response.status=0 http.response.written=0 ---- PASS: TestRepoPrefixMatches (0.01s) +time="2025-06-09T13:39:17Z" level=info msg="updated docker.io/notary to timestamp version 1, checksum d8213fc95f3f993c5a57d0c2068e0dc4f719916fb3a917094581ef489bf56391" docker.io/notary=gun go.version=go1.22.2 http.request.contenttype="multipart/form-data; boundary=03b0774dbba7d21910336a8c0c5a6112ae233bf4ceb34104ba395f5f1ea4" http.request.host="127.0.0.1:46777" http.request.id=57898fa9-cda3-4866-9ae1-bc03ed561622 http.request.method=POST http.request.remoteaddr="127.0.0.1:50318" http.request.uri=/v2/docker.io/notary/_trust/tuf/ http.request.useragent=Go-http-client/1.1 +time="2025-06-09T13:39:17Z" level=info msg="response completed" go.version=go1.22.2 http.request.contenttype="multipart/form-data; boundary=03b0774dbba7d21910336a8c0c5a6112ae233bf4ceb34104ba395f5f1ea4" http.request.host="127.0.0.1:46777" http.request.id=57898fa9-cda3-4866-9ae1-bc03ed561622 http.request.method=POST http.request.remoteaddr="127.0.0.1:50318" http.request.uri=/v2/docker.io/notary/_trust/tuf/ http.request.useragent=Go-http-client/1.1 http.response.duration=2.16956ms http.response.status=0 http.response.written=0 +time="2025-06-09T13:39:17Z" level=info msg="response completed" go.version=go1.22.2 http.request.host="127.0.0.1:46777" http.request.id=390d154a-3de0-4fdd-afb8-61544af3bddc http.request.method=GET http.request.remoteaddr="127.0.0.1:50318" http.request.uri=/v2/docker.io/notary/_trust/tuf/snapshot.json http.request.useragent=Go-http-client/1.1 http.response.duration="339.96µs" http.response.status=200 http.response.written=683 +time="2025-06-09T13:39:17Z" level=info msg="response completed" go.version=go1.22.2 http.request.host="127.0.0.1:46777" http.request.id=12daccb4-e83d-4542-b03b-ce81f94d9be9 http.request.method=GET http.request.remoteaddr="127.0.0.1:50318" http.request.uri=/v2/docker.io/notary/_trust/tuf/snapshot.5e3a434e4f8bce6a4eacf191527f80d032c5206ad82555e54de1ca30f601a560.json http.request.useragent=Go-http-client/1.1 http.response.duration="56.56µs" http.response.status=200 http.response.written=683 +time="2025-06-09T13:39:17Z" level=info msg="response completed" go.version=go1.22.2 http.request.host="127.0.0.1:46777" http.request.id=288b3988-e393-49d3-b161-0bb29cd9c2e8 http.request.method=GET http.request.remoteaddr="127.0.0.1:50318" http.request.uri=/v2/docker.io/notary/_trust/tuf/timestamp.key http.request.useragent=Go-http-client/1.1 http.response.duration="391.44µs" http.response.status=200 http.response.written=181 +time="2025-06-09T13:39:17Z" level=info msg="trust data deleted for docker.io/notary" docker.io/notary=gun go.version=go1.22.2 http.request.host="127.0.0.1:46777" http.request.id=7170f18e-025b-4611-b314-a2edd7a119fd http.request.method=DELETE http.request.remoteaddr="127.0.0.1:50318" http.request.uri=/v2/docker.io/notary/_trust/tuf/ http.request.useragent=Go-http-client/1.1 +time="2025-06-09T13:39:17Z" level=info msg="response completed" go.version=go1.22.2 http.request.host="127.0.0.1:46777" http.request.id=7170f18e-025b-4611-b314-a2edd7a119fd http.request.method=DELETE http.request.remoteaddr="127.0.0.1:50318" http.request.uri=/v2/docker.io/notary/_trust/tuf/ http.request.useragent=Go-http-client/1.1 http.response.duration="47.56µs" http.response.status=0 http.response.written=0 +--- PASS: TestRepoPrefixMatches (0.05s) === RUN TestRepoPrefixDoesNotMatch ---- PASS: TestRepoPrefixDoesNotMatch (0.02s) +--- PASS: TestRepoPrefixDoesNotMatch (0.06s) === RUN TestMetricsEndpoint ---- PASS: TestMetricsEndpoint (0.01s) +--- PASS: TestMetricsEndpoint (0.03s) === RUN TestGetKeysEndpoint -time="2024-05-07T07:12:05Z" level=info msg="response completed" go.version=go1.22.2 http.request.host="127.0.0.1:46371" http.request.id=9a252dc2-1720-4b64-b1bb-ff30b662a197 http.request.method=GET http.request.remoteaddr="127.0.0.1:38418" http.request.uri=/v2/gun/_trust/tuf/timestamp.key http.request.useragent=Go-http-client/1.1 http.response.duration=4.123705ms http.response.status=200 http.response.written=103 -time="2024-05-07T07:12:05Z" level=info msg="response completed" go.version=go1.22.2 http.request.host="127.0.0.1:46371" http.request.id=a2979ab5-49e8-4aae-8151-b7c35e7794e0 http.request.method=GET http.request.remoteaddr="127.0.0.1:38430" http.request.uri=/v2/gun/_trust/tuf/snapshot.key http.request.useragent=Go-http-client/1.1 http.response.duration="136.521µs" http.response.status=200 http.response.written=103 -time="2024-05-07T07:12:05Z" level=info msg="metadata not found: You have requested metadata that does not exist.: " go.version=go1.22.2 http.request.host="127.0.0.1:46371" http.request.id=943220b0-a583-4f7d-ba3b-6ac117ca191f http.request.method=GET http.request.remoteaddr="127.0.0.1:38446" http.request.uri=/v2/gun/_trust/tuf/targets.key http.request.useragent=Go-http-client/1.1 -time="2024-05-07T07:12:05Z" level=info msg="response completed" go.version=go1.22.2 http.request.host="127.0.0.1:46371" http.request.id=943220b0-a583-4f7d-ba3b-6ac117ca191f http.request.method=GET http.request.remoteaddr="127.0.0.1:38446" http.request.uri=/v2/gun/_trust/tuf/targets.key http.request.useragent=Go-http-client/1.1 http.response.contenttype="application/json; charset=utf-8" http.response.duration="66.6µs" http.response.status=404 http.response.written=104 -time="2024-05-07T07:12:05Z" level=info msg="metadata not found: You have requested metadata that does not exist.: " go.version=go1.22.2 http.request.host="127.0.0.1:46371" http.request.id=7d3e580b-f870-4e7a-baa4-40868b252e41 http.request.method=GET http.request.remoteaddr="127.0.0.1:38452" http.request.uri=/v2/gun/_trust/tuf/root.key http.request.useragent=Go-http-client/1.1 -time="2024-05-07T07:12:05Z" level=info msg="response completed" go.version=go1.22.2 http.request.host="127.0.0.1:46371" http.request.id=7d3e580b-f870-4e7a-baa4-40868b252e41 http.request.method=GET http.request.remoteaddr="127.0.0.1:38452" http.request.uri=/v2/gun/_trust/tuf/root.key http.request.useragent=Go-http-client/1.1 http.response.contenttype="application/json; charset=utf-8" http.response.duration="44.321µs" http.response.status=404 http.response.written=104 -time="2024-05-07T07:12:05Z" level=info msg="metadata not found: You have requested metadata that does not exist.: " go.version=go1.22.2 http.request.host="127.0.0.1:46371" http.request.id=36d2f20a-6e18-4ff6-8e9b-5866992fd67d http.request.method=GET http.request.remoteaddr="127.0.0.1:38454" http.request.uri=/v2/gun/_trust/tuf/somerandomrole.key http.request.useragent=Go-http-client/1.1 -time="2024-05-07T07:12:05Z" level=info msg="response completed" go.version=go1.22.2 http.request.host="127.0.0.1:46371" http.request.id=36d2f20a-6e18-4ff6-8e9b-5866992fd67d http.request.method=GET http.request.remoteaddr="127.0.0.1:38454" http.request.uri=/v2/gun/_trust/tuf/somerandomrole.key http.request.useragent=Go-http-client/1.1 http.response.contenttype="application/json; charset=utf-8" http.response.duration="124.561µs" http.response.status=404 http.response.written=104 ---- PASS: TestGetKeysEndpoint (0.01s) +time="2025-06-09T13:39:18Z" level=info msg="response completed" go.version=go1.22.2 http.request.host="127.0.0.1:36779" http.request.id=cb7b472b-17ae-4bfe-bc2c-76df13353a5d http.request.method=GET http.request.remoteaddr="127.0.0.1:59824" http.request.uri=/v2/gun/_trust/tuf/snapshot.key http.request.useragent=Go-http-client/1.1 http.response.duration=13.64128ms http.response.status=200 http.response.written=103 +time="2025-06-09T13:39:18Z" level=info msg="metadata not found: You have requested metadata that does not exist.: " go.version=go1.22.2 http.request.host="127.0.0.1:36779" http.request.id=7abf8e99-890a-41a0-b841-c337a00f7da8 http.request.method=GET http.request.remoteaddr="127.0.0.1:59836" http.request.uri=/v2/gun/_trust/tuf/targets.key http.request.useragent=Go-http-client/1.1 +time="2025-06-09T13:39:18Z" level=info msg="response completed" go.version=go1.22.2 http.request.host="127.0.0.1:36779" http.request.id=7abf8e99-890a-41a0-b841-c337a00f7da8 http.request.method=GET http.request.remoteaddr="127.0.0.1:59836" http.request.uri=/v2/gun/_trust/tuf/targets.key http.request.useragent=Go-http-client/1.1 http.response.contenttype="application/json; charset=utf-8" http.response.duration="100.48µs" http.response.status=404 http.response.written=104 +time="2025-06-09T13:39:18Z" level=info msg="metadata not found: You have requested metadata that does not exist.: " go.version=go1.22.2 http.request.host="127.0.0.1:36779" http.request.id=097a5611-5307-464b-b769-18b614abd263 http.request.method=GET http.request.remoteaddr="127.0.0.1:59852" http.request.uri=/v2/gun/_trust/tuf/root.key http.request.useragent=Go-http-client/1.1 +time="2025-06-09T13:39:18Z" level=info msg="response completed" go.version=go1.22.2 http.request.host="127.0.0.1:36779" http.request.id=097a5611-5307-464b-b769-18b614abd263 http.request.method=GET http.request.remoteaddr="127.0.0.1:59852" http.request.uri=/v2/gun/_trust/tuf/root.key http.request.useragent=Go-http-client/1.1 http.response.contenttype="application/json; charset=utf-8" http.response.duration="59.28µs" http.response.status=404 http.response.written=104 +time="2025-06-09T13:39:18Z" level=info msg="metadata not found: You have requested metadata that does not exist.: " go.version=go1.22.2 http.request.host="127.0.0.1:36779" http.request.id=90bc7f6e-a604-4b88-b002-f9c11cae9941 http.request.method=GET http.request.remoteaddr="127.0.0.1:59854" http.request.uri=/v2/gun/_trust/tuf/somerandomrole.key http.request.useragent=Go-http-client/1.1 +time="2025-06-09T13:39:18Z" level=info msg="response completed" go.version=go1.22.2 http.request.host="127.0.0.1:36779" http.request.id=90bc7f6e-a604-4b88-b002-f9c11cae9941 http.request.method=GET http.request.remoteaddr="127.0.0.1:59854" http.request.uri=/v2/gun/_trust/tuf/somerandomrole.key http.request.useragent=Go-http-client/1.1 http.response.contenttype="application/json; charset=utf-8" http.response.duration="50.04µs" http.response.status=404 http.response.written=104 +time="2025-06-09T13:39:18Z" level=info msg="response completed" go.version=go1.22.2 http.request.host="127.0.0.1:36779" http.request.id=7139d762-2abd-4c25-be3f-c0cd48c2e841 http.request.method=GET http.request.remoteaddr="127.0.0.1:59862" http.request.uri=/v2/gun/_trust/tuf/timestamp.key http.request.useragent=Go-http-client/1.1 http.response.duration="126.76µs" http.response.status=200 http.response.written=103 +--- PASS: TestGetKeysEndpoint (0.04s) === RUN TestGetRoleByHash -time="2024-05-07T07:12:05Z" level=info msg="response completed" go.version=go1.22.2 http.request.host="127.0.0.1:38833" http.request.id=15242981-2084-4831-bfef-980360523e7a http.request.method=GET http.request.remoteaddr="127.0.0.1:36142" http.request.uri=/v2/gun/_trust/tuf/timestamp.60d4dd4dbd5f5fe36bd163f2cd2b184bda7e31d76481a0d6bc62829c245bae8c.json http.request.useragent=Go-http-client/1.1 http.response.duration="68.24µs" http.response.status=200 http.response.written=115 +time="2025-06-09T13:39:18Z" level=info msg="response completed" go.version=go1.22.2 http.request.host="127.0.0.1:46145" http.request.id=56ec20f9-df2b-4e01-97ed-53bbef7fac63 http.request.method=GET http.request.remoteaddr="127.0.0.1:38402" http.request.uri=/v2/gun/_trust/tuf/timestamp.95b6761a42cf2e344b3348c885ac8e929cbb312699dbbc43649afa6061f9b8f5.json http.request.useragent=Go-http-client/1.1 http.response.duration="69.12µs" http.response.status=200 http.response.written=115 --- PASS: TestGetRoleByHash (0.01s) === RUN TestGetRoleByVersion -time="2024-05-07T07:12:05Z" level=info msg="response completed" go.version=go1.22.2 http.request.host="127.0.0.1:44715" http.request.id=6d9ca573-e811-4f77-b569-6e4692c81717 http.request.method=GET http.request.remoteaddr="127.0.0.1:41408" http.request.uri=/v2/gun/_trust/tuf/1.timestamp.json http.request.useragent=Go-http-client/1.1 http.response.duration="70µs" http.response.status=200 http.response.written=115 ---- PASS: TestGetRoleByVersion (0.01s) +time="2025-06-09T13:39:18Z" level=info msg="response completed" go.version=go1.22.2 http.request.host="127.0.0.1:41265" http.request.id=27204d8b-d98e-4b08-831e-b825b1450054 http.request.method=GET http.request.remoteaddr="127.0.0.1:58700" http.request.uri=/v2/gun/_trust/tuf/1.timestamp.json http.request.useragent=Go-http-client/1.1 http.response.duration="69.12µs" http.response.status=200 http.response.written=115 +--- PASS: TestGetRoleByVersion (0.02s) === RUN TestGetCurrentRole -time="2024-05-07T07:12:05Z" level=info msg="response completed" go.version=go1.22.2 http.request.host="127.0.0.1:43957" http.request.id=4ae77359-6f25-4141-b649-e81783bb5320 http.request.method=GET http.request.remoteaddr="127.0.0.1:54486" http.request.uri=/v2/gun/_trust/tuf/timestamp.json http.request.useragent=Go-http-client/1.1 http.response.duration="344.642µs" http.response.status=200 http.response.written=495 ---- PASS: TestGetCurrentRole (0.01s) +time="2025-06-09T13:39:18Z" level=info msg="response completed" go.version=go1.22.2 http.request.host="127.0.0.1:38741" http.request.id=358776d4-666c-4416-81b0-b8c4c2eff0c9 http.request.method=GET http.request.remoteaddr="127.0.0.1:53092" http.request.uri=/v2/gun/_trust/tuf/timestamp.json http.request.useragent=Go-http-client/1.1 http.response.duration="399.84µs" http.response.status=200 http.response.written=495 +--- PASS: TestGetCurrentRole (0.02s) === RUN TestRotateKeyEndpoint -time="2024-05-07T07:12:05Z" level=info msg="metadata not found: You have requested metadata that does not exist.: " go.version=go1.22.2 http.request.contenttype=text/plain http.request.host="127.0.0.1:34689" http.request.id=eea5b0c1-86b9-4306-80a6-6eda84b92022 http.request.method=POST http.request.remoteaddr="127.0.0.1:53988" http.request.uri=/v2/gun/_trust/tuf/targets/delegation.key http.request.useragent=Go-http-client/1.1 -time="2024-05-07T07:12:05Z" level=info msg="response completed" go.version=go1.22.2 http.request.contenttype=text/plain http.request.host="127.0.0.1:34689" http.request.id=eea5b0c1-86b9-4306-80a6-6eda84b92022 http.request.method=POST http.request.remoteaddr="127.0.0.1:53988" http.request.uri=/v2/gun/_trust/tuf/targets/delegation.key http.request.useragent=Go-http-client/1.1 http.response.contenttype="application/json; charset=utf-8" http.response.duration="140.92µs" http.response.status=404 http.response.written=104 -time="2024-05-07T07:12:05Z" level=info msg="metadata not found: You have requested metadata that does not exist.: " go.version=go1.22.2 http.request.contenttype=text/plain http.request.host="127.0.0.1:34689" http.request.id=7bb82ec6-7dfb-40c4-925b-88561126413a http.request.method=POST http.request.remoteaddr="127.0.0.1:54000" http.request.uri=/v2/gun/_trust/tuf/somerandomrole.key http.request.useragent=Go-http-client/1.1 -time="2024-05-07T07:12:05Z" level=info msg="response completed" go.version=go1.22.2 http.request.contenttype=text/plain http.request.host="127.0.0.1:34689" http.request.id=7bb82ec6-7dfb-40c4-925b-88561126413a http.request.method=POST http.request.remoteaddr="127.0.0.1:54000" http.request.uri=/v2/gun/_trust/tuf/somerandomrole.key http.request.useragent=Go-http-client/1.1 http.response.contenttype="application/json; charset=utf-8" http.response.duration="82.321µs" http.response.status=404 http.response.written=104 -time="2024-05-07T07:12:05Z" level=info msg="response completed" go.version=go1.22.2 http.request.contenttype=text/plain http.request.host="127.0.0.1:34689" http.request.id=95567861-ac76-4228-b6d1-3f01a3395f3c http.request.method=POST http.request.remoteaddr="127.0.0.1:54010" http.request.uri=/v2/gun/_trust/tuf/timestamp.key http.request.useragent=Go-http-client/1.1 http.response.duration="165.161µs" http.response.status=200 http.response.written=103 -time="2024-05-07T07:12:05Z" level=info msg="response completed" go.version=go1.22.2 http.request.contenttype=text/plain http.request.host="127.0.0.1:34689" http.request.id=3b201971-32e5-4d7a-a4be-6d3800598aa3 http.request.method=POST http.request.remoteaddr="127.0.0.1:54018" http.request.uri=/v2/gun/_trust/tuf/snapshot.key http.request.useragent=Go-http-client/1.1 http.response.duration="185.241µs" http.response.status=200 http.response.written=103 -time="2024-05-07T07:12:05Z" level=info msg="metadata not found: You have requested metadata that does not exist.: " go.version=go1.22.2 http.request.contenttype=text/plain http.request.host="127.0.0.1:34689" http.request.id=bea0d311-2656-4594-984b-b61686f2575a http.request.method=POST http.request.remoteaddr="127.0.0.1:54022" http.request.uri=/v2/gun/_trust/tuf/targets.key http.request.useragent=Go-http-client/1.1 -time="2024-05-07T07:12:05Z" level=info msg="response completed" go.version=go1.22.2 http.request.contenttype=text/plain http.request.host="127.0.0.1:34689" http.request.id=bea0d311-2656-4594-984b-b61686f2575a http.request.method=POST http.request.remoteaddr="127.0.0.1:54022" http.request.uri=/v2/gun/_trust/tuf/targets.key http.request.useragent=Go-http-client/1.1 http.response.contenttype="application/json; charset=utf-8" http.response.duration="89.161µs" http.response.status=404 http.response.written=104 -time="2024-05-07T07:12:05Z" level=info msg="metadata not found: You have requested metadata that does not exist.: " go.version=go1.22.2 http.request.contenttype=text/plain http.request.host="127.0.0.1:34689" http.request.id=00d20f98-2735-43e0-ade6-88ca931517d0 http.request.method=POST http.request.remoteaddr="127.0.0.1:54028" http.request.uri=/v2/gun/_trust/tuf/root.key http.request.useragent=Go-http-client/1.1 -time="2024-05-07T07:12:05Z" level=info msg="response completed" go.version=go1.22.2 http.request.contenttype=text/plain http.request.host="127.0.0.1:34689" http.request.id=00d20f98-2735-43e0-ade6-88ca931517d0 http.request.method=POST http.request.remoteaddr="127.0.0.1:54028" http.request.uri=/v2/gun/_trust/tuf/root.key http.request.useragent=Go-http-client/1.1 http.response.contenttype="application/json; charset=utf-8" http.response.duration="82.281µs" http.response.status=404 http.response.written=104 +time="2025-06-09T13:39:18Z" level=info msg="response completed" go.version=go1.22.2 http.request.contenttype=text/plain http.request.host="127.0.0.1:40135" http.request.id=c00cf87a-3bea-4c05-9c07-6339b5fc5132 http.request.method=POST http.request.remoteaddr="127.0.0.1:52906" http.request.uri=/v2/gun/_trust/tuf/snapshot.key http.request.useragent=Go-http-client/1.1 http.response.duration="152.36µs" http.response.status=200 http.response.written=103 +time="2025-06-09T13:39:18Z" level=info msg="metadata not found: You have requested metadata that does not exist.: " go.version=go1.22.2 http.request.contenttype=text/plain http.request.host="127.0.0.1:40135" http.request.id=b8163e6f-a71d-4fa2-aa4c-c3eb2d396b58 http.request.method=POST http.request.remoteaddr="127.0.0.1:52914" http.request.uri=/v2/gun/_trust/tuf/targets.key http.request.useragent=Go-http-client/1.1 +time="2025-06-09T13:39:18Z" level=info msg="response completed" go.version=go1.22.2 http.request.contenttype=text/plain http.request.host="127.0.0.1:40135" http.request.id=b8163e6f-a71d-4fa2-aa4c-c3eb2d396b58 http.request.method=POST http.request.remoteaddr="127.0.0.1:52914" http.request.uri=/v2/gun/_trust/tuf/targets.key http.request.useragent=Go-http-client/1.1 http.response.contenttype="application/json; charset=utf-8" http.response.duration="80.92µs" http.response.status=404 http.response.written=104 +time="2025-06-09T13:39:18Z" level=info msg="metadata not found: You have requested metadata that does not exist.: " go.version=go1.22.2 http.request.contenttype=text/plain http.request.host="127.0.0.1:40135" http.request.id=3a7bc4ce-a5a6-4d69-93e7-f675d56062d2 http.request.method=POST http.request.remoteaddr="127.0.0.1:52924" http.request.uri=/v2/gun/_trust/tuf/root.key http.request.useragent=Go-http-client/1.1 +time="2025-06-09T13:39:18Z" level=info msg="response completed" go.version=go1.22.2 http.request.contenttype=text/plain http.request.host="127.0.0.1:40135" http.request.id=3a7bc4ce-a5a6-4d69-93e7-f675d56062d2 http.request.method=POST http.request.remoteaddr="127.0.0.1:52924" http.request.uri=/v2/gun/_trust/tuf/root.key http.request.useragent=Go-http-client/1.1 http.response.contenttype="application/json; charset=utf-8" http.response.duration="55.88µs" http.response.status=404 http.response.written=104 +time="2025-06-09T13:39:18Z" level=info msg="metadata not found: You have requested metadata that does not exist.: " go.version=go1.22.2 http.request.contenttype=text/plain http.request.host="127.0.0.1:40135" http.request.id=fff659fe-7a2c-4e02-a8af-c1e0b76d0f2a http.request.method=POST http.request.remoteaddr="127.0.0.1:52932" http.request.uri=/v2/gun/_trust/tuf/targets/delegation.key http.request.useragent=Go-http-client/1.1 +time="2025-06-09T13:39:18Z" level=info msg="response completed" go.version=go1.22.2 http.request.contenttype=text/plain http.request.host="127.0.0.1:40135" http.request.id=fff659fe-7a2c-4e02-a8af-c1e0b76d0f2a http.request.method=POST http.request.remoteaddr="127.0.0.1:52932" http.request.uri=/v2/gun/_trust/tuf/targets/delegation.key http.request.useragent=Go-http-client/1.1 http.response.contenttype="application/json; charset=utf-8" http.response.duration="48.12µs" http.response.status=404 http.response.written=104 +time="2025-06-09T13:39:18Z" level=info msg="metadata not found: You have requested metadata that does not exist.: " go.version=go1.22.2 http.request.contenttype=text/plain http.request.host="127.0.0.1:40135" http.request.id=83ddc344-3768-4cd5-8a3e-e755bcadbd58 http.request.method=POST http.request.remoteaddr="127.0.0.1:52934" http.request.uri=/v2/gun/_trust/tuf/somerandomrole.key http.request.useragent=Go-http-client/1.1 +time="2025-06-09T13:39:18Z" level=info msg="response completed" go.version=go1.22.2 http.request.contenttype=text/plain http.request.host="127.0.0.1:40135" http.request.id=83ddc344-3768-4cd5-8a3e-e755bcadbd58 http.request.method=POST http.request.remoteaddr="127.0.0.1:52934" http.request.uri=/v2/gun/_trust/tuf/somerandomrole.key http.request.useragent=Go-http-client/1.1 http.response.contenttype="application/json; charset=utf-8" http.response.duration="55.56µs" http.response.status=404 http.response.written=104 +time="2025-06-09T13:39:18Z" level=info msg="response completed" go.version=go1.22.2 http.request.contenttype=text/plain http.request.host="127.0.0.1:40135" http.request.id=6297591f-868a-401e-a9e6-2c40ad3d1dfe http.request.method=POST http.request.remoteaddr="127.0.0.1:52936" http.request.uri=/v2/gun/_trust/tuf/timestamp.key http.request.useragent=Go-http-client/1.1 http.response.duration="134.92µs" http.response.status=200 http.response.written=103 --- PASS: TestRotateKeyEndpoint (0.01s) PASS -ok github.com/theupdateframework/notary/server 0.156s +ok github.com/theupdateframework/notary/server 0.411s === RUN Test_changefeed --- PASS: Test_changefeed (0.00s) === RUN Test_checkChangefeedInputs -time="2024-05-07T07:12:05Z" level=error msg="500 GET unable to retrieve storage" -time="2024-05-07T07:12:05Z" level=error msg="400 GET invalid pageSize: not_a_number" +time="2025-06-09T13:39:17Z" level=error msg="500 GET unable to retrieve storage" +time="2025-06-09T13:39:17Z" level=error msg="400 GET invalid pageSize: not_a_number" --- PASS: Test_checkChangefeedInputs (0.00s) === RUN TestMainHandlerGet -time="2024-05-07T07:12:05Z" level=info msg="response completed" go.version=go1.22.2 http.request.host="127.0.0.1:33817" http.request.id=459de3f5-65e9-4014-ab6e-fd5e542c3704 http.request.method=GET http.request.remoteaddr="127.0.0.1:43286" http.request.uri=/ http.request.useragent=Go-http-client/1.1 http.response.duration="47.28µs" http.response.status=200 http.response.written=2 ---- PASS: TestMainHandlerGet (0.01s) +time="2025-06-09T13:39:17Z" level=info msg="response completed" go.version=go1.22.2 http.request.host="127.0.0.1:40357" http.request.id=4e329f93-8b5f-4bcc-abfd-30b26f52aef3 http.request.method=GET http.request.remoteaddr="127.0.0.1:49944" http.request.uri=/ http.request.useragent=Go-http-client/1.1 http.response.duration="26.44µs" http.response.status=200 http.response.written=2 +--- PASS: TestMainHandlerGet (0.00s) === RUN TestMainHandlerNotGet -time="2024-05-07T07:12:05Z" level=info msg="generic not found: You have requested a resource that does not exist.: " go.version=go1.22.2 http.request.host="127.0.0.1:40549" http.request.id=f4bc4a54-3e4d-445d-bedb-8dee47bd75e9 http.request.method=HEAD http.request.remoteaddr="127.0.0.1:58202" http.request.uri=/ http.request.useragent=Go-http-client/1.1 -time="2024-05-07T07:12:05Z" level=info msg="response completed" go.version=go1.22.2 http.request.host="127.0.0.1:40549" http.request.id=f4bc4a54-3e4d-445d-bedb-8dee47bd75e9 http.request.method=HEAD http.request.remoteaddr="127.0.0.1:58202" http.request.uri=/ http.request.useragent=Go-http-client/1.1 http.response.contenttype="application/json; charset=utf-8" http.response.duration="261.521µs" http.response.status=404 http.response.written=105 ---- PASS: TestMainHandlerNotGet (0.01s) +time="2025-06-09T13:39:17Z" level=info msg="generic not found: You have requested a resource that does not exist.: " go.version=go1.22.2 http.request.host="127.0.0.1:40621" http.request.id=023e84bc-9b47-41f0-8883-1cbe239735bb http.request.method=HEAD http.request.remoteaddr="127.0.0.1:43534" http.request.uri=/ http.request.useragent=Go-http-client/1.1 +time="2025-06-09T13:39:17Z" level=info msg="response completed" go.version=go1.22.2 http.request.host="127.0.0.1:40621" http.request.id=023e84bc-9b47-41f0-8883-1cbe239735bb http.request.method=HEAD http.request.remoteaddr="127.0.0.1:43534" http.request.uri=/ http.request.useragent=Go-http-client/1.1 http.response.contenttype="application/json; charset=utf-8" http.response.duration="185.16µs" http.response.status=404 http.response.written=105 +--- PASS: TestMainHandlerNotGet (0.02s) === RUN TestKeyHandlersInvalidConfiguration -time="2024-05-07T07:12:05Z" level=error msg="500 GET storage not configured" go.version=go1.22.2 gun=gun -time="2024-05-07T07:12:05Z" level=error msg="500 GET storage not configured" go.version=go1.22.2 gun=gun -time="2024-05-07T07:12:05Z" level=error msg="500 GET crypto service not configured" go.version=go1.22.2 gun=gun -time="2024-05-07T07:12:05Z" level=error msg="500 GET crypto service not configured" go.version=go1.22.2 gun=gun -time="2024-05-07T07:12:05Z" level=error msg="500 GET key algorithm not configured" go.version=go1.22.2 gun=gun -time="2024-05-07T07:12:05Z" level=error msg="500 GET key algorithm not configured" go.version=go1.22.2 gun=gun -time="2024-05-07T07:12:05Z" level=error msg="500 POST storage not configured" go.version=go1.22.2 gun=gun -time="2024-05-07T07:12:05Z" level=error msg="500 POST storage not configured" go.version=go1.22.2 gun=gun -time="2024-05-07T07:12:05Z" level=error msg="500 POST crypto service not configured" go.version=go1.22.2 gun=gun -time="2024-05-07T07:12:05Z" level=error msg="500 POST crypto service not configured" go.version=go1.22.2 gun=gun -time="2024-05-07T07:12:05Z" level=error msg="500 POST key algorithm not configured" go.version=go1.22.2 gun=gun -time="2024-05-07T07:12:05Z" level=error msg="500 POST key algorithm not configured" go.version=go1.22.2 gun=gun +time="2025-06-09T13:39:17Z" level=error msg="500 GET storage not configured" go.version=go1.22.2 gun=gun +time="2025-06-09T13:39:17Z" level=error msg="500 GET storage not configured" go.version=go1.22.2 gun=gun +time="2025-06-09T13:39:17Z" level=error msg="500 GET crypto service not configured" go.version=go1.22.2 gun=gun +time="2025-06-09T13:39:17Z" level=error msg="500 GET crypto service not configured" go.version=go1.22.2 gun=gun +time="2025-06-09T13:39:17Z" level=error msg="500 GET key algorithm not configured" go.version=go1.22.2 gun=gun +time="2025-06-09T13:39:17Z" level=error msg="500 GET key algorithm not configured" go.version=go1.22.2 gun=gun +time="2025-06-09T13:39:17Z" level=error msg="500 POST key algorithm not configured" go.version=go1.22.2 gun=gun +time="2025-06-09T13:39:17Z" level=error msg="500 POST key algorithm not configured" go.version=go1.22.2 gun=gun +time="2025-06-09T13:39:17Z" level=error msg="500 POST storage not configured" go.version=go1.22.2 gun=gun +time="2025-06-09T13:39:17Z" level=error msg="500 POST storage not configured" go.version=go1.22.2 gun=gun +time="2025-06-09T13:39:17Z" level=error msg="500 POST crypto service not configured" go.version=go1.22.2 gun=gun +time="2025-06-09T13:39:17Z" level=error msg="500 POST crypto service not configured" go.version=go1.22.2 gun=gun --- PASS: TestKeyHandlersInvalidConfiguration (0.00s) === RUN TestKeyHandlersNoRoleOrRepo -time="2024-05-07T07:12:05Z" level=info msg="400 GET no gun in request" =gun go.version=go1.22.2 -time="2024-05-07T07:12:05Z" level=info msg="400 GET no gun in request" =gun go.version=go1.22.2 -time="2024-05-07T07:12:05Z" level=info msg="400 GET no role in request" go.version=go1.22.2 gun=gun -time="2024-05-07T07:12:05Z" level=info msg="400 GET no role in request" go.version=go1.22.2 gun=gun -time="2024-05-07T07:12:05Z" level=info msg="400 POST no gun in request" =gun go.version=go1.22.2 -time="2024-05-07T07:12:05Z" level=info msg="400 POST no gun in request" =gun go.version=go1.22.2 -time="2024-05-07T07:12:05Z" level=info msg="400 POST no role in request" go.version=go1.22.2 gun=gun -time="2024-05-07T07:12:05Z" level=info msg="400 POST no role in request" go.version=go1.22.2 gun=gun +time="2025-06-09T13:39:17Z" level=info msg="400 GET no gun in request" =gun go.version=go1.22.2 +time="2025-06-09T13:39:17Z" level=info msg="400 GET no gun in request" =gun go.version=go1.22.2 +time="2025-06-09T13:39:17Z" level=info msg="400 GET no role in request" go.version=go1.22.2 gun=gun +time="2025-06-09T13:39:17Z" level=info msg="400 GET no role in request" go.version=go1.22.2 gun=gun +time="2025-06-09T13:39:17Z" level=info msg="400 POST no gun in request" =gun go.version=go1.22.2 +time="2025-06-09T13:39:17Z" level=info msg="400 POST no gun in request" =gun go.version=go1.22.2 +time="2025-06-09T13:39:17Z" level=info msg="400 POST no role in request" go.version=go1.22.2 gun=gun +time="2025-06-09T13:39:17Z" level=info msg="400 POST no role in request" go.version=go1.22.2 gun=gun --- PASS: TestKeyHandlersNoRoleOrRepo (0.00s) === RUN TestKeyHandlersInvalidRole -time="2024-05-07T07:12:05Z" level=info msg="400 GET root key: " go.version=go1.22.2 gun=gun -time="2024-05-07T07:12:05Z" level=info msg="400 GET targets key: " go.version=go1.22.2 gun=gun -time="2024-05-07T07:12:05Z" level=info msg="400 GET targets/a key: " go.version=go1.22.2 gun=gun -time="2024-05-07T07:12:05Z" level=info msg="400 GET invalidrole key: " go.version=go1.22.2 gun=gun -time="2024-05-07T07:12:05Z" level=info msg="400 POST root key: " go.version=go1.22.2 gun=gun -time="2024-05-07T07:12:05Z" level=info msg="400 POST targets key: " go.version=go1.22.2 gun=gun -time="2024-05-07T07:12:05Z" level=info msg="400 POST targets/a key: " go.version=go1.22.2 gun=gun -time="2024-05-07T07:12:05Z" level=info msg="400 POST invalidrole key: " go.version=go1.22.2 gun=gun +time="2025-06-09T13:39:17Z" level=info msg="400 GET root key: " go.version=go1.22.2 gun=gun +time="2025-06-09T13:39:17Z" level=info msg="400 GET targets key: " go.version=go1.22.2 gun=gun +time="2025-06-09T13:39:17Z" level=info msg="400 GET targets/a key: " go.version=go1.22.2 gun=gun +time="2025-06-09T13:39:17Z" level=info msg="400 GET invalidrole key: " go.version=go1.22.2 gun=gun +time="2025-06-09T13:39:17Z" level=info msg="400 POST root key: " go.version=go1.22.2 gun=gun +time="2025-06-09T13:39:17Z" level=info msg="400 POST targets key: " go.version=go1.22.2 gun=gun +time="2025-06-09T13:39:17Z" level=info msg="400 POST targets/a key: " go.version=go1.22.2 gun=gun +time="2025-06-09T13:39:17Z" level=info msg="400 POST invalidrole key: " go.version=go1.22.2 gun=gun --- PASS: TestKeyHandlersInvalidRole (0.00s) === RUN TestGetKeyHandlerCreatesOnce ---- PASS: TestGetKeyHandlerCreatesOnce (0.01s) +--- PASS: TestGetKeyHandlerCreatesOnce (0.02s) === RUN TestKeyHandlersInvalidKeyAlgo -time="2024-05-07T07:12:05Z" level=error msg="500 GET timestamp key: only ED25519 supported by this cryptoservice" go.version=go1.22.2 gun=gun -time="2024-05-07T07:12:05Z" level=error msg="500 GET snapshot key: only ED25519 supported by this cryptoservice" go.version=go1.22.2 gun=gun -time="2024-05-07T07:12:05Z" level=error msg="500 POST timestamp key: only ED25519 supported by this cryptoservice" go.version=go1.22.2 gun=gun -time="2024-05-07T07:12:05Z" level=error msg="500 POST snapshot key: only ED25519 supported by this cryptoservice" go.version=go1.22.2 gun=gun +time="2025-06-09T13:39:17Z" level=error msg="500 GET timestamp key: only ED25519 supported by this cryptoservice" go.version=go1.22.2 gun=gun +time="2025-06-09T13:39:17Z" level=error msg="500 GET snapshot key: only ED25519 supported by this cryptoservice" go.version=go1.22.2 gun=gun +time="2025-06-09T13:39:17Z" level=error msg="500 POST timestamp key: only ED25519 supported by this cryptoservice" go.version=go1.22.2 gun=gun +time="2025-06-09T13:39:17Z" level=error msg="500 POST snapshot key: only ED25519 supported by this cryptoservice" go.version=go1.22.2 gun=gun --- PASS: TestKeyHandlersInvalidKeyAlgo (0.00s) === RUN TestRotateKeyHandlerSuccessfulRotation --- PASS: TestRotateKeyHandlerSuccessfulRotation (0.00s) === RUN TestGetHandlerRoot -time="2024-05-07T07:12:05Z" level=info msg="404 GET root role" go.version=go1.22.2 gun=gun +time="2025-06-09T13:39:17Z" level=info msg="404 GET root role" go.version=go1.22.2 gun=gun --- PASS: TestGetHandlerRoot (0.00s) === RUN TestGetHandlerTimestamp --- PASS: TestGetHandlerTimestamp (0.00s) === RUN TestGetHandlerSnapshot ---- PASS: TestGetHandlerSnapshot (0.00s) +--- PASS: TestGetHandlerSnapshot (0.02s) === RUN TestGetHandler404 -time="2024-05-07T07:12:05Z" level=info msg="404 GET root role" go.version=go1.22.2 gun=gun +time="2025-06-09T13:39:17Z" level=info msg="404 GET root role" go.version=go1.22.2 gun=gun --- PASS: TestGetHandler404 (0.00s) === RUN TestGetHandlerNilData -time="2024-05-07T07:12:05Z" level=info msg="404 GET root role" go.version=go1.22.2 gun=gun +time="2025-06-09T13:39:17Z" level=info msg="404 GET root role" go.version=go1.22.2 gun=gun --- PASS: TestGetHandlerNilData (0.00s) === RUN TestGetHandlerNoStorage -time="2024-05-07T07:12:05Z" level=error msg="500 GET: no storage exists" =gun go.version=go1.22.2 +time="2025-06-09T13:39:17Z" level=error msg="500 GET: no storage exists" =gun go.version=go1.22.2 --- PASS: TestGetHandlerNoStorage (0.00s) === RUN TestAtomicUpdateValidationFailurePropagated ---- PASS: TestAtomicUpdateValidationFailurePropagated (0.01s) +--- PASS: TestAtomicUpdateValidationFailurePropagated (0.02s) === RUN TestAtomicUpdateNonValidationFailureNotPropagated -time="2024-05-07T07:12:05Z" level=info msg="400 POST error validating update" go.version=go1.22.2 testGUN=gun ---- PASS: TestAtomicUpdateNonValidationFailureNotPropagated (0.01s) +time="2025-06-09T13:39:17Z" level=info msg="400 POST error validating update" go.version=go1.22.2 testGUN=gun +--- PASS: TestAtomicUpdateNonValidationFailureNotPropagated (0.05s) === RUN TestAtomicUpdateVersionErrorPropagated -time="2024-05-07T07:12:05Z" level=info msg="400 POST old version error" go.version=go1.22.2 testGUN=gun ---- PASS: TestAtomicUpdateVersionErrorPropagated (0.01s) +time="2025-06-09T13:39:17Z" level=info msg="400 POST old version error" go.version=go1.22.2 testGUN=gun +--- PASS: TestAtomicUpdateVersionErrorPropagated (0.02s) === RUN TestGetMaybeServerSignedNoCrypto --- PASS: TestGetMaybeServerSignedNoCrypto (0.00s) === RUN TestGetMaybeServerSignedNoKey --- PASS: TestGetMaybeServerSignedNoKey (0.00s) === RUN TestValidateEmptyNew ---- PASS: TestValidateEmptyNew (0.01s) +--- PASS: TestValidateEmptyNew (0.04s) === RUN TestValidateRootCanContainOnlyx509KeysWithRightGun ---- PASS: TestValidateRootCanContainOnlyx509KeysWithRightGun (0.01s) +--- PASS: TestValidateRootCanContainOnlyx509KeysWithRightGun (0.03s) === RUN TestValidatePrevTimestamp ---- PASS: TestValidatePrevTimestamp (0.01s) +--- PASS: TestValidatePrevTimestamp (0.04s) === RUN TestValidatePreviousTimestampCorrupt -time="2024-05-07T07:12:05Z" level=error msg="Failed to unmarshal existing timestamp for GUN docker.com/notary" ---- PASS: TestValidatePreviousTimestampCorrupt (0.01s) +time="2025-06-09T13:39:18Z" level=error msg="Failed to unmarshal existing timestamp for GUN docker.com/notary" +--- PASS: TestValidatePreviousTimestampCorrupt (0.03s) === RUN TestValidateGetCurrentTimestampBroken ---- PASS: TestValidateGetCurrentTimestampBroken (0.01s) +--- PASS: TestValidateGetCurrentTimestampBroken (0.03s) === RUN TestValidateNoNewRoot ---- PASS: TestValidateNoNewRoot (0.01s) +--- PASS: TestValidateNoNewRoot (0.05s) === RUN TestValidateNoNewTargets ---- PASS: TestValidateNoNewTargets (0.01s) +--- PASS: TestValidateNoNewTargets (0.03s) === RUN TestValidateOnlySnapshot ---- PASS: TestValidateOnlySnapshot (0.01s) +--- PASS: TestValidateOnlySnapshot (0.03s) === RUN TestValidateOldRoot ---- PASS: TestValidateOldRoot (0.01s) +--- PASS: TestValidateOldRoot (0.05s) === RUN TestValidateOldRootCorrupt --- PASS: TestValidateOldRootCorrupt (0.00s) === RUN TestValidateOldRootCorruptRootRole ---- PASS: TestValidateOldRootCorruptRootRole (0.00s) +--- PASS: TestValidateOldRootCorruptRootRole (0.02s) === RUN TestValidateRootGetCurrentRootBroken --- PASS: TestValidateRootGetCurrentRootBroken (0.00s) === RUN TestValidateRootRotationWithOldSigs ---- PASS: TestValidateRootRotationWithOldSigs (0.02s) +--- PASS: TestValidateRootRotationWithOldSigs (0.10s) === RUN TestValidateRootRotationMultipleKeysThreshold1 ---- PASS: TestValidateRootRotationMultipleKeysThreshold1 (0.02s) +--- PASS: TestValidateRootRotationMultipleKeysThreshold1 (0.06s) === RUN TestRootRotationNotSignedWithOldKeysForOldRole ---- PASS: TestRootRotationNotSignedWithOldKeysForOldRole (0.02s) +--- PASS: TestRootRotationNotSignedWithOldKeysForOldRole (0.06s) === RUN TestRootRotationVersionIncrement ---- PASS: TestRootRotationVersionIncrement (0.01s) +--- PASS: TestRootRotationVersionIncrement (0.06s) === RUN TestValidateNoRoot --- PASS: TestValidateNoRoot (0.00s) === RUN TestValidateSnapshotMissingNoSnapshotKey ---- PASS: TestValidateSnapshotMissingNoSnapshotKey (0.01s) +--- PASS: TestValidateSnapshotMissingNoSnapshotKey (0.03s) === RUN TestValidateSnapshotGenerateNoPrev ---- PASS: TestValidateSnapshotGenerateNoPrev (0.01s) +--- PASS: TestValidateSnapshotGenerateNoPrev (0.03s) === RUN TestValidateSnapshotGenerateWithPrev ---- PASS: TestValidateSnapshotGenerateWithPrev (0.01s) +--- PASS: TestValidateSnapshotGenerateWithPrev (0.04s) === RUN TestValidateSnapshotGeneratePrevCorrupt -time="2024-05-07T07:12:05Z" level=error msg="Failed to unmarshal existing snapshot for GUN docker.com/notary" ---- PASS: TestValidateSnapshotGeneratePrevCorrupt (0.01s) +time="2025-06-09T13:39:18Z" level=error msg="Failed to unmarshal existing snapshot for GUN docker.com/notary" +--- PASS: TestValidateSnapshotGeneratePrevCorrupt (0.02s) === RUN TestValidateSnapshotGenerateStoreGetCurrentSnapshotBroken ---- PASS: TestValidateSnapshotGenerateStoreGetCurrentSnapshotBroken (0.01s) +--- PASS: TestValidateSnapshotGenerateStoreGetCurrentSnapshotBroken (0.02s) === RUN TestValidateSnapshotGenerateNoTargets ---- PASS: TestValidateSnapshotGenerateNoTargets (0.01s) +--- PASS: TestValidateSnapshotGenerateNoTargets (0.04s) === RUN TestValidateSnapshotGenerate --- PASS: TestValidateSnapshotGenerate (0.01s) === RUN TestValidateRootNoTimestampKey ---- PASS: TestValidateRootNoTimestampKey (0.00s) +--- PASS: TestValidateRootNoTimestampKey (0.02s) === RUN TestValidateRootInvalidTimestampKey ---- PASS: TestValidateRootInvalidTimestampKey (0.00s) +--- PASS: TestValidateRootInvalidTimestampKey (0.02s) === RUN TestValidateRootInvalidTimestampThreshold ---- PASS: TestValidateRootInvalidTimestampThreshold (0.01s) +--- PASS: TestValidateRootInvalidTimestampThreshold (0.03s) === RUN TestValidateRootInvalidZeroThreshold ---- PASS: TestValidateRootInvalidZeroThreshold (0.02s) +--- PASS: TestValidateRootInvalidZeroThreshold (0.07s) === RUN TestValidateRootRoleMissing --- PASS: TestValidateRootRoleMissing (0.00s) === RUN TestValidateTargetsRoleMissing ---- PASS: TestValidateTargetsRoleMissing (0.00s) +--- PASS: TestValidateTargetsRoleMissing (0.03s) === RUN TestValidateSnapshotRoleMissing --- PASS: TestValidateSnapshotRoleMissing (0.00s) === RUN TestValidateRootSigMissing ---- PASS: TestValidateRootSigMissing (0.00s) +--- PASS: TestValidateRootSigMissing (0.02s) === RUN TestValidateTargetsSigMissing -time="2024-05-07T07:12:05Z" level=error msg="ErrBadTargets: tuf: data has no signatures" ---- PASS: TestValidateTargetsSigMissing (0.00s) +time="2025-06-09T13:39:19Z" level=error msg="ErrBadTargets: tuf: data has no signatures" +--- PASS: TestValidateTargetsSigMissing (0.04s) === RUN TestValidateSnapshotSigMissing ---- PASS: TestValidateSnapshotSigMissing (0.00s) +--- PASS: TestValidateSnapshotSigMissing (0.02s) === RUN TestValidateRootCorrupt ---- PASS: TestValidateRootCorrupt (0.00s) +--- PASS: TestValidateRootCorrupt (0.02s) === RUN TestValidateTargetsCorrupt -time="2024-05-07T07:12:05Z" level=error msg="ErrBadTargets: invalid character '\\u0084' looking for beginning of value" ---- PASS: TestValidateTargetsCorrupt (0.00s) +time="2025-06-09T13:39:19Z" level=error msg="ErrBadTargets: invalid character '\\u0084' looking for beginning of value" +--- PASS: TestValidateTargetsCorrupt (0.02s) === RUN TestValidateSnapshotCorrupt --- PASS: TestValidateSnapshotCorrupt (0.01s) === RUN TestValidateRootModifiedSize ---- PASS: TestValidateRootModifiedSize (0.00s) +--- PASS: TestValidateRootModifiedSize (0.02s) === RUN TestValidateTargetsModifiedSize ---- PASS: TestValidateTargetsModifiedSize (0.01s) +--- PASS: TestValidateTargetsModifiedSize (0.02s) === RUN TestValidateRootModifiedHash ---- PASS: TestValidateRootModifiedHash (0.00s) +--- PASS: TestValidateRootModifiedHash (0.02s) === RUN TestValidateTargetsModifiedHash ---- PASS: TestValidateTargetsModifiedHash (0.00s) +--- PASS: TestValidateTargetsModifiedHash (0.03s) === RUN TestGenerateSnapshotRootNotLoaded --- PASS: TestGenerateSnapshotRootNotLoaded (0.00s) === RUN TestGenerateSnapshotNoKey ---- PASS: TestGenerateSnapshotNoKey (0.00s) +--- PASS: TestGenerateSnapshotNoKey (0.02s) === RUN TestLoadTargetsLoadsNothingIfNoUpdates ---- PASS: TestLoadTargetsLoadsNothingIfNoUpdates (0.00s) +--- PASS: TestLoadTargetsLoadsNothingIfNoUpdates (0.01s) === RUN TestValidateTargetsRequiresStoredParent -time="2024-05-07T07:12:05Z" level=error msg="ErrBadTargets: targets must be loaded first" ---- PASS: TestValidateTargetsRequiresStoredParent (0.01s) +time="2025-06-09T13:39:19Z" level=error msg="ErrBadTargets: targets must be loaded first" +--- PASS: TestValidateTargetsRequiresStoredParent (0.02s) === RUN TestValidateTargetsParentInUpdate -time="2024-05-07T07:12:05Z" level=error msg="ErrBadTargets: invalid character 'I' looking for beginning of value" ---- PASS: TestValidateTargetsParentInUpdate (0.00s) +time="2025-06-09T13:39:19Z" level=error msg="ErrBadTargets: invalid character 'I' looking for beginning of value" +--- PASS: TestValidateTargetsParentInUpdate (0.01s) === RUN TestValidateTargetsRoleNotInParent -time="2024-05-07T07:12:06Z" level=error msg="ErrBadTargets: tuf: invalid role targets/level1. delegation does not exist" -time="2024-05-07T07:12:06Z" level=error msg="ErrBadTargets: targets has already been loaded" -time="2024-05-07T07:12:06Z" level=error msg="ErrBadTargets: tuf: invalid role targets/level1. delegation does not exist" ---- PASS: TestValidateTargetsRoleNotInParent (0.01s) +time="2025-06-09T13:39:19Z" level=error msg="ErrBadTargets: tuf: invalid role targets/level1. delegation does not exist" +time="2025-06-09T13:39:19Z" level=error msg="ErrBadTargets: targets has already been loaded" +time="2025-06-09T13:39:19Z" level=error msg="ErrBadTargets: tuf: invalid role targets/level1. delegation does not exist" +--- PASS: TestValidateTargetsRoleNotInParent (0.03s) PASS -ok github.com/theupdateframework/notary/server/handlers 0.426s +ok github.com/theupdateframework/notary/server/handlers 1.607s === RUN TestSnapshotExpired --- PASS: TestSnapshotExpired (0.00s) === RUN TestSnapshotNotExpired @@ -2907,28 +2943,28 @@ === RUN TestGetSnapshotKeyCreate --- PASS: TestGetSnapshotKeyCreate (0.01s) === RUN TestGetSnapshotKeyCreateWithFailingStore -time="2024-05-07T07:12:06Z" level=error msg="Error when retrieving root role for GUN gun: failing store failed" +time="2025-06-09T13:39:21Z" level=error msg="Error when retrieving root role for GUN gun: failing store failed" --- PASS: TestGetSnapshotKeyCreateWithFailingStore (0.00s) === RUN TestGetSnapshotKeyCreateWithCorruptedStore -time="2024-05-07T07:12:06Z" level=error msg="Failed to unmarshal existing root for GUN gun to retrieve snapshot key ID" +time="2025-06-09T13:39:21Z" level=error msg="Failed to unmarshal existing root for GUN gun to retrieve snapshot key ID" --- PASS: TestGetSnapshotKeyCreateWithCorruptedStore (0.00s) === RUN TestGetSnapshotKeyCreateWithInvalidAlgo --- PASS: TestGetSnapshotKeyCreateWithInvalidAlgo (0.00s) === RUN TestGetSnapshotKeyExistingMetadata ---- PASS: TestGetSnapshotKeyExistingMetadata (0.00s) +--- PASS: TestGetSnapshotKeyExistingMetadata (0.02s) === RUN TestGetSnapshotNoPreviousSnapshot -time="2024-05-07T07:12:06Z" level=error msg="Failed to unmarshal existing snapshot for GUN gun" +time="2025-06-09T13:39:21Z" level=error msg="Failed to unmarshal existing snapshot for GUN gun" --- PASS: TestGetSnapshotNoPreviousSnapshot (0.00s) === RUN TestGetSnapshotReturnsPreviousSnapshotIfUnexpired ---- PASS: TestGetSnapshotReturnsPreviousSnapshotIfUnexpired (0.00s) +--- PASS: TestGetSnapshotReturnsPreviousSnapshotIfUnexpired (0.02s) === RUN TestGetSnapshotOldSnapshotExpired --- PASS: TestGetSnapshotOldSnapshotExpired (0.00s) === RUN TestCannotMakeNewSnapshotIfNoRoot ---- PASS: TestCannotMakeNewSnapshotIfNoRoot (0.00s) +--- PASS: TestCannotMakeNewSnapshotIfNoRoot (0.02s) === RUN TestCreateSnapshotNoKeyInCrypto ---- PASS: TestCreateSnapshotNoKeyInCrypto (0.00s) +--- PASS: TestCreateSnapshotNoKeyInCrypto (0.02s) PASS -ok github.com/theupdateframework/notary/server/snapshot 0.041s +ok github.com/theupdateframework/notary/server/snapshot 0.164s === RUN TestMemoryUpdateCurrentEmpty --- PASS: TestMemoryUpdateCurrentEmpty (0.00s) === RUN TestMemoryUpdateCurrentVersionCheckOldVersionExists @@ -2940,7 +2976,7 @@ === RUN TestMemoryUpdateManyConflictRollback --- PASS: TestMemoryUpdateManyConflictRollback (0.00s) === RUN TestMemoryDeleteSuccess ---- PASS: TestMemoryDeleteSuccess (0.00s) +--- PASS: TestMemoryDeleteSuccess (0.01s) === RUN TestGetCurrent --- PASS: TestGetCurrent (0.00s) === RUN TestGetChecksumNotFound @@ -2958,13 +2994,13 @@ === RUN TestSQLUpdateCurrentVersionCheckOldVersionExists --- PASS: TestSQLUpdateCurrentVersionCheckOldVersionExists (0.00s) === RUN TestSQLUpdateCurrentVersionCheckOldVersionNotExist ---- PASS: TestSQLUpdateCurrentVersionCheckOldVersionNotExist (0.00s) +--- PASS: TestSQLUpdateCurrentVersionCheckOldVersionNotExist (0.01s) === RUN TestSQLUpdateManyNoConflicts ---- PASS: TestSQLUpdateManyNoConflicts (0.01s) +--- PASS: TestSQLUpdateManyNoConflicts (0.03s) === RUN TestSQLUpdateManyConflictRollback ---- PASS: TestSQLUpdateManyConflictRollback (0.01s) +--- PASS: TestSQLUpdateManyConflictRollback (0.03s) === RUN TestSQLDelete ---- PASS: TestSQLDelete (0.01s) +--- PASS: TestSQLDelete (0.05s) === RUN TestSQLDBCheckHealthTableMissing --- PASS: TestSQLDBCheckHealthTableMissing (0.00s) === RUN TestSQLDBCheckHealthDBConnectionFail @@ -2972,17 +3008,17 @@ === RUN TestSQLDBCheckHealthSucceeds --- PASS: TestSQLDBCheckHealthSucceeds (0.00s) === RUN TestSQLDBGetChecksum ---- PASS: TestSQLDBGetChecksum (0.00s) +--- PASS: TestSQLDBGetChecksum (0.05s) === RUN TestSQLDBGetChecksumNotFound --- PASS: TestSQLDBGetChecksumNotFound (0.00s) === RUN TestSQLTUFMetaStoreGetCurrent ---- PASS: TestSQLTUFMetaStoreGetCurrent (0.02s) +--- PASS: TestSQLTUFMetaStoreGetCurrent (0.08s) === RUN TestSQLGetChanges ---- PASS: TestSQLGetChanges (0.01s) +--- PASS: TestSQLGetChanges (0.02s) === RUN TestSQLDBGetVersion --- PASS: TestSQLDBGetVersion (0.00s) PASS -ok github.com/theupdateframework/notary/server/storage 0.126s +ok github.com/theupdateframework/notary/server/storage 0.384s === RUN TestTimestampExpired --- PASS: TestTimestampExpired (0.00s) === RUN TestTimestampNotExpired @@ -2990,33 +3026,33 @@ === RUN TestGetTimestampKey --- PASS: TestGetTimestampKey (0.01s) === RUN TestGetTimestampNoPreviousTimestamp -time="2024-05-07T07:12:06Z" level=error msg="Failed to unmarshal existing timestamp" ---- PASS: TestGetTimestampNoPreviousTimestamp (0.00s) +time="2025-06-09T13:39:21Z" level=error msg="Failed to unmarshal existing timestamp" +--- PASS: TestGetTimestampNoPreviousTimestamp (0.01s) === RUN TestGetTimestampReturnsPreviousTimestampIfUnexpired --- PASS: TestGetTimestampReturnsPreviousTimestampIfUnexpired (0.00s) === RUN TestGetTimestampOldTimestampExpired ---- PASS: TestGetTimestampOldTimestampExpired (0.00s) +--- PASS: TestGetTimestampOldTimestampExpired (0.02s) === RUN TestCannotMakeNewTimestampIfNoRootOrSnapshot -time="2024-05-07T07:12:06Z" level=error msg="Failed to create a new timestamp" -time="2024-05-07T07:12:06Z" level=error msg="Failed to create a new timestamp" ---- PASS: TestCannotMakeNewTimestampIfNoRootOrSnapshot (0.00s) +time="2025-06-09T13:39:21Z" level=error msg="Failed to create a new timestamp" +time="2025-06-09T13:39:21Z" level=error msg="Failed to create a new timestamp" +--- PASS: TestCannotMakeNewTimestampIfNoRootOrSnapshot (0.02s) === RUN TestCreateTimestampNoKeyInCrypto -time="2024-05-07T07:12:06Z" level=error msg="Failed to create a new timestamp" ---- PASS: TestCreateTimestampNoKeyInCrypto (0.00s) +time="2025-06-09T13:39:21Z" level=error msg="Failed to create a new timestamp" +--- PASS: TestCreateTimestampNoKeyInCrypto (0.02s) === RUN TestGetTimestampKeyCreateWithFailingStore -time="2024-05-07T07:12:06Z" level=error msg="Error when retrieving root role for GUN gun: failing store failed" +time="2025-06-09T13:39:21Z" level=error msg="Error when retrieving root role for GUN gun: failing store failed" --- PASS: TestGetTimestampKeyCreateWithFailingStore (0.00s) === RUN TestGetTimestampKeyCreateWithCorruptedStore -time="2024-05-07T07:12:06Z" level=error msg="Failed to unmarshal existing root for GUN gun to retrieve timestamp key ID" +time="2025-06-09T13:39:21Z" level=error msg="Failed to unmarshal existing root for GUN gun to retrieve timestamp key ID" --- PASS: TestGetTimestampKeyCreateWithCorruptedStore (0.00s) === RUN TestGetTimestampKeyCreateWithInvalidAlgo --- PASS: TestGetTimestampKeyCreateWithInvalidAlgo (0.00s) === RUN TestGetTimestampKeyExistingMetadata --- PASS: TestGetTimestampKeyExistingMetadata (0.00s) PASS -ok github.com/theupdateframework/notary/server/timestamp 0.057s +ok github.com/theupdateframework/notary/server/timestamp 0.196s === RUN TestHealthCheckKMUnhealthy ---- PASS: TestHealthCheckKMUnhealthy (0.00s) +--- PASS: TestHealthCheckKMUnhealthy (0.04s) === RUN TestHealthCheckSignerUnhealthy --- PASS: TestHealthCheckSignerUnhealthy (0.00s) === RUN TestHealthCheckKMTimeout @@ -3036,29 +3072,29 @@ === RUN TestHealthCheckNonexistentService --- PASS: TestHealthCheckNonexistentService (0.00s) === RUN TestGetPrivateKeyAndSignWithExistingKey -time="2024-05-07T07:12:06Z" level=info msg="Sign: Signed message! with KeyID 1fa16cfe4a74f3ed5439d65efe1387954c17417d5e788fbee99c48fef34205fd" go.version=go1.22.2 ---- PASS: TestGetPrivateKeyAndSignWithExistingKey (0.01s) +time="2025-06-09T13:39:21Z" level=info msg="Sign: Signed message! with KeyID 23d9c444f34991dd1bcefa5412213fee71ed06d91855f23134659efd5ee4b1de" go.version=go1.22.2 +--- PASS: TestGetPrivateKeyAndSignWithExistingKey (0.00s) === RUN TestCannotSignWithKeyThatDoesntExist -time="2024-05-07T07:12:06Z" level=error msg="Sign: key 44c090b52f2a8d62f1ca36db0b6ba08e654bec228d9ed89fc9527b0753744346 not found" go.version=go1.22.2 +time="2025-06-09T13:39:21Z" level=error msg="Sign: key d378a5aeaa10519359d340e473bd545b610d1308cb75d2abc3340f566d5b2692 not found" go.version=go1.22.2 --- PASS: TestCannotSignWithKeyThatDoesntExist (0.00s) === RUN TestCryptoSignerInterfaceBehavior -time="2024-05-07T07:12:06Z" level=error msg="GetKeyInfo: key nonexistent not found" go.version=go1.22.2 -time="2024-05-07T07:12:06Z" level=error msg="GetKeyInfo: key nonexistent not found" go.version=go1.22.2 -time="2024-05-07T07:12:06Z" level=info msg="CreateKey: Created KeyID 9a8477b475aa998d57aa6dddd03b6ca706dbb7a2bf14d8adf3f7d861da1b5c5c" go.version=go1.22.2 -time="2024-05-07T07:12:06Z" level=info msg="CreateKey: Created KeyID 757fb21d4db350240aede0151bca82ac15d5687d3ac1581e219d56b271a2f5e7" go.version=go1.22.2 -time="2024-05-07T07:12:06Z" level=error msg="GetKeyInfo: key 9a8477b475aa998d57aa6dddd03b6ca706dbb7a2bf14d8adf3f7d861da1b5c5c not found" go.version=go1.22.2 -time="2024-05-07T07:12:06Z" level=error msg="GetKeyInfo: key 757fb21d4db350240aede0151bca82ac15d5687d3ac1581e219d56b271a2f5e7 not found" go.version=go1.22.2 ---- PASS: TestCryptoSignerInterfaceBehavior (0.01s) +time="2025-06-09T13:39:21Z" level=error msg="GetKeyInfo: key nonexistent not found" go.version=go1.22.2 +time="2025-06-09T13:39:21Z" level=error msg="GetKeyInfo: key nonexistent not found" go.version=go1.22.2 +time="2025-06-09T13:39:21Z" level=info msg="CreateKey: Created KeyID ecb4c339bd39d8223a3323a11b8f59f20f7814b2034a58b2c36d908d481ba34b" go.version=go1.22.2 +time="2025-06-09T13:39:21Z" level=info msg="CreateKey: Created KeyID e9697d2dc1526fe0c11ee08a6cc24b568d1ad03662961af8c29f0120a0e70391" go.version=go1.22.2 +time="2025-06-09T13:39:21Z" level=error msg="GetKeyInfo: key ecb4c339bd39d8223a3323a11b8f59f20f7814b2034a58b2c36d908d481ba34b not found" go.version=go1.22.2 +time="2025-06-09T13:39:21Z" level=error msg="GetKeyInfo: key e9697d2dc1526fe0c11ee08a6cc24b568d1ad03662961af8c29f0120a0e70391 not found" go.version=go1.22.2 +--- PASS: TestCryptoSignerInterfaceBehavior (0.02s) PASS -ok github.com/theupdateframework/notary/signer 0.058s +ok github.com/theupdateframework/notary/signer 0.132s === RUN TestGetSuccessPopulatesCache ---- PASS: TestGetSuccessPopulatesCache (0.00s) +--- PASS: TestGetSuccessPopulatesCache (0.01s) === RUN TestAddKeyPopulatesCacheIfSuccessful --- PASS: TestAddKeyPopulatesCacheIfSuccessful (0.00s) === RUN TestDeleteKeyRemovesKeyFromCache --- PASS: TestDeleteKeyRemovesKeyFromCache (0.00s) === RUN TestRDBPrivateKeyJSONUnmarshalling ---- PASS: TestRDBPrivateKeyJSONUnmarshalling (0.00s) +--- PASS: TestRDBPrivateKeyJSONUnmarshalling (0.01s) === RUN TestRDBPrivateKeyJSONUnmarshallingFailure --- PASS: TestRDBPrivateKeyJSONUnmarshallingFailure (0.00s) === RUN TestNewSQLKeyDBStorePropagatesDBError @@ -3069,26 +3105,26 @@ === RUN TestSQLDBHealthCheckNoConnection --- PASS: TestSQLDBHealthCheckNoConnection (0.00s) === RUN TestSQLKeyCanOnlyBeAddedOnce ---- PASS: TestSQLKeyCanOnlyBeAddedOnce (0.03s) -=== RUN TestSQLCreateDelete (/build/reproducible-path/notary-0.7.0+ds1/_build/src/github.com/theupdateframework/notary/signer/keydbstore/sql_keydbstore.go:98) -[2024-05-07 07:12:07]  UNIQUE constraint failed: private_keys.key_id  ---- PASS: TestSQLCreateDelete (0.02s) +[2025-06-09 13:39:21]  UNIQUE constraint failed: private_keys.key_id  +--- PASS: TestSQLKeyCanOnlyBeAddedOnce (0.04s) +=== RUN TestSQLCreateDelete +--- PASS: TestSQLCreateDelete (0.07s) === RUN TestSQLKeyRotation ---- PASS: TestSQLKeyRotation (0.03s) +--- PASS: TestSQLKeyRotation (0.06s) === RUN TestSQLSigningMarksKeyActive -time="2024-05-07T07:12:07Z" level=error msg="Key 1d787e1d56e8a56331bba89d7aaf9a691a8192eaa65da0d044fbba9bc82194bb was just used to sign hash successful, db closed, error when trying to mark key as active: sql: database is closed" ---- PASS: TestSQLSigningMarksKeyActive (0.04s) +time="2025-06-09T13:39:22Z" level=error msg="Key 70e42b9dbb543d7802888dea45e073d201ba1c1cc7df97d8d71f2c30b3e56515 was just used to sign hash successful, db closed, error when trying to mark key as active: sql: database is closed" +--- PASS: TestSQLSigningMarksKeyActive (0.09s) +=== RUN TestSQLCreateKey (/build/reproducible-path/notary-0.7.0+ds1/_build/src/github.com/theupdateframework/notary/signer/keydbstore/sql_keydbstore.go:197) -[2024-05-07 07:12:07]  sql: database is closed  -=== RUN TestSQLCreateKey ---- PASS: TestSQLCreateKey (0.06s) +[2025-06-09 13:39:22]  sql: database is closed  +--- PASS: TestSQLCreateKey (0.13s) === RUN TestSQLUnimplementedInterfaceBehavior ---- PASS: TestSQLUnimplementedInterfaceBehavior (0.01s) +--- PASS: TestSQLUnimplementedInterfaceBehavior (0.02s) PASS -ok github.com/theupdateframework/notary/signer/keydbstore 0.219s +ok github.com/theupdateframework/notary/signer/keydbstore 0.493s === RUN TestSet --- PASS: TestSet (0.00s) === RUN TestSetWithNoParentDirectory @@ -3122,7 +3158,7 @@ === RUN TestFileStoreConsistency --- PASS: TestFileStoreConsistency (0.00s) === RUN TestHTTPStoreGetSized ---- PASS: TestHTTPStoreGetSized (0.00s) +--- PASS: TestHTTPStoreGetSized (0.02s) === RUN TestHTTPStoreGetAllMeta --- PASS: TestHTTPStoreGetAllMeta (0.00s) === RUN TestSetSingleAndSetMultiMeta @@ -3144,9 +3180,9 @@ === RUN TestHTTPStoreRotateKey --- PASS: TestHTTPStoreRotateKey (0.00s) === RUN TestHTTPStoreGetKey ---- PASS: TestHTTPStoreGetKey (0.00s) +--- PASS: TestHTTPStoreGetKey (0.03s) === RUN TestHTTPStoreGetRotateKeySizeLimited ---- PASS: TestHTTPStoreGetRotateKeySizeLimited (0.03s) +--- PASS: TestHTTPStoreGetRotateKeySizeLimited (0.08s) === RUN TestHTTPOffline --- PASS: TestHTTPOffline (0.00s) === RUN TestErrServerUnavailable @@ -3167,7 +3203,7 @@ === RUN TestMemoryStoreMetadata --- PASS: TestMemoryStoreMetadata (0.00s) PASS -ok github.com/theupdateframework/notary/storage 0.056s +ok github.com/theupdateframework/notary/storage 0.204s === RUN TestExportKeys --- PASS: TestExportKeys (0.00s) === RUN TestExportKeysByGUN @@ -3181,7 +3217,7 @@ === RUN TestImportNoPath --- PASS: TestImportNoPath (0.00s) === RUN TestNonRootPathInference ---- PASS: TestNonRootPathInference (0.00s) +--- PASS: TestNonRootPathInference (0.02s) === RUN TestBlockHeaderPrecedenceRoleAndGun --- PASS: TestBlockHeaderPrecedenceRoleAndGun (0.00s) === RUN TestBlockHeaderPrecedenceGunFromPath @@ -3189,18 +3225,18 @@ === RUN TestImportKeys2InOneFile --- PASS: TestImportKeys2InOneFile (0.00s) === RUN TestImportKeys2InOneFileNoPath ---- PASS: TestImportKeys2InOneFileNoPath (0.00s) +--- PASS: TestImportKeys2InOneFileNoPath (0.01s) === RUN TestEncryptedKeyImportFail -time="2024-05-07T07:12:07Z" level=warning msg="failed to import key to store: Invalid key generated, key may be encrypted and does not contain path header" +time="2025-06-09T13:39:23Z" level=warning msg="failed to import key to store: Invalid key generated, key may be encrypted and does not contain path header" --- PASS: TestEncryptedKeyImportFail (0.00s) === RUN TestEncryptedKeyImportSuccess ---- PASS: TestEncryptedKeyImportSuccess (0.00s) +--- PASS: TestEncryptedKeyImportSuccess (0.01s) === RUN TestEncryption ---- PASS: TestEncryption (0.00s) +--- PASS: TestEncryption (0.01s) === RUN TestAddKey --- PASS: TestAddKey (0.01s) === RUN TestKeyStoreInternalState ---- PASS: TestKeyStoreInternalState (0.00s) +--- PASS: TestKeyStoreInternalState (0.01s) === RUN TestGet --- PASS: TestGet (0.01s) === RUN TestGetLegacyKey @@ -3210,84 +3246,84 @@ === RUN TestAddGetKeyMemStore --- PASS: TestAddGetKeyMemStore (0.00s) === RUN TestAddGetKeyInfoMemStore ---- PASS: TestAddGetKeyInfoMemStore (0.00s) +--- PASS: TestAddGetKeyInfoMemStore (0.01s) === RUN TestGetDecryptedWithTamperedCipherText -time="2024-05-07T07:12:07Z" level=error msg="PEM block is empty" +time="2025-06-09T13:39:24Z" level=error msg="PEM block is empty" --- PASS: TestGetDecryptedWithTamperedCipherText (0.00s) === RUN TestGetDecryptedWithInvalidPassphrase ---- PASS: TestGetDecryptedWithInvalidPassphrase (0.01s) +--- PASS: TestGetDecryptedWithInvalidPassphrase (0.03s) === RUN TestGetDecryptedWithConsistentlyInvalidPassphrase ---- PASS: TestGetDecryptedWithConsistentlyInvalidPassphrase (0.01s) +--- PASS: TestGetDecryptedWithConsistentlyInvalidPassphrase (0.04s) === RUN TestRemoveKey ---- PASS: TestRemoveKey (0.01s) +--- PASS: TestRemoveKey (0.03s) === RUN TestKeysAreCached --- PASS: TestKeysAreCached (0.00s) PASS -ok github.com/theupdateframework/notary/trustmanager 0.083s +ok github.com/theupdateframework/notary/trustmanager 0.314s === RUN TestRemoteStore -time="2024-05-07T07:12:07Z" level=info msg="listing files from localhost:9888" -time="2024-05-07T07:12:07Z" level=info msg="listing files from localhost:9888" ---- PASS: TestRemoteStore (0.04s) +time="2025-06-09T13:39:25Z" level=info msg="listing files from localhost:9888" +time="2025-06-09T13:39:25Z" level=info msg="listing files from localhost:9888" +--- PASS: TestRemoteStore (0.18s) === RUN TestErrors -time="2024-05-07T07:12:07Z" level=error msg="failed to store: test error" ---- PASS: TestErrors (0.04s) +time="2025-06-09T13:39:25Z" level=error msg="failed to store: test error" +--- PASS: TestErrors (0.19s) === RUN TestNewGRPCStorage --- PASS: TestNewGRPCStorage (0.00s) === RUN TestGRPCStorage --- PASS: TestGRPCStorage (0.00s) PASS -ok github.com/theupdateframework/notary/trustmanager/remoteks 0.095s +ok github.com/theupdateframework/notary/trustmanager/remoteks 0.447s === RUN TestWildcardMatch --- PASS: TestWildcardMatch (0.00s) === RUN TestValidateRoot -2024/05/07 07:12:07 [INFO] generate received request -2024/05/07 07:12:07 [INFO] received CSR -2024/05/07 07:12:07 [INFO] generating key: ecdsa-256 -2024/05/07 07:12:07 [INFO] encoded CSR -2024/05/07 07:12:07 [INFO] signed certificate with serial number 709947366099585731487934012871864368450561022197 -2024/05/07 07:12:07 [INFO] received CSR -2024/05/07 07:12:07 [INFO] generating key: ecdsa-256 -2024/05/07 07:12:07 [INFO] encoded CSR -2024/05/07 07:12:07 [INFO] signed certificate with serial number 599434077739060383067543902958801331547679087746 -2024/05/07 07:12:07 [INFO] received CSR -2024/05/07 07:12:07 [INFO] generating key: ecdsa-256 -2024/05/07 07:12:07 [INFO] encoded CSR -2024/05/07 07:12:07 [INFO] signed certificate with serial number 201821411886567423664060047251727811797336184982 ---- PASS: TestValidateRoot (0.01s) +2025/06/09 13:39:25 [INFO] generate received request +2025/06/09 13:39:25 [INFO] received CSR +2025/06/09 13:39:25 [INFO] generating key: ecdsa-256 +2025/06/09 13:39:25 [INFO] encoded CSR +2025/06/09 13:39:25 [INFO] signed certificate with serial number 618848926574189925682991941058803830410623568606 +2025/06/09 13:39:25 [INFO] received CSR +2025/06/09 13:39:25 [INFO] generating key: ecdsa-256 +2025/06/09 13:39:25 [INFO] encoded CSR +2025/06/09 13:39:25 [INFO] signed certificate with serial number 265342244897119331183484946625675731943172753771 +2025/06/09 13:39:25 [INFO] received CSR +2025/06/09 13:39:25 [INFO] generating key: ecdsa-256 +2025/06/09 13:39:25 [INFO] encoded CSR +2025/06/09 13:39:25 [INFO] signed certificate with serial number 313010116422329491288788796784441766958366435451 +--- PASS: TestValidateRoot (0.03s) === RUN TestValidateRootWithoutTOFUS --- PASS: TestValidateRootWithoutTOFUS (0.00s) === RUN TestValidateRootWithPinnedCert --- PASS: TestValidateRootWithPinnedCert (0.00s) === RUN TestValidateRootWithPinnedCertAndIntermediates ---- PASS: TestValidateRootWithPinnedCertAndIntermediates (0.01s) +--- PASS: TestValidateRootWithPinnedCertAndIntermediates (0.02s) === RUN TestValidateRootFailuresWithPinnedCert ---- PASS: TestValidateRootFailuresWithPinnedCert (0.00s) +--- PASS: TestValidateRootFailuresWithPinnedCert (0.01s) === RUN TestValidateRootWithPinnedCA ---- PASS: TestValidateRootWithPinnedCA (0.02s) +--- PASS: TestValidateRootWithPinnedCA (0.03s) === RUN TestValidateSuccessfulRootRotation ---- PASS: TestValidateSuccessfulRootRotation (0.03s) +--- PASS: TestValidateSuccessfulRootRotation (0.07s) === RUN TestValidateRootRotationMissingOrigSig ---- PASS: TestValidateRootRotationMissingOrigSig (0.02s) +--- PASS: TestValidateRootRotationMissingOrigSig (0.05s) === RUN TestValidateRootRotationMissingNewSig ---- PASS: TestValidateRootRotationMissingNewSig (0.02s) +--- PASS: TestValidateRootRotationMissingNewSig (0.05s) === RUN TestValidateRootRotationTrustPinning ---- PASS: TestValidateRootRotationTrustPinning (0.03s) +--- PASS: TestValidateRootRotationTrustPinning (0.06s) === RUN TestValidateRootRotationTrustPinningInvalidCA ---- PASS: TestValidateRootRotationTrustPinningInvalidCA (0.02s) +--- PASS: TestValidateRootRotationTrustPinningInvalidCA (0.06s) === RUN TestParsePEMPublicKey -time="2024-05-07T07:12:08Z" level=warning msg="certificate with CN notary is near expiry" ---- PASS: TestParsePEMPublicKey (0.00s) +time="2025-06-09T13:39:26Z" level=warning msg="certificate with CN notary is near expiry" +--- PASS: TestParsePEMPublicKey (0.02s) === RUN TestCheckingCertExpiry -time="2024-05-07T07:12:08Z" level=warning msg="certificate with CN notary is near expiry" ---- PASS: TestCheckingCertExpiry (0.00s) +time="2025-06-09T13:39:26Z" level=warning msg="certificate with CN notary is near expiry" +--- PASS: TestCheckingCertExpiry (0.01s) === RUN TestValidateRootWithExpiredIntermediate --- PASS: TestValidateRootWithExpiredIntermediate (0.00s) === RUN TestCheckingWildcardCert ---- PASS: TestCheckingWildcardCert (0.00s) +--- PASS: TestCheckingWildcardCert (0.01s) === RUN TestWildcardMatching --- PASS: TestWildcardMatching (0.00s) PASS -ok github.com/theupdateframework/notary/trustpinning 0.188s +ok github.com/theupdateframework/notary/trustpinning 0.440s === RUN TestInitSnapshotNoTargets --- PASS: TestInitSnapshotNoTargets (0.01s) === RUN TestInitRepo @@ -3295,11 +3331,11 @@ === RUN TestUpdateDelegations --- PASS: TestUpdateDelegations (0.00s) === RUN TestPurgeDelegationsKeyFromTop -time="2024-05-07T07:12:08Z" level=warning msg="role targets/sybil has fewer keys than its threshold of 1; it will not be usable until keys are added to it" -time="2024-05-07T07:12:08Z" level=warning msg="role targets/vimes/carrot has fewer keys than its threshold of 1; it will not be usable until keys are added to it" +time="2025-06-09T13:39:25Z" level=warning msg="role targets/sybil has fewer keys than its threshold of 1; it will not be usable until keys are added to it" +time="2025-06-09T13:39:25Z" level=warning msg="role targets/vimes/carrot has fewer keys than its threshold of 1; it will not be usable until keys are added to it" --- PASS: TestPurgeDelegationsKeyFromTop (0.00s) === RUN TestPurgeDelegationsKeyFromDeep -time="2024-05-07T07:12:08Z" level=warning msg="role targets/vimes/carrot has fewer keys than its threshold of 1; it will not be usable until keys are added to it" +time="2025-06-09T13:39:25Z" level=warning msg="role targets/vimes/carrot has fewer keys than its threshold of 1; it will not be usable until keys are added to it" --- PASS: TestPurgeDelegationsKeyFromDeep (0.00s) === RUN TestPurgeDelegationsKeyBadWildRole --- PASS: TestPurgeDelegationsKeyBadWildRole (0.00s) @@ -3310,9 +3346,9 @@ === RUN TestUpdateDelegationsInvalidRole --- PASS: TestUpdateDelegationsInvalidRole (0.00s) === RUN TestUpdateDelegationsRoleThatIsMissingDelegationKey ---- PASS: TestUpdateDelegationsRoleThatIsMissingDelegationKey (0.00s) +--- PASS: TestUpdateDelegationsRoleThatIsMissingDelegationKey (0.01s) === RUN TestUpdateDelegationsNotEnoughKeys -time="2024-05-07T07:12:08Z" level=warning msg="role targets/role has fewer keys than its threshold of 2; it will not be usable until keys are added to it" +time="2025-06-09T13:39:25Z" level=warning msg="role targets/role has fewer keys than its threshold of 2; it will not be usable until keys are added to it" --- PASS: TestUpdateDelegationsNotEnoughKeys (0.00s) === RUN TestUpdateDelegationsAddKeyToRole --- PASS: TestUpdateDelegationsAddKeyToRole (0.00s) @@ -3345,7 +3381,7 @@ === RUN TestAddTargetsRoleDoesntExist --- PASS: TestAddTargetsRoleDoesntExist (0.00s) === RUN TestAddTargetsNoSigningKeys ---- PASS: TestAddTargetsNoSigningKeys (0.00s) +--- PASS: TestAddTargetsNoSigningKeys (0.01s) === RUN TestRemoveExistingAndNonexistingTargets --- PASS: TestRemoveExistingAndNonexistingTargets (0.00s) === RUN TestRemoveTargetsRoleDoesntExist @@ -3355,9 +3391,9 @@ === RUN TestAddBaseKeysToRoot --- PASS: TestAddBaseKeysToRoot (0.00s) === RUN TestRemoveBaseKeysFromRoot ---- PASS: TestRemoveBaseKeysFromRoot (0.00s) +--- PASS: TestRemoveBaseKeysFromRoot (0.01s) === RUN TestReplaceBaseKeysInRoot ---- PASS: TestReplaceBaseKeysInRoot (0.00s) +--- PASS: TestReplaceBaseKeysInRoot (0.01s) === RUN TestGetAllRoles --- PASS: TestGetAllRoles (0.00s) === RUN TestGetBaseRoles @@ -3379,21 +3415,21 @@ === RUN TestGetDelegationRoleKeyMissing --- PASS: TestGetDelegationRoleKeyMissing (0.00s) === RUN TestSignRootOldKeyCertExists ---- PASS: TestSignRootOldKeyCertExists (0.01s) +--- PASS: TestSignRootOldKeyCertExists (0.02s) === RUN TestSignRootOldKeyCertMissing ---- PASS: TestSignRootOldKeyCertMissing (0.01s) +--- PASS: TestSignRootOldKeyCertMissing (0.02s) === RUN TestRootKeyRotation ---- PASS: TestRootKeyRotation (0.02s) +--- PASS: TestRootKeyRotation (0.06s) === RUN TestBuilderLoadsValidRolesOnly ---- PASS: TestBuilderLoadsValidRolesOnly (0.00s) +--- PASS: TestBuilderLoadsValidRolesOnly (0.01s) === RUN TestBuilderOnlyAcceptsRootFirstWhenLoading --- PASS: TestBuilderOnlyAcceptsRootFirstWhenLoading (0.00s) === RUN TestBuilderOnlyAcceptsDelegationsAfterParent ---- PASS: TestBuilderOnlyAcceptsDelegationsAfterParent (0.00s) +--- PASS: TestBuilderOnlyAcceptsDelegationsAfterParent (0.01s) === RUN TestMarkingIsValid --- PASS: TestMarkingIsValid (0.00s) === RUN TestBuilderLoadInvalidDelegations ---- PASS: TestBuilderLoadInvalidDelegations (0.00s) +--- PASS: TestBuilderLoadInvalidDelegations (0.01s) === RUN TestBuilderLoadInvalidDelegationsOldVersion --- PASS: TestBuilderLoadInvalidDelegationsOldVersion (0.00s) === RUN TestBuilderAcceptRoleOnce @@ -3401,19 +3437,19 @@ === RUN TestBuilderStopsAcceptingOrProducingDataOnceDone --- PASS: TestBuilderStopsAcceptingOrProducingDataOnceDone (0.00s) === RUN TestGenerateSnapshotInvalidOperations ---- PASS: TestGenerateSnapshotInvalidOperations (0.02s) +--- PASS: TestGenerateSnapshotInvalidOperations (0.06s) === RUN TestGenerateTimestampInvalidOperations ---- PASS: TestGenerateTimestampInvalidOperations (0.02s) +--- PASS: TestGenerateTimestampInvalidOperations (0.05s) === RUN TestGetConsistentInfo ---- PASS: TestGetConsistentInfo (0.00s) +--- PASS: TestGetConsistentInfo (0.02s) === RUN TestTimestampPreAndPostChecksumming ---- PASS: TestTimestampPreAndPostChecksumming (0.01s) +--- PASS: TestTimestampPreAndPostChecksumming (0.04s) === RUN TestSnapshotLoadedFirstChecksumsOthers --- PASS: TestSnapshotLoadedFirstChecksumsOthers (0.01s) === RUN TestSnapshotLoadedAfterChecksumsOthersRetroactively ---- PASS: TestSnapshotLoadedAfterChecksumsOthersRetroactively (0.02s) +--- PASS: TestSnapshotLoadedAfterChecksumsOthersRetroactively (0.04s) PASS -ok github.com/theupdateframework/notary/tuf 0.188s +ok github.com/theupdateframework/notary/tuf 0.464s === RUN TestMergeStrSlicesExclusive --- PASS: TestMergeStrSlicesExclusive (0.00s) === RUN TestMergeStrSlicesOverlap @@ -3461,7 +3497,7 @@ === RUN TestRootFromSignedCopiesSignatures --- PASS: TestRootFromSignedCopiesSignatures (0.00s) === RUN TestRootFromSignedValidatesRoleData ---- PASS: TestRootFromSignedValidatesRoleData (0.00s) +--- PASS: TestRootFromSignedValidatesRoleData (0.01s) === RUN TestRootFromSignedValidatesRoleType --- PASS: TestRootFromSignedValidatesRoleType (0.00s) === RUN TestRootFromSignedValidatesVersion @@ -3505,7 +3541,7 @@ === RUN TestTargetsFromSignedValidatesDelegations --- PASS: TestTargetsFromSignedValidatesDelegations (0.00s) === RUN TestTargetsFromSignedValidatesRoleType ---- PASS: TestTargetsFromSignedValidatesRoleType (0.00s) +--- PASS: TestTargetsFromSignedValidatesRoleType (0.01s) === RUN TestTargetsFromSignedValidatesRoleName --- PASS: TestTargetsFromSignedValidatesRoleName (0.00s) === RUN TestTargetsFromSignedValidatesVersion @@ -3547,9 +3583,9 @@ === RUN TestFileMetaEquals --- PASS: TestFileMetaEquals (0.00s) PASS -ok github.com/theupdateframework/notary/tuf/data 0.034s +ok github.com/theupdateframework/notary/tuf/data 0.077s === RUN TestListKeys ---- PASS: TestListKeys (0.00s) +--- PASS: TestListKeys (0.01s) === RUN TestGetKeys --- PASS: TestGetKeys (0.00s) === RUN TestBasicSign @@ -3557,7 +3593,7 @@ === RUN TestReSign --- PASS: TestReSign (0.00s) === RUN TestMultiSign ---- PASS: TestMultiSign (0.00s) +--- PASS: TestMultiSign (0.01s) === RUN TestSignReturnsNoSigs --- PASS: TestSignReturnsNoSigs (0.00s) === RUN TestSignWithX509 @@ -3565,7 +3601,7 @@ === RUN TestSignRemovesValidSigByInvalidKey --- PASS: TestSignRemovesValidSigByInvalidKey (0.00s) === RUN TestSignRemovesInvalidSig ---- PASS: TestSignRemovesInvalidSig (0.00s) +--- PASS: TestSignRemovesInvalidSig (0.01s) === RUN TestSignMinSignatures --- PASS: TestSignMinSignatures (0.00s) === RUN TestSignFailingKeys @@ -3573,32 +3609,32 @@ === RUN TestErrInsufficientSignaturesMessaging --- PASS: TestErrInsufficientSignaturesMessaging (0.00s) === RUN TestRSAPSSVerifier ---- PASS: TestRSAPSSVerifier (0.00s) +--- PASS: TestRSAPSSVerifier (0.02s) === RUN TestRSAPSSx509Verifier --- PASS: TestRSAPSSx509Verifier (0.00s) === RUN TestRSAPSSVerifierWithInvalidKeyType --- PASS: TestRSAPSSVerifierWithInvalidKeyType (0.00s) === RUN TestRSAPSSVerifierWithInvalidKeyLength ---- PASS: TestRSAPSSVerifierWithInvalidKeyLength (0.06s) +--- PASS: TestRSAPSSVerifierWithInvalidKeyLength (0.14s) === RUN TestRSAPSSVerifierWithInvalidKey --- PASS: TestRSAPSSVerifierWithInvalidKey (0.00s) === RUN TestRSAPSSVerifierWithInvalidSignature ---- PASS: TestRSAPSSVerifierWithInvalidSignature (0.00s) +--- PASS: TestRSAPSSVerifierWithInvalidSignature (0.01s) === RUN TestRSAPKCS1v15Verifier ---- PASS: TestRSAPKCS1v15Verifier (0.00s) +--- PASS: TestRSAPKCS1v15Verifier (0.01s) === RUN TestRSAPKCS1v15x509Verifier ---- PASS: TestRSAPKCS1v15x509Verifier (0.00s) +--- PASS: TestRSAPKCS1v15x509Verifier (0.01s) === RUN TestRSAPKCS1v15VerifierWithInvalidKeyType --- PASS: TestRSAPKCS1v15VerifierWithInvalidKeyType (0.00s) === RUN TestRSAPKCS1v15VerifierWithInvalidKey --- PASS: TestRSAPKCS1v15VerifierWithInvalidKey (0.00s) === RUN TestRSAPKCS1v15VerifierWithInvalidSignature -time="2024-05-07T07:12:08Z" level=error msg="Failed verification: crypto/rsa: verification error" ---- PASS: TestRSAPKCS1v15VerifierWithInvalidSignature (0.00s) +time="2025-06-09T13:39:25Z" level=error msg="Failed verification: crypto/rsa: verification error" +--- PASS: TestRSAPKCS1v15VerifierWithInvalidSignature (0.01s) === RUN TestECDSAVerifier --- PASS: TestECDSAVerifier (0.00s) === RUN TestECDSAVerifierOtherCurves ---- PASS: TestECDSAVerifierOtherCurves (0.03s) +--- PASS: TestECDSAVerifierOtherCurves (0.12s) === RUN TestECDSAx509Verifier --- PASS: TestECDSAx509Verifier (0.00s) === RUN TestECDSAVerifierWithInvalidKeyType @@ -3616,7 +3652,7 @@ === RUN TestPyNaCled25519Compat --- PASS: TestPyNaCled25519Compat (0.00s) === RUN TestRoleNoKeys ---- PASS: TestRoleNoKeys (0.00s) +--- PASS: TestRoleNoKeys (0.02s) === RUN TestNotEnoughSigs --- PASS: TestNotEnoughSigs (0.00s) === RUN TestNoSigs @@ -3636,48 +3672,48 @@ === RUN TestVerifyVersion --- PASS: TestVerifyVersion (0.00s) === RUN TestVerifyExpiry -time="2024-05-07T07:12:08Z" level=error msg="Metadata for root expired" +time="2025-06-09T13:39:26Z" level=error msg="Metadata for root expired" --- PASS: TestVerifyExpiry (0.00s) === RUN TestVerifyPublicKeyMatchesPrivateKeyHappyCase --- PASS: TestVerifyPublicKeyMatchesPrivateKeyHappyCase (0.00s) === RUN TestVerifyPublicKeyMatchesPrivateKeyFails ---- PASS: TestVerifyPublicKeyMatchesPrivateKeyFails (0.00s) +--- PASS: TestVerifyPublicKeyMatchesPrivateKeyFails (0.01s) PASS -ok github.com/theupdateframework/notary/tuf/signed 0.153s +ok github.com/theupdateframework/notary/tuf/signed 0.475s === RUN TestNewSwizzler ---- PASS: TestNewSwizzler (0.01s) +--- PASS: TestNewSwizzler (0.03s) === RUN TestSwizzlerSetInvalidJSON ---- PASS: TestSwizzlerSetInvalidJSON (0.00s) +--- PASS: TestSwizzlerSetInvalidJSON (0.03s) === RUN TestSwizzlerAddExtraSpace ---- PASS: TestSwizzlerAddExtraSpace (0.00s) +--- PASS: TestSwizzlerAddExtraSpace (0.03s) === RUN TestSwizzlerSetInvalidSigned ---- PASS: TestSwizzlerSetInvalidSigned (0.00s) +--- PASS: TestSwizzlerSetInvalidSigned (0.02s) === RUN TestSwizzlerSetInvalidSignedMeta ---- PASS: TestSwizzlerSetInvalidSignedMeta (0.00s) +--- PASS: TestSwizzlerSetInvalidSignedMeta (0.02s) === RUN TestSwizzlerSetInvalidMetadataType ---- PASS: TestSwizzlerSetInvalidMetadataType (0.00s) +--- PASS: TestSwizzlerSetInvalidMetadataType (0.03s) === RUN TestSwizzlerInvalidateMetadataSignatures ---- PASS: TestSwizzlerInvalidateMetadataSignatures (0.00s) +--- PASS: TestSwizzlerInvalidateMetadataSignatures (0.02s) === RUN TestSwizzlerRemoveMetadata ---- PASS: TestSwizzlerRemoveMetadata (0.00s) +--- PASS: TestSwizzlerRemoveMetadata (0.02s) === RUN TestSwizzlerSignMetadataWithInvalidKey ---- PASS: TestSwizzlerSignMetadataWithInvalidKey (0.00s) +--- PASS: TestSwizzlerSignMetadataWithInvalidKey (0.02s) === RUN TestSwizzlerOffsetMetadataVersion ---- PASS: TestSwizzlerOffsetMetadataVersion (0.01s) +--- PASS: TestSwizzlerOffsetMetadataVersion (0.04s) === RUN TestSwizzlerExpireMetadata ---- PASS: TestSwizzlerExpireMetadata (0.00s) +--- PASS: TestSwizzlerExpireMetadata (0.02s) === RUN TestSwizzlerSetThresholdBaseRole ---- PASS: TestSwizzlerSetThresholdBaseRole (0.00s) +--- PASS: TestSwizzlerSetThresholdBaseRole (0.02s) === RUN TestSwizzlerSetThresholdDelegatedRole ---- PASS: TestSwizzlerSetThresholdDelegatedRole (0.00s) +--- PASS: TestSwizzlerSetThresholdDelegatedRole (0.02s) === RUN TestSwizzlerChangeRootKey ---- PASS: TestSwizzlerChangeRootKey (0.01s) +--- PASS: TestSwizzlerChangeRootKey (0.03s) === RUN TestSwizzlerUpdateSnapshotHashesSpecifiedRoles ---- PASS: TestSwizzlerUpdateSnapshotHashesSpecifiedRoles (0.00s) +--- PASS: TestSwizzlerUpdateSnapshotHashesSpecifiedRoles (0.02s) === RUN TestSwizzlerUpdateSnapshotHashesNoSpecifiedRoles ---- PASS: TestSwizzlerUpdateSnapshotHashesNoSpecifiedRoles (0.00s) +--- PASS: TestSwizzlerUpdateSnapshotHashesNoSpecifiedRoles (0.02s) === RUN TestSwizzlerUpdateTimestamp ---- PASS: TestSwizzlerUpdateTimestamp (0.00s) +--- PASS: TestSwizzlerUpdateTimestamp (0.03s) === RUN TestMissingSigningKey --- PASS: TestMissingSigningKey (0.01s) === RUN TestSwizzlerMutateRoot @@ -3685,19 +3721,19 @@ === RUN TestSwizzlerMutateTimestamp --- PASS: TestSwizzlerMutateTimestamp (0.00s) === RUN TestSwizzlerMutateSnapshot ---- PASS: TestSwizzlerMutateSnapshot (0.00s) +--- PASS: TestSwizzlerMutateSnapshot (0.02s) === RUN TestSwizzlerMutateTargets ---- PASS: TestSwizzlerMutateTargets (0.00s) +--- PASS: TestSwizzlerMutateTargets (0.01s) === RUN TestSwizzlerRotateKeyBaseRole ---- PASS: TestSwizzlerRotateKeyBaseRole (0.01s) +--- PASS: TestSwizzlerRotateKeyBaseRole (0.02s) === RUN TestSwizzlerRotateKeyDelegationRole ---- PASS: TestSwizzlerRotateKeyDelegationRole (0.00s) +--- PASS: TestSwizzlerRotateKeyDelegationRole (0.02s) PASS -ok github.com/theupdateframework/notary/tuf/testutils 0.137s +ok github.com/theupdateframework/notary/tuf/testutils 0.605s === RUN TestConvertTUFKeyToPKCS8 ---- PASS: TestConvertTUFKeyToPKCS8 (0.01s) +--- PASS: TestConvertTUFKeyToPKCS8 (0.03s) === RUN TestParsePKCS8ToTufKey ---- PASS: TestParsePKCS8ToTufKey (0.04s) +--- PASS: TestParsePKCS8ToTufKey (0.11s) === RUN TestPEMtoPEM --- PASS: TestPEMtoPEM (0.00s) === RUN TestRoleListLen @@ -3743,7 +3779,7 @@ === RUN TestNewCertificate --- PASS: TestNewCertificate (0.00s) === RUN TestKeyOperations ---- PASS: TestKeyOperations (0.01s) +--- PASS: TestKeyOperations (0.03s) === RUN TestRSAX509PublickeyID --- PASS: TestRSAX509PublickeyID (0.00s) === RUN TestECDSAX509PublickeyID @@ -3759,9 +3795,9 @@ === RUN TestValidateCertificateWithInvalidExpiry --- PASS: TestValidateCertificateWithInvalidExpiry (0.00s) === RUN TestValidateCertificateWithShortKey ---- PASS: TestValidateCertificateWithShortKey (0.04s) +--- PASS: TestValidateCertificateWithShortKey (0.09s) PASS -ok github.com/theupdateframework/notary/tuf/utils 0.115s +ok github.com/theupdateframework/notary/tuf/utils 0.351s === RUN TestNewSerializableErrorNonValidationError --- PASS: TestNewSerializableErrorNonValidationError (0.00s) === RUN TestNewSerializableErrorValidationError @@ -3777,9 +3813,9 @@ === RUN TestUnmarshalInvalidJSON --- PASS: TestUnmarshalInvalidJSON (0.00s) PASS -ok github.com/theupdateframework/notary/tuf/validation 0.010s +ok github.com/theupdateframework/notary/tuf/validation 0.096s === RUN TestSetSignalTrap ---- PASS: TestSetSignalTrap (0.00s) +--- PASS: TestSetSignalTrap (0.01s) === RUN TestLogLevelSignalHandle Attempt to increase log level failed, will remain at debug level, error: log level can not be set higher than Debug Successfully setting log level to debug @@ -3851,7 +3887,7 @@ === RUN TestAdjustLogLevel --- PASS: TestAdjustLogLevel (0.00s) === RUN TestRootHandlerFactory ---- PASS: TestRootHandlerFactory (0.00s) +--- PASS: TestRootHandlerFactory (0.01s) === RUN TestRootHandlerError --- PASS: TestRootHandlerError (0.00s) === RUN TestWrapWithCacheHeaderNilCacheControlConfig @@ -3877,7 +3913,7 @@ === RUN TestDoAuthWildcardImage --- PASS: TestDoAuthWildcardImage (0.00s) PASS -ok github.com/theupdateframework/notary/utils 0.032s +ok github.com/theupdateframework/notary/utils 0.125s create-stamp debian/debhelper-build-stamp dh_testroot -O--builddirectory=/build/reproducible-path/notary-0.7.0\+ds1/_build -O--buildsystem=golang dh_prep -O--builddirectory=/build/reproducible-path/notary-0.7.0\+ds1/_build -O--buildsystem=golang @@ -3924,12 +3960,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/478752/tmp/hooks/B01_cleanup starting +I: user script /srv/workspace/pbuilder/478752/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/3573580 and its subdirectories -I: Current time: Mon May 6 19:13:01 -12 2024 -I: pbuilder-time-stamp: 1715065981 +I: removing directory /srv/workspace/pbuilder/478752 and its subdirectories +I: Current time: Tue Jun 10 03:41:00 +14 2025 +I: pbuilder-time-stamp: 1749476460