[16:23:02.878] New invocation is queued and will start shortly
[16:23:02.878] Triggered by user:v8-ci-builder@chops-service-accounts.iam.gserviceaccount.com
[16:23:04.171] Starting the invocation (attempt 1)
[16:23:04.207] Popped buildset tag "buildset:commit/gitiles/chromium.googlesource.com/v8/v8/+/aeeab6305d9717ff0ddb88626f108db2ad7f9526"
[16:23:04.207] Reconstructed gitiles commit from tags
[16:23:04.207] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[16:23:04.207] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[16:23:04.208] Buildbucket request:
{
"requestId": "8956320928859405280",
"builder": {
"project": "v8",
"bucket": "ci",
"builder": "V8 Linux64 - debug - perfetto"
},
"properties": {
"$recipe_engine/scheduler": {
"hostname": "luci-scheduler.appspot.com",
"invocation": "8956320928859405280",
"job": "v8/V8 Linux64 - debug - perfetto",
"triggers": [
{
"buildbucket": {
"properties": {
"newest_gitiles_revision": "919166e9ef0621d66ab4f6774cfca32ca9394b85",
"oldest_gitiles_revision": "919166e9ef0621d66ab4f6774cfca32ca9394b85",
"parent_build": "https://cr-buildbucket.appspot.com/build/8790893526437363265",
"parent_buildername": "V8 Linux64 - debug - perfetto - builder",
"parent_gn_args": [
"is_component_build = true",
"is_debug = true",
"target_cpu = \"x64\"",
"use_goma = false",
"use_remoteexec = true",
"v8_enable_backtrace = true",
"v8_enable_google_benchmark = true",
"v8_enable_slow_dchecks = true",
"v8_use_perfetto = true"
],
"parent_got_revision": "919166e9ef0621d66ab4f6774cfca32ca9394b85",
"parent_got_revision_cp": "refs/heads/main@{#85503}",
"parent_test_spec": {
"swarming_dimensions": {
"os": "Ubuntu-18.04"
},
"swarming_task_attrs": {
"expiration": 14400,
"hard_timeout": 3600,
"priority": 35
},
"tests": [
[
"v8testing",
2,
null,
"",
[
],
{
},
{
}
]
]
},
"revision": "919166e9ef0621d66ab4f6774cfca32ca9394b85",
"swarm_hashes": {
"bot_default": "f7a6d85f7079424615d0cfcee0e1c5e3813e6c85e82604e21e217a41995d9ef9/320"
}
},
"tags": [
"buildset:commit/gitiles/chromium.googlesource.com/v8/v8/+/919166e9ef0621d66ab4f6774cfca32ca9394b85",
"gitiles_ref:refs/heads/main",
"parent_buildername:V8 Linux64 - debug - perfetto - builder",
"parent_buildnumber:23548",
"user_agent:recipe"
]
},
"id": "42fe5234-0193-4d68-8829-fd831ef3548a",
"title": "V8 Linux64 - debug - perfetto - builder/23548"
},
{
"buildbucket": {
"properties": {
"newest_gitiles_revision": "f4900cf92b51d94744451ad5ea9d2ef629011918",
"oldest_gitiles_revision": "f4900cf92b51d94744451ad5ea9d2ef629011918",
"parent_build": "https://cr-buildbucket.appspot.com/build/8790892588608190513",
"parent_buildername": "V8 Linux64 - debug - perfetto - builder",
"parent_gn_args": [
"is_component_build = true",
"is_debug = true",
"target_cpu = \"x64\"",
"use_goma = false",
"use_remoteexec = true",
"v8_enable_backtrace = true",
"v8_enable_google_benchmark = true",
"v8_enable_slow_dchecks = true",
"v8_use_perfetto = true"
],
"parent_got_revision": "f4900cf92b51d94744451ad5ea9d2ef629011918",
"parent_got_revision_cp": "refs/heads/main@{#85504}",
"parent_test_spec": {
"swarming_dimensions": {
"os": "Ubuntu-18.04"
},
"swarming_task_attrs": {
"expiration": 14400,
"hard_timeout": 3600,
"priority": 35
},
"tests": [
[
"v8testing",
2,
null,
"",
[
],
{
},
{
}
]
]
},
"revision": "f4900cf92b51d94744451ad5ea9d2ef629011918",
"swarm_hashes": {
"bot_default": "d5c7b1dda75bd476c23d0d0f803644b7a5e199bc1e183918048c6ee70978097b/320"
}
},
"tags": [
"buildset:commit/gitiles/chromium.googlesource.com/v8/v8/+/f4900cf92b51d94744451ad5ea9d2ef629011918",
"gitiles_ref:refs/heads/main",
"parent_buildername:V8 Linux64 - debug - perfetto - builder",
"parent_buildnumber:23549",
"user_agent:recipe"
]
},
"id": "9eb4c24b-e968-46bb-b634-a7c1958ccfd0",
"title": "V8 Linux64 - debug - perfetto - builder/23549"
},
{
"buildbucket": {
"properties": {
"newest_gitiles_revision": "aeeab6305d9717ff0ddb88626f108db2ad7f9526",
"oldest_gitiles_revision": "aeeab6305d9717ff0ddb88626f108db2ad7f9526",
"parent_build": "https://cr-buildbucket.appspot.com/build/8790891898574003537",
"parent_buildername": "V8 Linux64 - debug - perfetto - builder",
"parent_gn_args": [
"is_component_build = true",
"is_debug = true",
"target_cpu = \"x64\"",
"use_goma = false",
"use_remoteexec = true",
"v8_enable_backtrace = true",
"v8_enable_google_benchmark = true",
"v8_enable_slow_dchecks = true",
"v8_use_perfetto = true"
],
"parent_got_revision": "aeeab6305d9717ff0ddb88626f108db2ad7f9526",
"parent_got_revision_cp": "refs/heads/main@{#85505}",
"parent_test_spec": {
"swarming_dimensions": {
"os": "Ubuntu-18.04"
},
"swarming_task_attrs": {
"expiration": 14400,
"hard_timeout": 3600,
"priority": 35
},
"tests": [
[
"v8testing",
2,
null,
"",
[
],
{
},
{
}
]
]
},
"revision": "aeeab6305d9717ff0ddb88626f108db2ad7f9526",
"swarm_hashes": {
"bot_default": "1bcc635d990c40be42f73f3b5a10682c7a00730369df93ca1f9050d0d2f23190/320"
}
},
"tags": [
"buildset:commit/gitiles/chromium.googlesource.com/v8/v8/+/aeeab6305d9717ff0ddb88626f108db2ad7f9526",
"gitiles_ref:refs/heads/main",
"parent_buildername:V8 Linux64 - debug - perfetto - builder",
"parent_buildnumber:23550",
"user_agent:recipe"
]
},
"id": "4e5cbf23-1907-4fe2-acff-70b202b34933",
"title": "V8 Linux64 - debug - perfetto - builder/23550"
}
]
},
"newest_gitiles_revision": "aeeab6305d9717ff0ddb88626f108db2ad7f9526",
"oldest_gitiles_revision": "aeeab6305d9717ff0ddb88626f108db2ad7f9526",
"parent_build": "https://cr-buildbucket.appspot.com/build/8790891898574003537",
"parent_buildername": "V8 Linux64 - debug - perfetto - builder",
"parent_gn_args": [
"is_component_build = true",
"is_debug = true",
"target_cpu = \"x64\"",
"use_goma = false",
"use_remoteexec = true",
"v8_enable_backtrace = true",
"v8_enable_google_benchmark = true",
"v8_enable_slow_dchecks = true",
"v8_use_perfetto = true"
],
"parent_got_revision": "aeeab6305d9717ff0ddb88626f108db2ad7f9526",
"parent_got_revision_cp": "refs/heads/main@{#85505}",
"parent_test_spec": {
"swarming_dimensions": {
"os": "Ubuntu-18.04"
},
"swarming_task_attrs": {
"expiration": 14400,
"hard_timeout": 3600,
"priority": 35
},
"tests": [
[
"v8testing",
2,
null,
"",
[
],
{
},
{
}
]
]
},
"swarm_hashes": {
"bot_default": "1bcc635d990c40be42f73f3b5a10682c7a00730369df93ca1f9050d0d2f23190/320"
}
},
"gitilesCommit": {
"host": "chromium.googlesource.com",
"project": "v8/v8",
"id": "aeeab6305d9717ff0ddb88626f108db2ad7f9526",
"ref": "refs/heads/main"
},
"tags": [
{
"key": "scheduler_invocation_id",
"value": "8956320928859405280"
},
{
"key": "scheduler_job_id",
"value": "v8/V8 Linux64 - debug - perfetto"
},
{
"key": "user_agent",
"value": "luci-scheduler"
},
{
"key": "parent_buildername",
"value": "V8 Linux64 - debug - perfetto - builder"
},
{
"key": "parent_buildnumber",
"value": "23550"
},
{
"key": "user_agent",
"value": "recipe"
}
],
"notify": {
"pubsubTopic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
}
}
[16:23:04.713] Scheduled build:
{
"id": "8790890866704556673",
"builder": {
"project": "v8",
"bucket": "ci",
"builder": "V8 Linux64 - debug - perfetto"
},
"number": 16367,
"createdBy": "project:v8",
"createTime": "2023-01-26T16:23:04.301946405Z",
"updateTime": "2023-01-26T16:23:04.301946405Z",
"status": "SCHEDULED",
"input": {
"gitilesCommit": {
"host": "chromium.googlesource.com",
"project": "v8/v8",
"id": "aeeab6305d9717ff0ddb88626f108db2ad7f9526",
"ref": "refs/heads/main"
}
}
}
[16:23:04.713] Task URL: https://cr-buildbucket.appspot.com/build/8790890866704556673
[16:23:04.713] Scheduling timer "check-buildbucket-build-status" (v8/V8 Linux64 - debug - perfetto:8956320928859405280:2:0) after 3m52s
[16:23:09.919] Received PubSub notification, asking Buildbucket for the build status
[16:23:09.949] Build status: STARTED
[16:26:56.747] Handling timer "check-buildbucket-build-status" (v8/V8 Linux64 - debug - perfetto:8956320928859405280:2:0)
[16:26:56.806] Build status: STARTED
[16:26:56.806] Scheduling timer "check-buildbucket-build-status" (v8/V8 Linux64 - debug - perfetto:8956320928859405280:4:0) after 8m8s
[16:35:05.026] Handling timer "check-buildbucket-build-status" (v8/V8 Linux64 - debug - perfetto:8956320928859405280:4:0)
[16:35:05.091] Build status: STARTED
[16:35:05.091] Scheduling timer "check-buildbucket-build-status" (v8/V8 Linux64 - debug - perfetto:8956320928859405280:5:0) after 3m31s
[16:38:36.204] Handling timer "check-buildbucket-build-status" (v8/V8 Linux64 - debug - perfetto:8956320928859405280:5:0)
[16:38:36.227] Build status: STARTED
[16:38:36.227] Scheduling timer "check-buildbucket-build-status" (v8/V8 Linux64 - debug - perfetto:8956320928859405280:6:0) after 5m2s
[16:43:38.297] Handling timer "check-buildbucket-build-status" (v8/V8 Linux64 - debug - perfetto:8956320928859405280:6:0)
[16:43:38.333] Build status: STARTED
[16:43:38.333] Scheduling timer "check-buildbucket-build-status" (v8/V8 Linux64 - debug - perfetto:8956320928859405280:7:0) after 1m6s
[16:44:44.464] Handling timer "check-buildbucket-build-status" (v8/V8 Linux64 - debug - perfetto:8956320928859405280:7:0)
[16:44:44.488] Build status: STARTED
[16:44:44.488] Scheduling timer "check-buildbucket-build-status" (v8/V8 Linux64 - debug - perfetto:8956320928859405280:8:0) after 2m45s
[16:47:29.609] Handling timer "check-buildbucket-build-status" (v8/V8 Linux64 - debug - perfetto:8956320928859405280:8:0)
[16:47:29.635] Build status: STARTED
[16:47:29.635] Scheduling timer "check-buildbucket-build-status" (v8/V8 Linux64 - debug - perfetto:8956320928859405280:9:0) after 9m1s
[16:56:30.664] Handling timer "check-buildbucket-build-status" (v8/V8 Linux64 - debug - perfetto:8956320928859405280:9:0)
[16:56:30.701] Build status: STARTED
[16:56:30.701] Scheduling timer "check-buildbucket-build-status" (v8/V8 Linux64 - debug - perfetto:8956320928859405280:10:0) after 1m3s
[16:57:33.749] Handling timer "check-buildbucket-build-status" (v8/V8 Linux64 - debug - perfetto:8956320928859405280:10:0)
[16:57:34.010] Build status: STARTED
[16:57:34.010] Scheduling timer "check-buildbucket-build-status" (v8/V8 Linux64 - debug - perfetto:8956320928859405280:11:0) after 8m44s
[17:06:18.030] Handling timer "check-buildbucket-build-status" (v8/V8 Linux64 - debug - perfetto:8956320928859405280:11:0)
[17:06:18.070] Build status: STARTED
[17:06:18.070] Scheduling timer "check-buildbucket-build-status" (v8/V8 Linux64 - debug - perfetto:8956320928859405280:12:0) after 3m12s
[17:09:30.161] Handling timer "check-buildbucket-build-status" (v8/V8 Linux64 - debug - perfetto:8956320928859405280:12:0)
[17:09:30.261] Build status: STARTED
[17:09:30.261] Scheduling timer "check-buildbucket-build-status" (v8/V8 Linux64 - debug - perfetto:8956320928859405280:13:0) after 1m44s
[17:11:14.357] Handling timer "check-buildbucket-build-status" (v8/V8 Linux64 - debug - perfetto:8956320928859405280:13:0)
[17:11:14.389] Build status: STARTED
[17:11:14.389] Scheduling timer "check-buildbucket-build-status" (v8/V8 Linux64 - debug - perfetto:8956320928859405280:14:0) after 7m54s
[17:19:08.470] Handling timer "check-buildbucket-build-status" (v8/V8 Linux64 - debug - perfetto:8956320928859405280:14:0)
[17:19:08.505] Build status: STARTED
[17:19:08.506] Scheduling timer "check-buildbucket-build-status" (v8/V8 Linux64 - debug - perfetto:8956320928859405280:15:0) after 5m6s
[17:24:14.555] Handling timer "check-buildbucket-build-status" (v8/V8 Linux64 - debug - perfetto:8956320928859405280:15:0)
[17:24:14.580] Build status: STARTED
[17:24:14.580] Scheduling timer "check-buildbucket-build-status" (v8/V8 Linux64 - debug - perfetto:8956320928859405280:16:0) after 8m47s
[17:33:01.658] Handling timer "check-buildbucket-build-status" (v8/V8 Linux64 - debug - perfetto:8956320928859405280:16:0)
[17:33:01.757] Build status: STARTED
[17:33:01.757] Scheduling timer "check-buildbucket-build-status" (v8/V8 Linux64 - debug - perfetto:8956320928859405280:17:0) after 5m28s
[17:38:29.842] Handling timer "check-buildbucket-build-status" (v8/V8 Linux64 - debug - perfetto:8956320928859405280:17:0)
[17:38:29.863] Build status: STARTED
[17:38:29.863] Scheduling timer "check-buildbucket-build-status" (v8/V8 Linux64 - debug - perfetto:8956320928859405280:18:0) after 2m56s
[17:41:25.933] Handling timer "check-buildbucket-build-status" (v8/V8 Linux64 - debug - perfetto:8956320928859405280:18:0)
[17:41:25.957] Build status: STARTED
[17:41:25.957] Scheduling timer "check-buildbucket-build-status" (v8/V8 Linux64 - debug - perfetto:8956320928859405280:19:0) after 4m23s
[17:45:48.974] Handling timer "check-buildbucket-build-status" (v8/V8 Linux64 - debug - perfetto:8956320928859405280:19:0)
[17:45:49.033] Build status: STARTED
[17:45:49.033] Scheduling timer "check-buildbucket-build-status" (v8/V8 Linux64 - debug - perfetto:8956320928859405280:20:0) after 5m50s
[17:51:39.084] Handling timer "check-buildbucket-build-status" (v8/V8 Linux64 - debug - perfetto:8956320928859405280:20:0)
[17:51:39.113] Build status: STARTED
[17:51:39.113] Scheduling timer "check-buildbucket-build-status" (v8/V8 Linux64 - debug - perfetto:8956320928859405280:21:0) after 4m34s
[17:56:13.105] Handling timer "check-buildbucket-build-status" (v8/V8 Linux64 - debug - perfetto:8956320928859405280:21:0)
[17:56:13.139] Build status: STARTED
[17:56:13.139] Scheduling timer "check-buildbucket-build-status" (v8/V8 Linux64 - debug - perfetto:8956320928859405280:22:0) after 8m36s
[18:04:49.247] Handling timer "check-buildbucket-build-status" (v8/V8 Linux64 - debug - perfetto:8956320928859405280:22:0)
[18:04:49.276] Build status: STARTED
[18:04:49.276] Scheduling timer "check-buildbucket-build-status" (v8/V8 Linux64 - debug - perfetto:8956320928859405280:23:0) after 3m20s
[18:08:09.486] Handling timer "check-buildbucket-build-status" (v8/V8 Linux64 - debug - perfetto:8956320928859405280:23:0)
[18:08:09.515] Build status: STARTED
[18:08:09.515] Scheduling timer "check-buildbucket-build-status" (v8/V8 Linux64 - debug - perfetto:8956320928859405280:24:0) after 5m29s
[18:10:22.943] Received PubSub notification, asking Buildbucket for the build status
[18:10:22.991] Build:
{
"id": "8790890866704556673",
"builder": {
"project": "v8",
"bucket": "ci",
"builder": "V8 Linux64 - debug - perfetto"
},
"number": 16367,
"createdBy": "project:v8",
"createTime": "2023-01-26T16:23:04.301946405Z",
"startTime": "2023-01-26T16:23:09.310561Z",
"endTime": "2023-01-26T18:10:22.641175764Z",
"updateTime": "2023-01-26T18:10:22.641175764Z",
"status": "SUCCESS",
"input": {
"gitilesCommit": {
"host": "chromium.googlesource.com",
"project": "v8/v8",
"id": "aeeab6305d9717ff0ddb88626f108db2ad7f9526",
"ref": "refs/heads/main"
}
}
}
[18:10:22.991] Invocation finished in 1h47m20.128709918s with status SUCCEEDED