[10:48:42.353] New invocation is queued and will start shortly
[10:48:42.353] Triggered by user:v8-ci-builder@chops-service-accounts.iam.gserviceaccount.com
[10:48:43.772] Starting the invocation (attempt 1)
[10:48:43.811] Popped buildset tag "buildset:commit/gitiles/chromium.googlesource.com/v8/v8/+/25647e8e5d9667d430903c0d0351c99d7086c878"
[10:48:43.811] Reconstructed gitiles commit from tags
[10:48:43.811] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[10:48:43.811] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[10:48:43.812] Buildbucket request:
{
"requestId": "8983158665898316400",
"builder": {
"project": "v8",
"bucket": "ci.br.stable",
"builder": "V8 Linux64 - debug"
},
"properties": {
"$recipe_engine/scheduler": {
"hostname": "luci-scheduler.appspot.com",
"triggers": [
{
"buildbucket": {
"properties": {
"newest_gitiles_revision": "25647e8e5d9667d430903c0d0351c99d7086c878",
"oldest_gitiles_revision": "25647e8e5d9667d430903c0d0351c99d7086c878",
"parent_build": "https://cr-buildbucket.appspot.com/build/8817728951685239985",
"parent_buildername": "V8 Linux64 - debug builder",
"parent_gn_args": [
"is_component_build = true",
"is_debug = true",
"target_cpu = \"x64\"",
"use_goma = true",
"v8_enable_backtrace = true",
"v8_enable_google_benchmark = true",
"v8_enable_slow_dchecks = true"
],
"parent_got_revision": "25647e8e5d9667d430903c0d0351c99d7086c878",
"parent_got_revision_cp": "refs/branch-heads/10.0@{#20}",
"parent_test_spec": {
"swarming_dimensions": {
"cpu": "x86-64-avx2",
"os": "Ubuntu-18.04"
},
"swarming_task_attrs": {
},
"tests": [
[
"benchmarks",
1,
null,
"",
[
],
{
},
{
}
],
[
"benchmarks",
1,
"extra",
"extra",
[
],
{
},
{
}
],
[
"mjsunit_sp_frame_access",
1,
null,
"",
[
],
{
},
{
}
],
[
"mozilla",
1,
null,
"",
[
],
{
},
{
}
],
[
"mozilla",
1,
"extra",
"extra",
[
],
{
},
{
}
],
[
"optimize_for_size",
1,
null,
"",
[
],
{
},
{
}
],
[
"test262",
7,
null,
"",
[
],
{
},
{
}
],
[
"test262",
5,
"extra",
"extra",
[
],
{
},
{
}
],
[
"v8testing",
2,
null,
"",
[
],
{
},
{
}
],
[
"v8testing",
2,
"extra",
"extra",
[
],
{
},
{
}
],
[
"v8testing",
1,
"minor_mc",
"minor_mc",
[
],
{
},
{
}
],
[
"v8testing",
1,
"no_lfa",
"no_lfa",
[
],
{
},
{
}
],
[
"v8testing",
1,
"slow_path",
"slow_path",
[
],
{
},
{
}
],
[
"v8testing",
1,
"stress_instruction_scheduling",
"stress_instruction_scheduling",
[
],
{
},
{
}
],
[
"v8testing",
1,
"stress_concurrent_allocation",
"stress_concurrent_allocation",
[
],
{
},
{
}
],
[
"v8testing",
1,
"stress_concurrent_inlining",
"stress_concurrent_inlining",
[
],
{
},
{
}
],
[
"mozilla",
1,
null,
"noavx",
[
"--extra-flags",
"--noenable-avx"
],
{
},
{
}
],
[
"test262",
1,
"default",
"noavx",
[
"--extra-flags",
"--noenable-avx"
],
{
},
{
}
],
[
"v8testing",
2,
null,
"noavx",
[
"--extra-flags",
"--noenable-avx"
],
{
},
{
}
]
]
},
"revision": "25647e8e5d9667d430903c0d0351c99d7086c878",
"swarm_hashes": {
"benchmarks": "01001f8ec84256dfc5261408b7ff171fe53f1d31497f7ec8742b8dd2a92ce591/318",
"bot_default": "6e7e72f2990fa04fbc214caf37f3979297b7acaccacd14f10afb2855757a0c7d/319",
"jsfunfuzz": "a586f818abdbf54198ece06abd303e025b075e373d71a2d5a6f4285cae48b14b/156",
"mjsunit": "c9cfb79b3e305b8ce99abc3592cada53769148acaf16a18274e707113b296033/318",
"mozilla": "9bc9d75e589f6eca687b1b7350944f192b3a4c8f986b31f70bc35bd38dc942e5/318",
"optimize_for_size": "be8ba4b019b817dcfa7f67a360014a7a7ccb3398d6953d59c7a33a80993a6f97/319",
"test262": "b25b207f5b0e6a6012ac0620424a282b91d24f9772396b8eb971bd8b6d1ee8ee/403"
}
},
"tags": [
"buildset:commit/gitiles/chromium.googlesource.com/v8/v8/+/25647e8e5d9667d430903c0d0351c99d7086c878",
"gitiles_ref:refs/branch-heads/10.0",
"parent_buildername:V8 Linux64 - debug builder",
"parent_buildnumber:270",
"user_agent:recipe"
]
},
"id": "fefe9a35-d27d-4d5b-b3fe-1a2a759c07d8",
"title": "V8 Linux64 - debug builder/270"
}
]
},
"newest_gitiles_revision": "25647e8e5d9667d430903c0d0351c99d7086c878",
"oldest_gitiles_revision": "25647e8e5d9667d430903c0d0351c99d7086c878",
"parent_build": "https://cr-buildbucket.appspot.com/build/8817728951685239985",
"parent_buildername": "V8 Linux64 - debug builder",
"parent_gn_args": [
"is_component_build = true",
"is_debug = true",
"target_cpu = \"x64\"",
"use_goma = true",
"v8_enable_backtrace = true",
"v8_enable_google_benchmark = true",
"v8_enable_slow_dchecks = true"
],
"parent_got_revision": "25647e8e5d9667d430903c0d0351c99d7086c878",
"parent_got_revision_cp": "refs/branch-heads/10.0@{#20}",
"parent_test_spec": {
"swarming_dimensions": {
"cpu": "x86-64-avx2",
"os": "Ubuntu-18.04"
},
"swarming_task_attrs": {
},
"tests": [
[
"benchmarks",
1,
null,
"",
[
],
{
},
{
}
],
[
"benchmarks",
1,
"extra",
"extra",
[
],
{
},
{
}
],
[
"mjsunit_sp_frame_access",
1,
null,
"",
[
],
{
},
{
}
],
[
"mozilla",
1,
null,
"",
[
],
{
},
{
}
],
[
"mozilla",
1,
"extra",
"extra",
[
],
{
},
{
}
],
[
"optimize_for_size",
1,
null,
"",
[
],
{
},
{
}
],
[
"test262",
7,
null,
"",
[
],
{
},
{
}
],
[
"test262",
5,
"extra",
"extra",
[
],
{
},
{
}
],
[
"v8testing",
2,
null,
"",
[
],
{
},
{
}
],
[
"v8testing",
2,
"extra",
"extra",
[
],
{
},
{
}
],
[
"v8testing",
1,
"minor_mc",
"minor_mc",
[
],
{
},
{
}
],
[
"v8testing",
1,
"no_lfa",
"no_lfa",
[
],
{
},
{
}
],
[
"v8testing",
1,
"slow_path",
"slow_path",
[
],
{
},
{
}
],
[
"v8testing",
1,
"stress_instruction_scheduling",
"stress_instruction_scheduling",
[
],
{
},
{
}
],
[
"v8testing",
1,
"stress_concurrent_allocation",
"stress_concurrent_allocation",
[
],
{
},
{
}
],
[
"v8testing",
1,
"stress_concurrent_inlining",
"stress_concurrent_inlining",
[
],
{
},
{
}
],
[
"mozilla",
1,
null,
"noavx",
[
"--extra-flags",
"--noenable-avx"
],
{
},
{
}
],
[
"test262",
1,
"default",
"noavx",
[
"--extra-flags",
"--noenable-avx"
],
{
},
{
}
],
[
"v8testing",
2,
null,
"noavx",
[
"--extra-flags",
"--noenable-avx"
],
{
},
{
}
]
]
},
"swarm_hashes": {
"benchmarks": "01001f8ec84256dfc5261408b7ff171fe53f1d31497f7ec8742b8dd2a92ce591/318",
"bot_default": "6e7e72f2990fa04fbc214caf37f3979297b7acaccacd14f10afb2855757a0c7d/319",
"jsfunfuzz": "a586f818abdbf54198ece06abd303e025b075e373d71a2d5a6f4285cae48b14b/156",
"mjsunit": "c9cfb79b3e305b8ce99abc3592cada53769148acaf16a18274e707113b296033/318",
"mozilla": "9bc9d75e589f6eca687b1b7350944f192b3a4c8f986b31f70bc35bd38dc942e5/318",
"optimize_for_size": "be8ba4b019b817dcfa7f67a360014a7a7ccb3398d6953d59c7a33a80993a6f97/319",
"test262": "b25b207f5b0e6a6012ac0620424a282b91d24f9772396b8eb971bd8b6d1ee8ee/403"
}
},
"gitilesCommit": {
"host": "chromium.googlesource.com",
"project": "v8/v8",
"id": "25647e8e5d9667d430903c0d0351c99d7086c878",
"ref": "refs/branch-heads/10.0"
},
"tags": [
{
"key": "scheduler_invocation_id",
"value": "8983158665898316400"
},
{
"key": "scheduler_job_id",
"value": "v8/ci.br.stable-V8 Linux64 - debug"
},
{
"key": "user_agent",
"value": "luci-scheduler"
},
{
"key": "parent_buildername",
"value": "V8 Linux64 - debug builder"
},
{
"key": "parent_buildnumber",
"value": "270"
},
{
"key": "user_agent",
"value": "recipe"
}
],
"notify": {
"pubsubTopic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
}
}
[10:48:45.458] Scheduled build:
{
"id": "8817728602543541585",
"builder": {
"project": "v8",
"bucket": "ci.br.stable",
"builder": "V8 Linux64 - debug"
},
"number": 253,
"createdBy": "project:v8",
"createTime": "2022-04-05T10:48:44.921659188Z",
"updateTime": "2022-04-05T10:48:44.921659188Z",
"status": "SCHEDULED",
"input": {
"gitilesCommit": {
"host": "chromium.googlesource.com",
"project": "v8/v8",
"id": "25647e8e5d9667d430903c0d0351c99d7086c878",
"ref": "refs/branch-heads/10.0"
}
}
}
[10:48:45.458] Task URL: https://cr-buildbucket.appspot.com/build/8817728602543541585
[10:48:45.458] Scheduling timer "check-buildbucket-build-status" (v8/ci.br.stable-V8 Linux64 - debug:8983158665898316400:2:0) after 8m46s
[10:57:31.571] Handling timer "check-buildbucket-build-status" (v8/ci.br.stable-V8 Linux64 - debug:8983158665898316400:2:0)
[10:57:31.603] Build status: SCHEDULED
[10:57:31.603] Scheduling timer "check-buildbucket-build-status" (v8/ci.br.stable-V8 Linux64 - debug:8983158665898316400:3:0) after 4m26s
[11:01:57.655] Handling timer "check-buildbucket-build-status" (v8/ci.br.stable-V8 Linux64 - debug:8983158665898316400:3:0)
[11:01:57.687] Build status: SCHEDULED
[11:01:57.687] Scheduling timer "check-buildbucket-build-status" (v8/ci.br.stable-V8 Linux64 - debug:8983158665898316400:4:0) after 9m36s
[11:11:33.761] Handling timer "check-buildbucket-build-status" (v8/ci.br.stable-V8 Linux64 - debug:8983158665898316400:4:0)
[11:11:33.794] Build status: SCHEDULED
[11:11:33.794] Scheduling timer "check-buildbucket-build-status" (v8/ci.br.stable-V8 Linux64 - debug:8983158665898316400:5:0) after 9m8s
[11:20:41.930] Handling timer "check-buildbucket-build-status" (v8/ci.br.stable-V8 Linux64 - debug:8983158665898316400:5:0)
[11:20:41.972] Build status: SCHEDULED
[11:20:41.972] Scheduling timer "check-buildbucket-build-status" (v8/ci.br.stable-V8 Linux64 - debug:8983158665898316400:6:0) after 5m39s
[11:26:21.190] Handling timer "check-buildbucket-build-status" (v8/ci.br.stable-V8 Linux64 - debug:8983158665898316400:6:0)
[11:26:21.220] Build status: SCHEDULED
[11:26:21.220] Scheduling timer "check-buildbucket-build-status" (v8/ci.br.stable-V8 Linux64 - debug:8983158665898316400:7:0) after 2m17s
[11:28:38.423] Handling timer "check-buildbucket-build-status" (v8/ci.br.stable-V8 Linux64 - debug:8983158665898316400:7:0)
[11:28:38.458] Build status: SCHEDULED
[11:28:38.458] Scheduling timer "check-buildbucket-build-status" (v8/ci.br.stable-V8 Linux64 - debug:8983158665898316400:8:0) after 6m18s
[11:34:56.480] Handling timer "check-buildbucket-build-status" (v8/ci.br.stable-V8 Linux64 - debug:8983158665898316400:8:0)
[11:34:56.513] Build status: SCHEDULED
[11:34:56.513] Scheduling timer "check-buildbucket-build-status" (v8/ci.br.stable-V8 Linux64 - debug:8983158665898316400:9:0) after 4m40s
[11:39:36.534] Handling timer "check-buildbucket-build-status" (v8/ci.br.stable-V8 Linux64 - debug:8983158665898316400:9:0)
[11:39:36.570] Build status: SCHEDULED
[11:39:36.570] Scheduling timer "check-buildbucket-build-status" (v8/ci.br.stable-V8 Linux64 - debug:8983158665898316400:10:0) after 8m2s
[11:47:38.753] Handling timer "check-buildbucket-build-status" (v8/ci.br.stable-V8 Linux64 - debug:8983158665898316400:10:0)
[11:47:38.857] Build status: SCHEDULED
[11:47:38.857] Scheduling timer "check-buildbucket-build-status" (v8/ci.br.stable-V8 Linux64 - debug:8983158665898316400:11:0) after 3m38s
[11:51:16.879] Handling timer "check-buildbucket-build-status" (v8/ci.br.stable-V8 Linux64 - debug:8983158665898316400:11:0)
[11:51:16.912] Build status: SCHEDULED
[11:51:16.912] Scheduling timer "check-buildbucket-build-status" (v8/ci.br.stable-V8 Linux64 - debug:8983158665898316400:12:0) after 8m19s
[11:59:36.019] Handling timer "check-buildbucket-build-status" (v8/ci.br.stable-V8 Linux64 - debug:8983158665898316400:12:0)
[11:59:36.048] Build status: SCHEDULED
[11:59:36.048] Scheduling timer "check-buildbucket-build-status" (v8/ci.br.stable-V8 Linux64 - debug:8983158665898316400:13:0) after 9m50s
[12:07:17.273] Received PubSub notification, asking Buildbucket for the build status
[12:07:17.296] Build status: STARTED
[12:09:26.076] Handling timer "check-buildbucket-build-status" (v8/ci.br.stable-V8 Linux64 - debug:8983158665898316400:13:0)
[12:09:26.109] Build status: STARTED
[12:09:26.109] Scheduling timer "check-buildbucket-build-status" (v8/ci.br.stable-V8 Linux64 - debug:8983158665898316400:15:0) after 6m45s
[12:16:11.495] Handling timer "check-buildbucket-build-status" (v8/ci.br.stable-V8 Linux64 - debug:8983158665898316400:15:0)
[12:16:11.521] Build status: STARTED
[12:16:11.521] Scheduling timer "check-buildbucket-build-status" (v8/ci.br.stable-V8 Linux64 - debug:8983158665898316400:16:0) after 2m42s
[12:18:53.509] Handling timer "check-buildbucket-build-status" (v8/ci.br.stable-V8 Linux64 - debug:8983158665898316400:16:0)
[12:18:53.543] Build status: STARTED
[12:18:53.543] Scheduling timer "check-buildbucket-build-status" (v8/ci.br.stable-V8 Linux64 - debug:8983158665898316400:17:0) after 4m45s
[12:23:38.544] Handling timer "check-buildbucket-build-status" (v8/ci.br.stable-V8 Linux64 - debug:8983158665898316400:17:0)
[12:23:38.653] Build status: STARTED
[12:23:38.653] Scheduling timer "check-buildbucket-build-status" (v8/ci.br.stable-V8 Linux64 - debug:8983158665898316400:18:0) after 3m5s
[12:26:43.672] Handling timer "check-buildbucket-build-status" (v8/ci.br.stable-V8 Linux64 - debug:8983158665898316400:18:0)
[12:26:43.701] Build status: STARTED
[12:26:43.701] Scheduling timer "check-buildbucket-build-status" (v8/ci.br.stable-V8 Linux64 - debug:8983158665898316400:19:0) after 2m31s
[12:29:14.718] Handling timer "check-buildbucket-build-status" (v8/ci.br.stable-V8 Linux64 - debug:8983158665898316400:19:0)
[12:29:14.757] Build status: STARTED
[12:29:14.757] Scheduling timer "check-buildbucket-build-status" (v8/ci.br.stable-V8 Linux64 - debug:8983158665898316400:20:0) after 5m13s
[12:34:27.855] Handling timer "check-buildbucket-build-status" (v8/ci.br.stable-V8 Linux64 - debug:8983158665898316400:20:0)
[12:34:28.050] Build status: STARTED
[12:34:28.050] Scheduling timer "check-buildbucket-build-status" (v8/ci.br.stable-V8 Linux64 - debug:8983158665898316400:21:0) after 7m38s
[12:42:06.135] Handling timer "check-buildbucket-build-status" (v8/ci.br.stable-V8 Linux64 - debug:8983158665898316400:21:0)
[12:42:06.304] Build status: STARTED
[12:42:06.304] Scheduling timer "check-buildbucket-build-status" (v8/ci.br.stable-V8 Linux64 - debug:8983158665898316400:22:0) after 9m37s
[12:45:00.604] Received PubSub notification, asking Buildbucket for the build status
[12:45:00.630] Build:
{
"id": "8817728602543541585",
"builder": {
"project": "v8",
"bucket": "ci.br.stable",
"builder": "V8 Linux64 - debug"
},
"number": 253,
"createdBy": "project:v8",
"createTime": "2022-04-05T10:48:44.921659188Z",
"startTime": "2022-04-05T12:07:12.872156Z",
"endTime": "2022-04-05T12:44:59.620469967Z",
"updateTime": "2022-04-05T12:44:59.620469967Z",
"status": "SUCCESS",
"input": {
"gitilesCommit": {
"host": "chromium.googlesource.com",
"project": "v8/v8",
"id": "25647e8e5d9667d430903c0d0351c99d7086c878",
"ref": "refs/branch-heads/10.0"
}
}
}
[12:45:00.630] Invocation finished in 1h56m18.292543131s with status SUCCEEDED