[23:17:28.522] New invocation is queued and will start shortly
[23:17:30.793] Starting the invocation (attempt 1)
[23:17:30.827] Popped buildset tag "buildset:commit/gitiles/fuchsia.googlesource.com/integration/+/a9a5ab103d23329b40629a1ff686f1841be81da1"
[23:17:30.827] Popped gitiles commit info from properties and tags
[23:17:30.827] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[23:17:30.827] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[23:17:30.828] Buildbucket request:
{
"requestId": "8911992938768694224",
"builder": {
"project": "fuchsia",
"bucket": "global.ci",
"builder": "core.x64-release-minfs"
},
"properties": {
"$recipe_engine/scheduler": {
"hostname": "luci-scheduler.appspot.com",
"invocation": "8911992938768694224",
"job": "fuchsia/core.x64-release-minfs-e5a0ec7f",
"triggers": [
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "6fc469a89bae8b5b0e3c00f69b849c65c33d2ad6"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@6fc469a89bae8b5b0e3c00f69b849c65c33d2ad6",
"title": "6fc469a89bae8b5b0e3c00f69b849c65c33d2ad6",
"url": "https://fuchsia.googlesource.com/integration/+/6fc469a89bae8b5b0e3c00f69b849c65c33d2ad6"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "4de9e1fbd6a238442c528f60405324674f8f2067"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@4de9e1fbd6a238442c528f60405324674f8f2067",
"title": "4de9e1fbd6a238442c528f60405324674f8f2067",
"url": "https://fuchsia.googlesource.com/integration/+/4de9e1fbd6a238442c528f60405324674f8f2067"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "9d5ed5f414440fc354f3962984a383a6f66a626a"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@9d5ed5f414440fc354f3962984a383a6f66a626a",
"title": "9d5ed5f414440fc354f3962984a383a6f66a626a",
"url": "https://fuchsia.googlesource.com/integration/+/9d5ed5f414440fc354f3962984a383a6f66a626a"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "81c10d497829a64eb5db1a55d06ab1e34e661934"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@81c10d497829a64eb5db1a55d06ab1e34e661934",
"title": "81c10d497829a64eb5db1a55d06ab1e34e661934",
"url": "https://fuchsia.googlesource.com/integration/+/81c10d497829a64eb5db1a55d06ab1e34e661934"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "74ff9a558b6736393b059e805558559ef05e7fd3"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@74ff9a558b6736393b059e805558559ef05e7fd3",
"title": "74ff9a558b6736393b059e805558559ef05e7fd3",
"url": "https://fuchsia.googlesource.com/integration/+/74ff9a558b6736393b059e805558559ef05e7fd3"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "f382c10ec28944cfc67e4f5a42a92c54abefa115"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@f382c10ec28944cfc67e4f5a42a92c54abefa115",
"title": "f382c10ec28944cfc67e4f5a42a92c54abefa115",
"url": "https://fuchsia.googlesource.com/integration/+/f382c10ec28944cfc67e4f5a42a92c54abefa115"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "cdd5f1aa822897505e58968e5c1284e2ddd261ee"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@cdd5f1aa822897505e58968e5c1284e2ddd261ee",
"title": "cdd5f1aa822897505e58968e5c1284e2ddd261ee",
"url": "https://fuchsia.googlesource.com/integration/+/cdd5f1aa822897505e58968e5c1284e2ddd261ee"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "b1851dd06207d1bf084e0d7b75e4e2eadb9d215b"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@b1851dd06207d1bf084e0d7b75e4e2eadb9d215b",
"title": "b1851dd06207d1bf084e0d7b75e4e2eadb9d215b",
"url": "https://fuchsia.googlesource.com/integration/+/b1851dd06207d1bf084e0d7b75e4e2eadb9d215b"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "b49fa0294e04858084114d207bc3fbe50083ff8e"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@b49fa0294e04858084114d207bc3fbe50083ff8e",
"title": "b49fa0294e04858084114d207bc3fbe50083ff8e",
"url": "https://fuchsia.googlesource.com/integration/+/b49fa0294e04858084114d207bc3fbe50083ff8e"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "f8d9d3eebf4541c14826cd01814f5943e57dad2a"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@f8d9d3eebf4541c14826cd01814f5943e57dad2a",
"title": "f8d9d3eebf4541c14826cd01814f5943e57dad2a",
"url": "https://fuchsia.googlesource.com/integration/+/f8d9d3eebf4541c14826cd01814f5943e57dad2a"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "d45c1ef25d1b02d6cf8d70e7c5003f2828689d42"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@d45c1ef25d1b02d6cf8d70e7c5003f2828689d42",
"title": "d45c1ef25d1b02d6cf8d70e7c5003f2828689d42",
"url": "https://fuchsia.googlesource.com/integration/+/d45c1ef25d1b02d6cf8d70e7c5003f2828689d42"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "4019fe98bb04e50dab172969957660eb28252a2e"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@4019fe98bb04e50dab172969957660eb28252a2e",
"title": "4019fe98bb04e50dab172969957660eb28252a2e",
"url": "https://fuchsia.googlesource.com/integration/+/4019fe98bb04e50dab172969957660eb28252a2e"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "df040283bc8e6f37783eaca00c17ac55b3c7045b"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@df040283bc8e6f37783eaca00c17ac55b3c7045b",
"title": "df040283bc8e6f37783eaca00c17ac55b3c7045b",
"url": "https://fuchsia.googlesource.com/integration/+/df040283bc8e6f37783eaca00c17ac55b3c7045b"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "8370c08c798587f94ef0dd71837a392f712adfc3"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@8370c08c798587f94ef0dd71837a392f712adfc3",
"title": "8370c08c798587f94ef0dd71837a392f712adfc3",
"url": "https://fuchsia.googlesource.com/integration/+/8370c08c798587f94ef0dd71837a392f712adfc3"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "511dc8d86c38398a93380125b27331fac750756c"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@511dc8d86c38398a93380125b27331fac750756c",
"title": "511dc8d86c38398a93380125b27331fac750756c",
"url": "https://fuchsia.googlesource.com/integration/+/511dc8d86c38398a93380125b27331fac750756c"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "3e3bbef97d8bd3322885373eec21989d8e10740a"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@3e3bbef97d8bd3322885373eec21989d8e10740a",
"title": "3e3bbef97d8bd3322885373eec21989d8e10740a",
"url": "https://fuchsia.googlesource.com/integration/+/3e3bbef97d8bd3322885373eec21989d8e10740a"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "c8afd5568672ce4a247128be51905c1484bfbd98"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@c8afd5568672ce4a247128be51905c1484bfbd98",
"title": "c8afd5568672ce4a247128be51905c1484bfbd98",
"url": "https://fuchsia.googlesource.com/integration/+/c8afd5568672ce4a247128be51905c1484bfbd98"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "aec5eb928cc5fc77b8df60d2fe409cfccb918a64"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@aec5eb928cc5fc77b8df60d2fe409cfccb918a64",
"title": "aec5eb928cc5fc77b8df60d2fe409cfccb918a64",
"url": "https://fuchsia.googlesource.com/integration/+/aec5eb928cc5fc77b8df60d2fe409cfccb918a64"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "bc785ae1776fcf2424d79b1308da85f87202fbaa"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@bc785ae1776fcf2424d79b1308da85f87202fbaa",
"title": "bc785ae1776fcf2424d79b1308da85f87202fbaa",
"url": "https://fuchsia.googlesource.com/integration/+/bc785ae1776fcf2424d79b1308da85f87202fbaa"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "71575f711f8cb68f49617f4a2aa5a5d5b1efd21f"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@71575f711f8cb68f49617f4a2aa5a5d5b1efd21f",
"title": "71575f711f8cb68f49617f4a2aa5a5d5b1efd21f",
"url": "https://fuchsia.googlesource.com/integration/+/71575f711f8cb68f49617f4a2aa5a5d5b1efd21f"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "faf0980c3d92b6fb1b920f665c56f94bec47f2d8"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@faf0980c3d92b6fb1b920f665c56f94bec47f2d8",
"title": "faf0980c3d92b6fb1b920f665c56f94bec47f2d8",
"url": "https://fuchsia.googlesource.com/integration/+/faf0980c3d92b6fb1b920f665c56f94bec47f2d8"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "138b44dedaf33ccba6ab3be4a2cbf4665a99633f"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@138b44dedaf33ccba6ab3be4a2cbf4665a99633f",
"title": "138b44dedaf33ccba6ab3be4a2cbf4665a99633f",
"url": "https://fuchsia.googlesource.com/integration/+/138b44dedaf33ccba6ab3be4a2cbf4665a99633f"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "a9a5ab103d23329b40629a1ff686f1841be81da1"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@a9a5ab103d23329b40629a1ff686f1841be81da1",
"title": "a9a5ab103d23329b40629a1ff686f1841be81da1",
"url": "https://fuchsia.googlesource.com/integration/+/a9a5ab103d23329b40629a1ff686f1841be81da1"
}
]
}
},
"gitilesCommit": {
"host": "fuchsia.googlesource.com",
"project": "integration",
"id": "a9a5ab103d23329b40629a1ff686f1841be81da1",
"ref": "refs/heads/main"
},
"tags": [
{
"key": "scheduler_invocation_id",
"value": "8911992938768694224"
},
{
"key": "scheduler_job_id",
"value": "fuchsia/core.x64-release-minfs-e5a0ec7f"
},
{
"key": "user_agent",
"value": "luci-scheduler"
}
],
"notify": {
"pubsubTopic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
}
}
[23:17:31.276] Scheduled build:
{
"id": "8746562875636235153",
"builder": {
"project": "fuchsia",
"bucket": "global.ci",
"builder": "core.x64-release-minfs"
},
"createdBy": "project:fuchsia",
"createTime": "2024-05-29T23:17:30.881730055Z",
"updateTime": "2024-05-29T23:17:30.881730055Z",
"status": "SCHEDULED",
"input": {
"gitilesCommit": {
"host": "fuchsia.googlesource.com",
"project": "integration",
"id": "a9a5ab103d23329b40629a1ff686f1841be81da1",
"ref": "refs/heads/main"
}
}
}
[23:17:31.276] Task URL: https://cr-buildbucket.appspot.com/build/8746562875636235153
[23:17:31.276] Scheduling timer "check-buildbucket-build-status" (fuchsia/core.x64-release-minfs-e5a0ec7f:8911992938768694224:2:0) after 9m14s
[23:17:32.205] Received PubSub notification, asking Buildbucket for the build status
[23:17:32.229] Build status: SCHEDULED
[23:18:50.413] Received PubSub notification, asking Buildbucket for the build status
[23:18:50.436] Build status: STARTED
[23:26:45.359] Handling timer "check-buildbucket-build-status" (fuchsia/core.x64-release-minfs-e5a0ec7f:8911992938768694224:2:0)
[23:26:45.376] Build status: STARTED
[23:26:45.376] Scheduling timer "check-buildbucket-build-status" (fuchsia/core.x64-release-minfs-e5a0ec7f:8911992938768694224:5:0) after 1m59s
[23:28:44.393] Handling timer "check-buildbucket-build-status" (fuchsia/core.x64-release-minfs-e5a0ec7f:8911992938768694224:5:0)
[23:28:44.409] Build status: STARTED
[23:28:44.409] Scheduling timer "check-buildbucket-build-status" (fuchsia/core.x64-release-minfs-e5a0ec7f:8911992938768694224:6:0) after 4m16s
[23:33:00.427] Handling timer "check-buildbucket-build-status" (fuchsia/core.x64-release-minfs-e5a0ec7f:8911992938768694224:6:0)
[23:33:00.624] Build status: STARTED
[23:33:00.625] Scheduling timer "check-buildbucket-build-status" (fuchsia/core.x64-release-minfs-e5a0ec7f:8911992938768694224:7:0) after 4m28s
[23:37:28.722] Handling timer "check-buildbucket-build-status" (fuchsia/core.x64-release-minfs-e5a0ec7f:8911992938768694224:7:0)
[23:37:28.748] Build status: STARTED
[23:37:28.748] Scheduling timer "check-buildbucket-build-status" (fuchsia/core.x64-release-minfs-e5a0ec7f:8911992938768694224:8:0) after 7m10s
[23:44:38.920] Handling timer "check-buildbucket-build-status" (fuchsia/core.x64-release-minfs-e5a0ec7f:8911992938768694224:8:0)
[23:44:38.979] Build status: STARTED
[23:44:38.979] Scheduling timer "check-buildbucket-build-status" (fuchsia/core.x64-release-minfs-e5a0ec7f:8911992938768694224:9:0) after 5m20s
[23:49:59.044] Handling timer "check-buildbucket-build-status" (fuchsia/core.x64-release-minfs-e5a0ec7f:8911992938768694224:9:0)
[23:49:59.071] Build status: STARTED
[23:49:59.071] Scheduling timer "check-buildbucket-build-status" (fuchsia/core.x64-release-minfs-e5a0ec7f:8911992938768694224:10:0) after 3m6s
[23:53:05.093] Handling timer "check-buildbucket-build-status" (fuchsia/core.x64-release-minfs-e5a0ec7f:8911992938768694224:10:0)
[23:53:05.114] Build status: STARTED
[23:53:05.115] Scheduling timer "check-buildbucket-build-status" (fuchsia/core.x64-release-minfs-e5a0ec7f:8911992938768694224:11:0) after 3m45s
[23:56:50.146] Handling timer "check-buildbucket-build-status" (fuchsia/core.x64-release-minfs-e5a0ec7f:8911992938768694224:11:0)
[23:56:50.162] Build status: STARTED
[23:56:50.162] Scheduling timer "check-buildbucket-build-status" (fuchsia/core.x64-release-minfs-e5a0ec7f:8911992938768694224:12:0) after 9m57s
[00:06:47.211] Handling timer "check-buildbucket-build-status" (fuchsia/core.x64-release-minfs-e5a0ec7f:8911992938768694224:12:0)
[00:06:47.238] Build status: STARTED
[00:06:47.238] Scheduling timer "check-buildbucket-build-status" (fuchsia/core.x64-release-minfs-e5a0ec7f:8911992938768694224:13:0) after 8m25s
[00:15:12.294] Handling timer "check-buildbucket-build-status" (fuchsia/core.x64-release-minfs-e5a0ec7f:8911992938768694224:13:0)
[00:15:12.309] Build status: STARTED
[00:15:12.309] Scheduling timer "check-buildbucket-build-status" (fuchsia/core.x64-release-minfs-e5a0ec7f:8911992938768694224:14:0) after 7m7s
[00:22:19.722] Handling timer "check-buildbucket-build-status" (fuchsia/core.x64-release-minfs-e5a0ec7f:8911992938768694224:14:0)
[00:22:19.740] Build status: STARTED
[00:22:19.740] Scheduling timer "check-buildbucket-build-status" (fuchsia/core.x64-release-minfs-e5a0ec7f:8911992938768694224:15:0) after 9m19s
[00:31:38.742] Handling timer "check-buildbucket-build-status" (fuchsia/core.x64-release-minfs-e5a0ec7f:8911992938768694224:15:0)
[00:31:38.759] Build status: STARTED
[00:31:38.759] Scheduling timer "check-buildbucket-build-status" (fuchsia/core.x64-release-minfs-e5a0ec7f:8911992938768694224:16:0) after 3m6s
[00:34:44.824] Handling timer "check-buildbucket-build-status" (fuchsia/core.x64-release-minfs-e5a0ec7f:8911992938768694224:16:0)
[00:34:44.850] Build status: STARTED
[00:34:44.850] Scheduling timer "check-buildbucket-build-status" (fuchsia/core.x64-release-minfs-e5a0ec7f:8911992938768694224:17:0) after 8m31s
[00:42:54.795] Received PubSub notification, asking Buildbucket for the build status
[00:42:54.815] Build:
{
"id": "8746562875636235153",
"builder": {
"project": "fuchsia",
"bucket": "global.ci",
"builder": "core.x64-release-minfs"
},
"createdBy": "project:fuchsia",
"createTime": "2024-05-29T23:17:30.881730055Z",
"startTime": "2024-05-29T23:18:50.233618351Z",
"endTime": "2024-05-30T00:42:54.284752493Z",
"updateTime": "2024-05-30T00:42:54.284752493Z",
"status": "SUCCESS",
"input": {
"gitilesCommit": {
"host": "fuchsia.googlesource.com",
"project": "integration",
"id": "a9a5ab103d23329b40629a1ff686f1841be81da1",
"ref": "refs/heads/main"
}
}
}
[00:42:54.815] Invocation finished in 1h25m26.305754856s with status SUCCEEDED