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

{ "shards": [ { "bot_dimensions": [ { "key": "caches", "value": [ "swarming_module_cache_vpython", "xcode_ios_10b61", "xcode_ios_10l232m", "xcode_ios_10o45e" ] }, { "key": "cores", "value": [ "8" ] }, { "key": "cpu", "value": [ "x86", "x86-64", "x86-64-E5-2697_v2" ] }, { "key": "gce", "value": [ "0" ] }, { "key": "gpu", "value": [ "none" ] }, { "key": "id", "value": [ "vm948-m4" ] }, { "key": "mac_model", "value": [ "VMware7,1" ] }, { "key": "machine_type", "value": [ "n1-highcpu-8" ] }, { "key": "os", "value": [ "Mac", "Mac-10.13", "Mac-10.13.6" ] }, { "key": "pool", "value": [ "Chrome" ] }, { "key": "python", "value": [ "2.7.10" ] }, { "key": "server_version", "value": [ "4274-a0a5f8c" ] }, { "key": "ssd", "value": [ "1" ] }, { "key": "zone", "value": [ "us", "us-golo", "us-golo-4" ] } ], "bot_id": "vm948-m4", "bot_version": "ed4565f416d57730e75be543776f9c0eb206896ef8831a69fda252ac9fa2095a", "cipd_pins": { "client_package": { "package_name": "infra/tools/cipd/mac-amd64", "version": "1vQ99wQk82cRyVYu18rqMpXtb7XZ3WHvL3HFXTcLHN4C" }, "packages": [ { "package_name": "infra/tools/mac_toolchain/mac-amd64", "path": ".", "version": "1065f97353165dfafa89b64bfdaf9b424d705bc7" }, { "package_name": "infra/python/cpython/mac-amd64", "path": ".swarming_module", "version": "6dd10e31dc5d4cbb3c8f42a6fbd9485aeeb9ef0c" }, { "package_name": "infra/tools/luci/logdog/butler/mac-amd64", "path": ".swarming_module", "version": "3138aa2054ab30eac6f7e1e589e590571ae44692" }, { "package_name": "infra/tools/luci/vpython-native/mac-amd64", "path": ".swarming_module", "version": "QDLPZ3UAgZNoR5d69kckoahXHUl1oKiq5UVzhbr3X4EC" }, { "package_name": "infra/tools/luci/vpython/mac-amd64", "path": ".swarming_module", "version": "up_SZsefNVjCYV99Mh2FddLgkRCR_FxXo_Qn2bhROIsC" } ] }, "completed_ts": "2019-04-25T07:42:49.123404", "costs_usd": [ 0.22007747404048444 ], "created_ts": "2019-04-25T07:26:05.803398", "duration": 920.17906498909, "modified_ts": "2019-04-25T07:42:49.123404", "name": "ios_chrome_web_egtests (iPhone 7 iOS 12.1)/Mac-10.13.6/609acf9add/ios-simulator-full-configs/14055", "output": "[I 2019-04-25 00:26:27] About to install Xcode 10b61 in Xcode.app for ios\n[12:26:30:INFO] Using Xcode version 10.1 build 10B61 at /b/s/w/ir/Xcode.app/Contents/Developer\nDevice wiped.\n[12:26:42:DEBUG] Setting sigterm handler.\n[12:26:44:INFO] User defaults from command line:\n[12:26:44:INFO] IDETestRunSpecificationPath = /var/folders/2j/22s2gz0s7hn48k32d47clxf80000gm/T/CDDE2146-8A72-4974-8ED8-68BC2F3EFBD9\n[12:26:44:INFO] \n[12:26:44:INFO] Testing started on 'iPhone 7'\n[12:26:44:INFO] 2019-04-25 00:26:44.845 xcodebuild[7133:84614] IDETestOperationsObserverDebug: Writing diagnostic log for test session to:\n[12:26:44:INFO] /Users/chrome-bot/Library/Developer/Xcode/DerivedData/temporary-gsuopqiueirojudysnnszpmdatgd/Logs/Test/Test-Transient Testing-2019.04.25_00-26-44--0700.xcresult/1_Test/Diagnostics/ios_chrome_web_egtests_module-87BE3389-D32D-45C5-AD73-3B889BE984C3/ios_chrome_web_egtests_module-241EBD9E-E4A3-4C47-B8AF-C2A8447625CC/Session-ios_chrome_web_egtests_module-2019-04-25_002644-37QjS8.log\n[12:26:44:INFO] 2019-04-25 00:26:44.846 xcodebuild[7133:84605] [MT] IDETestOperationsObserverDebug: (89323A1B-3388-41F6-BE6C-EE925C0F903E) Beginning test session ios_chrome_web_egtests_module-89323A1B-3388-41F6-BE6C-EE925C0F903E at 2019-04-25 00:26:44.846 with Xcode 10B61 on target <DVTiPhoneSimulator: 0x7ff97fa50610> {\n[12:26:44:INFO] \t\tSimDevice: iPhone 7 (A0F36617-63FE-4FFE-A598-3EF71B75EA7D, iOS 12.1, Shutdown)\n[12:26:44:INFO] } (12.1 (16B91))\n[12:27:14:INFO] 2019-04-25 00:27:14.324 ios_chrome_web_egtests[7259:85889] Crash handler setup started.\n[12:27:14:INFO] 2019-04-25 00:27:14.326 ios_chrome_web_egtests[7259:85889] Crash handler setup completed.\n[12:27:14:INFO] 2019-04-25 00:27:14.327 ios_chrome_web_egtests[7259:85889] Enabling accessibility for automation on Simulator.\n[12:27:16:INFO] 2019-04-25 00:27:16.057 ios_chrome_web_egtests[7259:85889] could not create directory \"\" for future sandbox extension, error Error Domain=NSCocoaErrorDomain Code=512 \"The file \u201c\u201d couldn\u2019t be saved.\" UserInfo={NSFilePath=}\n[12:27:16:INFO] 2019-04-25 00:27:16.057 ios_chrome_web_egtests[7259:85889] could not create directory \"\" for future sandbox extension, error Error Domain=NSCocoaErrorDomain Code=512 \"The file \u201c\u201d couldn\u2019t be saved.\" UserInfo={NSFilePath=}\n[12:27:16:INFO] 2019-04-25 00:27:16.058 ios_chrome_web_egtests[7259:85889] could not create directory \"\" for future sandbox extension, error Error Domain=NSCocoaErrorDomain Code=512 \"The file \u201c\u201d couldn\u2019t be saved.\" UserInfo={NSFilePath=}\n[12:27:16:INFO] 2019-04-25 00:27:16.058 ios_chrome_web_egtests[7259:85889] could not create directory \"\" for future sandbox extension, error Error Domain=NSCocoaErrorDomain Code=512 \"The file \u201c\u201d couldn\u2019t be saved.\" UserInfo={NSFilePath=}\n[12:27:17:INFO] 2019-04-25 00:27:17.623 ios_chrome_web_egtests[7259:85889] Unbalanced calls to begin/end appearance transitions for <TabGridViewController: 0x7fa567880200>.\n[12:27:17:INFO] [0425/002717.708541:WARNING:leveldb_database.cc(106)] Unable to open /Users/chrome-bot/Library/Developer/CoreSimulator/Devices/A0F36617-63FE-4FFE-A598-3EF71B75EA7D/data/Containers/Data/Application/32B5AC45-3CE7-447E-AE4F-266ABF34B358/Library/Application Support/Chromium/Default/shared_proto_db: Invalid argument: /Users/chrome-bot/Library/Developer/CoreSimulator/Devices/A0F36617-63FE-4FFE-A598-3EF71B75EA7D/data/Containers/Data/Application/32B5AC45-3CE7-447E-AE4F-266ABF34B358/Library/Application Support/Chromium/Default/shared_proto_db: does not exist (create_if_missing is false)\n[12:27:17:INFO] [0425/002717.887206:ERROR:send_tab_to_self_client_service_ios.mm(120)] Not implemented reached in virtual void send_tab_to_self::SendTabToSelfClientServiceIOS::EntriesRemovedRemotely(const std::vector<std::string> &)\n[12:27:25:INFO] Test Suite 'All tests' started at 2019-04-25 00:27:25.406\n[12:27:25:INFO] Test Suite 'ios_chrome_web_egtests.app' started at 2019-04-25 00:27:25.408\n[12:27:25:INFO] Test Suite 'BrowsingPreventDefaultTestCase' started at 2019-04-25 00:27:25.408\n[12:27:25:INFO] [0425/002725.420657:WARNING:loopback_server.cc(820)] Loopback sync persistent state file does not exist.\n[12:27:27:INFO] Test Case '-[BrowsingPreventDefaultTestCase testPreventDefaultOverridesStopPropagation]' started.\n[12:27:29:INFO] [0425/002729.364174:WARNING:embedded_test_server.cc(238)] Request not handled. Returning 404: /favicon.ico\n[12:27:32:INFO] Test Case '-[BrowsingPreventDefaultTestCase testPreventDefaultOverridesStopPropagation]' passed (4.929 seconds).\n[12:27:32:INFO] Test Case '-[BrowsingPreventDefaultTestCase testPreventDefaultOverridesTargetBlank]' started.\n[12:27:37:INFO] Test Case '-[BrowsingPreventDefaultTestCase testPreventDefaultOverridesTargetBlank]' passed (4.771 seconds).\n[12:27:37:INFO] Test Case '-[BrowsingPreventDefaultTestCase testPreventDefaultOverridesWindowOpen]' started.\n[12:27:42:INFO] Test Case '-[BrowsingPreventDefaultTestCase testPreventDefaultOverridesWindowOpen]' passed (5.853 seconds).\n[12:27:42:INFO] Test Suite 'BrowsingPreventDefaultTestCase' passed at 2019-04-25 00:27:42.856.\n[12:27:42:INFO] \t Executed 3 tests, with 0 failures (0 unexpected) in 15.553 (17.448) seconds\n[12:27:42:INFO] Test Suite 'BrowsingTestCase' started at 2019-04-25 00:27:42.857\n[12:27:42:INFO] [0425/002742.858266:WARNING:loopback_server.cc(820)] Loopback sync persistent state file does not exist.\n[12:27:42:INFO] Test Case '-[BrowsingTestCase testBrowsingJavaScriptBasedNavigation]' started.\n[12:27:44:INFO] [0425/002744.737105:WARNING:embedded_test_server.cc(238)] Request not handled. Returning 404: /favicon.ico\n[12:27:50:INFO] Test Case '-[BrowsingTestCase testBrowsingJavaScriptBasedNavigation]' passed (7.633 seconds).\n[12:27:50:INFO] Test Case '-[BrowsingTestCase testBrowsingStopPropagation]' started.\n[12:27:56:INFO] Test Case '-[BrowsingTestCase testBrowsingStopPropagation]' passed (5.962 seconds).\n[12:27:56:INFO] Test Case '-[BrowsingTestCase testBrowsingStopPropagationRelativePath]' started.\n[12:28:02:INFO] Test Case '-[BrowsingTestCase testBrowsingStopPropagationRelativePath]' passed (5.983 seconds).\n[12:28:02:INFO] Test Case '-[BrowsingTestCase testBrowsingTabTitleSetFromScript]' started.\n[12:28:04:INFO] 2019-04-25 00:28:04.267 ios_chrome_web_egtests[7259:85889] -- Earl Grey Test Skipped -- Tab Title not displayed on handset.\n[12:28:06:INFO] Test Case '-[BrowsingTestCase testBrowsingTabTitleSetFromScript]' passed (3.704 seconds).\n[12:28:06:INFO] Test Case '-[BrowsingTestCase testBrowsingTabTitleSetFromURL]' started.\n[12:28:07:INFO] 2019-04-25 00:28:07.966 ios_chrome_web_egtests[7259:85889] -- Earl Grey Test Skipped -- Tab Title not displayed on handset.\n[12:28:09:INFO] Test Case '-[BrowsingTestCase testBrowsingTabTitleSetFromURL]' passed (3.697 seconds).\n[12:28:09:INFO] Test Case '-[BrowsingTestCase testBrowsingUserJavaScriptNavigation]' started.\n[12:28:14:INFO] 2019-04-25 00:28:14.301 ios_chrome_web_egtests[7259:85889] Attempting to type key j.\n[12:28:14:INFO] 2019-04-25 00:28:14.304 ios_chrome_web_egtests[7259:85889] Tapping on key: j.\n[12:28:14:INFO] 2019-04-25 00:28:14.451 ios_chrome_web_egtests[7259:85889] Attempting to type key a.\n[12:28:14:INFO] 2019-04-25 00:28:14.454 ios_chrome_web_egtests[7259:85889] Tapping on key: a.\n[12:28:14:INFO] 2019-04-25 00:28:14.552 ios_chrome_web_egtests[7259:85889] Attempting to type key v.\n[12:28:14:INFO] 2019-04-25 00:28:14.555 ios_chrome_web_egtests[7259:85889] Tapping on key: v.\n[12:28:14:INFO] 2019-04-25 00:28:14.646 ios_chrome_web_egtests[7259:85889] Attempting to type key a.\n[12:28:14:INFO] 2019-04-25 00:28:14.647 ios_chrome_web_egtests[7259:85889] Tapping on key: a.\n[12:28:14:INFO] 2019-04-25 00:28:14.718 ios_chrome_web_egtests[7259:85889] Attempting to type key s.\n[12:28:14:INFO] 2019-04-25 00:28:14.719 ios_chrome_web_egtests[7259:85889] Tapping on key: s.\n[12:28:14:INFO] 2019-04-25 00:28:14.788 ios_chrome_web_egtests[7259:85889] Attempting to type key c.\n[12:28:14:INFO] 2019-04-25 00:28:14.789 ios_chrome_web_egtests[7259:85889] Tapping on key: c.\n[12:28:14:INFO] 2019-04-25 00:28:14.861 ios_chrome_web_egtests[7259:85889] Attempting to type key r.\n[12:28:14:INFO] 2019-04-25 00:28:14.862 ios_chrome_web_egtests[7259:85889] Tapping on key: r.\n[12:28:14:INFO] 2019-04-25 00:28:14.931 ios_chrome_web_egtests[7259:85889] Attempting to type key i.\n[12:28:14:INFO] 2019-04-25 00:28:14.932 ios_chrome_web_egtests[7259:85889] Tapping on key: i.\n[12:28:15:INFO] 2019-04-25 00:28:15.002 ios_chrome_web_egtests[7259:85889] Attempting to type key p.\n[12:28:15:INFO] 2019-04-25 00:28:15.002 ios_chrome_web_egtests[7259:85889] Tapping on key: p.\n[12:28:15:INFO] 2019-04-25 00:28:15.071 ios_chrome_web_egtests[7259:85889] Attempting to type key t.\n[12:28:15:INFO] 2019-04-25 00:28:15.071 ios_chrome_web_egtests[7259:85889] Tapping on key: t.\n[12:28:15:INFO] 2019-04-25 00:28:15.150 ios_chrome_web_egtests[7259:85889] Attempting to type key :.\n[12:28:15:INFO] 2019-04-25 00:28:15.252 ios_chrome_web_egtests[7259:85889] Tapping on key: more, numbers.\n[12:28:15:INFO] 2019-04-25 00:28:15.339 ios_chrome_web_egtests[7259:85889] Tapping on key: :.\n[12:28:15:INFO] 2019-04-25 00:28:15.409 ios_chrome_web_egtests[7259:85889] Attempting to type key w.\n[12:28:15:INFO] 2019-04-25 00:28:15.714 ios_chrome_web_egtests[7259:85889] Tapping on key: more, letters.\n[12:28:15:INFO] 2019-04-25 00:28:15.765 ios_chrome_web_egtests[7259:85889] Tapping on key: w.\n[12:28:15:INFO] 2019-04-25 00:28:15.823 ios_chrome_web_egtests[7259:85889] Attempting to type key i.\n[12:28:15:INFO] 2019-04-25 00:28:15.823 ios_chrome_web_egtests[7259:85889] Tapping on key: i.\n[12:28:15:INFO] 2019-04-25 00:28:15.881 ios_chrome_web_egtests[7259:85889] Attempting to type key n.\n[12:28:15:INFO] 2019-04-25 00:28:15.883 ios_chrome_web_egtests[7259:85889] Tapping on key: n.\n[12:28:15:INFO] 2019-04-25 00:28:15.941 ios_chrome_web_egtests[7259:85889] Attempting to type key d.\n[12:28:15:INFO] 2019-04-25 00:28:15.941 ios_chrome_web_egtests[7259:85889] Tapping on key: d.\n[12:28:15:INFO] 2019-04-25 00:28:15.997 ios_chrome_web_egtests[7259:85889] Attempting to type key o.\n[12:28:16:INFO] 2019-04-25 00:28:15.998 ios_chrome_web_egtests[7259:85889] Tapping on key: o.\n[12:28:16:INFO] 2019-04-25 00:28:16.058 ios_chrome_web_egtests[7259:85889] Attempting to type key w.\n[12:28:16:INFO] 2019-04-25 00:28:16.058 ios_chrome_web_egtests[7259:85889] Tapping on key: w.\n[12:28:16:INFO] 2019-04-25 00:28:16.116 ios_chrome_web_egtests[7259:85889] Attempting to type key ..\n[12:28:16:INFO] 2019-04-25 00:28:16.118 ios_chrome_web_egtests[7259:85889] Tapping on key: ..\n[12:28:16:INFO] 2019-04-25 00:28:16.184 ios_chrome_web_egtests[7259:85889] Attempting to type key l.\n[12:28:16:INFO] 2019-04-25 00:28:16.185 ios_chrome_web_egtests[7259:85889] Tapping on key: l.\n[12:28:16:INFO] 2019-04-25 00:28:16.256 ios_chrome_web_egtests[7259:85889] Attempting to type key o.\n[12:28:16:INFO] 2019-04-25 00:28:16.257 ios_chrome_web_egtests[7259:85889] Tapping on key: o.\n[12:28:16:INFO] 2019-04-25 00:28:16.314 ios_chrome_web_egtests[7259:85889] Attempting to type key c.\n[12:28:16:INFO] 2019-04-25 00:28:16.314 ios_chrome_web_egtests[7259:85889] Tapping on key: c.\n[12:28:16:INFO] 2019-04-25 00:28:16.372 ios_chrome_web_egtests[7259:85889] Attempting to type key a.\n[12:28:16:INFO] 2019-04-25 00:28:16.373 ios_chrome_web_egtests[7259:85889] Tapping on key: a.\n[12:28:16:INFO] 2019-04-25 00:28:16.430 ios_chrome_web_egtests[7259:85889] Attempting to type key t.\n[12:28:16:INFO] 2019-04-25 00:28:16.431 ios_chrome_web_egtests[7259:85889] Tapping on key: t.\n[12:28:16:INFO] 2019-04-25 00:28:16.488 ios_chrome_web_egtests[7259:85889] Attempting to type key i.\n[12:28:16:INFO] 2019-04-25 00:28:16.489 ios_chrome_web_egtests[7259:85889] Tapping on key: i.\n[12:28:16:INFO] 2019-04-25 00:28:16.546 ios_chrome_web_egtests[7259:85889] Attempting to type key o.\n[12:28:16:INFO] 2019-04-25 00:28:16.547 ios_chrome_web_egtests[7259:85889] Tapping on key: o.\n[12:28:16:INFO] 2019-04-25 00:28:16.607 ios_chrome_web_egtests[7259:85889] Attempting to type key n.\n[12:28:16:INFO] 2019-04-25 00:28:16.608 ios_chrome_web_egtests[7259:85889] Tapping on key: n.\n[12:28:16:INFO] 2019-04-25 00:28:16.665 ios_chrome_web_egtests[7259:85889] Attempting to type key =.\n[12:28:16:INFO] 2019-04-25 00:28:16.766 ios_chrome_web_egtests[7259:85889] Tapping on key: more, numbers.\n[12:28:16:INFO] 2019-04-25 00:28:16.936 ios_chrome_web_egtests[7259:85889] Tapping on key: more, symbols.\n[12:28:17:INFO] 2019-04-25 00:28:17.005 ios_chrome_web_egtests[7259:85889] Tapping on key: =.\n[12:28:17:INFO] 2019-04-25 00:28:17.063 ios_chrome_web_egtests[7259:85889] Attempting to type key '.\n[12:28:17:INFO] 2019-04-25 00:28:17.065 ios_chrome_web_egtests[7259:85889] Tapping on key: '.\n[12:28:17:INFO] 2019-04-25 00:28:17.144 ios_chrome_web_egtests[7259:85889] Attempting to type key h.\n[12:28:17:INFO] 2019-04-25 00:28:17.146 ios_chrome_web_egtests[7259:85889] Tapping on key: h.\n[12:28:17:INFO] 2019-04-25 00:28:17.202 ios_chrome_web_egtests[7259:85889] Attempting to type key t.\n[12:28:17:INFO] 2019-04-25 00:28:17.203 ios_chrome_web_egtests[7259:85889] Tapping on key: t.\n[12:28:17:INFO] 2019-04-25 00:28:17.260 ios_chrome_web_egtests[7259:85889] Attempting to type key t.\n[12:28:17:INFO] 2019-04-25 00:28:17.261 ios_chrome_web_egtests[7259:85889] Tapping on key: t.\n[12:28:17:INFO] 2019-04-25 00:28:17.321 ios_chrome_web_egtests[7259:85889] Attempting to type key p.\n[12:28:17:INFO] 2019-04-25 00:28:17.321 ios_chrome_web_egtests[7259:85889] Tapping on key: p.\n[12:28:17:INFO] 2019-04-25 00:28:17.380 ios_chrome_web_egtests[7259:85889] Attempting to type key :.\n[12:28:17:INFO] 2019-04-25 00:28:17.484 ios_chrome_web_egtests[7259:85889] Tapping on key: more, numbers.\n[12:28:17:INFO] 2019-04-25 00:28:17.555 ios_chrome_web_egtests[7259:85889] Tapping on key: :.\n[12:28:17:INFO] 2019-04-25 00:28:17.616 ios_chrome_web_egtests[7259:85889] Attempting to type key /.\n[12:28:17:INFO] 2019-04-25 00:28:17.617 ios_chrome_web_egtests[7259:85889] Tapping on key: /.\n[12:28:17:INFO] 2019-04-25 00:28:17.676 ios_chrome_web_egtests[7259:85889] Attempting to type key /.\n[12:28:17:INFO] 2019-04-25 00:28:17.677 ios_chrome_web_egtests[7259:85889] Tapping on key: /.\n[12:28:17:INFO] 2019-04-25 00:28:17.736 ios_chrome_web_egtests[7259:85889] Attempting to type key 1.\n[12:28:17:INFO] 2019-04-25 00:28:17.736 ios_chrome_web_egtests[7259:85889] Tapping on key: 1.\n[12:28:17:INFO] 2019-04-25 00:28:17.798 ios_chrome_web_egtests[7259:85889] Attempting to type key 2.\n[12:28:17:INFO] 2019-04-25 00:28:17.799 ios_chrome_web_egtests[7259:85889] Tapping on key: 2.\n[12:28:17:INFO] 2019-04-25 00:28:17.858 ios_chrome_web_egtests[7259:85889] Attempting to type key 7.\n[12:28:17:INFO] 2019-04-25 00:28:17.858 ios_chrome_web_egtests[7259:85889] Tapping on key: 7.\n[12:28:17:INFO] 2019-04-25 00:28:17.919 ios_chrome_web_egtests[7259:85889] Attempting to type key ..\n[12:28:17:INFO] 2019-04-25 00:28:17.921 ios_chrome_web_egtests[7259:85889] Tapping on key: ..\n[12:28:17:INFO] 2019-04-25 00:28:17.982 ios_chrome_web_egtests[7259:85889] Attempting to type key 0.\n[12:28:17:INFO] 2019-04-25 00:28:17.983 ios_chrome_web_egtests[7259:85889] Tapping on key: 0.\n[12:28:18:INFO] 2019-04-25 00:28:18.053 ios_chrome_web_egtests[7259:85889] Attempting to type key ..\n[12:28:18:INFO] 2019-04-25 00:28:18.056 ios_chrome_web_egtests[7259:85889] Tapping on key: ..\n[12:28:18:INFO] 2019-04-25 00:28:18.121 ios_chrome_web_egtests[7259:85889] Attempting to type key 0.\n[12:28:18:INFO] 2019-04-25 00:28:18.122 ios_chrome_web_egtests[7259:85889] Tapping on key: 0.\n[12:28:18:INFO] 2019-04-25 00:28:18.182 ios_chrome_web_egtests[7259:85889] Attempting to type key ..\n[12:28:18:INFO] 2019-04-25 00:28:18.183 ios_chrome_web_egtests[7259:85889] Tapping on key: ..\n[12:28:18:INFO] 2019-04-25 00:28:18.242 ios_chrome_web_egtests[7259:85889] Attempting to type key 1.\n[12:28:18:INFO] 2019-04-25 00:28:18.242 ios_chrome_web_egtests[7259:85889] Tapping on key: 1.\n[12:28:18:INFO] 2019-04-25 00:28:18.304 ios_chrome_web_egtests[7259:85889] Attempting to type key :.\n[12:28:18:INFO] 2019-04-25 00:28:18.305 ios_chrome_web_egtests[7259:85889] Tapping on key: :.\n[12:28:18:INFO] 2019-04-25 00:28:18.364 ios_chrome_web_egtests[7259:85889] Attempting to type key 5.\n[12:28:18:INFO] 2019-04-25 00:28:18.365 ios_chrome_web_egtests[7259:85889] Tapping on key: 5.\n[12:28:18:INFO] 2019-04-25 00:28:18.425 ios_chrome_web_egtests[7259:85889] Attempting to type key 1.\n[12:28:18:INFO] 2019-04-25 00:28:18.426 ios_chrome_web_egtests[7259:85889] Tapping on key: 1.\n[12:28:18:INFO] 2019-04-25 00:28:18.486 ios_chrome_web_egtests[7259:85889] Attempting to type key 2.\n[12:28:18:INFO] 2019-04-25 00:28:18.487 ios_chrome_web_egtests[7259:85889] Tapping on key: 2.\n[12:28:18:INFO] 2019-04-25 00:28:18.552 ios_chrome_web_egtests[7259:85889] Attempting to type key 6.\n[12:28:18:INFO] 2019-04-25 00:28:18.553 ios_chrome_web_egtests[7259:85889] Tapping on key: 6.\n[12:28:18:INFO] 2019-04-25 00:28:18.613 ios_chrome_web_egtests[7259:85889] Attempting to type key 6.\n[12:28:18:INFO] 2019-04-25 00:28:18.614 ios_chrome_web_egtests[7259:85889] Tapping on key: 6.\n[12:28:18:INFO] 2019-04-25 00:28:18.675 ios_chrome_web_egtests[7259:85889] Attempting to type key /.\n[12:28:18:INFO] 2019-04-25 00:28:18.676 ios_chrome_web_egtests[7259:85889] Tapping on key: /.\n[12:28:18:INFO] 2019-04-25 00:28:18.737 ios_chrome_web_egtests[7259:85889] Attempting to type key t.\n[12:28:19:INFO] 2019-04-25 00:28:19.045 ios_chrome_web_egtests[7259:85889] Tapping on key: more, letters.\n[12:28:19:INFO] 2019-04-25 00:28:19.097 ios_chrome_web_egtests[7259:85889] Tapping on key: t.\n[12:28:19:INFO] 2019-04-25 00:28:19.158 ios_chrome_web_egtests[7259:85889] Attempting to type key a.\n[12:28:19:INFO] 2019-04-25 00:28:19.159 ios_chrome_web_egtests[7259:85889] Tapping on key: a.\n[12:28:19:INFO] 2019-04-25 00:28:19.219 ios_chrome_web_egtests[7259:85889] Attempting to type key r.\n[12:28:19:INFO] 2019-04-25 00:28:19.219 ios_chrome_web_egtests[7259:85889] Tapping on key: r.\n[12:28:19:INFO] 2019-04-25 00:28:19.279 ios_chrome_web_egtests[7259:85889] Attempting to type key g.\n[12:28:19:INFO] 2019-04-25 00:28:19.280 ios_chrome_web_egtests[7259:85889] Tapping on key: g.\n[12:28:19:INFO] 2019-04-25 00:28:19.340 ios_chrome_web_egtests[7259:85889] Attempting to type key e.\n[12:28:19:INFO] 2019-04-25 00:28:19.340 ios_chrome_web_egtests[7259:85889] Tapping on key: e.\n[12:28:19:INFO] 2019-04-25 00:28:19.401 ios_chrome_web_egtests[7259:85889] Attempting to type key t.\n[12:28:19:INFO] 2019-04-25 00:28:19.401 ios_chrome_web_egtests[7259:85889] Tapping on key: t.\n[12:28:19:INFO] 2019-04-25 00:28:19.459 ios_chrome_web_egtests[7259:85889] Attempting to type key p.\n[12:28:19:INFO] 2019-04-25 00:28:19.460 ios_chrome_web_egtests[7259:85889] Tapping on key: p.\n[12:28:19:INFO] 2019-04-25 00:28:19.520 ios_chrome_web_egtests[7259:85889] Attempting to type key a.\n[12:28:19:INFO] 2019-04-25 00:28:19.521 ios_chrome_web_egtests[7259:85889] Tapping on key: a.\n[12:28:19:INFO] 2019-04-25 00:28:19.581 ios_chrome_web_egtests[7259:85889] Attempting to type key g.\n[12:28:19:INFO] 2019-04-25 00:28:19.582 ios_chrome_web_egtests[7259:85889] Tapping on key: g.\n[12:28:19:INFO] 2019-04-25 00:28:19.643 ios_chrome_web_egtests[7259:85889] Attempting to type key e.\n[12:28:19:INFO] 2019-04-25 00:28:19.644 ios_chrome_web_egtests[7259:85889] Tapping on key: e.\n[12:28:19:INFO] 2019-04-25 00:28:19.703 ios_chrome_web_egtests[7259:85889] Attempting to type key /.\n[12:28:19:INFO] 2019-04-25 00:28:19.806 ios_chrome_web_egtests[7259:85889] Tapping on key: more, numbers.\n[12:28:19:INFO] 2019-04-25 00:28:19.858 ios_chrome_web_egtests[7259:85889] Tapping on key: /.\n[12:28:19:INFO] 2019-04-25 00:28:19.920 ios_chrome_web_egtests[7259:85889] Attempting to type key '.\n[12:28:19:INFO] 2019-04-25 00:28:19.922 ios_chrome_web_egtests[7259:85889] Tapping on key: '.\n[12:28:24:INFO] Test Case '-[BrowsingTestCase testBrowsingUserJavaScriptNavigation]' passed (14.787 seconds).\n[12:28:24:INFO] Test Case '-[BrowsingTestCase testBrowsingUserJavaScriptWithoutNavigation]' started.\n[12:28:29:INFO] 2019-04-25 00:28:29.650 ios_chrome_web_egtests[7259:85889] Attempting to type key j.\n[12:28:29:INFO] 2019-04-25 00:28:29.652 ios_chrome_web_egtests[7259:85889] Tapping on key: j.\n[12:28:29:INFO] 2019-04-25 00:28:29.770 ios_chrome_web_egtests[7259:85889] Attempting to type key a.\n[12:28:29:INFO] 2019-04-25 00:28:29.771 ios_chrome_web_egtests[7259:85889] Tapping on key: a.\n[12:28:29:INFO] 2019-04-25 00:28:29.858 ios_chrome_web_egtests[7259:85889] Attempting to type key v.\n[12:28:29:INFO] 2019-04-25 00:28:29.860 ios_chrome_web_egtests[7259:85889] Tapping on key: v.\n[12:28:29:INFO] 2019-04-25 00:28:29.941 ios_chrome_web_egtests[7259:85889] Attempting to type key a.\n[12:28:29:INFO] 2019-04-25 00:28:29.942 ios_chrome_web_egtests[7259:85889] Tapping on key: a.\n[12:28:30:INFO] 2019-04-25 00:28:30.024 ios_chrome_web_egtests[7259:85889] Attempting to type key s.\n[12:28:30:INFO] 2019-04-25 00:28:30.025 ios_chrome_web_egtests[7259:85889] Tapping on key: s.\n[12:28:30:INFO] 2019-04-25 00:28:30.110 ios_chrome_web_egtests[7259:85889] Attempting to type key c.\n[12:28:30:INFO] 2019-04-25 00:28:30.111 ios_chrome_web_egtests[7259:85889] Tapping on key: c.\n[12:28:30:INFO] 2019-04-25 00:28:30.182 ios_chrome_web_egtests[7259:85889] Attempting to type key r.\n[12:28:30:INFO] 2019-04-25 00:28:30.183 ios_chrome_web_egtests[7259:85889] Tapping on key: r.\n[12:28:30:INFO] 2019-04-25 00:28:30.254 ios_chrome_web_egtests[7259:85889] Attempting to type key i.\n[12:28:30:INFO] 2019-04-25 00:28:30.255 ios_chrome_web_egtests[7259:85889] Tapping on key: i.\n[12:28:30:INFO] 2019-04-25 00:28:30.334 ios_chrome_web_egtests[7259:85889] Attempting to type key p.\n[12:28:30:INFO] 2019-04-25 00:28:30.335 ios_chrome_web_egtests[7259:85889] Tapping on key: p.\n[12:28:30:INFO] 2019-04-25 00:28:30.405 ios_chrome_web_egtests[7259:85889] Attempting to type key t.\n[12:28:30:INFO] 2019-04-25 00:28:30.406 ios_chrome_web_egtests[7259:85889] Tapping on key: t.\n[12:28:30:INFO] 2019-04-25 00:28:30.479 ios_chrome_web_egtests[7259:85889] Attempting to type key :.\n[12:28:30:INFO] 2019-04-25 00:28:30.582 ios_chrome_web_egtests[7259:85889] Tapping on key: more, numbers.\n[12:28:30:INFO] 2019-04-25 00:28:30.652 ios_chrome_web_egtests[7259:85889] Tapping on key: :.\n[12:28:30:INFO] 2019-04-25 00:28:30.717 ios_chrome_web_egtests[7259:85889] Attempting to type key d.\n[12:28:31:INFO] 2019-04-25 00:28:31.023 ios_chrome_web_egtests[7259:85889] Tapping on key: more, letters.\n[12:28:31:INFO] 2019-04-25 00:28:31.075 ios_chrome_web_egtests[7259:85889] Tapping on key: d.\n[12:28:31:INFO] 2019-04-25 00:28:31.135 ios_chrome_web_egtests[7259:85889] Attempting to type key o.\n[12:28:31:INFO] 2019-04-25 00:28:31.136 ios_chrome_web_egtests[7259:85889] Tapping on key: o.\n[12:28:31:INFO] 2019-04-25 00:28:31.196 ios_chrome_web_egtests[7259:85889] Attempting to type key c.\n[12:28:31:INFO] 2019-04-25 00:28:31.198 ios_chrome_web_egtests[7259:85889] Tapping on key: c.\n[12:28:31:INFO] 2019-04-25 00:28:31.256 ios_chrome_web_egtests[7259:85889] Attempting to type key u.\n[12:28:31:INFO] 2019-04-25 00:28:31.257 ios_chrome_web_egtests[7259:85889] Tapping on key: u.\n[12:28:31:INFO] 2019-04-25 00:28:31.316 ios_chrome_web_egtests[7259:85889] Attempting to type key m.\n[12:28:31:INFO] 2019-04-25 00:28:31.317 ios_chrome_web_egtests[7259:85889] Tapping on key: m.\n[12:28:31:INFO] 2019-04-25 00:28:31.378 ios_chrome_web_egtests[7259:85889] Attempting to type key e.\n[12:28:31:INFO] 2019-04-25 00:28:31.378 ios_chrome_web_egtests[7259:85889] Tapping on key: e.\n[12:28:31:INFO] 2019-04-25 00:28:31.437 ios_chrome_web_egtests[7259:85889] Attempting to type key n.\n[12:28:31:INFO] 2019-04-25 00:28:31.438 ios_chrome_web_egtests[7259:85889] Tapping on key: n.\n[12:28:31:INFO] 2019-04-25 00:28:31.498 ios_chrome_web_egtests[7259:85889] Attempting to type key t.\n[12:28:31:INFO] 2019-04-25 00:28:31.499 ios_chrome_web_egtests[7259:85889] Tapping on key: t.\n[12:28:31:INFO] 2019-04-25 00:28:31.565 ios_chrome_web_egtests[7259:85889] Attempting to type key ..\n[12:28:31:INFO] 2019-04-25 00:28:31.567 ios_chrome_web_egtests[7259:85889] Tapping on key: ..\n[12:28:31:INFO] 2019-04-25 00:28:31.637 ios_chrome_web_egtests[7259:85889] Attempting to type key w.\n[12:28:31:INFO] 2019-04-25 00:28:31.638 ios_chrome_web_egtests[7259:85889] Tapping on key: w.\n[12:28:31:INFO] 2019-04-25 00:28:31.698 ios_chrome_web_egtests[7259:85889] Attempting to type key r.\n[12:28:31:INFO] 2019-04-25 00:28:31.698 ios_chrome_web_egtests[7259:85889] Tapping on key: r.\n[12:28:31:INFO] 2019-04-25 00:28:31.761 ios_chrome_web_egtests[7259:85889] Attempting to type key i.\n[12:28:31:INFO] 2019-04-25 00:28:31.762 ios_chrome_web_egtests[7259:85889] Tapping on key: i.\n[12:28:31:INFO] 2019-04-25 00:28:31.825 ios_chrome_web_egtests[7259:85889] Attempting to type key t.\n[12:28:31:INFO] 2019-04-25 00:28:31.826 ios_chrome_web_egtests[7259:85889] Tapping on key: t.\n[12:28:31:INFO] 2019-04-25 00:28:31.885 ios_chrome_web_egtests[7259:85889] Attempting to type key e.\n[12:28:31:INFO] 2019-04-25 00:28:31.885 ios_chrome_web_egtests[7259:85889] Tapping on key: e.\n[12:28:31:INFO] 2019-04-25 00:28:31.944 ios_chrome_web_egtests[7259:85889] Attempting to type key (.\n[12:28:32:INFO] 2019-04-25 00:28:32.047 ios_chrome_web_egtests[7259:85889] Tapping on key: more, numbers.\n[12:28:32:INFO] 2019-04-25 00:28:32.100 ios_chrome_web_egtests[7259:85889] Tapping on key: (.\n[12:28:32:INFO] 2019-04-25 00:28:32.162 ios_chrome_web_egtests[7259:85889] Attempting to type key '.\n[12:28:32:INFO] 2019-04-25 00:28:32.164 ios_chrome_web_egtests[7259:85889] Tapping on key: '.\n[12:28:32:INFO] 2019-04-25 00:28:32.243 ios_chrome_web_egtests[7259:85889] Attempting to type key f.\n[12:28:32:INFO] 2019-04-25 00:28:32.246 ios_chrome_web_egtests[7259:85889] Tapping on key: f.\n[12:28:32:INFO] 2019-04-25 00:28:32.306 ios_chrome_web_egtests[7259:85889] Attempting to type key o.\n[12:28:32:INFO] 2019-04-25 00:28:32.306 ios_chrome_web_egtests[7259:85889] Tapping on key: o.\n[12:28:32:INFO] 2019-04-25 00:28:32.366 ios_chrome_web_egtests[7259:85889] Attempting to type key o.\n[12:28:32:INFO] 2019-04-25 00:28:32.367 ios_chrome_web_egtests[7259:85889] Tapping on key: o.\n[12:28:32:INFO] 2019-04-25 00:28:32.427 ios_chrome_web_egtests[7259:85889] Attempting to type key '.\n[12:28:32:INFO] 2019-04-25 00:28:32.531 ios_chrome_web_egtests[7259:85889] Tapping on key: more, numbers.\n[12:28:32:INFO] 2019-04-25 00:28:32.603 ios_chrome_web_egtests[7259:85889] Tapping on key: '.\n[12:28:32:INFO] 2019-04-25 00:28:32.687 ios_chrome_web_egtests[7259:85889] Attempting to type key ).\n[12:28:32:INFO] 2019-04-25 00:28:32.788 ios_chrome_web_egtests[7259:85889] Tapping on key: more, numbers.\n[12:28:32:INFO] 2019-04-25 00:28:32.841 ios_chrome_web_egtests[7259:85889] Tapping on key: ).\n[12:28:32:INFO] 2019-04-25 00:28:32.908 ios_chrome_web_egtests[7259:85889] Attempting to type key\n[12:28:32:INFO] .\n[12:28:32:INFO] 2019-04-25 00:28:32.910 ios_chrome_web_egtests[7259:85889] Tapping on key: Go.\n[12:28:37:INFO] Test Case '-[BrowsingTestCase testBrowsingUserJavaScriptWithoutNavigation]' passed (12.908 seconds).\n[12:28:37:INFO] Test Case '-[BrowsingTestCase testBrowsingWindowDataLinkScriptRedirect]' started.\n[12:28:43:INFO] Test Case '-[BrowsingTestCase testBrowsingWindowDataLinkScriptRedirect]' passed (5.948 seconds).\n[12:28:43:INFO] Test Case '-[BrowsingTestCase testPDFLoadTitle]' started.\n[12:28:45:INFO] 2019-04-25 00:28:45.270 ios_chrome_web_egtests[7259:85889] -- Earl Grey Test Skipped -- Tab Title not displayed on handset.\n[12:28:47:INFO] Test Case '-[BrowsingTestCase testPDFLoadTitle]' passed (3.661 seconds).\n[12:28:47:INFO] Test Case '-[BrowsingTestCase testReload]' started.\n[12:28:52:INFO] [0425/002852.206752:WARNING:web_state_impl.mm(661)] Script execution has failed: A JavaScript exception occurred\n[12:28:55:INFO] Test Case '-[BrowsingTestCase testReload]' passed (7.957 seconds).\n[12:28:55:INFO] Test Case '-[BrowsingTestCase testTapLinkWithWebUIURL]' started.\n[12:28:59:INFO] Test Case '-[BrowsingTestCase testTapLinkWithWebUIURL]' passed (4.810 seconds).\n[12:28:59:INFO] Test Suite 'BrowsingTestCase' passed at 2019-04-25 00:28:59.915.\n[12:28:59:INFO] \t Executed 11 tests, with 0 failures (0 unexpected) in 77.047 (77.058) seconds\n[12:28:59:INFO] Test Suite 'CacheTestCase' started at 2019-04-25 00:28:59.916\n[12:28:59:INFO] [0425/002859.917418:WARNING:loopback_server.cc(820)] Loopback sync persistent state file does not exist.\n[12:28:59:INFO] Test Case '-[CacheTestCase testCachingBehaviorOnNavigateBackAndPageReload]' started.\n[12:29:01:INFO] 2019-04-25 00:29:01.666 ios_chrome_web_egtests[7259:85889] -- Earl Grey Test Disabled -- Disabled on iOS 10.3.1 and afterwards.\n[12:29:03:INFO] Test Case '-[CacheTestCase testCachingBehaviorOnNavigateBackAndPageReload]' passed (3.620 seconds).\n[12:29:03:INFO] Test Case '-[CacheTestCase testCachingBehaviorOnOpenNewTab]' started.\n[12:29:05:INFO] [0425/002905.431356:WARNING:embedded_test_server.cc(238)] Request not handled. Returning 404: /favicon.ico\n[12:29:10:INFO] Test Case '-[CacheTestCase testCachingBehaviorOnOpenNewTab]' passed (6.978 seconds).\n[12:29:10:INFO] Test Case '-[CacheTestCase testCachingBehaviorOnSelectOmniboxSuggestion]' started.\n[12:29:14:INFO] 2019-04-25 00:29:14.533 ios_chrome_web_egtests[7259:85889] Attempting to type key c.\n[12:29:14:INFO] 2019-04-25 00:29:14.535 ios_chrome_web_egtests[7259:85889] Tapping on key: c.\n[12:29:14:INFO] 2019-04-25 00:29:14.618 ios_chrome_web_egtests[7259:85889] Attempting to type key a.\n[12:29:14:INFO] 2019-04-25 00:29:14.619 ios_chrome_web_egtests[7259:85889] Tapping on key: a.\n[12:29:14:INFO] 2019-04-25 00:29:14.710 ios_chrome_web_egtests[7259:85889] Attempting to type key c.\n[12:29:14:INFO] 2019-04-25 00:29:14.711 ios_chrome_web_egtests[7259:85889] Tapping on key: c.\n[12:29:14:INFO] 2019-04-25 00:29:14.789 ios_chrome_web_egtests[7259:85889] Attempting to type key h.\n[12:29:14:INFO] 2019-04-25 00:29:14.790 ios_chrome_web_egtests[7259:85889] Tapping on key: h.\n[12:29:14:INFO] 2019-04-25 00:29:14.878 ios_chrome_web_egtests[7259:85889] Attempting to type key e.\n[12:29:14:INFO] 2019-04-25 00:29:14.879 ios_chrome_web_egtests[7259:85889] Tapping on key: e.\n[12:29:14:INFO] 2019-04-25 00:29:14.960 ios_chrome_web_egtests[7259:85889] Attempting to type key t.\n[12:29:14:INFO] 2019-04-25 00:29:14.960 ios_chrome_web_egtests[7259:85889] Tapping on key: t.\n[12:29:15:INFO] 2019-04-25 00:29:15.050 ios_chrome_web_egtests[7259:85889] Attempting to type key e.\n[12:29:15:INFO] 2019-04-25 00:29:15.051 ios_chrome_web_egtests[7259:85889] Tapping on key: e.\n[12:29:15:INFO] 2019-04-25 00:29:15.134 ios_chrome_web_egtests[7259:85889] Attempting to type key s.\n[12:29:15:INFO] 2019-04-25 00:29:15.135 ios_chrome_web_egtests[7259:85889] Tapping on key: s.\n[12:29:15:INFO] 2019-04-25 00:29:15.216 ios_chrome_web_egtests[7259:85889] Attempting to type key t.\n[12:29:15:INFO] 2019-04-25 00:29:15.217 ios_chrome_web_egtests[7259:85889] Tapping on key: t.\n[12:29:15:INFO] 2019-04-25 00:29:15.299 ios_chrome_web_egtests[7259:85889] Attempting to type key f.\n[12:29:15:INFO] 2019-04-25 00:29:15.300 ios_chrome_web_egtests[7259:85889] Tapping on key: f.\n[12:29:15:INFO] 2019-04-25 00:29:15.390 ios_chrome_web_egtests[7259:85889] Attempting to type key i.\n[12:29:15:INFO] 2019-04-25 00:29:15.391 ios_chrome_web_egtests[7259:85889] Tapping on key: i.\n[12:29:15:INFO] 2019-04-25 00:29:15.466 ios_chrome_web_egtests[7259:85889] Attempting to type key r.\n[12:29:15:INFO] 2019-04-25 00:29:15.467 ios_chrome_web_egtests[7259:85889] Tapping on key: r.\n[12:29:15:INFO] 2019-04-25 00:29:15.535 ios_chrome_web_egtests[7259:85889] Attempting to type key s.\n[12:29:15:INFO] 2019-04-25 00:29:15.536 ios_chrome_web_egtests[7259:85889] Tapping on key: s.\n[12:29:15:INFO] 2019-04-25 00:29:15.599 ios_chrome_web_egtests[7259:85889] Attempting to type key t.\n[12:29:15:INFO] 2019-04-25 00:29:15.599 ios_chrome_web_egtests[7259:85889] Tapping on key: t.\n[12:29:15:INFO] 2019-04-25 00:29:15.661 ios_chrome_web_egtests[7259:85889] Attempting to type key p.\n[12:29:15:INFO] 2019-04-25 00:29:15.662 ios_chrome_web_egtests[7259:85889] Tapping on key: p.\n[12:29:15:INFO] 2019-04-25 00:29:15.725 ios_chrome_web_egtests[7259:85889] Attempting to type key a.\n[12:29:15:INFO] 2019-04-25 00:29:15.726 ios_chrome_web_egtests[7259:85889] Tapping on key: a.\n[12:29:15:INFO] 2019-04-25 00:29:15.789 ios_chrome_web_egtests[7259:85889] Attempting to type key g.\n[12:29:15:INFO] 2019-04-25 00:29:15.789 ios_chrome_web_egtests[7259:85889] Tapping on key: g.\n[12:29:15:INFO] 2019-04-25 00:29:15.855 ios_chrome_web_egtests[7259:85889] Attempting to type key e.\n[12:29:15:INFO] 2019-04-25 00:29:15.855 ios_chrome_web_egtests[7259:85889] Tapping on key: e.\n[12:29:19:INFO] Test Case '-[CacheTestCase testCachingBehaviorOnSelectOmniboxSuggestion]' passed (9.005 seconds).\n[12:29:19:INFO] Test Suite 'CacheTestCase' passed at 2019-04-25 00:29:19.525.\n[12:29:19:INFO] \t Executed 3 tests, with 0 failures (0 unexpected) in 19.604 (19.609) seconds\n[12:29:19:INFO] Test Suite 'ChildWindowOpenByDOMTestCase' started at 2019-04-25 00:29:19.525\n[12:29:19:INFO] [0425/002919.527012:WARNING:loopback_server.cc(820)] Loopback sync persistent state file does not exist.\n[12:29:19:INFO] Test Case '-[ChildWindowOpenByDOMTestCase test2ChildWindowsWithName]' started.\n[12:29:21:INFO] [0425/002921.488535:WARNING:embedded_test_server.cc(238)] Request not handled. Returning 404: /favicon.ico\n[12:29:26:INFO] Test Case '-[ChildWindowOpenByDOMTestCase test2ChildWindowsWithName]' passed (6.515 seconds).\n[12:29:26:INFO] Test Case '-[ChildWindowOpenByDOMTestCase test2ChildWindowsWithoutName]' started.\n[12:29:33:INFO] Test Case '-[ChildWindowOpenByDOMTestCase test2ChildWindowsWithoutName]' passed (7.499 seconds).\n[12:29:33:INFO] Test Case '-[ChildWindowOpenByDOMTestCase testChildWindowsWithAndWithoutName]' started.\n[12:29:41:INFO] Test Case '-[ChildWindowOpenByDOMTestCase testChildWindowsWithAndWithoutName]' passed (7.455 seconds).\n[12:29:41:INFO] Test Case '-[ChildWindowOpenByDOMTestCase testWindowClosedWithName]' started.\n[12:29:48:INFO] Test Case '-[ChildWindowOpenByDOMTestCase testWindowClosedWithName]' passed (7.052 seconds).\n[12:29:48:INFO] Test Case '-[ChildWindowOpenByDOMTestCase testWindowClosedWithoutName]' started.\n[12:29:56:INFO] Test Case '-[ChildWindowOpenByDOMTestCase testWindowClosedWithoutName]' passed (8.644 seconds).\n[12:29:56:INFO] Test Suite 'ChildWindowOpenByDOMTestCase' passed at 2019-04-25 00:29:56.699.\n[12:29:56:INFO] \t Executed 5 tests, with 0 failures (0 unexpected) in 37.166 (37.174) seconds\n[12:29:56:INFO] Test Suite 'ErrorPageTestCase' started at 2019-04-25 00:29:56.700\n[12:29:56:INFO] [0425/002956.701658:WARNING:loopback_server.cc(820)] Loopback sync persistent state file does not exist.\n[12:29:56:INFO] Test Case '-[ErrorPageTestCase testReloadErrorPage]' started.\n[12:29:58:INFO] [0425/002958.767608:WARNING:embedded_test_server.cc(238)] Request not handled. Returning 404: /favicon.ico\n[12:30:02:INFO] Test Case '-[ErrorPageTestCase testReloadErrorPage]' passed (6.017 seconds).\n[12:30:02:INFO] Test Case '-[ErrorPageTestCase testReloadPageAfterServerIsDown]' started.\n[12:30:04:INFO] [0425/003004.591933:WARNING:embedded_test_server.cc(238)] Request not handled. Returning 404: /favicon.ico\n[12:30:08:INFO] Test Case '-[ErrorPageTestCase testReloadPageAfterServerIsDown]' passed (5.923 seconds).\n[12:30:08:INFO] Test Suite 'ErrorPageTestCase' passed at 2019-04-25 00:30:08.648.\n[12:30:08:INFO] \t Executed 2 tests, with 0 failures (0 unexpected) in 11.941 (11.948) seconds\n[12:30:08:INFO] Test Suite 'FormsTestCase' started at 2019-04-25 00:30:08.649\n[12:30:08:INFO] [0425/003008.651220:WARNING:loopback_server.cc(820)] Loopback sync persistent state file does not exist.\n[12:30:08:INFO] Test Case '-[FormsTestCase testGoBackButtonAfterFormSubmission]' started.\n[12:30:10:INFO] [0425/003010.606216:WARNING:embedded_test_server.cc(238)] Request not handled. Returning 404: /favicon.ico\n[12:30:15:INFO] Test Case '-[FormsTestCase testGoBackButtonAfterFormSubmission]' passed (6.944 seconds).\n[12:30:15:INFO] Test Case '-[FormsTestCase testPostFormEntryWithKeyboard]' started.\n[12:30:23:INFO] Test Case '-[FormsTestCase testPostFormEntryWithKeyboard]' passed (8.308 seconds).\n[12:30:23:INFO] Test Case '-[FormsTestCase testPostFormToSamePage]' started.\n[12:30:32:INFO] Test Case '-[FormsTestCase testPostFormToSamePage]' passed (8.975 seconds).\n[12:30:32:INFO] Test Case '-[FormsTestCase testRepostFormAfterIndexNavigation]' started.\n[12:30:45:INFO] Test Case '-[FormsTestCase testRepostFormAfterIndexNavigation]' passed (12.173 seconds).\n[12:30:45:INFO] Test Case '-[FormsTestCase testRepostFormAfterReload]' started.\n[12:30:53:INFO] Test Case '-[FormsTestCase testRepostFormAfterReload]' passed (8.813 seconds).\n[12:30:53:INFO] Test Case '-[FormsTestCase testRepostFormAfterTappingBack]' started.\n[12:31:03:INFO] Test Case '-[FormsTestCase testRepostFormAfterTappingBack]' passed (9.947 seconds).\n[12:31:03:INFO] Test Case '-[FormsTestCase testRepostFormAfterTappingBackAndForward]' started.\n[12:31:13:INFO] Test Case '-[FormsTestCase testRepostFormAfterTappingBackAndForward]' passed (9.904 seconds).\n[12:31:13:INFO] Test Case '-[FormsTestCase testRepostFormCancelling]' started.\n[12:31:22:INFO] Test Case '-[FormsTestCase testRepostFormCancelling]' passed (8.386 seconds).\n[12:31:22:INFO] Test Case '-[FormsTestCase testRepostFormCancellingAfterRedirect]' started.\n[12:31:28:INFO] Test Case '-[FormsTestCase testRepostFormCancellingAfterRedirect]' passed (6.851 seconds).\n[12:31:28:INFO] Test Case '-[FormsTestCase testRepostFormDismissedByNewNavigation]' started.\n[12:31:36:INFO] Test Case '-[FormsTestCase testRepostFormDismissedByNewNavigation]' passed (7.664 seconds).\n[12:31:36:INFO] Test Suite 'FormsTestCase' passed at 2019-04-25 00:31:36.624.\n[12:31:36:INFO] \t Executed 10 tests, with 0 failures (0 unexpected) in 87.964 (87.975) seconds\n[12:31:36:INFO] Test Suite 'HTTPAuthTestCase' started at 2019-04-25 00:31:36.625\n[12:31:36:INFO] [0425/003136.626448:WARNING:loopback_server.cc(820)] Loopback sync persistent state file does not exist.\n[12:31:36:INFO] Test Case '-[HTTPAuthTestCase testCancellingBasicAuth]' started.\n[12:31:51:INFO] Test Case '-[HTTPAuthTestCase testCancellingBasicAuth]' passed (14.453 seconds).\n[12:31:51:INFO] Test Case '-[HTTPAuthTestCase testSuccessfullBasicAuth]' started.\n[12:32:01:INFO] 2019-04-25 00:32:01.814 ios_chrome_web_egtests[7259:85889] Attempting to type key g.\n[12:32:01:INFO] 2019-04-25 00:32:01.815 ios_chrome_web_egtests[7259:85889] Tapping on key: g.\n[12:32:01:INFO] 2019-04-25 00:32:01.867 ios_chrome_web_egtests[7259:85889] Attempting to type key o.\n[12:32:01:INFO] 2019-04-25 00:32:01.868 ios_chrome_web_egtests[7259:85889] Tapping on key: o.\n[12:32:01:INFO] 2019-04-25 00:32:01.918 ios_chrome_web_egtests[7259:85889] Attempting to type key o.\n[12:32:01:INFO] 2019-04-25 00:32:01.919 ios_chrome_web_egtests[7259:85889] Tapping on key: o.\n[12:32:01:INFO] 2019-04-25 00:32:01.970 ios_chrome_web_egtests[7259:85889] Attempting to type key d.\n[12:32:01:INFO] 2019-04-25 00:32:01.970 ios_chrome_web_egtests[7259:85889] Tapping on key: d.\n[12:32:02:INFO] 2019-04-25 00:32:02.023 ios_chrome_web_egtests[7259:85889] Attempting to type key u.\n[12:32:02:INFO] 2019-04-25 00:32:02.024 ios_chrome_web_egtests[7259:85889] Tapping on key: u.\n[12:32:02:INFO] 2019-04-25 00:32:02.074 ios_chrome_web_egtests[7259:85889] Attempting to type key s.\n[12:32:02:INFO] 2019-04-25 00:32:02.075 ios_chrome_web_egtests[7259:85889] Tapping on key: s.\n[12:32:02:INFO] 2019-04-25 00:32:02.128 ios_chrome_web_egtests[7259:85889] Attempting to type key e.\n[12:32:02:INFO] 2019-04-25 00:32:02.128 ios_chrome_web_egtests[7259:85889] Tapping on key: e.\n[12:32:02:INFO] 2019-04-25 00:32:02.179 ios_chrome_web_egtests[7259:85889] Attempting to type key r.\n[12:32:02:INFO] 2019-04-25 00:32:02.179 ios_chrome_web_egtests[7259:85889] Tapping on key: r.\n[12:32:02:INFO] 2019-04-25 00:32:02.862 ios_chrome_web_egtests[7259:85889] Attempting to type key g.\n[12:32:02:INFO] 2019-04-25 00:32:02.863 ios_chrome_web_egtests[7259:85889] Tapping on key: g.\n[12:32:02:INFO] 2019-04-25 00:32:02.915 ios_chrome_web_egtests[7259:85889] Attempting to type key o.\n[12:32:02:INFO] 2019-04-25 00:32:02.916 ios_chrome_web_egtests[7259:85889] Tapping on key: o.\n[12:32:02:INFO] 2019-04-25 00:32:02.967 ios_chrome_web_egtests[7259:85889] Attempting to type key o.\n[12:32:02:INFO] 2019-04-25 00:32:02.967 ios_chrome_web_egtests[7259:85889] Tapping on key: o.\n[12:32:03:INFO] 2019-04-25 00:32:03.020 ios_chrome_web_egtests[7259:85889] Attempting to type key d.\n[12:32:03:INFO] 2019-04-25 00:32:03.022 ios_chrome_web_egtests[7259:85889] Tapping on key: d.\n[12:32:03:INFO] 2019-04-25 00:32:03.072 ios_chrome_web_egtests[7259:85889] Attempting to type key p.\n[12:32:03:INFO] 2019-04-25 00:32:03.073 ios_chrome_web_egtests[7259:85889] Tapping on key: p.\n[12:32:03:INFO] 2019-04-25 00:32:03.124 ios_chrome_web_egtests[7259:85889] Attempting to type key a.\n[12:32:03:INFO] 2019-04-25 00:32:03.124 ios_chrome_web_egtests[7259:85889] Tapping on key: a.\n[12:32:03:INFO] 2019-04-25 00:32:03.175 ios_chrome_web_egtests[7259:85889] Attempting to type key s.\n[12:32:03:INFO] 2019-04-25 00:32:03.176 ios_chrome_web_egtests[7259:85889] Tapping on key: s.\n[12:32:03:INFO] 2019-04-25 00:32:03.226 ios_chrome_web_egtests[7259:85889] Attempting to type key s.\n[12:32:03:INFO] 2019-04-25 00:32:03.227 ios_chrome_web_egtests[7259:85889] Tapping on key: s.\n[12:32:04:INFO] [0425/003204.463046:WARNING:embedded_test_server.cc(238)] Request not handled. Returning 404: /favicon.ico\n[12:32:07:INFO] Test Case '-[HTTPAuthTestCase testSuccessfullBasicAuth]' passed (16.210 seconds).\n[12:32:07:INFO] Test Case '-[HTTPAuthTestCase testUnsuccessfullBasicAuth]' started.\n[12:32:18:INFO] 2019-04-25 00:32:18.111 ios_chrome_web_egtests[7259:85889] Attempting to type key g.\n[12:32:18:INFO] 2019-04-25 00:32:18.111 ios_chrome_web_egtests[7259:85889] Tapping on key: g.\n[12:32:18:INFO] 2019-04-25 00:32:18.164 ios_chrome_web_egtests[7259:85889] Attempting to type key o.\n[12:32:18:INFO] 2019-04-25 00:32:18.165 ios_chrome_web_egtests[7259:85889] Tapping on key: o.\n[12:32:18:INFO] 2019-04-25 00:32:18.215 ios_chrome_web_egtests[7259:85889] Attempting to type key o.\n[12:32:18:INFO] 2019-04-25 00:32:18.216 ios_chrome_web_egtests[7259:85889] Tapping on key: o.\n[12:32:18:INFO] 2019-04-25 00:32:18.267 ios_chrome_web_egtests[7259:85889] Attempting to type key d.\n[12:32:18:INFO] 2019-04-25 00:32:18.268 ios_chrome_web_egtests[7259:85889] Tapping on key: d.\n[12:32:18:INFO] 2019-04-25 00:32:18.318 ios_chrome_web_egtests[7259:85889] Attempting to type key u.\n[12:32:18:INFO] 2019-04-25 00:32:18.319 ios_chrome_web_egtests[7259:85889] Tapping on key: u.\n[12:32:18:INFO] 2019-04-25 00:32:18.370 ios_chrome_web_egtests[7259:85889] Attempting to type key s.\n[12:32:18:INFO] 2019-04-25 00:32:18.370 ios_chrome_web_egtests[7259:85889] Tapping on key: s.\n[12:32:18:INFO] 2019-04-25 00:32:18.423 ios_chrome_web_egtests[7259:85889] Attempting to type key e.\n[12:32:18:INFO] 2019-04-25 00:32:18.424 ios_chrome_web_egtests[7259:85889] Tapping on key: e.\n[12:32:18:INFO] 2019-04-25 00:32:18.474 ios_chrome_web_egtests[7259:85889] Attempting to type key r.\n[12:32:18:INFO] 2019-04-25 00:32:18.475 ios_chrome_web_egtests[7259:85889] Tapping on key: r.\n[12:32:19:INFO] 2019-04-25 00:32:19.160 ios_chrome_web_egtests[7259:85889] Attempting to type key g.\n[12:32:19:INFO] 2019-04-25 00:32:19.161 ios_chrome_web_egtests[7259:85889] Tapping on key: g.\n[12:32:19:INFO] 2019-04-25 00:32:19.213 ios_chrome_web_egtests[7259:85889] Attempting to type key o.\n[12:32:19:INFO] 2019-04-25 00:32:19.214 ios_chrome_web_egtests[7259:85889] Tapping on key: o.\n[12:32:19:INFO] 2019-04-25 00:32:19.264 ios_chrome_web_egtests[7259:85889] Attempting to type key o.\n[12:32:19:INFO] 2019-04-25 00:32:19.265 ios_chrome_web_egtests[7259:85889] Tapping on key: o.\n[12:32:19:INFO] 2019-04-25 00:32:19.317 ios_chrome_web_egtests[7259:85889] Attempting to type key d.\n[12:32:19:INFO] 2019-04-25 00:32:19.318 ios_chrome_web_egtests[7259:85889] Tapping on key: d.\n[12:32:19:INFO] 2019-04-25 00:32:19.369 ios_chrome_web_egtests[7259:85889] Attempting to type key p.\n[12:32:19:INFO] 2019-04-25 00:32:19.369 ios_chrome_web_egtests[7259:85889] Tapping on key: p.\n[12:32:19:INFO] 2019-04-25 00:32:19.420 ios_chrome_web_egtests[7259:85889] Attempting to type key a.\n[12:32:19:INFO] 2019-04-25 00:32:19.421 ios_chrome_web_egtests[7259:85889] Tapping on key: a.\n[12:32:19:INFO] 2019-04-25 00:32:19.471 ios_chrome_web_egtests[7259:85889] Attempting to type key s.\n[12:32:19:INFO] 2019-04-25 00:32:19.472 ios_chrome_web_egtests[7259:85889] Tapping on key: s.\n[12:32:19:INFO] 2019-04-25 00:32:19.522 ios_chrome_web_egtests[7259:85889] Attempting to type key s.\n[12:32:19:INFO] 2019-04-25 00:32:19.523 ios_chrome_web_egtests[7259:85889] Tapping on key: s.\n[12:32:24:INFO] Test Case '-[HTTPAuthTestCase testUnsuccessfullBasicAuth]' passed (17.216 seconds).\n[12:32:24:INFO] Test Suite 'HTTPAuthTestCase' passed at 2019-04-25 00:32:24.509.\n[12:32:24:INFO] \t Executed 3 tests, with 0 failures (0 unexpected) in 47.879 (47.884) seconds\n[12:32:24:INFO] Test Suite 'JSPrintTestCase' started at 2019-04-25 00:32:24.509\n[12:32:24:INFO] [0425/003224.510825:WARNING:loopback_server.cc(820)] Loopback sync persistent state file does not exist.\n[12:32:24:INFO] Test Case '-[JSPrintTestCase testWebPrintButton]' started.\n[12:32:26:INFO] [0425/003226.362948:WARNING:embedded_test_server.cc(238)] Request not handled. Returning 404: /favicon.ico\n[12:32:27:INFO] 2019-04-25 00:32:27.928 ios_chrome_web_egtests[7259:85889] Unbalanced calls to begin/end appearance transitions for <UIViewController: 0x7fa566ecd510>.\n[12:32:29:INFO] 2019-04-25 00:32:29.787 ios_chrome_web_egtests[7259:85889] Warning: Attempt to dismiss from view controller <UIViewController: 0x7fa566ecd510> while a presentation or dismiss is in progress!\n[12:32:32:INFO] Test Case '-[JSPrintTestCase testWebPrintButton]' passed (7.934 seconds).\n[12:32:32:INFO] Test Suite 'JSPrintTestCase' passed at 2019-04-25 00:32:32.449.\n[12:32:32:INFO] \t Executed 1 test, with 0 failures (0 unexpected) in 7.934 (7.940) seconds\n[12:32:32:INFO] Test Suite 'NavigationTestCase' started at 2019-04-25 00:32:32.450\n[12:32:32:INFO] [0425/003232.451640:WARNING:loopback_server.cc(820)] Loopback sync persistent state file does not exist.\n[12:32:32:INFO] Test Case '-[NavigationTestCase test301Redirect]' started.\n[12:32:34:INFO] [0425/003234.331972:WARNING:embedded_test_server.cc(238)] Request not handled. Returning 404: /favicon.ico\n[12:32:42:INFO] Test Case '-[NavigationTestCase test301Redirect]' passed (10.385 seconds).\n[12:32:42:INFO] Test Case '-[NavigationTestCase testHistoryBackAndForwardAroundNTP]' started.\n[12:32:44:INFO] [0425/003244.694698:WARNING:embedded_test_server.cc(238)] Request not handled. Returning 404: /favicon.ico\n[12:32:47:INFO] [0425/003247.375373:WARNING:web_state_impl.mm(661)] Script execution has failed: A JavaScript exception occurred\n[12:32:47:INFO] [0425/003247.401294:WARNING:web_state_impl.mm(661)] Script execution has failed: A JavaScript exception occurred\n[12:32:47:INFO] [0425/003247.403682:WARNING:web_state_impl.mm(661)] Script execution has failed: A JavaScript exception occurred\n[12:32:50:INFO] Test Case '-[NavigationTestCase testHistoryBackAndForwardAroundNTP]' passed (7.498 seconds).\n[12:32:50:INFO] Test Case '-[NavigationTestCase testHistoryBackNavigation]' started.\n[12:32:52:INFO] [0425/003252.228261:WARNING:embedded_test_server.cc(238)] Request not handled. Returning 404: /favicon.ico\n[12:32:58:INFO] Test Case '-[NavigationTestCase testHistoryBackNavigation]' passed (8.048 seconds).\n[12:32:58:INFO] Test Case '-[NavigationTestCase testHistoryCrossDocumentLoad]' started.\n[12:33:09:INFO] Test Case '-[NavigationTestCase testHistoryCrossDocumentLoad]' passed (10.909 seconds).\n[12:33:09:INFO] Test Case '-[NavigationTestCase testHistoryForwardNavigation]' started.\n[12:33:11:INFO] [0425/003311.196004:WARNING:embedded_test_server.cc(238)] Request not handled. Returning 404: /favicon.ico\n[12:33:17:INFO] Test Case '-[NavigationTestCase testHistoryForwardNavigation]' passed (8.058 seconds).\n[12:33:17:INFO] Test Case '-[NavigationTestCase testHistoryGoDelta]' started.\n[12:33:19:INFO] [0425/003319.274975:WARNING:embedded_test_server.cc(238)] Request not handled. Returning 404: /favicon.ico\n[12:33:27:INFO] Test Case '-[NavigationTestCase testHistoryGoDelta]' passed (10.137 seconds).\n[12:33:27:INFO] Test Case '-[NavigationTestCase testHistoryGoDeltaZero]' started.\n[12:33:29:INFO] [0425/003329.482291:WARNING:embedded_test_server.cc(238)] Request not handled. Returning 404: /favicon.ico\n[12:33:33:INFO] Test Case '-[NavigationTestCase testHistoryGoDeltaZero]' passed (5.942 seconds).\n[12:33:33:INFO] Test Case '-[NavigationTestCase testHistoryGoNoParameter]' started.\n[12:33:35:INFO] [0425/003335.344484:WARNING:embedded_test_server.cc(238)] Request not handled. Returning 404: /favicon.ico\n[12:33:39:INFO] Test Case '-[NavigationTestCase testHistoryGoNoParameter]' passed (5.849 seconds).\n[12:33:39:INFO] Test Case '-[NavigationTestCase testHistoryGoOutOfBounds]' started.\n[12:33:41:INFO] [0425/003341.191735:WARNING:embedded_test_server.cc(238)] Request not handled. Returning 404: /favicon.ico\n[12:33:46:INFO] Test Case '-[NavigationTestCase testHistoryGoOutOfBounds]' passed (6.823 seconds).\n[12:33:46:INFO] Test Case '-[NavigationTestCase testJavaScriptRedirect]' started.\n[12:33:48:INFO] [0425/003348.031969:WARNING:embedded_test_server.cc(238)] Request not handled. Returning 404: /favicon.ico\n[12:33:54:INFO] Test Case '-[NavigationTestCase testJavaScriptRedirect]' passed (8.379 seconds).\n[12:33:54:INFO] Test Case '-[NavigationTestCase testRedirectRefresh]' started.\n[12:33:56:INFO] [0425/003356.422931:WARNING:embedded_test_server.cc(238)] Request not handled. Returning 404: /favicon.ico\n[12:34:05:INFO] Test Case '-[NavigationTestCase testRedirectRefresh]' passed (10.623 seconds).\n[12:34:05:INFO] Test Case '-[NavigationTestCase testRedirectWindow]' started.\n[12:34:07:INFO] [0425/003407.071190:WARNING:embedded_test_server.cc(238)] Request not handled. Returning 404: /favicon.ico\n[12:34:15:INFO] Test Case '-[NavigationTestCase testRedirectWindow]' passed (10.652 seconds).\n[12:34:15:INFO] Test Case '-[NavigationTestCase testRestoreHistoryToNTPAndNavigateForward]' started.\n[12:34:17:INFO] [0425/003417.724520:WARNING:embedded_test_server.cc(238)] Request not handled. Returning 404: /favicon.ico\n[12:34:23:INFO] Test Case '-[NavigationTestCase testRestoreHistoryToNTPAndNavigateForward]' passed (7.925 seconds).\n[12:34:23:INFO] Test Case '-[NavigationTestCase testRestoreHistoryToWebUIAndNavigateForward]' started.\n[12:34:26:INFO] [0425/003426.771910:WARNING:embedded_test_server.cc(238)] Request not handled. Returning 404: /favicon.ico\n[12:34:33:INFO] Test Case '-[NavigationTestCase testRestoreHistoryToWebUIAndNavigateForward]' passed (10.104 seconds).\n[12:34:33:INFO] Test Case '-[NavigationTestCase testWindowLocationChangeHash]' started.\n[12:34:35:INFO] [0425/003435.697604:WARNING:embedded_test_server.cc(238)] Request not handled. Returning 404: /favicon.ico\n[12:34:43:INFO] Test Case '-[NavigationTestCase testWindowLocationChangeHash]' passed (9.242 seconds).\n[12:34:43:INFO] Test Case '-[NavigationTestCase testWindowLocationChangeToSameHash]' started.\n[12:34:45:INFO] [0425/003445.016886:WARNING:embedded_test_server.cc(238)] Request not handled. Returning 404: /favicon.ico\n[12:34:51:INFO] Test Case '-[NavigationTestCase testWindowLocationChangeToSameHash]' passed (8.229 seconds).\n[12:34:51:INFO] Test Case '-[NavigationTestCase testWindowLocationReplaceAndChangeHash]' started.\n[12:34:53:INFO] [0425/003453.239559:WARNING:embedded_test_server.cc(238)] Request not handled. Returning 404: /favicon.ico\n[12:34:59:INFO] Test Case '-[NavigationTestCase testWindowLocationReplaceAndChangeHash]' passed (8.094 seconds).\n[12:34:59:INFO] Test Suite 'NavigationTestCase' passed at 2019-04-25 00:34:59.365.\n[12:34:59:INFO] \t Executed 17 tests, with 0 failures (0 unexpected) in 146.897 (146.915) seconds\n[12:34:59:INFO] Test Suite 'ProgressIndicatorTestCase' started at 2019-04-25 00:34:59.366\n[12:34:59:INFO] [0425/003459.367042:WARNING:loopback_server.cc(820)] Loopback sync persistent state file does not exist.\n[12:34:59:INFO] Test Case '-[ProgressIndicatorTestCase testProgressIndicatorDisappearsAfterFormSubmit]' started.\n[12:35:01:INFO] [0425/003501.327823:WARNING:embedded_test_server.cc(238)] Request not handled. Returning 404: /favicon.ico\n[12:35:05:INFO] Test Case '-[ProgressIndicatorTestCase testProgressIndicatorDisappearsAfterFormSubmit]' passed (5.904 seconds).\n[12:35:05:INFO] Test Case '-[ProgressIndicatorTestCase testProgressIndicatorDisappearsAfterSuppressedFormPost]' started.\n[12:35:21:INFO] Test Case '-[ProgressIndicatorTestCase testProgressIndicatorDisappearsAfterSuppressedFormPost]' passed (16.020 seconds).\n[12:35:21:INFO] Test Case '-[ProgressIndicatorTestCase testProgressIndicatorShown]' started.\n[12:35:35:INFO] Test Case '-[ProgressIndicatorTestCase testProgressIndicatorShown]' passed (13.949 seconds).\n[12:35:35:INFO] Test Case '-[ProgressIndicatorTestCase testProgressIndicatorShownOnFormSubmit]' started.\n[12:35:50:INFO] Test Case '-[ProgressIndicatorTestCase testProgressIndicatorShownOnFormSubmit]' passed (15.011 seconds).\n[12:35:50:INFO] Test Suite 'ProgressIndicatorTestCase' passed at 2019-04-25 00:35:50.257.\n[12:35:50:INFO] \t Executed 4 tests, with 0 failures (0 unexpected) in 50.883 (50.891) seconds\n[12:35:50:INFO] Test Suite 'PushAndReplaceStateNavigationTestCase' started at 2019-04-25 00:35:50.257\n[12:35:50:INFO] [0425/003550.259237:WARNING:loopback_server.cc(820)] Loopback sync persistent state file does not exist.\n[12:35:50:INFO] Test Case '-[PushAndReplaceStateNavigationTestCase testHtml5HistoryNavigatingPastNonPushedURL]' started.\n[12:35:52:INFO] [0425/003552.183371:WARNING:embedded_test_server.cc(238)] Request not handled. Returning 404: /favicon.ico\n[12:36:04:INFO] Test Case '-[PushAndReplaceStateNavigationTestCase testHtml5HistoryNavigatingPastNonPushedURL]' passed (14.018 seconds).\n[12:36:04:INFO] Test Case '-[PushAndReplaceStateNavigationTestCase testHtml5HistoryPushStateThenGoBackAndForward]' started.\n[12:36:13:INFO] Test Case '-[PushAndReplaceStateNavigationTestCase testHtml5HistoryPushStateThenGoBackAndForward]' passed (9.586 seconds).\n[12:36:13:INFO] Test Case '-[PushAndReplaceStateNavigationTestCase testHtml5HistoryPushUnicodeCharacters]' started.\n[12:36:21:INFO] Test Case '-[PushAndReplaceStateNavigationTestCase testHtml5HistoryPushUnicodeCharacters]' passed (7.445 seconds).\n[12:36:21:INFO] Test Case '-[PushAndReplaceStateNavigationTestCase testHtml5HistoryReplaceStateThenGoBackAndForward]' started.\n[12:36:33:INFO] Test Case '-[PushAndReplaceStateNavigationTestCase testHtml5HistoryReplaceStateThenGoBackAndForward]' passed (12.180 seconds).\n[12:36:33:INFO] Test Case '-[PushAndReplaceStateNavigationTestCase testHtml5HistoryWithBase]' started.\n[12:36:38:INFO] Test Case '-[PushAndReplaceStateNavigationTestCase testHtml5HistoryWithBase]' passed (5.085 seconds).\n[12:36:38:INFO] Test Suite 'PushAndReplaceStateNavigationTestCase' passed at 2019-04-25 00:36:38.578.\n[12:36:38:INFO] \t Executed 5 tests, with 0 failures (0 unexpected) in 48.314 (48.320) seconds\n[12:36:38:INFO] Test Suite 'StopLoadingTestCase' started at 2019-04-25 00:36:38.579\n[12:36:38:INFO] [0425/003638.579821:WARNING:loopback_server.cc(820)] Loopback sync persistent state file does not exist.\n[12:36:38:INFO] Test Case '-[StopLoadingTestCase testStopLoading]' started.\n[12:36:56:INFO] Test Case '-[StopLoadingTestCase testStopLoading]' passed (18.236 seconds).\n[12:36:56:INFO] Test Suite 'StopLoadingTestCase' passed at 2019-04-25 00:36:56.819.\n[12:36:56:INFO] \t Executed 1 test, with 0 failures (0 unexpected) in 18.236 (18.241) seconds\n[12:36:56:INFO] Test Suite 'TabOrderTestCase' started at 2019-04-25 00:36:56.821\n[12:36:56:INFO] [0425/003656.822251:WARNING:loopback_server.cc(820)] Loopback sync persistent state file does not exist.\n[12:36:56:INFO] Test Case '-[TabOrderTestCase testChildTabOrdering]' started.\n[12:36:58:INFO] [0425/003658.746532:WARNING:embedded_test_server.cc(238)] Request not handled. Returning 404: /favicon.ico\n[12:37:19:INFO] Test Case '-[TabOrderTestCase testChildTabOrdering]' passed (22.563 seconds).\n[12:37:19:INFO] Test Suite 'TabOrderTestCase' passed at 2019-04-25 00:37:19.392.\n[12:37:19:INFO] \t Executed 1 test, with 0 failures (0 unexpected) in 22.563 (22.571) seconds\n[12:37:19:INFO] Test Suite 'VisibleURLTestCase' started at 2019-04-25 00:37:19.393\n[12:37:19:INFO] [0425/003719.394983:WARNING:loopback_server.cc(820)] Loopback sync persistent state file does not exist.\n[12:37:19:INFO] Test Case '-[VisibleURLTestCase testBackForwardNavigation]' started.\n[12:37:21:INFO] [0425/003721.443968:WARNING:embedded_test_server.cc(238)] Request not handled. Returning 404: /favicon.ico\n[12:37:31:INFO] Test Case '-[VisibleURLTestCase testBackForwardNavigation]' passed (11.712 seconds).\n[12:37:31:INFO] Test Case '-[VisibleURLTestCase testBackNavigationWithPendingReload]' started.\n[12:37:59:INFO] Test Case '-[VisibleURLTestCase testBackNavigationWithPendingReload]' passed (28.799 seconds).\n[12:37:59:INFO] Test Case '-[VisibleURLTestCase testBackNavigationWithPendingRendererInitiatedNavigation]' started.\n[12:38:08:INFO] Test Case '-[VisibleURLTestCase testBackNavigationWithPendingRendererInitiatedNavigation]' passed (8.660 seconds).\n[12:38:08:INFO] Test Case '-[VisibleURLTestCase testDoubleBackJSNavigation]' started.\n[12:38:18:INFO] Test Case '-[VisibleURLTestCase testDoubleBackJSNavigation]' passed (9.612 seconds).\n[12:38:18:INFO] Test Case '-[VisibleURLTestCase testDoubleBackNavigation]' started.\n[12:38:28:INFO] Test Case '-[VisibleURLTestCase testDoubleBackNavigation]' passed (9.936 seconds).\n[12:38:28:INFO] Test Case '-[VisibleURLTestCase testDoubleForwardNavigationToWebUIPage]' started.\n[12:38:39:INFO] Test Case '-[VisibleURLTestCase testDoubleForwardNavigationToWebUIPage]' passed (11.075 seconds).\n[12:38:39:INFO] Test Case '-[VisibleURLTestCase testHistoryNavigation]' started.\n[12:38:50:INFO] Test Case '-[VisibleURLTestCase testHistoryNavigation]' passed (10.861 seconds).\n[12:38:50:INFO] Test Case '-[VisibleURLTestCase testJSBackForwardNavigation]' started.\n[12:38:58:INFO] [0425/003858.101535:WARNING:web_state_impl.mm(661)] Script execution has failed: A JavaScript exception occurred\n[12:39:01:INFO] Test Case '-[VisibleURLTestCase testJSBackForwardNavigation]' passed (10.978 seconds).\n[12:39:01:INFO] Test Case '-[VisibleURLTestCase testJSGoNavigation]' started.\n[12:39:09:INFO] [0425/003909.226568:WARNING:web_state_impl.mm(661)] Script execution has failed: A JavaScript exception occurred\n[12:39:12:INFO] Test Case '-[VisibleURLTestCase testJSGoNavigation]' passed (11.114 seconds).\n[12:39:12:INFO] Test Case '-[VisibleURLTestCase testRendererInitiatedNavigationWithPendingBackNavigation]' started.\n[12:39:20:INFO] Test Case '-[VisibleURLTestCase testRendererInitiatedNavigationWithPendingBackNavigation]' passed (8.690 seconds).\n[12:39:20:INFO] Test Case '-[VisibleURLTestCase testStoppingPendingBackNavigationAndReload]' started.\n[12:39:43:INFO] Test Case '-[VisibleURLTestCase testStoppingPendingBackNavigationAndReload]' passed (22.846 seconds).\n[12:39:43:INFO] Test Suite 'VisibleURLTestCase' passed at 2019-04-25 00:39:43.696.\n[12:39:43:INFO] \t Executed 11 tests, with 0 failures (0 unexpected) in 144.284 (144.303) seconds\n[12:39:43:INFO] Test Suite 'WindowOpenByDOMTestCase' started at 2019-04-25 00:39:43.698\n[12:39:43:INFO] [0425/003943.699449:WARNING:loopback_server.cc(820)] Loopback sync persistent state file does not exist.\n[12:39:43:INFO] Test Case '-[WindowOpenByDOMTestCase testBlockPopupInjectedIntoOpenedWindow]' started.\n[12:39:45:INFO] [0425/003945.743754:WARNING:embedded_test_server.cc(238)] Request not handled. Returning 404: /favicon.ico\n[12:39:50:INFO] Test Case '-[WindowOpenByDOMTestCase testBlockPopupInjectedIntoOpenedWindow]' passed (6.321 seconds).\n[12:39:50:INFO] Test Case '-[WindowOpenByDOMTestCase testCloseWindowNotOpenByDOM]' started.\n[12:39:54:INFO] Test Case '-[WindowOpenByDOMTestCase testCloseWindowNotOpenByDOM]' passed (4.869 seconds).\n[12:39:54:INFO] Test Case '-[WindowOpenByDOMTestCase testLinkWithBlankTarget]' started.\n[12:40:01:INFO] Test Case '-[WindowOpenByDOMTestCase testLinkWithBlankTarget]' passed (6.592 seconds).\n[12:40:01:INFO] Test Case '-[WindowOpenByDOMTestCase testLinkWithBlankTargetMultipleTimes]' started.\n[12:40:11:INFO] Test Case '-[WindowOpenByDOMTestCase testLinkWithBlankTargetMultipleTimes]' passed (10.327 seconds).\n[12:40:11:INFO] Test Case '-[WindowOpenByDOMTestCase testLinkWithBlankTargetSessionStorage]' started.\n[12:40:18:INFO] Test Case '-[WindowOpenByDOMTestCase testLinkWithBlankTargetSessionStorage]' passed (6.507 seconds).\n[12:40:18:INFO] Test Case '-[WindowOpenByDOMTestCase testLinkWithBlankTargetWithDelayedClose]' started.\n[12:40:26:INFO] Test Case '-[WindowOpenByDOMTestCase testLinkWithBlankTargetWithDelayedClose]' passed (8.115 seconds).\n[12:40:26:INFO] Test Case '-[WindowOpenByDOMTestCase testLinkWithBlankTargetWithImmediateClose]' started.\n[12:40:32:INFO] Test Case '-[WindowOpenByDOMTestCase testLinkWithBlankTargetWithImmediateClose]' passed (5.936 seconds).\n[12:40:32:INFO] Test Case '-[WindowOpenByDOMTestCase testLinkWithBlankTargetWithoutUserGesture]' started.\n[12:40:37:INFO] Test Case '-[WindowOpenByDOMTestCase testLinkWithBlankTargetWithoutUserGesture]' passed (5.239 seconds).\n[12:40:37:INFO] Test Case '-[WindowOpenByDOMTestCase testLocationReplaceInWindowOpenWithEmptyTarget]' started.\n[12:40:43:INFO] Test Case '-[WindowOpenByDOMTestCase testLocationReplaceInWindowOpenWithEmptyTarget]' passed (6.028 seconds).\n[12:40:43:INFO] Test Case '-[WindowOpenByDOMTestCase testWindowOpenAndAssignToHref]' started.\n[12:40:49:INFO] Test Case '-[WindowOpenByDOMTestCase testWindowOpenAndAssignToHref]' passed (6.102 seconds).\n[12:40:49:INFO] Test Case '-[WindowOpenByDOMTestCase testWindowOpenAndCallLocationAssign]' started.\n[12:40:55:INFO] Test Case '-[WindowOpenByDOMTestCase testWindowOpenAndCallLocationAssign]' passed (6.071 seconds).\n[12:40:55:INFO] Test Case '-[WindowOpenByDOMTestCase testWindowOpenAndSetLocation]' started.\n[12:41:01:INFO] Test Case '-[WindowOpenByDOMTestCase testWindowOpenAndSetLocation]' passed (6.132 seconds).\n[12:41:01:INFO] Test Case '-[WindowOpenByDOMTestCase testWindowOpenWithBlankTarget]' started.\n[12:41:08:INFO] Test Case '-[WindowOpenByDOMTestCase testWindowOpenWithBlankTarget]' passed (6.042 seconds).\n[12:41:08:INFO] Test Case '-[WindowOpenByDOMTestCase testWindowOpenWithButtonOnClick]' started.\n[12:41:13:INFO] Test Case '-[WindowOpenByDOMTestCase testWindowOpenWithButtonOnClick]' passed (5.931 seconds).\n[12:41:13:INFO] Test Case '-[WindowOpenByDOMTestCase testWindowOpenWithEmptyTarget]' started.\n[12:41:19:INFO] Test Case '-[WindowOpenByDOMTestCase testWindowOpenWithEmptyTarget]' passed (5.967 seconds).\n[12:41:19:INFO] Test Case '-[WindowOpenByDOMTestCase testWindowOpenWithMetaRefresh]' started.\n[12:41:25:INFO] Test Case '-[WindowOpenByDOMTestCase testWindowOpenWithMetaRefresh]' passed (6.043 seconds).\n[12:41:25:INFO] Test Case '-[WindowOpenByDOMTestCase testWindowOpenWithPreventDefaultLink]' started.\n[12:41:32:INFO] Test Case '-[WindowOpenByDOMTestCase testWindowOpenWithPreventDefaultLink]' passed (6.427 seconds).\n[12:41:32:INFO] Test Suite 'WindowOpenByDOMTestCase' passed at 2019-04-25 00:41:32.372.\n[12:41:32:INFO] \t Executed 17 tests, with 0 failures (0 unexpected) in 108.651 (108.674) seconds\n[12:41:32:INFO] Test Suite 'ios_chrome_web_egtests.app' passed at 2019-04-25 00:41:32.373.\n[12:41:32:INFO] \t Executed 94 tests, with 0 failures (0 unexpected) in 844.917 (846.965) seconds\n[12:41:32:INFO] Test Suite 'All tests' passed at 2019-04-25 00:41:32.374.\n[12:41:32:INFO] \t Executed 94 tests, with 0 failures (0 unexpected) in 844.917 (846.968) seconds\n[12:41:32:INFO] \n[12:41:32:INFO] \n[12:41:32:INFO] Test session results and logs:\n[12:41:32:INFO] \t/Users/chrome-bot/Library/Developer/Xcode/DerivedData/temporary-gsuopqiueirojudysnnszpmdatgd/Logs/Test/Test-Transient Testing-2019.04.25_00-26-44--0700.xcresult\n[12:41:32:INFO] \n[12:41:32:INFO] 2019-04-25 00:41:32.681 xcodebuild[7133:84605] [MT] IDETestOperationsObserverDebug: 887.952 elapsed -- Testing started completed.\n[12:41:32:INFO] 2019-04-25 00:41:32.681 xcodebuild[7133:84605] [MT] IDETestOperationsObserverDebug: 0.000 sec, +0.000 sec -- start\n[12:41:32:INFO] 2019-04-25 00:41:32.681 xcodebuild[7133:84605] [MT] IDETestOperationsObserverDebug: 887.952 sec, +887.952 sec -- end\n[12:41:32:INFO] ** TEST EXECUTE SUCCEEDED **\n[12:41:32:INFO] \n[12:41:38:DEBUG] Finished print_process_output.\n[12:41:38:INFO] Waiting for test process to terminate.\n[12:41:38:INFO] Test process terminated.\n[12:41:38:DEBUG] Setting sigterm handler.\n[12:41:38:DEBUG] Stdout flushed after test process.\n[12:41:38:DEBUG] Processing test results.\n[12:41:38:INFO] /b/s/w/ir/src/out/Debug-iphonesimulator/iossim returned 0\n\n[12:41:38:DEBUG] Extracting test data.\n[12:41:39:DEBUG] Retrieving crash reports.\n[12:41:39:DEBUG] Retrieving derived data.\n[12:41:39:DEBUG] Making desktop screenshots.\n[12:41:39:DEBUG] Killing simulators.\n[12:41:44:DEBUG] Wiping simulator.\nDevice wiped.\n[12:41:46:DEBUG] End of tear_down.\n", "outputs_ref": { "isolated": "c7358154d081ec380a2603038741b3fa306336c5", "isolatedserver": "https://isolateserver.appspot.com", "namespace": "default-gzip" }, "run_id": "446c34a68b7d7b11", "server_versions": [ "4274-a0a5f8c" ], "started_ts": "2019-04-25T07:26:06.766855", "state": "COMPLETED", "tags": [ "build_is_experimental:false", "buildername:ios-simulator-full-configs", "buildnumber:14055", "data:609acf9adda7c28c4bc12e45ff4bca04ec29c370", "device_type:iPhone 7", "ios_version:12.1", "master:chromium.mac", "name:ios_chrome_web_egtests", "os:Mac-10.13.6", "platform:simulator", "pool:Chrome", "priority:30", "service_account:ios-isolated-tester@chops-service-accounts.iam.gserviceaccount.com", "slavename:vm124-m9", "spec_name:chromium.ci:ios-simulator-full-configs", "stepname:ios_chrome_web_egtests (iPhone 7 iOS 12.1) on Mac-10.13.6", "swarming.pool.template:none", "swarming.pool.version:82448814faa4820fccac763aebde958e33abecf8", "test:ios_chrome_web_egtests", "user:None" ], "task_id": "446c34a68b7d7b10", "try_number": "1" } ] }