[09:51:37.646] New invocation is queued and will start shortly
[09:51:39.449] Starting the invocation (attempt 1)
[09:51:39.478] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[09:51:39.478] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[09:51:39.478] Buildbucket request:
{
"bucket": "luci.webrtc.ci",
"client_operation_id": "9100575925470780272",
"parameters_json": "{\"builder_name\":\"Win32 Release (Clang)\",\"properties\":{\"branch\":\"refs/heads/master\",\"repository\":\"https://webrtc.googlesource.com/src/\",\"revision\":\"cdf0e6d4c5a06f6c04435041cc5f7b35c8facb61\"}}",
"pubsub_callback": {
"auth_token": "...",
"topic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
},
"tags": [
"builder:Win32 Release (Clang)",
"scheduler_invocation_id:9100575925470780272",
"scheduler_job_id:webrtc/Win32 Release (Clang)",
"user_agent:luci-scheduler",
"buildset:commit/git/cdf0e6d4c5a06f6c04435041cc5f7b35c8facb61",
"buildset:commit/gitiles/webrtc.googlesource.com/src/+/cdf0e6d4c5a06f6c04435041cc5f7b35c8facb61",
"gitiles_ref:refs/heads/master"
]
}
[09:51:40.394] Buildbucket response:
{
"build": {
"bucket": "luci.webrtc.ci",
"canary_preference": "AUTO",
"created_by": "user:luci-scheduler@appspot.gserviceaccount.com",
"created_ts": "1537177899539222",
"id": "8935145862771661568",
"lease_expiration_ts": "1537293100158043",
"lease_key": "281220545",
"parameters_json": "{\"builder_name\": \"Win32 Release (Clang)\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://webrtc.googlesource.com/src/\", \"revision\": \"cdf0e6d4c5a06f6c04435041cc5f7b35c8facb61\"}}",
"project": "webrtc",
"result_details_json": "null",
"service_account": "webrtc-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"status": "SCHEDULED",
"status_changed_ts": "1537177900301301",
"tags": [
"build_address:luci.webrtc.ci/Win32 Release (Clang)/13302",
"builder:Win32 Release (Clang)",
"buildset:commit/git/cdf0e6d4c5a06f6c04435041cc5f7b35c8facb61",
"buildset:commit/gitiles/webrtc.googlesource.com/src/+/cdf0e6d4c5a06f6c04435041cc5f7b35c8facb61",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9100575925470780272",
"scheduler_job_id:webrtc/Win32 Release (Clang)",
"swarming_dimension:builder_group:Win-Generic",
"swarming_dimension:cpu:x86-64",
"swarming_dimension:os:Windows",
"swarming_dimension:pool:luci.webrtc.ci",
"swarming_hostname:chromium-swarm.appspot.com",
"swarming_tag:build_address:luci.webrtc.ci/Win32 Release (Clang)/13302",
"swarming_tag:buildbucket_bucket:luci.webrtc.ci",
"swarming_tag:buildbucket_build_id:8935145862771661568",
"swarming_tag:buildbucket_hostname:cr-buildbucket.appspot.com",
"swarming_tag:buildbucket_template_canary:0",
"swarming_tag:buildbucket_template_revision:ca2c7a741e04d0385e2bf62941ac932dc0521af3",
"swarming_tag:builder:Win32 Release (Clang)",
"swarming_tag:builder_group:Win-Generic",
"swarming_tag:buildset:commit/git/cdf0e6d4c5a06f6c04435041cc5f7b35c8facb61",
"swarming_tag:buildset:commit/gitiles/webrtc.googlesource.com/src/+/cdf0e6d4c5a06f6c04435041cc5f7b35c8facb61",
"swarming_tag:cpu:x86-64",
"swarming_tag:gitiles_ref:refs/heads/master",
"swarming_tag:log_location:logdog://logs.chromium.org/webrtc/buildbucket/cr-buildbucket.appspot.com/8935145862771661568/+/annotations",
"swarming_tag:luci_project:webrtc",
"swarming_tag:os:Windows",
"swarming_tag:pool:luci.webrtc.ci",
"swarming_tag:priority:30",
"swarming_tag:recipe_name:webrtc/standalone",
"swarming_tag:recipe_package:infra/recipe_bundles/chromium.googlesource.com/chromium/tools/build",
"swarming_tag:scheduler_invocation_id:9100575925470780272",
"swarming_tag:scheduler_job_id:webrtc/Win32 Release (Clang)",
"swarming_tag:service_account:webrtc-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"swarming_tag:swarming.pool.template:skip",
"swarming_tag:swarming.pool.version:aab2657fb2352342b61c0380ef1d346e0cfd7da5",
"swarming_tag:user:None",
"swarming_tag:user_agent:luci-scheduler",
"swarming_tag:vpython:native-python-wrapper",
"swarming_task_id:3fffc2dbd5967110",
"user_agent:luci-scheduler"
],
"updated_ts": "1537177900301396",
"url": "https://ci.chromium.org/p/webrtc/builders/luci.webrtc.ci/Win32 Release (Clang)/13302",
"utcnow_ts": "1537177900384483"
}
}
[09:51:40.394] Task URL: https://ci.chromium.org/p/webrtc/builders/luci.webrtc.ci/Win32 Release (Clang)/13302
[09:51:40.394] Scheduling timer "check-buildbucket-build-status" (webrtc/Win32 Release (Clang):9100575925470780272:2:0) after 1m0s
[09:51:50.503] Received PubSub notification, asking Buildbucket for the build status
[09:51:50.545] Build 8935145862771661568: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:52:40.430] Handling timer "check-buildbucket-build-status" (webrtc/Win32 Release (Clang):9100575925470780272:2:0)
[09:52:40.430] Timer tick, asking Buildbucket for the build status
[09:52:40.546] Build 8935145862771661568: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:52:40.546] Scheduling timer "check-buildbucket-build-status" (webrtc/Win32 Release (Clang):9100575925470780272:4:0) after 1m0s
[09:53:40.567] Handling timer "check-buildbucket-build-status" (webrtc/Win32 Release (Clang):9100575925470780272:4:0)
[09:53:40.567] Timer tick, asking Buildbucket for the build status
[09:53:40.617] Build 8935145862771661568: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:53:40.617] Scheduling timer "check-buildbucket-build-status" (webrtc/Win32 Release (Clang):9100575925470780272:5:0) after 1m0s
[09:54:40.639] Handling timer "check-buildbucket-build-status" (webrtc/Win32 Release (Clang):9100575925470780272:5:0)
[09:54:40.639] Timer tick, asking Buildbucket for the build status
[09:54:40.812] Build 8935145862771661568: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:54:40.812] Scheduling timer "check-buildbucket-build-status" (webrtc/Win32 Release (Clang):9100575925470780272:6:0) after 1m0s
[09:55:40.826] Handling timer "check-buildbucket-build-status" (webrtc/Win32 Release (Clang):9100575925470780272:6:0)
[09:55:40.826] Timer tick, asking Buildbucket for the build status
[09:55:40.874] Build 8935145862771661568: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:55:40.874] Scheduling timer "check-buildbucket-build-status" (webrtc/Win32 Release (Clang):9100575925470780272:7:0) after 1m0s
[09:56:40.888] Handling timer "check-buildbucket-build-status" (webrtc/Win32 Release (Clang):9100575925470780272:7:0)
[09:56:40.888] Timer tick, asking Buildbucket for the build status
[09:56:40.950] Build 8935145862771661568: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:56:40.950] Scheduling timer "check-buildbucket-build-status" (webrtc/Win32 Release (Clang):9100575925470780272:8:0) after 1m0s
[09:57:40.965] Handling timer "check-buildbucket-build-status" (webrtc/Win32 Release (Clang):9100575925470780272:8:0)
[09:57:40.965] Timer tick, asking Buildbucket for the build status
[09:57:41.113] Build 8935145862771661568: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:57:41.113] Scheduling timer "check-buildbucket-build-status" (webrtc/Win32 Release (Clang):9100575925470780272:9:0) after 1m0s
[09:58:41.156] Handling timer "check-buildbucket-build-status" (webrtc/Win32 Release (Clang):9100575925470780272:9:0)
[09:58:41.156] Timer tick, asking Buildbucket for the build status
[09:58:41.228] Build 8935145862771661568: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:58:41.229] Scheduling timer "check-buildbucket-build-status" (webrtc/Win32 Release (Clang):9100575925470780272:10:0) after 1m0s
[09:59:41.260] Handling timer "check-buildbucket-build-status" (webrtc/Win32 Release (Clang):9100575925470780272:10:0)
[09:59:41.260] Timer tick, asking Buildbucket for the build status
[09:59:41.411] Build 8935145862771661568: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:59:41.411] Scheduling timer "check-buildbucket-build-status" (webrtc/Win32 Release (Clang):9100575925470780272:11:0) after 1m0s
[10:00:41.429] Handling timer "check-buildbucket-build-status" (webrtc/Win32 Release (Clang):9100575925470780272:11:0)
[10:00:41.429] Timer tick, asking Buildbucket for the build status
[10:00:41.542] Build 8935145862771661568: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:00:41.542] Scheduling timer "check-buildbucket-build-status" (webrtc/Win32 Release (Clang):9100575925470780272:12:0) after 1m0s
[10:01:41.556] Handling timer "check-buildbucket-build-status" (webrtc/Win32 Release (Clang):9100575925470780272:12:0)
[10:01:41.556] Timer tick, asking Buildbucket for the build status
[10:01:41.616] Build 8935145862771661568: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:01:41.616] Scheduling timer "check-buildbucket-build-status" (webrtc/Win32 Release (Clang):9100575925470780272:13:0) after 1m0s
[10:02:41.634] Handling timer "check-buildbucket-build-status" (webrtc/Win32 Release (Clang):9100575925470780272:13:0)
[10:02:41.634] Timer tick, asking Buildbucket for the build status
[10:02:41.707] Build 8935145862771661568: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:02:41.707] Scheduling timer "check-buildbucket-build-status" (webrtc/Win32 Release (Clang):9100575925470780272:14:0) after 1m0s
[10:03:41.724] Handling timer "check-buildbucket-build-status" (webrtc/Win32 Release (Clang):9100575925470780272:14:0)
[10:03:41.724] Timer tick, asking Buildbucket for the build status
[10:03:41.777] Build 8935145862771661568: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:03:41.777] Scheduling timer "check-buildbucket-build-status" (webrtc/Win32 Release (Clang):9100575925470780272:15:0) after 1m0s
[10:04:41.839] Handling timer "check-buildbucket-build-status" (webrtc/Win32 Release (Clang):9100575925470780272:15:0)
[10:04:41.839] Timer tick, asking Buildbucket for the build status
[10:04:41.898] Build 8935145862771661568: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:04:41.898] Scheduling timer "check-buildbucket-build-status" (webrtc/Win32 Release (Clang):9100575925470780272:16:0) after 1m0s
[10:05:41.912] Handling timer "check-buildbucket-build-status" (webrtc/Win32 Release (Clang):9100575925470780272:16:0)
[10:05:41.912] Timer tick, asking Buildbucket for the build status
[10:05:41.956] Build 8935145862771661568: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:05:41.956] Scheduling timer "check-buildbucket-build-status" (webrtc/Win32 Release (Clang):9100575925470780272:17:0) after 1m0s
[10:06:41.983] Handling timer "check-buildbucket-build-status" (webrtc/Win32 Release (Clang):9100575925470780272:17:0)
[10:06:41.983] Timer tick, asking Buildbucket for the build status
[10:06:42.043] Build 8935145862771661568: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:06:42.043] Scheduling timer "check-buildbucket-build-status" (webrtc/Win32 Release (Clang):9100575925470780272:18:0) after 1m0s
[10:07:42.059] Handling timer "check-buildbucket-build-status" (webrtc/Win32 Release (Clang):9100575925470780272:18:0)
[10:07:42.059] Timer tick, asking Buildbucket for the build status
[10:07:42.169] Build 8935145862771661568: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:07:42.169] Scheduling timer "check-buildbucket-build-status" (webrtc/Win32 Release (Clang):9100575925470780272:19:0) after 1m0s
[10:08:42.185] Handling timer "check-buildbucket-build-status" (webrtc/Win32 Release (Clang):9100575925470780272:19:0)
[10:08:42.185] Timer tick, asking Buildbucket for the build status
[10:08:42.225] Build 8935145862771661568: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:08:42.225] Scheduling timer "check-buildbucket-build-status" (webrtc/Win32 Release (Clang):9100575925470780272:20:0) after 1m0s
[10:09:03.516] Received PubSub notification, asking Buildbucket for the build status
[10:09:03.660] Build 8935145862771661568: status "COMPLETED", result "SUCCESS", failure_reason "", cancelation_reason ""
[10:09:03.660] Buildbucket build:
{
"build": {
"bucket": "luci.webrtc.ci",
"canary_preference": "AUTO",
"completed_ts": "1537178942572827",
"created_by": "user:luci-scheduler@appspot.gserviceaccount.com",
"created_ts": "1537177899539222",
"id": "8935145862771661568",
"parameters_json": "{\"builder_name\": \"Win32 Release (Clang)\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://webrtc.googlesource.com/src/\", \"revision\": \"cdf0e6d4c5a06f6c04435041cc5f7b35c8facb61\"}}",
"project": "webrtc",
"result": "SUCCESS",
"result_details_json": "{\"ui\": {\"info\": \"\"}, \"build_run_result\": {\"infraFailure\": null, \"recipeResult\": {\"jsonResult\": \"null\"}, \"recipeExitCode\": {\"value\": 0}, \"recipe\": {\"name\": \"webrtc/standalone\", \"repository\": \"\", \"revision\": \"\"}, \"annotationUrl\": \"logdog://logs.chromium.org/webrtc/buildbucket/cr-buildbucket.appspot.com/8935145862771661568/+/annotations\"}, \"swarming\": {\"bot_dimensions\": {\"zone\": [\"us\", \"us-central\", \"us-central1\", \"us-central1-c\"], \"locale\": [\"en_US.cp1252\"], \"os\": [\"Windows\", \"Windows-10\", \"Windows-10-15063\"], \"image\": [\"chrome-win10-1703-2018-04-20-61acaf8983f\"], \"cpu\": [\"x86\", \"x86-64\", \"x86-64-Haswell_GCE\"], \"python\": [\"2.7.13\"], \"builder_group\": [\"Win-Generic\"], \"server_version\": [\"3772-022cb40\"], \"machine_type\": [\"n1-standard-8\"], \"gpu\": [\"none\"], \"cores\": [\"8\"], \"integrity\": [\"high\"], \"id\": [\"win10-webrtc-8983f7d1-us-central1-c-7b29\"], \"pool\": [\"luci.webrtc.ci\"]}}, \"properties\": {\"$recipe_engine/path\": {\"cache_dir\": \"C:\\\\b\\\\s\\\\w\\\\ir\\\\cache\", \"temp_dir\": \"C:\\\\b\\\\s\\\\w\\\\ir\\\\tmp\\\\rt\"}, \"buildnumber\": 13302, \"got_clang_revision\": \"340925-2\", \"repository\": \"https://webrtc.googlesource.com/src/\", \"buildername\": \"Win32 Release (Clang)\", \"got_revision\": \"cdf0e6d4c5a06f6c04435041cc5f7b35c8facb61\", \"recipe\": \"webrtc/standalone\", \"mastername\": \"client.webrtc\", \"$recipe_engine/runtime\": {\"is_experimental\": false, \"is_luci\": true}, \"buildbucket\": {\"hostname\": \"cr-buildbucket.appspot.com\", \"build\": {\"created_ts\": 1537177899539222, \"tags\": [\"builder:Win32 Release (Clang)\", \"buildset:commit/git/cdf0e6d4c5a06f6c04435041cc5f7b35c8facb61\", \"buildset:commit/gitiles/webrtc.googlesource.com/src/+/cdf0e6d4c5a06f6c04435041cc5f7b35c8facb61\", \"gitiles_ref:refs/heads/master\", \"scheduler_invocation_id:9100575925470780272\", \"scheduler_job_id:webrtc/Win32 Release (Clang)\", \"user_agent:luci-scheduler\"], \"bucket\": \"luci.webrtc.ci\", \"created_by\": \"user:luci-scheduler@appspot.gserviceaccount.com\", \"project\": \"webrtc\", \"id\": \"8935145862771661568\"}}, \"got_revision_cp\": \"refs/heads/master@{#24749}\", \"swarm_hashes\": {\"common_audio_unittests\": \"88266955cb1091b8508306c2e31ca611d72472ee\", \"system_wrappers_unittests\": \"548deec08aea49c72d55879035d47774c7c5b8ac\", \"rtc_unittests\": \"110a6223c66be2546c73fb1bfd0d1f497775626c\", \"low_bandwidth_audio_test\": \"bcf03d3cb72274731d47b0db07456690e65b3ed1\", \"test_support_unittests\": \"7c77eb20f545958bd65503f0597c311ef36f2d78\", \"tools_unittests\": \"e3fea8ff2c1852cc769eb76cc3cda60eb932a1f6\", \"rtc_pc_unittests\": \"162e98a3e7d0c915f0c11c02ccd730b761632639\", \"modules_tests\": \"c7ff0bd097c2bc391b48ab3a4bf532788be148eb\", \"common_video_unittests\": \"5f4281f742cf1afa294c5a8b3288dd3538345678\", \"video_engine_tests\": \"9804cc7b3efcc2ef6d15a61c80e458fe48655f0f\", \"webrtc_nonparallel_tests\": \"d29231ed6dbc57f194d0198e5147b13b5782cdbe\", \"peerconnection_unittests\": \"17f5f88f1c98340fbd287a35e11227623e5cad92\", \"rtc_stats_unittests\": \"915b005b8f5036a5d92518cb13f75b8f3bca474a\", \"video_capture_tests\": \"2c2a8dc68a2b9a10ffb6f313234132ad716e94d5\", \"audio_decoder_unittests\": \"9e34bead46df6313c809511121aa6b0060082e02\", \"modules_unittests\": \"f9cd923eae448587c9e8fde624fc91b81ea53602\", \"ortc_unittests\": \"e4cf3c85df83fb77444e70c0b6ed115fd98fd8df\", \"rtc_media_unittests\": \"f306b3bacedb052585c604e286b39030aeee2c85\"}, \"branch\": \"refs/heads/master\", \"path_config\": \"generic\", \"revision\": \"cdf0e6d4c5a06f6c04435041cc5f7b35c8facb61\", \"bot_id\": \"win10-webrtc-8983f7d1-us-central1-c-7b29\"}}",
"service_account": "webrtc-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"started_ts": "1537177908047101",
"status": "COMPLETED",
"status_changed_ts": "1537178943130916",
"tags": [
"build_address:luci.webrtc.ci/Win32 Release (Clang)/13302",
"builder:Win32 Release (Clang)",
"buildset:commit/git/cdf0e6d4c5a06f6c04435041cc5f7b35c8facb61",
"buildset:commit/gitiles/webrtc.googlesource.com/src/+/cdf0e6d4c5a06f6c04435041cc5f7b35c8facb61",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9100575925470780272",
"scheduler_job_id:webrtc/Win32 Release (Clang)",
"swarming_dimension:builder_group:Win-Generic",
"swarming_dimension:cpu:x86-64",
"swarming_dimension:os:Windows",
"swarming_dimension:pool:luci.webrtc.ci",
"swarming_hostname:chromium-swarm.appspot.com",
"swarming_tag:build_address:luci.webrtc.ci/Win32 Release (Clang)/13302",
"swarming_tag:buildbucket_bucket:luci.webrtc.ci",
"swarming_tag:buildbucket_build_id:8935145862771661568",
"swarming_tag:buildbucket_hostname:cr-buildbucket.appspot.com",
"swarming_tag:buildbucket_template_canary:0",
"swarming_tag:buildbucket_template_revision:ca2c7a741e04d0385e2bf62941ac932dc0521af3",
"swarming_tag:builder:Win32 Release (Clang)",
"swarming_tag:builder_group:Win-Generic",
"swarming_tag:buildset:commit/git/cdf0e6d4c5a06f6c04435041cc5f7b35c8facb61",
"swarming_tag:buildset:commit/gitiles/webrtc.googlesource.com/src/+/cdf0e6d4c5a06f6c04435041cc5f7b35c8facb61",
"swarming_tag:cpu:x86-64",
"swarming_tag:gitiles_ref:refs/heads/master",
"swarming_tag:log_location:logdog://logs.chromium.org/webrtc/buildbucket/cr-buildbucket.appspot.com/8935145862771661568/+/annotations",
"swarming_tag:luci_project:webrtc",
"swarming_tag:os:Windows",
"swarming_tag:pool:luci.webrtc.ci",
"swarming_tag:priority:30",
"swarming_tag:recipe_name:webrtc/standalone",
"swarming_tag:recipe_package:infra/recipe_bundles/chromium.googlesource.com/chromium/tools/build",
"swarming_tag:scheduler_invocation_id:9100575925470780272",
"swarming_tag:scheduler_job_id:webrtc/Win32 Release (Clang)",
"swarming_tag:service_account:webrtc-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"swarming_tag:swarming.pool.template:skip",
"swarming_tag:swarming.pool.version:aab2657fb2352342b61c0380ef1d346e0cfd7da5",
"swarming_tag:user:None",
"swarming_tag:user_agent:luci-scheduler",
"swarming_tag:vpython:native-python-wrapper",
"swarming_task_id:3fffc2dbd5967110",
"user_agent:luci-scheduler"
],
"updated_ts": "1537178943132893",
"url": "https://ci.chromium.org/p/webrtc/builders/luci.webrtc.ci/Win32 Release (Clang)/13302",
"utcnow_ts": "1537178943608234"
}
}
[10:09:03.660] Invocation finished in 17m26.079079017s with status SUCCEEDED