radicle-node-1.10.3
checks.x86_64-linux.home-manager-desktop
· build #829
· raw
1tribuchet: building on jamie2structuredAttrs is enabled3Using versionCheckHook
unpackPhase
4unpacking source archive /nix/store/8lmbr9d86v1cyr1ckxvkx83r56llzaw1-z3gqcJUoA1n9HaHKufZs5FCSGazv55source root is z3gqcJUoA1n9HaHKufZs5FCSGazv56Executing cargoSetupPostUnpackHook7Finished cargoSetupPostUnpackHookpatchPhase
8Executing cargoSetupPostPatchHook9Validating consistency between /build/z3gqcJUoA1n9HaHKufZs5FCSGazv5/Cargo.lock and /build/radicle-node-1.10.3-vendor/Cargo.lock10Finished cargoSetupPostPatchHookbuildPhase
11Executing cargoBuildHook12cargoBuildHook flags: -j 24 --target x86_64-unknown-linux-gnu --offline --profile release --package=radicle-node --package=radicle-cli --package=radicle-remote-helper13 Compiling libc v0.2.18314 Compiling proc-macro2 v1.0.10615 Compiling quote v1.0.4516 Compiling unicode-ident v1.0.2417 Compiling serde_core v1.0.22818 Compiling cfg-if v1.0.419 Compiling serde v1.0.22820 Compiling version_check v0.9.521 Compiling typenum v1.20.122 Compiling find-msvc-tools v0.1.923 Compiling subtle v2.6.124 Compiling shlex v1.3.025 Compiling memchr v2.8.026 Compiling const-oid v0.9.627 Compiling cpufeatures v0.2.1728 Compiling regex-syntax v0.8.1029 Compiling smallvec v1.15.130 Compiling thiserror v2.0.1831 Compiling parking_lot_core v0.9.1232 Compiling stable_deref_trait v1.2.133 Compiling scopeguard v1.2.034 Compiling fastrand v2.3.035 Compiling gix-trace v0.1.2136 Compiling tinyvec_macros v0.1.137 Compiling bitflags v2.11.038 Compiling byteorder v1.5.039 Compiling crc32fast v1.5.040 Compiling tinyvec v1.11.041 Compiling same-file v1.0.642 Compiling lock_api v0.4.1443 Compiling zlib-rs v0.6.544 Compiling heapless v0.8.045 Compiling typeid v1.0.346 Compiling walkdir v2.5.047 Compiling tree-sitter-language v0.1.748 Compiling generic-array v0.14.749 Compiling itoa v1.0.1750 Compiling hash32 v0.3.151 Compiling hashbrown v0.16.152 Compiling erased-serde v0.4.1053 Compiling pkg-config v0.3.3254 Compiling getrandom v0.4.355 Compiling rustix v1.1.456 Compiling linux-raw-sys v0.12.157 Compiling aho-corasick v1.1.458 Compiling unicode-normalization v0.1.2559 Compiling autocfg v1.5.060 Compiling libm v0.2.1661 Compiling opaque-debug v0.3.162 Compiling syn v1.0.10963 Compiling zerocopy v0.8.4264 Compiling base16ct v0.2.065 Compiling vcpkg v0.2.1566 Compiling zmij v1.0.2167 Compiling spin v0.9.968 Compiling equivalent v1.0.269 Compiling data-encoding v2.10.070 Compiling num-traits v0.2.1971 Compiling serde_json v1.0.14972 Compiling signature v1.6.473 Compiling gix-utils v0.3.274 Compiling lazy_static v1.5.075 Compiling semver v1.0.2776 Compiling ref-cast v1.0.2577 Compiling jiff v0.2.2378 Compiling dyn-clone v1.0.2079 Compiling const-str v0.4.380 Compiling rustc_version v0.4.181 Compiling faster-hex v0.10.082 Compiling ed25519 v1.5.383 Compiling syn v2.0.11784 Compiling base-x v0.2.1185 Compiling amplify_num v0.5.386 Compiling once_cell v1.21.487 Compiling ascii v1.1.088 Compiling curve25519-dalek v4.1.389 Compiling jobserver v0.1.3490 Compiling base64ct v1.8.391 Compiling num-bigint-dig v0.8.692 Compiling getrandom v0.2.1793 Compiling keccak v0.1.694 Compiling rand_core v0.6.495 Compiling cc v1.2.5796 Compiling parking_lot v0.12.597 Compiling ec25519 v0.1.098 Compiling pem-rfc7468 v0.7.099 Compiling regex-automata v0.4.14100 Compiling memmap2 v0.9.10101 Compiling ff v0.13.1102 Compiling base32 v0.4.0103 Compiling prodash v31.0.0104 Compiling group v0.13.0105 Compiling nonempty v0.12.0106 Compiling percent-encoding v2.3.2107 Compiling errno v0.3.14108 Compiling writeable v0.6.2109 Compiling utf8parse v0.2.2110 Compiling litemap v0.8.1111 Compiling icu_properties_data v2.1.2112 Compiling anstyle-query v1.1.5113 Compiling icu_normalizer_data v2.1.1114 Compiling radicle-dag v0.10.0 (/build/z3gqcJUoA1n9HaHKufZs5FCSGazv5/crates/radicle-dag)115 Compiling is_terminal_polyfill v1.70.2116 Compiling base64 v0.21.7117 Compiling radicle v0.25.1 (/build/z3gqcJUoA1n9HaHKufZs5FCSGazv5/crates/radicle)118 Compiling colorchoice v1.0.5119 Compiling amplify_syn v2.0.1120 Compiling signal-hook v0.3.18121 Compiling shell-words v1.1.1122 Compiling unicode-segmentation v1.12.0123 Compiling anstyle v1.0.14124 Compiling object v0.37.3125 Compiling convert_case v0.10.0126 Compiling signal-hook-registry v1.4.8127 Compiling sem_safe v0.2.1128 Compiling gimli v0.32.3129 Compiling serde_fmt v1.1.0130 Compiling indexmap v2.13.0131 Compiling bytesize v2.3.1132 Compiling either v1.15.0133 Compiling adler2 v2.0.1134 Compiling dunce v1.0.5135 Compiling libz-sys v1.1.25136 Compiling libgit2-sys v0.18.4+1.9.3137 Compiling sqlite3-src v0.7.0138 Compiling tree-sitter v0.24.7139 Compiling siphasher v1.0.2140 Compiling rustversion v1.0.22141 Compiling fast-glob v0.3.3142 Compiling amplify_derive v4.0.1143 Compiling miniz_oxide v0.8.9144 Compiling value-bag-serde1 v1.12.0145 Compiling serde-untagged v0.1.9146 Compiling value-bag v1.12.0147 Compiling num-integer v0.1.46148 Compiling signals_receipts v0.2.5149 Compiling anstyle-parse v1.0.0150 Compiling log v0.4.29151 Compiling num-iter v0.1.45152 Compiling gix-sec v0.14.0153 Compiling portable-atomic v1.13.1154 Compiling iana-time-zone v0.1.65155 Compiling thiserror v1.0.69156 Compiling rustc-demangle v0.1.27157 Compiling mio v1.1.1158 Compiling litrs v1.0.0159 Compiling unicode-width v0.2.2160 Compiling synstructure v0.13.2161 Compiling serde_derive_internals v0.29.1162 Compiling bstr v1.12.1163 Compiling tempfile v3.27.0164 Compiling document-features v0.2.12165 Compiling signal-hook-mio v0.2.5166 Compiling regex v1.12.3167 Compiling chrono v0.4.44168 Compiling anstream v1.0.0169 Compiling gix-validate v0.11.1170 Compiling gix-error v0.2.3171 Compiling ppv-lite86 v0.2.21172 Compiling addr2line v0.25.1173 Compiling gix-date v0.15.3174 Compiling gix-chunk v0.7.1175 Compiling rand_chacha v0.3.1176 Compiling gix-quote v0.7.1177 Compiling radicle-signals v0.12.1 (/build/z3gqcJUoA1n9HaHKufZs5FCSGazv5/crates/radicle-signals)178 Compiling gix-actor v0.41.0179 Compiling colored v2.2.0180 Compiling rand v0.8.5181 Compiling heck v0.5.0182 Compiling utf8_iter v1.0.4183 Compiling strsim v0.11.1184 Compiling streaming-iterator v0.1.9185 Compiling clap_lex v1.1.0186 Compiling arc-swap v1.9.1187 Compiling console v0.16.3188 Compiling serde_derive v1.0.228189 Compiling thiserror-impl v2.0.18190 Compiling match-lookup v0.1.2191 Compiling data-encoding-macro-internal v0.1.17192 Compiling zerofrom-derive v0.1.6193 Compiling yoke-derive v0.8.1194 Compiling ref-cast-impl v1.0.25195 Compiling schemars_derive v1.2.1196 Compiling curve25519-dalek-derive v0.1.1197 Compiling zerovec-derive v0.11.2198 Compiling displaydoc v0.2.5199 Compiling derive_more-impl v2.1.1200 Compiling amplify v4.9.0201 Compiling backtrace v0.3.76202 Compiling thiserror-impl v1.0.69203 Compiling clap_builder v4.6.0204 Compiling maybe-async v0.2.10205 Compiling data-encoding-macro v0.1.19206 Compiling clap_derive v4.6.0207 Compiling tree-sitter-rust v0.23.3208 Compiling tree-sitter-python v0.23.6209 Compiling base256emoji v1.0.2210 Compiling tree-sitter-html v0.23.2211 Compiling multibase v0.9.2212 Compiling tree-sitter-go v0.23.4213 Compiling tree-sitter-md v0.3.2214 Compiling tree-sitter-toml-ng v0.6.0215 Compiling tree-sitter-c v0.23.4216 Compiling tree-sitter-json v0.24.8217 Compiling tree-sitter-ruby v0.23.1218 Compiling tree-sitter-typescript v0.23.2219 Compiling derive_more v2.1.1220 Compiling gix-path v0.12.0221 Compiling gix-packetline v0.21.5222 Compiling crossterm v0.29.0223 Compiling gix-features v0.48.0224 Compiling gix-command v0.9.0225 Compiling gix-config-value v0.18.0226 Compiling zerofrom v0.1.6227 Compiling yoke v0.8.1228 Compiling gix-fs v0.21.1229 Compiling gix-url v0.36.0230 Compiling gix-glob v0.26.0231 Compiling zerovec v0.11.5232 Compiling zerotrie v0.2.3233 Compiling gix-prompt v0.15.0234 Compiling gix-tempfile v23.0.0235 Compiling tree-sitter-css v0.23.2236 Compiling tree-sitter-bash v0.23.3237 Compiling gix-transport v0.57.0238 Compiling gix-lock v23.0.0239 Compiling gix-credentials v0.38.0240 Compiling toml_datetime v0.7.5+spec-1.1.0241 Compiling serde_spanned v1.0.4242 Compiling anstyle-parse v0.2.7243 Compiling form_urlencoded v1.2.2244 Compiling toml_writer v1.0.7+spec-1.1.0245 Compiling tinystr v0.8.2246 Compiling potential_utf v0.1.4247 Compiling crossbeam-utils v0.8.21248 Compiling bytes v1.11.1249 Compiling anyhow v1.0.102250 Compiling icu_collections v2.1.1251 Compiling unit-prefix v0.5.2252 Compiling icu_locale_core v2.1.1253 Compiling indicatif v0.18.4254 Compiling toml v0.9.12+spec-1.1.0255 Compiling anstream v0.6.21256 Compiling clap v4.6.0257 Compiling inquire v0.9.4258 Compiling icu_provider v2.1.1259 Compiling unicode-display-width v0.3.0260 Compiling uuid v1.22.0261 Compiling icu_normalizer v2.1.1262 Compiling zeroize v1.9.0263 Compiling schemars v1.2.1264 Compiling radicle-git-ref-format v0.2.0 (/build/z3gqcJUoA1n9HaHKufZs5FCSGazv5/crates/radicle-git-ref-format)265 Compiling nonempty v0.9.0266 Compiling icu_properties v2.1.2267 Compiling der v0.7.10268 Compiling secrecy v0.10.3269 Compiling sysinfo v0.37.2270 Compiling radicle-cli v0.23.0 (/build/z3gqcJUoA1n9HaHKufZs5FCSGazv5/crates/radicle-cli)271 Compiling crypto-common v0.1.7272 Compiling block-buffer v0.10.4273 Compiling block-padding v0.3.3274 Compiling universal-hash v0.5.1275 Compiling digest v0.10.7276 Compiling inout v0.1.4277 Compiling crypto-bigint v0.5.5278 Compiling aead v0.5.2279 Compiling cipher v0.4.4280 Compiling poly1305 v0.8.0281 Compiling polyval v0.6.2282 Compiling sha1 v0.10.6283 Compiling sha2 v0.10.9284 Compiling hmac v0.12.1285 Compiling sha1-checked v0.10.0286 Compiling spki v0.7.3287 Compiling signature v2.2.0288 Compiling sec1 v0.7.3289 Compiling rfc6979 v0.4.0290 Compiling chacha20 v0.9.1291 Compiling pkcs8 v0.10.2292 Compiling gix-hash v0.25.0293 Compiling cyphergraphy v0.3.1294 Compiling pbkdf2 v0.12.2295 Compiling ctr v0.9.2296 Compiling aes v0.8.4297 Compiling ghash v0.5.1298 Compiling pkcs1 v0.7.5299 Compiling ed25519 v2.2.3300 Compiling gix-hashtable v0.15.0301 Compiling ssh-encoding v0.2.0302 Compiling cbc v0.1.2303 Compiling gix-object v0.60.0304 Compiling blowfish v0.9.1305 Compiling sha3 v0.10.8306 Compiling chacha20poly1305 v0.10.1307 Compiling bcrypt-pbkdf v0.10.0308 Compiling rsa v0.9.10309 Compiling noise-framework v0.4.1310 Compiling aes-gcm v0.10.3311 Compiling gix-commitgraph v0.37.0312 Compiling elliptic-curve v0.13.8313 Compiling ssh-cipher v0.2.0314 Compiling cypheraddr v0.4.1315 Compiling radicle-localtime v0.1.0 (/build/z3gqcJUoA1n9HaHKufZs5FCSGazv5/crates/radicle-localtime)316 Compiling idna_adapter v1.2.1317 Compiling radicle-log v0.2.0 (/build/z3gqcJUoA1n9HaHKufZs5FCSGazv5/crates/radicle-log)318 Compiling primeorder v0.13.6319 Compiling ecdsa v0.16.9320 Compiling ed25519-dalek v2.2.0321 Compiling idna v1.1.0322 Compiling gix-shallow v0.12.0323 Compiling gix-revwalk v0.31.0324 Compiling gix-diff v0.63.0325 Compiling socks5-client v0.4.3326 Compiling p521 v0.13.3327 Compiling p256 v0.13.2328 Compiling p384 v0.13.1329 Compiling gix-revision v0.45.0330 Compiling gix-traverse v0.57.0331 Compiling gix-negotiate v0.31.0332 Compiling cyphernet v0.5.4333 Compiling gix-ref v0.63.0334 Compiling url v2.5.8335 Compiling salsa20 v0.10.2336 Compiling pin-project-lite v0.2.17337 Compiling siphasher v0.3.11338 Compiling scrypt v0.11.0339 Compiling gix-refspec v0.41.0340 Compiling tokio v1.50.0341 Compiling gix-pack v0.70.0342 Compiling bloomy v1.2.0343 Compiling tree-sitter-highlight v0.24.7344 Compiling ssh-key v0.6.7345 Compiling human-panic v2.0.6346 Compiling gix-protocol v0.61.0347 Compiling clap_complete v4.6.0348 Compiling systemd-journal-logger v2.2.2349 Compiling itertools v0.14.0350 Compiling radicle-node v0.21.1 (/build/z3gqcJUoA1n9HaHKufZs5FCSGazv5/crates/radicle-node)351 Compiling timeago v0.4.2352 Compiling rs-release v0.1.11353 Compiling humantime v2.3.0354 Compiling crossbeam-channel v0.5.15355 Compiling radicle-systemd v0.13.0 (/build/z3gqcJUoA1n9HaHKufZs5FCSGazv5/crates/radicle-systemd)356 Compiling socket2 v0.5.10357 Compiling lexopt v0.3.2358 Compiling radicle-remote-helper v0.18.1 (/build/z3gqcJUoA1n9HaHKufZs5FCSGazv5/crates/radicle-remote-helper)359 Compiling gix-odb v0.80.0360 Compiling ssh-agent-lib v0.6.0361 Compiling structured-logger v1.0.5362 Compiling git2 v0.21.0363 Compiling radicle-oid v0.2.2 (/build/z3gqcJUoA1n9HaHKufZs5FCSGazv5/crates/radicle-oid)364 Compiling radicle-git-metadata v0.2.1 (/build/z3gqcJUoA1n9HaHKufZs5FCSGazv5/crates/radicle-git-metadata)365 Compiling radicle-term v0.19.1 (/build/z3gqcJUoA1n9HaHKufZs5FCSGazv5/crates/radicle-term)366 Compiling radicle-surf v0.29.0 (/build/z3gqcJUoA1n9HaHKufZs5FCSGazv5/crates/radicle-surf)367 Compiling sqlite3-sys v0.18.0368 Compiling sqlite v0.37.0369 Compiling radicle-crypto v0.19.0 (/build/z3gqcJUoA1n9HaHKufZs5FCSGazv5/crates/radicle-crypto)370 Compiling radicle-core v0.4.1 (/build/z3gqcJUoA1n9HaHKufZs5FCSGazv5/crates/radicle-core)371 Compiling radicle-cob v0.21.1 (/build/z3gqcJUoA1n9HaHKufZs5FCSGazv5/crates/radicle-cob)372 Compiling radicle-fetch v0.21.1 (/build/z3gqcJUoA1n9HaHKufZs5FCSGazv5/crates/radicle-fetch)373 Compiling radicle-protocol v0.9.1 (/build/z3gqcJUoA1n9HaHKufZs5FCSGazv5/crates/radicle-protocol)374 Finished `release` profile [optimized] target(s) in 1m 44s375Executing cargoInstallPostBuildHook376Finished cargoInstallPostBuildHook377Finished cargoBuildHook378buildPhase completed in 1 minutes 46 secondscheckPhase
379Executing cargoCheckHook380cargoCheckHook flags: -j 24 --profile release --target x86_64-unknown-linux-gnu --offline --package=radicle-node --package=radicle-cli --package=radicle-remote-helper -- --skip=service::message::tests::test_node_announcement_validate --skip=tests::test_announcement_relay --skip=tests::commands::rad_remote --skip=tests::e2e::test_connection_crossing --skip=rad_clone_partial_fail --skip=commands::patch::rad_patch_merge_unauthorized_branch381 Compiling rand v0.8.5382 Compiling radicle v0.25.1 (/build/z3gqcJUoA1n9HaHKufZs5FCSGazv5/crates/radicle)383 Compiling radicle-log v0.2.0 (/build/z3gqcJUoA1n9HaHKufZs5FCSGazv5/crates/radicle-log)384 Compiling snapbox-macros v1.1.0385 Compiling normalize-line-endings v0.3.0386 Compiling similar v3.1.1387 Compiling radicle-node v0.21.1 (/build/z3gqcJUoA1n9HaHKufZs5FCSGazv5/crates/radicle-node)388 Compiling escargot v0.5.15389 Compiling diff v0.1.13390 Compiling yansi v1.0.1391 Compiling env_filter v1.0.0392 Compiling test-log-macros v0.2.19393 Compiling env_logger v0.11.9394 Compiling pretty_assertions v1.4.1395 Compiling num-bigint-dig v0.8.6396 Compiling qcheck v1.0.0397 Compiling snapbox v1.2.2398 Compiling radicle-oid v0.2.2 (/build/z3gqcJUoA1n9HaHKufZs5FCSGazv5/crates/radicle-oid)399 Compiling radicle-surf v0.29.0 (/build/z3gqcJUoA1n9HaHKufZs5FCSGazv5/crates/radicle-surf)400 Compiling test-log v0.2.19401 Compiling rsa v0.9.10402 Compiling radicle-cli-test v0.14.1 (/build/z3gqcJUoA1n9HaHKufZs5FCSGazv5/crates/radicle-cli-test)403 Compiling ssh-key v0.6.7404 Compiling ssh-agent-lib v0.6.0405 Compiling radicle-crypto v0.19.0 (/build/z3gqcJUoA1n9HaHKufZs5FCSGazv5/crates/radicle-crypto)406 Compiling radicle-cob v0.21.1 (/build/z3gqcJUoA1n9HaHKufZs5FCSGazv5/crates/radicle-cob)407 Compiling radicle-core v0.4.1 (/build/z3gqcJUoA1n9HaHKufZs5FCSGazv5/crates/radicle-core)408 Compiling radicle-fetch v0.21.1 (/build/z3gqcJUoA1n9HaHKufZs5FCSGazv5/crates/radicle-fetch)409 Compiling radicle-cli v0.23.0 (/build/z3gqcJUoA1n9HaHKufZs5FCSGazv5/crates/radicle-cli)410 Compiling radicle-protocol v0.9.1 (/build/z3gqcJUoA1n9HaHKufZs5FCSGazv5/crates/radicle-protocol)411 Compiling radicle-remote-helper v0.18.1 (/build/z3gqcJUoA1n9HaHKufZs5FCSGazv5/crates/radicle-remote-helper)412 Finished `release` profile [optimized] target(s) in 1m 00s413 Running unittests src/lib.rs (target/x86_64-unknown-linux-gnu/release/deps/radicle_cli-5d238a131921a2ef)414415running 48 tests416test commands::block::args::test::should_not_parse ... ok417test commands::block::args::test::should_parse_rid ... ok418test commands::block::args::test::should_parse_nid ... ok419test commands::cob::args::test::should_allow_log_json_format ... ok420test commands::clone::args::test::should_parse_rid_url ... ok421test commands::clone::args::test::should_parse_rid_non_urn ... ok422test commands::clone::args::test::should_parse_rid_urn ... ok423test commands::cob::args::test::should_allow_log_pretty_format ... ok424test commands::id::args::test::should_parse_into_payload ... ok425test commands::cob::args::test::should_allow_update_json_format ... ok426test commands::cob::args::test::should_allow_show_json_format ... ok427test commands::cob::args::test::should_not_allow_show_pretty_format ... ok428test commands::cob::args::test::should_not_allow_update_pretty_format ... ok429test commands::init::args::test::should_not_parse_rid_url ... ok430test commands::init::args::test::should_parse_rid_non_urn ... ok431test commands::fork::args::test::should_not_parse_rid_url ... ok432test commands::id::args::test::should_parse_multiple_payloads ... ok433test commands::id::args::test::should_parse_single_payload ... ok434test commands::id::args::test::should_not_clobber_payload_args ... ok435test commands::id::args::test::should_not_parse_single_payloads ... ok436test commands::id::args::test::should_not_parse_single_payload ... ok437test commands::init::args::test::should_parse_rid_urn ... ok438test commands::fork::args::test::should_parse_rid_non_urn ... ok439test commands::id::args::test::should_not_parse_into_payload - should panic ... ok440test commands::patch::review::builder::tests::test_review_comments_multiline ... ok441test commands::patch::review::builder::tests::test_review_comments_before ... ok442test commands::patch::review::builder::tests::test_review_comments_basic ... ok443test commands::inspect::test::test_tree ... ok444test commands::fork::args::test::should_parse_rid_urn ... ok445test commands::patch::review::builder::tests::test_review_comments_split_hunk ... ok446test commands::publish::args::test::should_not_parse_rid_url ... ok447test commands::publish::args::test::should_parse_rid_non_urn ... ok448test commands::publish::args::test::should_parse_rid_urn ... ok449test commands::watch::args::test::should_parse_ref_str ... ok450test git::pretty_diff::test::test_pretty ... ignored451test git::test::test_version_from_str ... ok452test git::ddiff::tests::diff_encode_decode_ddiff_hunk ... ok453test git::test::test_version_ord ... ok454test git::unified_diff::test::test_diff_content_encode_decode_content ... ok455test terminal::args::test::should_not_parse ... ok456test terminal::args::test::should_parse_nid ... ok457test terminal::args::test::should_parse_rid ... ok458test terminal::format::test::test_bytes ... ok459test terminal::format::test::test_strip_comments ... ok460test git::unified_diff::test::test_diff_encode_decode_diff ... ok461test terminal::patch::test::test_edit_display_message ... ok462test terminal::patch::test::test_create_display_message ... ok463test terminal::patch::test::test_update_display_message ... ok464465test result: ok. 47 passed; 0 failed; 1 ignored; 0 measured; 0 filtered out; finished in 0.02s466467 Running unittests src/main.rs (target/x86_64-unknown-linux-gnu/release/deps/rad-1b850067bde0198b)468469running 0 tests470471test result: ok. 0 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out; finished in 0.00s472473 Running tests/commands.rs (target/x86_64-unknown-linux-gnu/release/deps/commands-e000c4b32af88c0d)474475running 124 tests476test commands::cob::rad_cob_multiset ... ok477test commands::clone::test_clone_without_seeds ... ok478test commands::cob::test_cob_deletion ... ok479test commands::cob::test_cob_replication ... ok480test commands::checkout::rad_checkout has been running for over 60 seconds481test commands::clone::rad_clone has been running for over 60 seconds482test commands::clone::rad_clone_all has been running for over 60 seconds483test commands::clone::rad_clone_bare has been running for over 60 seconds484test commands::clone::rad_clone_connect has been running for over 60 seconds485test commands::clone::rad_clone_directory has been running for over 60 seconds486test commands::clone::rad_clone_scope has been running for over 60 seconds487test commands::clone::rad_clone_unknown has been running for over 60 seconds488test commands::cob::rad_cob_log has been running for over 60 seconds489test commands::cob::rad_cob_migrate has been running for over 60 seconds490test commands::cob::rad_cob_operations has been running for over 60 seconds491test commands::cob::rad_cob_show has been running for over 60 seconds492test commands::cob::rad_cob_update has been running for over 60 seconds493test commands::cob::rad_cob_update_identity has been running for over 60 seconds494test commands::git::git_push_amend has been running for over 60 seconds495test commands::git::git_push_and_fetch has been running for over 60 seconds496test commands::git::git_push_canonical has been running for over 60 seconds497test commands::git::git_push_canonical_lightweight_tags has been running for over 60 seconds498test commands::git::git_push_converge has been running for over 60 seconds499test commands::git::git_push_diverge has been running for over 60 seconds500test commands::git::git_push_force_with_lease has been running for over 60 seconds501test commands::git::git_push_rollback has been running for over 60 seconds502test commands::git::git_tag has been running for over 60 seconds503test commands::id::rad_id has been running for over 60 seconds504test commands::clone::rad_clone_unknown ... ok505test commands::id::rad_id_collaboration ... ignored, slow506test commands::cob::rad_cob_update_identity ... ok507test commands::cob::rad_cob_migrate ... ok508test commands::checkout::rad_checkout ... ok509test commands::git::git_push_force_with_lease ... ok510test commands::cob::rad_cob_show ... ok511test commands::cob::rad_cob_operations ... ok512test commands::cob::rad_cob_log ... ok513test commands::clone::rad_clone_scope ... ok514test commands::clone::rad_clone ... ok515test commands::init::rad_init ... ignored, part of many other tests516test commands::clone::rad_clone_directory ... ok517test commands::clone::rad_clone_all ... ok518test commands::clone::rad_clone_bare ... ok519test commands::cob::rad_cob_update ... ok520test commands::id::rad_id_update_delete_field ... ok521test commands::init::rad_init_detached_head ... ok522test commands::init::rad_init_bare ... ok523test commands::id::rad_id_private ... ok524test commands::init::rad_init_existing ... ok525test commands::init::rad_init_existing_bare ... ok526test commands::init::rad_init_no_git ... ok527test commands::id::rad_id_unknown_field ... ok528test commands::init::rad_init_private ... ok529test commands::init::rad_init_no_seed ... ok530test commands::init::rad_init_private_no_seed ... ok531test commands::id::rad_id ... ok532test commands::git::git_push_amend ... ok533test commands::clone::rad_clone_connect ... ok534test commands::git::git_push_diverge ... ok535test commands::jj::rad_jj_bare ... ignored, the bare repository does not have a `rad` remote, and so it cannot determine the RID of the repository536test commands::jj::rad_jj_colocated_patch ... ok537test commands::git::git_push_and_fetch ... ok538test commands::git::git_tag ... ok539test commands::init::rad_init_sync_not_connected ... ok540test commands::init::rad_init_with_existing_remote ... ok541test commands::id::rad_id_unauthorized_delegate ... ok542test commands::git::git_push_rollback ... ok543test commands::init::rad_publish ... ok544test commands::issue::rad_issue ... ok545test commands::id::rad_id_threshold_soft_fork ... ok546test commands::git::git_push_canonical_lightweight_tags ... ok547test commands::issue::rad_issue_list ... ok548test commands::id::rad_id_conflict ... ok549test commands::patch::rad_merge_no_ff ... ok550test commands::init::rad_init_private_clone ... ok551test commands::patch::rad_patch ... ok552test commands::inbox::rad_inbox ... ok553test commands::patch::rad_patch_ahead_behind ... ok554test commands::patch::rad_patch_change_base ... ok555test commands::patch::rad_patch_checkout ... ok556test commands::node::rad_node ... ok557test commands::init::rad_init_private_clone_seed ... ok558test commands::patch::rad_merge_after_update ... ok559test commands::init::rad_init_private_seed ... ok560test commands::patch::rad_patch_checkout_revision ... ok561test commands::patch::rad_patch_detached_head ... ok562test commands::patch::rad_merge_via_push ... ok563test commands::git::git_push_canonical ... ok564test commands::patch::rad_patch_draft ... ok565test commands::init::rad_init_sync_and_clone ... ok566test commands::id::rad_id_threshold ... FAILED567test commands::init::rad_init_sync_preferred ... ok568test commands::patch::rad_patch_merge_draft ... ok569test commands::patch::rad_patch_diff ... ok570test commands::patch::rad_patch_merge_into_canonical_ref_branch ... ok571test commands::patch::rad_patch_edit ... ok572test commands::patch::rad_patch_magic_push ... ok573test commands::node::rad_node_connect_without_address ... ok574test commands::patch::rad_patch_fetch_2 ... ok575test commands::init::rad_init_sync_timeout ... ok576test commands::patch::rad_patch_merge_wrong_branch ... ok577test commands::node::rad_node_connect ... ok578test commands::git::git_push_converge ... ok579test commands::sigpipe::help ... ok580test commands::patch::rad_patch_revert_merge ... ok581test commands::patch::rad_patch_update ... ok582test commands::policy::rad_seed_and_follow ... ok583test commands::id::rad_id_multi_delegate ... ok584test commands::policy::rad_block ... ok585test commands::patch::rad_patch_revert_custom_branch ... ok586test commands::utility::rad_auth ... ok587test commands::utility::rad_auth_errors ... ok588test commands::patch::rad_patch_review_no_options ... ok589test commands::sigpipe::config ... ok590test commands::policy::rad_seed_scope ... ok591test commands::patch::rad_patch_via_push ... ok592test commands::patch::rad_review_by_hunk ... ok593test commands::sigpipe::rad_self ... ok594test commands::policy::rad_seed_policy_allow_no_scope ... ok595test commands::policy::rad_unseed ... ok596test commands::utility::rad_help ... ok597test commands::utility::rad_config ... ok598test commands::policy::rad_unseed_many ... ok599test commands::utility::rad_diff ... ok600test commands::utility::rad_key_mismatch ... ok601test commands::utility::rad_inspect ... ok602test commands::utility::rad_self ... ok603test commands::utility::framework_home ... ok604test commands::utility::rad_warn_ipv6 ... ok605test commands::utility::rad_warn_old_nodes ... ok606test commands::patch::rad_patch_fetch_1 ... ok607test commands::patch::rad_patch_checkout_force ... ok608test commands::sync::rad_sync_without_node ... ok609test commands::patch::rad_patch_open_explore ... ok610test commands::patch::rad_patch_merge_on_first_push ... ok611test commands::policy::rad_seed_many ... ok612test commands::watch::rad_watch ... ok613test commands::utility::rad_clean ... ok614test commands::sync::rad_fetch ... ok615test commands::remote::rad_remote ... ok616test commands::utility::rad_fork ... ok617test commands::patch::rad_push_and_pull_patches ... ok618test commands::sync::rad_sync ... ok619test commands::patch::rad_patch_pull_update ... ok620test rad_remote ... ok621test commands::sync::test_replication_via_seed ... ok622test commands::patch::rad_patch_delete ... ok623test commands::workflow::rad_workflow ... ok624625failures:626627---- commands::id::rad_id_threshold stdout ----6281792585579 test: rad-init:6: `rad init --name heartwood --description Radicle Heartwood Protocol & Stack --no-confirm --public -v` @ /build/.tmpbfUcXD/alice/work6291792585579 test: rad-init:28: `rad init` @ /build/.tmpbfUcXD/alice/work6301792585579 test: rad-init:35: `rad ls` @ /build/.tmpbfUcXD/alice/work6311792585579 test: rad-init:46: `rad node inventory` @ /build/.tmpbfUcXD/alice/work6321792585579 commands::id::rad_id_threshold node: Opening policy database..6331792585580 commands::id::rad_id_threshold node: Default seeding policy set to 'block (all)'6341792585580 commands::id::rad_id_threshold node: Initializing service (Test)..6351792585581 commands::id::rad_id_threshold node: Opening node database..6361792585581 commands::id::rad_id_threshold node: Address book is empty. Adding bootstrap nodes..6371792585581 commands::id::rad_id_threshold node: 0 nodes added to address book6381792585581 commands::id::rad_id_threshold service: Init @17925855798316391792585581 commands::id::rad_id_threshold service: Empty refs database, populating from storage..6401792585581 commands::id::rad_id_threshold radicle_protocol::service: Migrating `rad/sigrefs` of rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji to force feature level parent.6411792585581 commands::id::rad_id_threshold service: Saved local sync status for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji..6421792585581 commands::id::rad_id_threshold service: Adding refs announcement for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji to historical gossip messages..6431792585581 commands::id::rad_id_threshold service: Not enough available peers to connect to (available=0, wanted=8)6441792585581 commands::id::rad_id_threshold reactor-controller: Initializing reactor thread…6451792585581 service reactor: Entering reactor event loop6461792585581 service node: Listening on 127.0.0.1:33773..6471792585583 commands::id::rad_id_threshold node: Binding control socket /build/.tmpbfUcXD/alice/.radicle/node/control.sock..6481792585583 runtime node: Running node z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi in /build/.tmpbfUcXD/alice/.radicle..6491792585583 control control: Control thread listening on socket..6501792585583 service service: Received command QueryState(..)6511792585583 signals node: Signal notifications channel error: receiving on a closed channel6521792585583 commands::id::rad_id_threshold node: Opening policy database..6531792585583 commands::id::rad_id_threshold node: Default seeding policy set to 'block (all)'6541792585583 commands::id::rad_id_threshold node: Initializing service (Test)..6551792585583 commands::id::rad_id_threshold node: Opening node database..6561792585583 commands::id::rad_id_threshold node: Address book is empty. Adding bootstrap nodes..6571792585583 commands::id::rad_id_threshold node: 0 nodes added to address book6581792585583 commands::id::rad_id_threshold service: Init @17925855830656591792585583 commands::id::rad_id_threshold service: Empty refs database, populating from storage..6601792585583 commands::id::rad_id_threshold service: Not enough available peers to connect to (available=0, wanted=8)6611792585583 commands::id::rad_id_threshold reactor-controller: Initializing reactor thread…6621792585583 service reactor: Entering reactor event loop6631792585583 service node: Listening on 127.0.0.1:34665..6641792585584 commands::id::rad_id_threshold node: Binding control socket /build/.tmpbfUcXD/seed/.radicle/node/control.sock..6651792585584 runtime node: Running node z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z in /build/.tmpbfUcXD/seed/.radicle..6661792585584 control control: Control thread listening on socket..6671792585584 signals node: Signal notifications channel error: receiving on a closed channel6681792585584 service service: Received command QueryState(..)6691792585584 commands::id::rad_id_threshold node: Opening policy database..6701792585584 commands::id::rad_id_threshold node: Default seeding policy set to 'block (all)'6711792585584 commands::id::rad_id_threshold node: Initializing service (Test)..6721792585584 commands::id::rad_id_threshold node: Opening node database..6731792585585 commands::id::rad_id_threshold node: Address book is empty. Adding bootstrap nodes..6741792585585 commands::id::rad_id_threshold node: 0 nodes added to address book6751792585585 commands::id::rad_id_threshold service: Init @17925855844076761792585585 commands::id::rad_id_threshold service: Empty refs database, populating from storage..6771792585585 commands::id::rad_id_threshold service: Not enough available peers to connect to (available=0, wanted=8)6781792585585 commands::id::rad_id_threshold reactor-controller: Initializing reactor thread…6791792585585 service reactor: Entering reactor event loop6801792585585 service node: Listening on 127.0.0.1:45067..6811792585587 commands::id::rad_id_threshold node: Binding control socket /build/.tmpbfUcXD/bob/.radicle/node/control.sock..6821792585587 runtime node: Running node z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk in /build/.tmpbfUcXD/bob/.radicle..6831792585587 control control: Control thread listening on socket..6841792585587 signals node: Signal notifications channel error: receiving on a closed channel6851792585587 service service: Received command QueryState(..)6861792585587 service service: Received command Seed(rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji, all)6871792585587 service reactor: Service was busy 118.930426ms which exceeds the timeout of 100ms6881792585587 service service: Received command Seed(rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji, followed)6891792585587 service reactor: Service was busy 142.362974ms which exceeds the timeout of 100ms6901792585587 service service: Not enough available peers to connect to (available=0, wanted=8)6911792585587 service reactor: Service was busy 127.152109ms which exceeds the timeout of 100ms6921792585587 service service: Received command Follow(z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z)6931792585587 service service: Received command QueryState(..)6941792585587 service service: Received command Connect(z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z, 127.0.0.1:34665, ConnectOptions { persistent: false, timeout: 30s })6951792585587 service service: Connecting to z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z (127.0.0.1:34665)..6961792585587 service service: Attempted connection to z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z (127.0.0.1:34665)6971792585587 service wire: Registering outbound transport for z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z..6981792585587 service reactor: Registering transport6991792585587 service wire: Inbound connection from 127.0.0.1:60538..7001792585587 service wire: Outbound peer resource registered for z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z7011792585587 service wire: Accepted inbound connection from 127.0.0.1:60538..7021792585587 service reactor: Registering transport7031792585587 service wire: Inbound peer resource registered7041792585587 service transport: Handshake with ProtocolArtifact { session: "<omitted>", state: "<omitted>" } is complete7051792585587 service wire: Session established with z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z7061792585587 service transport: Handshake with ProtocolArtifact { session: "<omitted>", state: "<omitted>" } is complete7071792585587 service wire: Session established with z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi7081792585587 service service: Connected to z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z (127.0.0.1:34665) (Outbound)7091792585587 service service: Subscribing to messages since timestamp 1792499187959..7101792585587 service service: Connected to z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi (127.0.0.1:60538) (Inbound)7111792585587 service service: Subscribing to messages since timestamp 1792499187959..7121792585587 service service: Received node announcement of z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi with 0 address(es) from z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi (t=1792585579831)7131792585587 service service: Received node announcement of z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z with 0 address(es) from z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z (t=1792585583065)7141792585587 service service: Stored announcement from z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi to be broadcast in 0 millisecond(s) (t=1792585579831)7151792585587 service service: Stored announcement from z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z to be broadcast in 5.784 second(s) (t=1792585583065)7161792585588 service service: Address store entry for node z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z updated at 17925855830657171792585588 service service: Received inventory announcement of z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z with 0 item(s) from z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z (t=1792585583066)7181792585588 service service: Stored announcement from z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z to be broadcast in 5.784 second(s) (t=1792585583066)7191792585588 service service: Received subscription filter from z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z7201792585588 service service: Sending refs announcement of z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji with 1 remote(s) to z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z (t=1792585579832)7211792585588 service service: Sending inventory announcement of z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi with 1 item(s) to z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z (t=1792585579833)7221792585588 service reactor: Service was busy 226.073152ms which exceeds the timeout of 100ms7231792585588 service service: Received command QueryState(..)7241792585588 service service: Received command Connect(z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk, 127.0.0.1:45067, ConnectOptions { persistent: false, timeout: 30s })7251792585588 service service: Connecting to z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk (127.0.0.1:45067)..7261792585588 service service: Attempted connection to z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk (127.0.0.1:45067)7271792585588 service wire: Registering outbound transport for z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk..7281792585588 service reactor: Registering transport7291792585588 service wire: Outbound peer resource registered for z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk7301792585588 service wire: Inbound connection from 127.0.0.1:59664..7311792585588 service wire: Accepted inbound connection from 127.0.0.1:59664..7321792585588 service reactor: Registering transport7331792585588 service wire: Inbound peer resource registered7341792585588 service transport: Handshake with ProtocolArtifact { session: "<omitted>", state: "<omitted>" } is complete7351792585588 service transport: Handshake with ProtocolArtifact { session: "<omitted>", state: "<omitted>" } is complete7361792585588 service wire: Session established with z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk7371792585588 service wire: Session established with z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi7381792585588 service service: Connected to z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk (127.0.0.1:45067) (Outbound)7391792585588 service service: Subscribing to messages since timestamp 1792499188254..7401792585588 service service: Connected to z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi (127.0.0.1:59664) (Inbound)7411792585588 service service: Subscribing to messages since timestamp 1792499188254..7421792585588 service service: Received node announcement of z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi with 0 address(es) from z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi (t=1792585579831)7431792585588 service service: Received node announcement of z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk with 0 address(es) from z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk (t=1792585584407)7441792585588 service service: Address store entry for node z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi updated at 17925855798317451792585588 service service: Received inventory announcement of z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi with 1 item(s) from z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi (t=1792585579833)7461792585588 service service: Stored announcement from z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi to be broadcast in 0 millisecond(s) (t=1792585579831)7471792585588 service service: Stored announcement from z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk to be broadcast in 5.462 second(s) (t=1792585584407)7481792585588 service service: Stored announcement from z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi to be broadcast in 0 millisecond(s) (t=1792585579833)7491792585588 service service: Routing table updated for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji with seed z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi7501792585588 service service: Missing seeded inventory rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji; initiating fetch..7511792585588 service service: Starting fetch for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji from z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi7521792585588 service service: Fetch initiated for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji with z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi [inbound connected] (all remotes)..7531792585588 service service: Received subscription filter from z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi7541792585588 service reactor: Service was busy 389.574291ms which exceeds the timeout of 100ms7551792585588 service wire: Opened new stream with id 13 for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji and remote z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi7561792585588 service service: Received refs announcement of z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji with 1 remote(s) from z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi (t=1792585579832)7571792585588 worker#0 worker: Worker processing outgoing fetch for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji7581792585588 service service: Stored announcement from z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi to be broadcast in 0 millisecond(s) (t=1792585579832)7591792585588 service service: Queued fetch for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji from z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi7601792585588 service service: Received inventory announcement of z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi with 1 item(s) from z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi (t=1792585579833)7611792585588 service service: Ignoring stale announcement from z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi (t=1792585579833)7621792585588 worker#0 worker: z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z cloning from z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi7631792585588 service service: Address store entry for node z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk updated at 17925855844077641792585588 service service: Received inventory announcement of z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk with 0 item(s) from z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk (t=1792585584408)7651792585589 service service: Address store entry for node z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi updated at 17925855798317661792585589 service service: Received inventory announcement of z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi with 1 item(s) from z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi (t=1792585579833)7671792585589 service service: Stored announcement from z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi to be broadcast in 0 millisecond(s) (t=1792585579833)7681792585589 service service: Stored announcement from z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk to be broadcast in 5.462 second(s) (t=1792585584408)7691792585589 service service: Routing table updated for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji with seed z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi7701792585589 service service: Received subscription filter from z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk7711792585589 service service: Sending inventory announcement of z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi with 1 item(s) to z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk (t=1792585579833)7721792585589 service service: Received subscription filter from z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi7731792585589 service reactor: Service was busy 886.884571ms which exceeds the timeout of 100ms7741792585589 service reactor: Service was busy 886.73369ms which exceeds the timeout of 100ms7751792585589 service service: Received command QueryState(..)7761792585589 service wire: Received `open` command for stream 13 from z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z7771792585589 service service: Received command Connect(z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z, 127.0.0.1:34665, ConnectOptions { persistent: false, timeout: 30s })7781792585589 service service: Connecting to z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z (127.0.0.1:34665)..7791792585589 worker#0 worker: Worker processing incoming fetch for z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z on stream 13..7801792585589 service service: Attempted connection to z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z (127.0.0.1:34665)7811792585589 worker#0 worker: Spawning upload-pack process for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji on stream 13..7821792585589 service wire: Registering outbound transport for z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z..7831792585589 service reactor: Registering transport7841792585589 service wire: Outbound peer resource registered for z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z7851792585589 service service: Received inventory announcement of z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi with 1 item(s) from z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi (t=1792585579833)7861792585589 service wire: Inbound connection from 127.0.0.1:48566..7871792585589 service wire: Accepted inbound connection from 127.0.0.1:48566..7881792585589 service reactor: Registering transport7891792585589 service wire: Inbound peer resource registered7901792585589 service service: Ignoring stale announcement from z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi (t=1792585579833)7911792585589 service transport: Handshake with ProtocolArtifact { session: "<omitted>", state: "<omitted>" } is complete7921792585589 service wire: Session established with z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z7931792585589 service transport: Handshake with ProtocolArtifact { session: "<omitted>", state: "<omitted>" } is complete7941792585589 service wire: Session established with z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk7951792585589 service service: Connected to z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z (127.0.0.1:34665) (Outbound)7961792585589 service service: Subscribing to messages since timestamp 1792499189200..7971792585589 service service: Connected to z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk (127.0.0.1:48566) (Inbound)7981792585589 service service: Subscribing to messages since timestamp 1792499189201..7991792585589 service service: Received node announcement of z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk with 0 address(es) from z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk (t=1792585584407)8001792585589 test: Waiting for z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi to route to [(RepoId(rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji), PublicKey([230, 60, 201, 241, 191, 234, 99, 224, 69, 83, 141, 89, 171, 218, 190, 44, 26, 238, 5, 87, 218, 242, 137, 75, 243, 17, 93, 23, 125, 22, 80, 108]))]8011792585589 service service: Received node announcement of z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z with 0 address(es) from z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z (t=1792585583065)8021792585589 service service: Stored announcement from z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z to be broadcast in 0 millisecond(s) (t=1792585583065)8031792585589 service service: Stored announcement from z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk to be broadcast in 0 millisecond(s) (t=1792585584407)8041792585589 service service: Address store entry for node z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z updated at 17925855830658051792585589 service service: Received inventory announcement of z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z with 0 item(s) from z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z (t=1792585583066)8061792585589 service service: Address store entry for node z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk updated at 17925855844078071792585589 service service: Received inventory announcement of z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk with 0 item(s) from z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk (t=1792585584408)8081792585589 test: Found unexpected route for z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi: (rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji, z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi)8091792585589 service service: Stored announcement from z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk to be broadcast in 0 millisecond(s) (t=1792585584408)8101792585589 service service: Stored announcement from z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z to be broadcast in 0 millisecond(s) (t=1792585583066)8111792585589 service service: Received subscription filter from z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk8121792585589 service service: Received subscription filter from z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z8131792585589 service reactor: Service was busy 648.766839ms which exceeds the timeout of 100ms8141792585589 service reactor: Service was busy 648.572779ms which exceeds the timeout of 100ms8151792585589 service service: Not enough available peers to connect to (available=0, wanted=8)8161792585589 service service: Already fetching rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji from z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi8171792585589 service service: Sending inventory announcement of z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z with 0 item(s) to z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi (t=1792585583066)8181792585589 service service: Sending inventory announcement of z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z with 0 item(s) to z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk (t=1792585583066)8191792585589 service service: Received inventory announcement of z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z with 0 item(s) from z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z (t=1792585583066)8201792585589 service service: Received inventory announcement of z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z with 0 item(s) from z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z (t=1792585583066)8211792585589 service service: Ignoring stale announcement from z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z (t=1792585583066)8221792585589 service service: Ignoring stale announcement from z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z (t=1792585583066)8231792585590 worker#0 radicle_fetch::state: Fetched rad/id (83ms)8241792585590 worker#0 radicle_fetch::state: Fetched data for 1 remote(s) (143ms)8251792585590 worker#0 radicle_fetch::state: Fetched data refs for 0 remotes (201ms)8261792585590 worker#0 radicle_fetch::state: Sent done signal to remote z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi8271792585590 worker#0 radicle_fetch::state: Validated 1 remote(s) (201ms)8281792585590 service wire: Received `end-of-file` on stream 13 from z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z8291792585590 upload-pack worker: Exiting upload-pack reader thread for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji8301792585590 worker#0 worker: Upload pack finished (980ms)8311792585590 worker#0 worker: Upload process on stream 13 exited with result Ok(())8321792585590 service wire: Stream 13 of z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z closing with 0 byte(s) sent and 0 byte(s) received8331792585590 service wire: Peer z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z fetched rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji from us successfully8341792585590 service wire: Received `close` command for stream 13 from z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi8351792585590 service wire: Stream 13 of z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi closed with 0 byte(s) sent and 0 byte(s) received8361792585590 worker#0 radicle_fetch::state: Applied updates (237ms)8371792585590 worker#0 radicle_fetch: Finished clone of rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji from z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi (1831ms)8381792585590 worker#0 storage: Obtained identity COB root commit '0656c217f917c3e06234771e9ecae53aba5e173e' via reference 'refs/rad/root' in namespace of founder 'did:key:z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi' of identity document 'rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji'.8391792585590 worker#0 cob: Loading object of type xyz.radicle.id at 0656c217f917c3e06234771e9ecae53aba5e173e.8401792585590 worker#0 storage: Setting ref: refs/rad/id -> 0656c217f917c3e06234771e9ecae53aba5e173e8411792585590 worker#0 cob: Loading object of type xyz.radicle.id at 0656c217f917c3e06234771e9ecae53aba5e173e.8421792585590 service service: Dequeued fetch for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji from z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi8431792585590 service service: Skipping fetch for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji, all refs are already in storage8441792585590 service service: Fetched rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji from z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi successfully8451792585590 service service: Ref updated: * 0000000..0656c21 refs/namespaces/z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi/refs/rad/id for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji8461792585590 service service: Ref updated: * 0000000..55be805 refs/namespaces/z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi/refs/rad/sigrefs for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji8471792585590 service service: Ref updated: * 0000000..0656c21 refs/namespaces/z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi/refs/cobs/xyz.radicle.id/0656c217f917c3e06234771e9ecae53aba5e173e for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji8481792585590 service service: Ref updated: * 0000000..f2de534 refs/namespaces/z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi/refs/heads/master for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji8491792585590 service service: Ref updated: * 0000000..0656c21 refs/namespaces/z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi/refs/rad/root for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji8501792585590 service service: Updating and announcing inventory for cloned repository rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji..8511792585590 service service: Sending inventory announcement of z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z with 1 item(s) to z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi (t=1792585590395)8521792585590 service service: Sending inventory announcement of z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z with 1 item(s) to z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk (t=1792585590395)8531792585590 service service: Sending refs announcement of z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji with 1 remote(s) to z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi (t=1792585590396)8541792585590 service service: Skipping refs announcement relay to z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk [inbound connected]: peer isn't subscribed to rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji8551792585590 service reactor: Service was busy 440.083954ms which exceeds the timeout of 100ms8561792585590 service service: Received inventory announcement of z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z with 1 item(s) from z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z (t=1792585590395)8571792585590 service service: Received inventory announcement of z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z with 1 item(s) from z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z (t=1792585590395)8581792585590 service service: Stored announcement from z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z to be broadcast in 2.910 second(s) (t=1792585590395)8591792585590 service service: Stored announcement from z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z to be broadcast in 0 millisecond(s) (t=1792585590395)8601792585590 service service: Routing table updated for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji with seed z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z8611792585590 service service: Routing table updated for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji with seed z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z8621792585590 service service: Received refs announcement of z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji with 1 remote(s) from z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z (t=1792585590396)8631792585590 service service: Stored announcement from z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z to be broadcast in 2.910 second(s) (t=1792585590396)8641792585590 service service: Refs announcement of z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji contains our own remote at 55be80540a7e9f10478fbc846913f2a6a19abe1d (t=1792585590396)8651792585590 service service: Updating sync status of z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji to 55be80540a7e9f10478fbc846913f2a6a19abe1d8661792585590 service service: Skipping fetch for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji, all refs are already in storage8671792585591 service service: Not enough available peers to connect to (available=0, wanted=7)8681792585591 test: Found unexpected route for z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi: (rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji, z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi)8691792585591 service service: Received command Fetch(rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji, z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi)8701792585591 service service: Starting fetch for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji from z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi8711792585591 service service: Fetch initiated for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji with z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi [inbound connected] (all remotes)..8721792585591 service wire: Opened new stream with id 21 for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji and remote z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi8731792585591 worker#1 worker: Worker processing outgoing fetch for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji8741792585591 service wire: Received `open` command for stream 21 from z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z8751792585591 worker#1 worker: Worker processing incoming fetch for z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z on stream 21..8761792585591 service service: Sending inventory announcement of z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk with 0 item(s) to z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi (t=1792585584408)8771792585591 service service: Sending inventory announcement of z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk with 0 item(s) to z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z (t=1792585584408)8781792585591 service reactor: Service was busy 137.744927ms which exceeds the timeout of 100ms8791792585591 service service: Received inventory announcement of z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk with 0 item(s) from z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk (t=1792585584408)8801792585591 service service: Received inventory announcement of z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk with 0 item(s) from z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk (t=1792585584408)8811792585591 worker#1 worker: z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z pulling from z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi8821792585591 service service: Ignoring stale announcement from z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk (t=1792585584408)8831792585591 service service: Ignoring stale announcement from z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk (t=1792585584408)8841792585591 worker#1 worker: Spawning upload-pack process for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji on stream 21..8851792585591 worker#1 radicle_fetch::state: Fetched rad/id (64ms)8861792585591 worker#1 radicle_fetch::state: Fetched data for 1 remote(s) (159ms)8871792585591 worker#1 radicle_fetch::state: Fetched data refs for 0 remotes (191ms)8881792585591 worker#1 radicle_fetch::state: Sent done signal to remote z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi8891792585591 service wire: Received `end-of-file` on stream 21 from z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z8901792585591 upload-pack worker: Exiting upload-pack reader thread for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji8911792585591 worker#1 worker: Upload pack finished (300ms)8921792585591 worker#1 worker: Upload process on stream 21 exited with result Ok(())8931792585591 worker#1 radicle_fetch::state: Validated 1 remote(s) (218ms)8941792585591 service wire: Stream 21 of z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z closing with 0 byte(s) sent and 0 byte(s) received8951792585591 worker#1 radicle_fetch::state: Applied updates (218ms)8961792585591 service wire: Peer z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z fetched rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji from us successfully8971792585591 worker#1 radicle_fetch: Finished pull of rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji (392ms)8981792585591 service wire: Received `close` command for stream 21 from z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi8991792585591 service wire: Stream 21 of z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi closed with 0 byte(s) sent and 0 byte(s) received9001792585591 worker#1 storage: Obtained identity COB root commit '0656c217f917c3e06234771e9ecae53aba5e173e' via reference 'refs/rad/root' in namespace of founder 'did:key:z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi' of identity document 'rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji'.9011792585591 worker#1 cob: Loading object of type xyz.radicle.id at 0656c217f917c3e06234771e9ecae53aba5e173e.9021792585591 worker#1 storage: Setting ref: refs/rad/id -> 0656c217f917c3e06234771e9ecae53aba5e173e9031792585591 worker#1 cob: Loading object of type xyz.radicle.id at 0656c217f917c3e06234771e9ecae53aba5e173e.9041792585591 service service: Fetched rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji from z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi successfully9051792585591 test: rad-id-threshold:9: `rad id update --title Add Bob --description Add Bob as a delegate --delegate did:key:z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk --threshold 2` @ /build/.tmpbfUcXD/alice/work9061792585591 test: rad-id-threshold:20: `rad id update --title Add Bob --description Add Bob as a delegate --delegate did:key:z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk` @ /build/.tmpbfUcXD/alice/work9071792585592 test: rad-id-threshold:58: `touch REQUIREMENTS` @ /build/.tmpbfUcXD/alice/work9081792585592 test: rad-id-threshold:59: `git add REQUIREMENTS` @ /build/.tmpbfUcXD/alice/work9091792585592 service service: Nothing to announce, no refs were updated..9101792585592 service reactor: Service was busy 428.106285ms which exceeds the timeout of 100ms9111792585592 test: rad-id-threshold:60: `git commit -v -m Define power requirements` @ /build/.tmpbfUcXD/alice/work9121792585592 test: rad-id-threshold:67: `git push rad master` @ /build/.tmpbfUcXD/alice/work9131792585592 test: rad-id-threshold:74: `rad sync -a` @ /build/.tmpbfUcXD/alice/work9141792585592 control control: Received `{"command":"status"}` on control socket9151792585592 control control: Received `{"command":"seedsFor","rid":"rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji","namespaces":["z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi"]}` on control socket9161792585592 service service: Received command Seeds(rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji)9171792585592 service service: Found 1 connected seed(s) and 1 disconnected seed(s) for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji9181792585592 control control: Received `{"command":"subscribe"}` on control socket9191792585592 control control: Received `{"command":"announceRefsFor","rid":"rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji","namespaces":["z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi"]}` on control socket9201792585592 service service: Received command AnnounceRefs(rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji)9211792585592 service service: Announcing refs rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji/z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi @ 9f2bf77be1c2dc08d25e3b7b0bd7e0b37afbb848 to peers (t=1792585592568)..9221792585592 service service: Saved local sync status for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji..9231792585593 service service: Skipping refs announcement relay to z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk [outbound connected]: peer isn't subscribed to rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji9241792585593 service service: Sending refs announcement of z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji with 1 remote(s) to z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z (t=1792585592568)9251792585593 service reactor: Service was busy 455.7826ms which exceeds the timeout of 100ms9261792585593 service service: Received refs announcement of z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji with 1 remote(s) from z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi (t=1792585592568)9271792585593 service service: Stored announcement from z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi to be broadcast in 2.861 second(s) (t=1792585592568)9281792585593 service service: Starting fetch for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji from z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi9291792585593 service service: Fetch initiated for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji with z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi [inbound connected] (1 remote(s))..9301792585593 service wire: Opened new stream with id 29 for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji and remote z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi9311792585593 worker#2 worker: Worker processing outgoing fetch for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji9321792585593 service wire: Received `open` command for stream 29 from z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z9331792585593 worker#2 worker: Worker processing incoming fetch for z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z on stream 29..9341792585593 worker#2 worker: z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z pulling from z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi9351792585593 worker#2 worker: Spawning upload-pack process for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji on stream 29..9361792585593 worker#2 radicle_fetch::state: Fetched rad/id (56ms)9371792585593 worker#2 radicle_fetch::state: Fetched data for 1 remote(s) (140ms)9381792585593 worker#2 radicle_fetch::state: Fetched data refs for 0 remotes (245ms)9391792585593 worker#2 radicle_fetch::state: Sent done signal to remote z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi9401792585593 service wire: Received `end-of-file` on stream 29 from z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z9411792585593 upload-pack worker: Exiting upload-pack reader thread for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji9421792585593 worker#2 radicle_fetch::state: Validated 1 remote(s) (268ms)9431792585593 worker#2 worker: Upload pack finished (412ms)9441792585593 worker#2 worker: Upload process on stream 29 exited with result Ok(())9451792585593 service wire: Stream 29 of z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z closing with 0 byte(s) sent and 0 byte(s) received9461792585593 service wire: Peer z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z fetched rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji from us successfully9471792585593 service wire: Received `close` command for stream 29 from z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi9481792585593 service wire: Stream 29 of z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi closed with 0 byte(s) sent and 0 byte(s) received9491792585593 worker#2 radicle_fetch::state: Applied updates (335ms)9501792585593 worker#2 radicle_fetch: Finished pull of rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji (514ms)9511792585593 worker#2 storage: Obtained identity COB root commit '0656c217f917c3e06234771e9ecae53aba5e173e' via reference 'refs/rad/root' in namespace of founder 'did:key:z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi' of identity document 'rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji'.9521792585593 worker#2 cob: Loading object of type xyz.radicle.id at 0656c217f917c3e06234771e9ecae53aba5e173e.9531792585593 worker#2 storage: Setting ref: refs/rad/id -> 7be665f9fccba97abb21b2fa85a6fd3181c728589541792585593 worker#2 cob: Loading object of type xyz.radicle.id at 0656c217f917c3e06234771e9ecae53aba5e173e.9551792585593 service service: Fetched rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji from z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi successfully9561792585593 service service: Ref updated: ~ 55be805..9f2bf77 refs/namespaces/z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi/refs/rad/sigrefs for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji9571792585593 service service: Ref updated: ~ 0656c21..7be665f refs/namespaces/z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi/refs/cobs/xyz.radicle.id/0656c217f917c3e06234771e9ecae53aba5e173e for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji9581792585593 service service: Ref updated: ~ f2de534..3e674d1 refs/namespaces/z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi/refs/heads/master for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji9591792585593 service service: Ref updated: ~ 0656c21..7be665f refs/namespaces/z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi/refs/rad/id for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji9601792585593 service service: Sending refs announcement of z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji with 1 remote(s) to z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi (t=1792585593624)9611792585593 service service: Skipping refs announcement relay to z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk [inbound connected]: peer isn't subscribed to rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji9621792585593 service reactor: Service was busy 314.032997ms which exceeds the timeout of 100ms9631792585594 service reactor: Service was busy 260.313789ms which exceeds the timeout of 100ms9641792585594 service service: Received refs announcement of z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji with 1 remote(s) from z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z (t=1792585593624)9651792585594 service service: Stored announcement from z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z to be broadcast in 5.740 second(s) (t=1792585593624)9661792585594 service service: Refs announcement of z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji contains our own remote at 9f2bf77be1c2dc08d25e3b7b0bd7e0b37afbb848 (t=1792585593624)9671792585594 service service: Updating sync status of z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji to 9f2bf77be1c2dc08d25e3b7b0bd7e0b37afbb8489681792585594 service service: Skipping fetch for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji, all refs are already in storage9691792585594 service reactor: Service was busy 325.387276ms which exceeds the timeout of 100ms9701792585594 test: rad-id-threshold:79: `git checkout -b add-readme` @ /build/.tmpbfUcXD/alice/work9711792585594 test: rad-id-threshold:80: `touch README.md` @ /build/.tmpbfUcXD/alice/work9721792585594 test: rad-id-threshold:81: `git add README.md` @ /build/.tmpbfUcXD/alice/work9731792585594 test: rad-id-threshold:82: `git commit -v -m Add README file` @ /build/.tmpbfUcXD/alice/work9741792585594 test: rad-id-threshold:89: `git push rad HEAD:refs/patches` @ /build/.tmpbfUcXD/alice/work9751792585595 test: rad-id-threshold:99: Directory /build/.tmpbfUcXD/seed/work does not exist. Creating..9761792585595 test: rad-id-threshold:99: `rad sync rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji -f` @ /build/.tmpbfUcXD/seed/work9771792585595 control control: Received `{"command":"status"}` on control socket9781792585595 control control: Received `{"command":"seedsFor","rid":"rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji","namespaces":["z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z"]}` on control socket9791792585595 service service: Received command Seeds(rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji)9801792585595 service service: Found 1 connected seed(s) and 0 disconnected seed(s) for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji9811792585595 control control: Received `{"command":"session","nid":"z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi"}` on control socket9821792585595 service service: Received command QueryState(..)9831792585595 control control: Received `{"command":"fetch","rid":"rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji","nid":"z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi","timeout":{"secs":9,"nanos":0},"signedReferencesMinimumFeatureLevel":null}` on control socket9841792585595 service service: Received command Fetch(rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji, z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi)9851792585595 service service: Starting fetch for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji from z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi9861792585595 service service: Fetch initiated for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji with z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi [inbound connected] (all remotes)..9871792585595 service wire: Opened new stream with id 37 for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji and remote z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi9881792585595 worker#3 worker: Worker processing outgoing fetch for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji9891792585595 service wire: Received `open` command for stream 37 from z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z9901792585595 worker#3 worker: Worker processing incoming fetch for z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z on stream 37..9911792585595 worker#3 worker: z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z pulling from z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi9921792585595 worker#3 worker: Spawning upload-pack process for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji on stream 37..9931792585595 control control: Command returned error: i/o error: Broken pipe (os error 32)9941792585595 worker#3 radicle_fetch::state: Fetched rad/id (56ms)9951792585595 worker#3 radicle_fetch::state: Fetched data for 2 remote(s) (191ms)9961792585596 service reactor: Service was busy 182.986191ms which exceeds the timeout of 100ms9971792585596 worker#3 radicle_fetch::state: Fetched data refs for 0 remotes (435ms)9981792585596 worker#3 radicle_fetch::state: Sent done signal to remote z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi9991792585596 service wire: Received `end-of-file` on stream 37 from z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z10001792585596 upload-pack worker: Exiting upload-pack reader thread for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji10011792585596 worker#3 worker: Upload pack finished (530ms)10021792585596 worker#3 worker: Upload process on stream 37 exited with result Ok(())10031792585596 service wire: Stream 37 of z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z closing with 0 byte(s) sent and 0 byte(s) received10041792585596 service wire: Peer z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z fetched rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji from us successfully10051792585596 worker#3 radicle_fetch::state: Pruning delegate z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk tips, missing 'rad/sigrefs'10061792585596 worker#3 radicle_fetch::state: Validated 1 remote(s) (516ms)10071792585596 service wire: Received `close` command for stream 37 from z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi10081792585596 service wire: Stream 37 of z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi closed with 0 byte(s) sent and 0 byte(s) received10091792585596 worker#3 radicle_fetch::state: Applied updates (520ms)10101792585596 worker#3 radicle_fetch: Finished pull of rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji (710ms)10111792585596 worker#3 worker: Validation error: missing `refs/namespaces/z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk/refs/rad/sigrefs`10121792585596 worker#3 storage: Obtained identity COB root commit '0656c217f917c3e06234771e9ecae53aba5e173e' via reference 'refs/rad/root' in namespace of founder 'did:key:z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi' of identity document 'rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji'.10131792585596 worker#3 cob: Loading object of type xyz.radicle.id at 0656c217f917c3e06234771e9ecae53aba5e173e.10141792585596 worker#3 storage: Setting ref: refs/rad/id -> 7be665f9fccba97abb21b2fa85a6fd3181c7285810151792585596 worker#3 cob: Loading object of type xyz.radicle.id at 0656c217f917c3e06234771e9ecae53aba5e173e.10161792585596 worker#3 cob: Loading object of type xyz.radicle.patch at b09b2aa0ee055671c811e9ad4ba73eed211ebaa3.10171792585596 service service: Fetched rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji from z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi successfully10181792585596 service service: Ref updated: ~ 9f2bf77..e5c2007 refs/namespaces/z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi/refs/rad/sigrefs for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji10191792585596 service service: Ref updated: * 0000000..b09b2aa refs/namespaces/z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi/refs/cobs/xyz.radicle.patch/b09b2aa0ee055671c811e9ad4ba73eed211ebaa3 for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji10201792585596 service service: Ref updated: * 0000000..964513c refs/namespaces/z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi/refs/heads/patches/b09b2aa0ee055671c811e9ad4ba73eed211ebaa3 for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji10211792585596 test: rad-id-threshold:111: `rad inspect --identity` @ /build/.tmpbfUcXD/alice/work10221792585597 test: rad-id-threshold:132: `rad inspect --refs` @ /build/.tmpbfUcXD/alice/work10231792585597 test: rad-id-threshold:154: `rad inspect --sigrefs` @ /build/.tmpbfUcXD/alice/work10241792585597 service service: Sending refs announcement of z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji with 1 remote(s) to z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi (t=1792585596772)10251792585597 service service: Skipping refs announcement relay to z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk [inbound connected]: peer isn't subscribed to rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji10261792585597 service reactor: Service was busy 417.211086ms which exceeds the timeout of 100ms10271792585597 service service: Received refs announcement of z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji with 1 remote(s) from z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z (t=1792585596772)10281792585597 service service: Stored announcement from z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z to be broadcast in 2.559 second(s) (t=1792585596772)10291792585597 service service: Refs announcement of z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji contains our own remote at e5c200775dc6da38306f62c995df67a1ab1bf62d (t=1792585596772)10301792585597 test: rad-id-threshold:161: `rad ls` @ /build/.tmpbfUcXD/alice/work10311792585597 service service: Updating sync status of z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji to e5c200775dc6da38306f62c995df67a1ab1bf62d10321792585597 service service: Skipping fetch for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji, all refs are already in storage10331792585597 test: rad-id-threshold:174: Directory /build/.tmpbfUcXD/bob/work does not exist. Creating..10341792585597 test: rad-id-threshold:174: `rad clone rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji` @ /build/.tmpbfUcXD/bob/work10351792585597 control control: Received `{"command":"status"}` on control socket10361792585597 control control: Received `{"command":"seed","rid":"rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji","scope":"followed"}` on control socket10371792585597 service service: Received command Seed(rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji, followed)10381792585597 service service: Sending subscription filter to z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi10391792585597 service service: Sending subscription filter to z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z10401792585597 service service: Received subscription filter from z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk10411792585597 service service: Received subscription filter from z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk10421792585597 control control: Received `{"command":"seedsFor","rid":"rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji","namespaces":["z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk"]}` on control socket10431792585597 service service: Received command Seeds(rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji)10441792585597 service service: Found 2 connected seed(s) and 0 disconnected seed(s) for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji10451792585597 control control: Received `{"command":"session","nid":"z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi"}` on control socket10461792585597 service service: Received command QueryState(..)10471792585597 control control: Received `{"command":"fetch","rid":"rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji","nid":"z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi","timeout":{"secs":9,"nanos":0},"signedReferencesMinimumFeatureLevel":null}` on control socket10481792585597 service service: Received command Fetch(rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji, z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi)10491792585597 service service: Starting fetch for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji from z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi10501792585597 service service: Fetch initiated for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji with z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi [inbound connected] (all remotes)..10511792585597 service wire: Opened new stream with id 13 for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji and remote z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi10521792585597 service wire: Received `open` command for stream 13 from z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk10531792585597 worker#0 worker: Worker processing outgoing fetch for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji10541792585597 worker#4 worker: Worker processing incoming fetch for z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk on stream 13..10551792585597 worker#0 worker: z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk cloning from z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi10561792585597 worker#4 worker: Spawning upload-pack process for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji on stream 13..10571792585597 worker#0 radicle_fetch::state: Fetched rad/id (94ms)10581792585597 worker#0 radicle_fetch::state: Fetched data for 2 remote(s) (155ms)10591792585597 worker#0 radicle_fetch::state: Fetched data refs for 0 remotes (252ms)10601792585597 worker#0 radicle_fetch::state: Sent done signal to remote z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi10611792585597 worker#0 radicle_fetch::state: Pruning delegate z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk tips, missing 'rad/sigrefs'10621792585597 worker#0 radicle_fetch::state: Validated 1 remote(s) (252ms)10631792585597 service wire: Received `end-of-file` on stream 13 from z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk10641792585597 upload-pack worker: Exiting upload-pack reader thread for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji10651792585597 worker#4 worker: Upload pack finished (403ms)10661792585597 worker#4 worker: Upload process on stream 13 exited with result Ok(())10671792585597 service wire: Stream 13 of z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk closing with 0 byte(s) sent and 0 byte(s) received10681792585597 service wire: Peer z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk fetched rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji from us successfully10691792585598 service wire: Received `close` command for stream 13 from z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi10701792585598 service wire: Stream 13 of z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi closed with 0 byte(s) sent and 0 byte(s) received10711792585598 worker#0 radicle_fetch::state: Applied updates (359ms)10721792585598 worker#0 radicle_fetch: Finished clone of rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji from z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi (524ms)10731792585598 worker#0 worker: Validation error: missing `refs/namespaces/z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk/refs/rad/sigrefs`10741792585598 worker#0 storage: Obtained identity COB root commit '0656c217f917c3e06234771e9ecae53aba5e173e' via reference 'refs/rad/root' in namespace of founder 'did:key:z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi' of identity document 'rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji'.10751792585598 worker#0 cob: Loading object of type xyz.radicle.id at 0656c217f917c3e06234771e9ecae53aba5e173e.10761792585598 worker#0 storage: Setting ref: refs/rad/id -> 7be665f9fccba97abb21b2fa85a6fd3181c7285810771792585598 worker#0 cob: Loading object of type xyz.radicle.id at 0656c217f917c3e06234771e9ecae53aba5e173e.10781792585598 worker#0 cob: Loading object of type xyz.radicle.patch at b09b2aa0ee055671c811e9ad4ba73eed211ebaa3.10791792585598 service service: Fetched rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji from z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi successfully10801792585598 service service: Ref updated: * 0000000..7be665f refs/namespaces/z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi/refs/rad/id for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji10811792585598 service service: Ref updated: * 0000000..e5c2007 refs/namespaces/z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi/refs/rad/sigrefs for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji10821792585598 service service: Ref updated: * 0000000..7be665f refs/namespaces/z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi/refs/cobs/xyz.radicle.id/0656c217f917c3e06234771e9ecae53aba5e173e for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji10831792585598 service service: Ref updated: * 0000000..b09b2aa refs/namespaces/z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi/refs/cobs/xyz.radicle.patch/b09b2aa0ee055671c811e9ad4ba73eed211ebaa3 for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji10841792585598 service service: Ref updated: * 0000000..3e674d1 refs/namespaces/z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi/refs/heads/master for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji10851792585598 service service: Ref updated: * 0000000..964513c refs/namespaces/z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi/refs/heads/patches/b09b2aa0ee055671c811e9ad4ba73eed211ebaa3 for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji10861792585598 service service: Ref updated: * 0000000..0656c21 refs/namespaces/z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi/refs/rad/root for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji10871792585598 service service: Updating and announcing inventory for cloned repository rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji..10881792585598 test: rad-id-threshold:191: `cd /build/.tmpbfUcXD/bob/work/heartwood`..10891792585598 test: rad-id-threshold:192: `rad fork` @ /build/.tmpbfUcXD/bob/work/heartwood10901792585598 test: rad-id-threshold:197: `rad sync -f` @ /build/.tmpbfUcXD/alice/work10911792585598 control control: Received `{"command":"status"}` on control socket10921792585598 control control: Received `{"command":"seedsFor","rid":"rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji","namespaces":["z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi"]}` on control socket10931792585598 service service: Received command Seeds(rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji)10941792585598 service service: Found 1 connected seed(s) and 1 disconnected seed(s) for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji10951792585598 control control: Received `{"command":"session","nid":"z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z"}` on control socket10961792585598 service service: Received command QueryState(..)10971792585598 control control: Received `{"command":"fetch","rid":"rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji","nid":"z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z","timeout":{"secs":9,"nanos":0},"signedReferencesMinimumFeatureLevel":null}` on control socket10981792585598 service service: Received command Fetch(rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji, z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z)10991792585598 service service: Starting fetch for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji from z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z11001792585598 service service: Fetch initiated for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji with z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z [outbound connected] (all remotes)..11011792585598 service wire: Opened new stream with id 12 for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji and remote z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z11021792585598 worker#5 worker: Worker processing outgoing fetch for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji11031792585598 service wire: Received `open` command for stream 12 from z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi11041792585598 worker#4 worker: Worker processing incoming fetch for z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi on stream 12..11051792585598 worker#5 worker: z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi pulling from z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z11061792585598 worker#4 worker: Spawning upload-pack process for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji on stream 12..11071792585598 service service: Sending inventory announcement of z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk with 1 item(s) to z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi (t=1792585598231)11081792585598 service service: Sending inventory announcement of z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk with 1 item(s) to z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z (t=1792585598231)11091792585598 worker#5 radicle_fetch::state: Fetched rad/id (27ms)11101792585598 worker#5 radicle_fetch::state: Fetched data for 1 remote(s) (28ms)11111792585598 worker#5 radicle_fetch::state: Fetched data refs for 0 remotes (28ms)11121792585598 worker#5 radicle_fetch::state: Sent done signal to remote z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z11131792585598 service wire: Received `end-of-file` on stream 12 from z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi11141792585598 upload-pack worker: Exiting upload-pack reader thread for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji11151792585598 worker#4 worker: Upload pack finished (96ms)11161792585598 worker#4 worker: Upload process on stream 12 exited with result Ok(())11171792585598 worker#5 radicle_fetch::state: Pruning delegate z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk tips, missing 'rad/sigrefs'11181792585598 worker#5 radicle_fetch::state: Validated 0 remote(s) (49ms)11191792585598 worker#5 radicle_fetch::state: Applied updates (49ms)11201792585598 service wire: Stream 12 of z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi closing with 0 byte(s) sent and 0 byte(s) received11211792585598 worker#5 radicle_fetch: Finished pull of rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji (99ms)11221792585598 service wire: Peer z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi fetched rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji from us successfully11231792585598 worker#5 worker: Validation error: missing `refs/namespaces/z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk/refs/rad/sigrefs`11241792585598 service wire: Received `close` command for stream 12 from z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z11251792585598 service wire: Stream 12 of z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z closed with 0 byte(s) sent and 0 byte(s) received11261792585598 worker#5 storage: Obtained identity COB root commit '0656c217f917c3e06234771e9ecae53aba5e173e' via reference 'refs/rad/root' in namespace of founder 'did:key:z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi' of identity document 'rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji'.11271792585598 worker#5 cob: Loading object of type xyz.radicle.id at 0656c217f917c3e06234771e9ecae53aba5e173e.11281792585598 service service: Sending refs announcement of z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji with 1 remote(s) to z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi (t=1792585598232)11291792585598 service service: Sending refs announcement of z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji with 1 remote(s) to z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z (t=1792585598232)11301792585598 worker#5 storage: Setting ref: refs/rad/id -> 7be665f9fccba97abb21b2fa85a6fd3181c7285811311792585598 service reactor: Service was busy 643.051057ms which exceeds the timeout of 100ms11321792585598 service service: Received inventory announcement of z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk with 1 item(s) from z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk (t=1792585598231)11331792585598 service service: Received inventory announcement of z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk with 1 item(s) from z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk (t=1792585598231)11341792585598 worker#5 cob: Loading object of type xyz.radicle.id at 0656c217f917c3e06234771e9ecae53aba5e173e.11351792585598 service service: Stored announcement from z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk to be broadcast in 875 millisecond(s) (t=1792585598231)11361792585598 service service: Routing table updated for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji with seed z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk11371792585598 service service: Stored announcement from z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk to be broadcast in 3.23 second(s) (t=1792585598231)11381792585598 service service: Received refs announcement of z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji with 1 remote(s) from z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk (t=1792585598232)11391792585598 service service: Routing table updated for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji with seed z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk11401792585598 service service: Received refs announcement of z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji with 1 remote(s) from z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk (t=1792585598232)11411792585598 service service: Stored announcement from z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk to be broadcast in 875 millisecond(s) (t=1792585598232)11421792585598 service service: Stored announcement from z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk to be broadcast in 3.23 second(s) (t=1792585598232)11431792585598 service service: Refs announcement of z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji contains our own remote at e5c200775dc6da38306f62c995df67a1ab1bf62d (t=1792585598232)11441792585598 service service: Skipping fetch for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji, all refs are already in storage11451792585598 service reactor: Service was busy 123.656014ms which exceeds the timeout of 100ms11461792585599 service service: Updating sync status of z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji to e5c200775dc6da38306f62c995df67a1ab1bf62d11471792585599 service service: Skipping fetch for rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji, all refs are already in storage11481792585599 service reactor: Service was busy 151.93397ms which exceeds the timeout of 100ms11491792585599 service service: Fetched rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji from z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z successfully11501792585599 service service: Nothing to announce, no refs were updated..11511152thread 'commands::id::rad_id_threshold' (18220) panicked at crates/radicle-cli-test/src/lib.rs:504:36:11531154--- Expected1155++++ actual: stdout1156 1 - Fetching rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji from the network, found 2 potential seed(s).1157 2 - ✓ Target met: 2 seed(s)1158 1 + Fetching rad:z42hL2jL4XNk6K8oHQaSWfMgCL7ji from the network, found 1 potential seed(s).1159 2 + ✓ Target met: 1 seed(s)1160 3 3 | 🌱 Fetched from z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z1161 4 - 🌱 Fetched from z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk1162116311641165note: run with `RUST_BACKTRACE=1` environment variable to display a backtrace11661792585599 test: Node z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk shutting down..11671792585599 commands::id::rad_id_threshold reactor::controller: Initiating reactor shutdown…11681792585599 control control: Received `{"command":"shutdown"}` on control socket11691792585599 service reactor: Shutdown11701792585599 control control: Shutdown requested..11711792585599 runtime pool: Worker pool shutting down..11721792585599 runtime node: Node shutdown completed for z6Mkt67GdsW7715MEfRuP4pSZxJRJh6kj6Y48WRqVv4N1tRk11731792585599 test: Node z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z shutting down..11741792585599 commands::id::rad_id_threshold reactor::controller: Initiating reactor shutdown…11751792585599 service reactor: Shutdown11761792585599 control control: Received `{"command":"shutdown"}` on control socket11771792585599 control control: Shutdown requested..11781792585599 runtime pool: Worker pool shutting down..11791792585599 runtime node: Node shutdown completed for z6Mkux1aUQD2voWWukVb5nNUR7thrHveQG4pDQua8nVhib7Z11801792585599 test: Node z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi shutting down..11811792585599 commands::id::rad_id_threshold reactor::controller: Initiating reactor shutdown…11821792585599 control control: Received `{"command":"shutdown"}` on control socket11831792585599 control control: Shutdown requested..11841792585599 service reactor: Shutdown11851792585599 runtime pool: Worker pool shutting down..11861792585599 runtime node: Node shutdown completed for z6MknSLrJoTcukLrE435hVNQT4JUhbvWLX4kUzqkEStBU8Vi118711881189failures:1190 commands::id::rad_id_threshold11911192test result: FAILED. 120 passed; 1 failed; 3 ignored; 0 measured; 2 filtered out; finished in 119.83s11931194error: test failed, to rerun pass `-p radicle-cli --test commands`