Back to build
Raw log | Switch to full mode | Login

python -u /b/s/w/ir/kitchen-checkout/build/scripts/tools/runit.py --show-path --with-third-party-lib -- python /b/s/w/ir/kitchen-checkout/build/scripts/slave/recipe_modules/chromium_swarming/resources/collect_task.py --verbose -o /b/s/w/ir/tmp/t/tmpXMAFnX.json --task-output-dir /b/s/w/ir/k/recipe_cleanup/26jb5C31 --merge-script /b/s/w/ir/kitchen-checkout/build/scripts/slave/recipe_modules/chromium_swarming/resources/noop_merge.py --merge-script-stdout-file /b/s/w/ir/tmp/t/tmp7P2NTFmerge_script_log --merge-additional-args '[]' --summary-json-file /b/s/w/ir/tmp/t/tmpOEmHgb.json -- swarming collect -server https://chromium-swarm.appspot.com -worker 50 -task-summary-python -task-output-stdout all -verbose -requests-json /b/s/w/ir/tmp/t/tmpZhFQNm.json in dir /b/s/w/ir/k: allow_subannotations: False base_name: 'ios_web_shell_egtests (iPad Air 2 iOS 11.4) on Mac-10.13.6' cmd: ['python', '-u', '/b/s/w/ir/kitchen-checkout/build/scripts/tools/runit.py', '--show-path', '--with-third-party-lib', '--', 'python', '/b/s/w/ir/kitchen-checkout/build/scripts/slave/recipe_modules/chromium_swarming/resources/collect_task.py', '--verbose', '-o', '/b/s/w/ir/tmp/t/tmpXMAFnX.json', '--task-output-dir', '/b/s/w/ir/k/recipe_cleanup/26jb5C31', '--merge-script', '/b/s/w/ir/kitchen-checkout/build/scripts/slave/recipe_modules/chromium_swarming/resources/noop_merge.py', '--merge-script-stdout-file', '/b/s/w/ir/tmp/t/tmp7P2NTFmerge_script_log', '--merge-additional-args', '[]', '--summary-json-file', '/b/s/w/ir/tmp/t/tmpOEmHgb.json', '--', 'swarming', 'collect', '-server', 'https://chromium-swarm.appspot.com', '-worker', '50', '-task-summary-python', '-task-output-stdout', 'all', '-verbose', '-requests-json', '/b/s/w/ir/tmp/t/tmpZhFQNm.json'] env: {} env_prefixes: {'PATH': '/b/s/w/ir/cache/swarming_client'} env_suffixes: {} infra_step: False name: 'ios_web_shell_egtests (iPad Air 2 iOS 11.4) on Mac-10.13.6' nest_level: 0 ok_ret: frozenset([0]) step_test_data: <lambda>(...) trigger_specs: () full environment: Apple_PubSub_Socket_Render: /private/tmp/com.apple.launchd.NioKeSpGo4/Render BOTO_CONFIG: /b/s/w/ir/tmp/gsutil_task/.boto BUILDBUCKET_EXPERIMENTAL: FALSE CIPD_CACHE_DIR: /b/s/cipd_cache/cache CIPD_PROTOCOL: v2 DEVSHELL_CLIENT_PORT: 49362 DOCKER_CONFIG: /b/s/w/ir/tmp/docker_cfg_task DOCKER_TMPDIR: /b/s/w/ir/tmp/docker_tmp_task GIT_CONFIG_NOSYSTEM: 1 GIT_TERMINAL_PROMPT: 0 HOME: /Users/chrome-bot INFRA_GIT_WRAPPER_HOME: /b/s/w/ir/tmp/git_home_task LOGDOG_COORDINATOR_HOST: logs.chromium.org LOGDOG_STREAM_PREFIX: buildbucket/cr-buildbucket.appspot.com/8919340566138599872 LOGDOG_STREAM_PROJECT: chromium LOGDOG_STREAM_SERVER_PATH: unix:/b/s/w/ir/tmp/ld.sock LOGNAME: chrome-bot LUCI_CONTEXT: /b/s/w/ityaGJXL/luci_context.090825864 MAC_CHROMIUM_TMPDIR: /b/s/w/ir/tmp/t NO_GCE_CHECK: False PATH: /b/s/w/ir/cache/swarming_client:/b/s/w/ir/cipd_bin_packages:/b/s/w/ir/cipd_bin_packages/bin:/b/s/cipd_cache/bin:/opt/local/bin:/opt/local/sbin:/usr/local/sbin:/usr/local/git/bin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin PWD: /b/s/w/ir/k PYTHONIOENCODING: UTF-8 PYTHONUNBUFFERED: 1 SHELL: /bin/bash SHLVL: 1 SSH_AUTH_SOCK: /private/tmp/com.apple.launchd.WZbIjIdlth/Listeners SWARMING_BOT_ID: vm1094-m4 SWARMING_HEADLESS: 1 SWARMING_SERVER: https://chromium-swarm.appspot.com SWARMING_TASK_ID: 43823033448d8711 TEMP: /b/s/w/ir/tmp/t TEMPDIR: /b/s/w/ir/tmp/t TMP: /b/s/w/ir/tmp/t TMPDIR: /b/s/w/ir/tmp/t USER: chrome-bot VERSIONER_PYTHON_PREFER_32_BIT: no VERSIONER_PYTHON_VERSION: 2.7 VPYTHON_VIRTUALENV_ROOT: /b/s/w/ir/cache/vpython XPC_FLAGS: 0x0 XPC_SERVICE_NAME: 0 _: /b/s/w/ir/cipd_bin_packages/vpython __CF_USER_TEXT_ENCODING: 0x1F4:0x0:0x0 Set PYTHONPATH: /b/s/w/ir/kitchen-checkout/build/scripts:/b/s/w/ir/kitchen-checkout/build/site_config:/b/s/w/ir/kitchen-checkout/build/third_party:/b/s/w/ir/kitchen-checkout/build/third_party/buildbot_8_4p1:/b/s/w/ir/kitchen-checkout/build/third_party/buildbot_slave_8_4:/b/s/w/ir/kitchen-checkout/build/third_party/coverage-3.7.1:/b/s/w/ir/kitchen-checkout/build/third_party/decorator_3_3_1:/b/s/w/ir/kitchen-checkout/build/third_party/google_api_python_client:/b/s/w/ir/kitchen-checkout/build/third_party/httplib2/python2:/b/s/w/ir/kitchen-checkout/build/third_party/infra_libs:/b/s/w/ir/kitchen-checkout/build/third_party/jinja2:/b/s/w/ir/kitchen-checkout/build/third_party/markupsafe:/b/s/w/ir/kitchen-checkout/build/third_party/oauth2client:/b/s/w/ir/kitchen-checkout/build/third_party/pyasn1:/b/s/w/ir/kitchen-checkout/build/third_party/pyasn1-modules:/b/s/w/ir/kitchen-checkout/build/third_party/python-rsa:/b/s/w/ir/kitchen-checkout/build/third_party/requests_2_10_0:/b/s/w/ir/kitchen-checkout/build/third_party/setuptools-0.6c11:/b/s/w/ir/kitchen-checkout/build/third_party/sqlalchemy_0_7_1:/b/s/w/ir/kitchen-checkout/build/third_party/sqlalchemy_migrate_0_7_1:/b/s/w/ir/kitchen-checkout/build/third_party/tempita_0_5:/b/s/w/ir/kitchen-checkout/build/third_party/twisted_10_2:/b/s/w/ir/kitchen-checkout/build/third_party/uritemplate:/b/s/w/ir/kitchen-checkout/build/third_party/site-packages 2019-03-10 14:44:17,328 - root: [DEBUG] Using task_output_dir: '/b/s/w/ir/k/recipe_cleanup/26jb5C31' 2019-03-10 14:44:17,328 - root: [WARNING] task_output_dir '/b/s/w/ir/k/recipe_cleanup/26jb5C31' already exists! 2019-03-10 14:44:17,328 - root: [WARNING] task_output_dir existing content: [] 2019-03-10 14:44:17,328 - root: [INFO] collect_cmd: swarming collect -server https://chromium-swarm.appspot.com -worker 50 -task-summary-python -task-output-stdout all -verbose -requests-json /b/s/w/ir/tmp/t/tmpZhFQNm.json -output-dir /b/s/w/ir/k/recipe_cleanup/26jb5C31 -task-summary-json /b/s/w/ir/tmp/t/tmpOEmHgb.json [D2019-03-10T14:44:17.348400-07:00 41709 0 auth.go:1265] Minting a new token {"key":"luci_ctx/6a2181bf0c38d0cf4d95978e5d8210d9a8c62af2f4699bb8fdee6476342d00ef", "scopes":"https://www.googleapis.com/auth/userinfo.email"} [D2019-03-10T14:44:17.348500-07:00 41709 0 luci_ctx.go:138] POST http://127.0.0.1:49350/rpc/LuciLocalAuthService.GetOAuthToken {"key":"luci_ctx/6a2181bf0c38d0cf4d95978e5d8210d9a8c62af2f4699bb8fdee6476342d00ef", "scopes":"https://www.googleapis.com/auth/userinfo.email"} [D2019-03-10T14:44:17.350356-07:00 41709 0 auth.go:1222] Token expires in 4m52.649701s {"key":"luci_ctx/6a2181bf0c38d0cf4d95978e5d8210d9a8c62af2f4699bb8fdee6476342d00ef", "scopes":"https://www.googleapis.com/auth/userinfo.email"} 438240ae6df80f10: exit 0 [I 2019-03-10 14:08:20] About to install Xcode 10b61 in Xcode.app for ios [02:08:25:INFO] Using Xcode version 10.1 build 10B61 at /b/s/w/ir/Xcode.app/Contents/Developer [02:08:25:INFO] Erasing all simulators. [02:08:36:INFO] Start test attempt #0 for command [xcodebuild test-without-building -xctestrun /b/s/w/io_16NKk/run_1552252116.xctestrun -destination platform=iOS Simulator,OS=11.4,name=iPad Air 2 -resultBundlePath /b/s/w/io_16NKk/11.4 iPad Air 2/attempt_0 -parallel-testing-enabled YES -parallel-testing-worker-count 3] [02:08:36:INFO] Launching ['xcodebuild', 'test-without-building', '-xctestrun', '/b/s/w/io_16NKk/run_1552252116.xctestrun', '-destination', 'platform=iOS Simulator,OS=11.4,name=iPad Air 2', '-resultBundlePath', '/b/s/w/io_16NKk/11.4 iPad Air 2/attempt_0', '-parallel-testing-enabled', 'YES', '-parallel-testing-worker-count', '3'] with env {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'MAC_CHROMIUM_TMPDIR': '/b/s/w/itPEuBr9', 'LOGNAME': 'chrome-bot', 'USER': 'chrome-bot', 'HOME': '/Users/chrome-bot', 'BOTO_CONFIG': '/Users/chrome-bot/.boto', 'PATH': '/b/s/w/ir/.swarming_module_cache/vpython/80b654/bin:/b/s/w/ir/.swarming_module:/b/s/w/ir/.swarming_module/bin:/b/s/cipd_cache/bin:/opt/local/bin:/opt/local/sbin:/usr/local/sbin:/usr/local/git/bin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin', 'SWARMING_BOT_ID': 'vm1065-m4', 'VIRTUAL_ENV': '/b/s/w/ir/.swarming_module_cache/vpython/80b654', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.7GIk1xZlrb/Render', 'SWARMING_SERVER': 'https://chromium-swarm.appspot.com', 'VERSIONER_PYTHON_VERSION': '2.7', 'XPC_FLAGS': '0x0', 'SWARMING_HEADLESS': '1', 'PYTHONNOUSERSITE': '1', 'LUCI_CONTEXT': '/b/s/w/itPEuBr9/luci_ctx.1dfwGI.json', 'CIPD_CACHE_DIR': '/b/s/cipd_cache/cache', 'XPC_SERVICE_NAME': 'org.swarm.bot.plist', 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.8X7lT9wbgT/Listeners', 'VPYTHON_VIRTUALENV_ROOT': '/b/s/w/ir/.swarming_module_cache/vpython', 'SWARMING_TASK_ID': '438240ae6df80f11', 'SHELL': '/bin/bash', 'NO_GCE_CHECK': 'False', 'TMPDIR': '/b/s/w/itPEuBr9', 'CIPD_PROTOCOL': 'v2', '__CF_USER_TEXT_ENCODING': '0x1F4:0x0:0x0', 'NSUnbufferedIO': 'YES'} [02:08:36:INFO] User defaults from command line: [02:08:36:INFO] IDEBuildOperationResultBundlePath = /b/s/w/io_16NKk/11.4 iPad Air 2/attempt_0 [02:08:36:INFO] IDETestRunSpecificationPath = /b/s/w/io_16NKk/run_1552252116.xctestrun [02:08:36:INFO] [02:08:37:INFO] Testing started on 'iPad Air 2' [02:08:39:INFO] 2019-03-10 14:08:39.452 xcodebuild[35819:390740] IDETestOperationsObserverDebug: Writing diagnostic log for test session to: [02:08:39:INFO] /b/s/w/io_16NKk/11.4 iPad Air 2/attempt_0/1_Test/Diagnostics/ios_web_shell_egtests_module-52430F53-4601-4C93-9BBD-EF3C31178024/ios_web_shell_egtests_module-9DC6692A-9C6B-4FC0-8549-1164D2A0C33D/Session-ios_web_shell_egtests_module-2019-03-10_140839-lduLsu.log [02:08:39:INFO] 2019-03-10 14:08:39.453 xcodebuild[35819:390735] [MT] IDETestOperationsObserverDebug: (87A46D39-05B3-4271-AACB-410023BE71E9) Beginning test session ios_web_shell_egtests_module-87A46D39-05B3-4271-AACB-410023BE71E9 at 2019-03-10 14:08:39.452 with Xcode 10B61 on target <DVTiPhoneSimulator: 0x7fe0cf11fef0> { [02:08:39:INFO] SimDevice: Clone 1 of iPad Air 2 (B8F96BB4-1B11-430E-A134-5D88742646E5, iOS 11.4, Shutdown) [02:08:39:INFO] } (11.4 (15F79)) [02:09:09:INFO] Test suite 'ContextMenuTestCase' started on 'Clone 1 of iPad Air 2 - ios_web_shell_egtests.app (35938)' [02:09:12:INFO] 2019-03-10 14:09:12.524 xcodebuild[35819:392370] IDETestOperationsObserverDebug: Writing diagnostic log for test session to: [02:09:12:INFO] /b/s/w/io_16NKk/11.4 iPad Air 2/attempt_0/1_Test/Diagnostics/ios_web_shell_egtests_module-52430F53-4601-4C93-9BBD-EF3C31178024/ios_web_shell_egtests_module-595DA490-D701-4C16-ABD6-6A962C58692E/Session-ios_web_shell_egtests_module-2019-03-10_140912-9cvHMZ.log [02:09:12:INFO] 2019-03-10 14:09:12.524 xcodebuild[35819:390735] [MT] IDETestOperationsObserverDebug: (866AFD00-9D6E-465F-8887-5BA721EAC219) Beginning test session ios_web_shell_egtests_module-866AFD00-9D6E-465F-8887-5BA721EAC219 at 2019-03-10 14:09:12.524 with Xcode 10B61 on target <DVTiPhoneSimulator: 0x7fe0cf128350> { [02:09:12:INFO] SimDevice: Clone 2 of iPad Air 2 (F2BB3577-369F-4369-8A46-9EBE0C584755, iOS 11.4, Shutdown) [02:09:12:INFO] } (11.4 (15F79)) [02:09:12:INFO] 2019-03-10 14:09:12.821 xcodebuild[35819:392485] IDETestOperationsObserverDebug: Writing diagnostic log for test session to: [02:09:12:INFO] /b/s/w/io_16NKk/11.4 iPad Air 2/attempt_0/1_Test/Diagnostics/ios_web_shell_egtests_module-52430F53-4601-4C93-9BBD-EF3C31178024/ios_web_shell_egtests_module-FB76036A-EB7C-4A5F-AB66-621C7E81E202/Session-ios_web_shell_egtests_module-2019-03-10_140912-o6bk4o.log [02:09:12:INFO] 2019-03-10 14:09:12.822 xcodebuild[35819:390735] [MT] IDETestOperationsObserverDebug: (1049C665-99FC-4F1D-A013-A584D0D2DA33) Beginning test session ios_web_shell_egtests_module-1049C665-99FC-4F1D-A013-A584D0D2DA33 at 2019-03-10 14:09:12.822 with Xcode 10B61 on target <DVTiPhoneSimulator: 0x7fe0cde93b80> { [02:09:12:INFO] SimDevice: Clone 3 of iPad Air 2 (E5A1C62D-D088-4C22-AEB5-CA54A5171C36, iOS 11.4, Shutdown) [02:09:12:INFO] } (11.4 (15F79)) [02:09:17:INFO] Test case '-[ContextMenuTestCase testContextMenu]' passed on 'Clone 1 of iPad Air 2 - ios_web_shell_egtests.app (35938)' (7.573 seconds) [02:09:20:INFO] Test case '-[ContextMenuTestCase testContextMenuWebkitTouchCalloutOverride]' passed on 'Clone 1 of iPad Air 2 - ios_web_shell_egtests.app (35938)' (3.293 seconds) [02:09:20:INFO] Test suite 'PageStateTestCase' started on 'Clone 1 of iPad Air 2 - ios_web_shell_egtests.app (35938)' [02:09:28:INFO] Test case '-[PageStateTestCase testScrollPositionRestoring]' passed on 'Clone 1 of iPad Air 2 - ios_web_shell_egtests.app (35938)' (8.436 seconds) [02:09:43:INFO] Test suite 'ServiceManagerTestCase' started on 'Clone 2 of iPad Air 2 - ios_web_shell_egtests.app (36175)' [02:09:43:INFO] Test case '-[ServiceManagerTestCase testConnectionToAllUsersEmbeddedService]' passed on 'Clone 2 of iPad Air 2 - ios_web_shell_egtests.app (36175)' (0.073 seconds) [02:09:43:INFO] Test case '-[ServiceManagerTestCase testConnectionToPerUserEmbeddedService]' passed on 'Clone 2 of iPad Air 2 - ios_web_shell_egtests.app (36175)' (0.007 seconds) [02:09:43:INFO] Test case '-[ServiceManagerTestCase testConnectionToWebStateInterface]' passed on 'Clone 2 of iPad Air 2 - ios_web_shell_egtests.app (36175)' (0.004 seconds) [02:09:48:INFO] Test case '-[PageStateTestCase testZeroContentOffsetAfterLoad]' passed on 'Clone 1 of iPad Air 2 - ios_web_shell_egtests.app (35938)' (19.341 seconds) [02:09:48:INFO] 2019-03-10 14:09:48.748 xcodebuild[35819:390735] [MT] IDETestOperationsObserverDebug: 71.148 elapsed -- Testing started completed. [02:09:48:INFO] 2019-03-10 14:09:48.748 xcodebuild[35819:390735] [MT] IDETestOperationsObserverDebug: 0.000 sec, +0.000 sec -- start [02:09:48:INFO] 2019-03-10 14:09:48.748 xcodebuild[35819:390735] [MT] IDETestOperationsObserverDebug: 71.148 sec, +71.148 sec -- end [02:09:48:INFO] ** TEST EXECUTE SUCCEEDED ** [02:09:48:INFO] [02:10:06:INFO] Command ['xcodebuild', 'test-without-building', '-xctestrun', '/b/s/w/io_16NKk/run_1552252116.xctestrun', '-destination', 'platform=iOS Simulator,OS=11.4,name=iPad Air 2', '-resultBundlePath', '/b/s/w/io_16NKk/11.4 iPad Air 2/attempt_0', '-parallel-testing-enabled', 'YES', '-parallel-testing-worker-count', '3'] finished with 0 [02:10:06:DEBUG] self.logs: [02:10:06:DEBUG] {'failed': [], 'flaked': [], 'passed': ['ContextMenuTestCase/testContextMenu', 'ContextMenuTestCase/testContextMenuWebkitTouchCalloutOverride', 'PageStateTestCase/testScrollPositionRestoring', 'PageStateTestCase/testZeroContentOffsetAfterLoad', 'ServiceManagerTestCase/testConnectionToAllUsersEmbeddedService', 'ServiceManagerTestCase/testConnectionToPerUserEmbeddedService', 'ServiceManagerTestCase/testConnectionToWebStateInterface']} 2019-03-10 14:44:22,554 - root: [DEBUG] Contents of task_output_dir: ['/b/s/w/ir/k/recipe_cleanup/26jb5C31/438240ae6df80f10'] 2019-03-10 14:44:22,554 - root: [WARNING] Expected output.json file missing: set(['/b/s/w/ir/k/recipe_cleanup/26jb5C31/438240ae6df80f10/output.json']) Found: [] Expected: ['/b/s/w/ir/k/recipe_cleanup/26jb5C31/438240ae6df80f10/output.json'] 2019-03-10 14:44:22,555 - root: [WARNING] No shard json files found in task_output_dir: '/b/s/w/ir/k/recipe_cleanup/26jb5C31' Found ['/b/s/w/ir/k/recipe_cleanup/26jb5C31/438240ae6df80f10'] 2019-03-10 14:44:22,555 - root: [DEBUG] Found shard_json_files: ['/b/s/w/ir/k/recipe_cleanup/26jb5C31/438240ae6df80f10/output.json'] 2019-03-10 14:44:22,555 - root: [INFO] merge_cmd: /b/s/w/ir/cache/vpython/5b0713/bin/python /b/s/w/ir/kitchen-checkout/build/scripts/slave/recipe_modules/chromium_swarming/resources/noop_merge.py --summary-json /b/s/w/ir/tmp/t/tmpOEmHgb.json --task-output-dir /b/s/w/ir/k/recipe_cleanup/26jb5C31 -o /b/s/w/ir/tmp/t/tmpXMAFnX.json Running ['/b/s/w/ir/cache/vpython/5b0713/bin/python', '/b/s/w/ir/kitchen-checkout/build/scripts/slave/recipe_modules/chromium_swarming/resources/noop_merge.py', '--summary-json', '/b/s/w/ir/tmp/t/tmpOEmHgb.json', '--task-output-dir', '/b/s/w/ir/k/recipe_cleanup/26jb5C31', '-o', '/b/s/w/ir/tmp/t/tmpXMAFnX.json'] in None (env: None) Command ['/b/s/w/ir/cache/vpython/5b0713/bin/python', '/b/s/w/ir/kitchen-checkout/build/scripts/slave/recipe_modules/chromium_swarming/resources/noop_merge.py', '--summary-json', '/b/s/w/ir/tmp/t/tmpOEmHgb.json', '--task-output-dir', '/b/s/w/ir/k/recipe_cleanup/26jb5C31', '-o', '/b/s/w/ir/tmp/t/tmpXMAFnX.json'] returned exit code 0