builder: mozilla-beta_ubuntu64_hw_test-dromaeojs-e10s slave: talos-linux64-ix-057 starttime: 1505439510.69 results: success (0) revision: c38455951db4121afd705adadadebe55f039578d ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2017-09-14 18:38:30.691706) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2017-09-14 18:38:30.692417) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-09-14 18:38:30.692959) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-09-14 18:38:30.717749) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-09-14 18:38:30.718507) ========= bash -c 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=934fc3100db09dcb9af4d4b6000001ab-1505437288.179532-1377774891 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2017-09-14 18:38:30-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12179 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 223M=0s 2017-09-14 18:38:30 (223 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.186442 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-09-14 18:38:30.924332) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-09-14 18:38:30.924848) ========= rm -rf scripts properties in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'scripts', 'properties'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=934fc3100db09dcb9af4d4b6000001ab-1505437288.179532-1377774891 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.014684 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-09-14 18:38:30.975642) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2017-09-14 18:38:30.975986) ========= bash -c 'python archiver_client.py mozharness --repo releases/mozilla-beta --rev c38455951db4121afd705adadadebe55f039578d --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'python archiver_client.py mozharness --repo releases/mozilla-beta --rev c38455951db4121afd705adadadebe55f039578d --destination scripts --debug'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=934fc3100db09dcb9af4d4b6000001ab-1505437288.179532-1377774891 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2017-09-14 18:38:31,035 truncating revision to first 12 chars 2017-09-14 18:38:31,035 Setting DEBUG logging. 2017-09-14 18:38:31,035 attempt 1/10 2017-09-14 18:38:31,035 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/releases/mozilla-beta/c38455951db4?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2017-09-14 18:38:31,712 unpacking tar archive at: mozilla-beta-c38455951db4/testing/mozharness/ program finished with exit code 0 elapsedTime=1.032507 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2017-09-14 18:38:32.025358) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-09-14 18:38:32.025644) ========= script_repo_revision: c38455951db4121afd705adadadebe55f039578d ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-09-14 18:38:32.026014) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-09-14 18:38:32.026273) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-09-14 18:38:32.039781) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 8 secs) (at 2017-09-14 18:38:32.040097) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Beta-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Beta-Non-PGO in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Mozilla-Beta-Non-PGO', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-Beta-Non-PGO'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=934fc3100db09dcb9af4d4b6000001ab-1505437288.179532-1377774891 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 18:38:32 INFO - MultiFileLogger online at 20170914 18:38:32 in /builds/slave/test 18:38:32 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Beta-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Beta-Non-PGO 18:38:32 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 18:38:32 INFO - {'append_to_log': False, 18:38:32 INFO - 'base_work_dir': '/builds/slave/test', 18:38:32 INFO - 'blob_upload_branch': 'Mozilla-Beta-Non-PGO', 18:38:32 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 18:38:32 INFO - 'branch': 'Mozilla-Beta-Non-PGO', 18:38:32 INFO - 'buildbot_json_path': 'buildprops.json', 18:38:32 INFO - 'code_coverage': False, 18:38:32 INFO - 'config_files': ('talos/linux_config.py',), 18:38:32 INFO - 'default_actions': ('clobber', 18:38:32 INFO - 'read-buildbot-config', 18:38:32 INFO - 'download-and-extract', 18:38:32 INFO - 'populate-webroot', 18:38:32 INFO - 'create-virtualenv', 18:38:32 INFO - 'install', 18:38:32 INFO - 'setup-mitmproxy', 18:38:32 INFO - 'run-tests'), 18:38:32 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 18:38:32 INFO - 'disable_ccov_upload': False, 18:38:32 INFO - 'disable_stylo': False, 18:38:32 INFO - 'download_minidump_stackwalk': True, 18:38:32 INFO - 'download_symbols': 'ondemand', 18:38:32 INFO - 'enable_stylo': False, 18:38:32 INFO - 'enable_webrender': False, 18:38:32 INFO - 'exes': {'tooltool.py': '/tools/tooltool.py'}, 18:38:32 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 18:38:32 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 18:38:32 INFO - 'gecko_profile': False, 18:38:32 INFO - 'gecko_profile_interval': 0, 18:38:32 INFO - 'installer_path': 'installer.exe', 18:38:32 INFO - 'log_level': 'info', 18:38:32 INFO - 'log_name': 'talos', 18:38:32 INFO - 'log_to_console': True, 18:38:32 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 18:38:32 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 18:38:32 INFO - 'opt_config_files': (), 18:38:32 INFO - 'pip_index': False, 18:38:32 INFO - 'suite': 'dromaeojs-e10s', 18:38:32 INFO - 'system_bits': '32', 18:38:32 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 18:38:32 INFO - 'title': 'talos-linux64-ix-057', 18:38:32 INFO - 'tooltool_cache': '/builds/tooltool_cache', 18:38:32 INFO - 'use_talos_json': True, 18:38:32 INFO - 'verify': 'False', 18:38:32 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 18:38:32 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 18:38:32 INFO - 'work_dir': 'build'} 18:38:32 INFO - [mozharness: 2017-09-15 01:38:32.241069Z] Running clobber step. 18:38:32 INFO - Running pre-action listener: _resource_record_pre_action 18:38:32 INFO - Running main action method: clobber 18:38:32 INFO - rmtree: /builds/slave/test/build 18:38:32 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 18:38:33 INFO - Running post-action listener: _resource_record_post_action 18:38:33 INFO - [mozharness: 2017-09-15 01:38:33.755448Z] Finished clobber step (success) 18:38:33 INFO - [mozharness: 2017-09-15 01:38:33.755544Z] Running read-buildbot-config step. 18:38:33 INFO - Running pre-action listener: _resource_record_pre_action 18:38:33 INFO - Running main action method: read_buildbot_config 18:38:33 INFO - Using buildbot properties: 18:38:33 INFO - { 18:38:33 INFO - "project": "", 18:38:33 INFO - "product": "firefox", 18:38:33 INFO - "who": "jlund@mozilla.com", 18:38:33 INFO - "installer_path": "public/build/target.tar.bz2", 18:38:33 INFO - "builddir": "mozilla-beta_ubuntu64_hw_test-dromaeojs-e10s", 18:38:33 INFO - "repository": "https://hg.mozilla.org/releases/mozilla-beta", 18:38:33 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-beta talos dromaeojs-e10s", 18:38:33 INFO - "stage_platform": "linux64", 18:38:33 INFO - "basedir": "/builds/slave/test", 18:38:33 INFO - "buildnumber": 108, 18:38:33 INFO - "platform": "ubuntu64_hw", 18:38:33 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 18:38:33 INFO - "slavebuilddir": "test", 18:38:33 INFO - "taskId": "Po2fO-b7SBun2PsSkeU9tA", 18:38:33 INFO - "branch": "mozilla-beta", 18:38:33 INFO - "script_repo_revision": "production", 18:38:33 INFO - "revision": "c38455951db4121afd705adadadebe55f039578d", 18:38:33 INFO - "slavename": "talos-linux64-ix-057", 18:38:33 INFO - "repo_path": "releases/mozilla-beta" 18:38:33 INFO - } 18:38:33 INFO - Finding installer, test and symbols from parent task. 18:38:33 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/Po2fO-b7SBun2PsSkeU9tA'}, attempt #1 18:38:34 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/Po2fO-b7SBun2PsSkeU9tA'}, attempt #1 18:38:34 INFO - Task dependencies: dwA3zIQnSsC5sWxXs_oG_Q 18:38:34 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/dwA3zIQnSsC5sWxXs_oG_Q'}, attempt #1 18:38:35 INFO - Set installer_url: https://queue.taskcluster.net/v1/task/dwA3zIQnSsC5sWxXs_oG_Q/artifacts/public/build/target.tar.bz2 18:38:35 INFO - Set test_packages_url: https://queue.taskcluster.net/v1/task/dwA3zIQnSsC5sWxXs_oG_Q/artifacts/public/build/target.test_packages.json 18:38:35 INFO - Set symbols_url: https://queue.taskcluster.net/v1/task/dwA3zIQnSsC5sWxXs_oG_Q/artifacts/public/build/target.crashreporter-symbols.zip 18:38:35 INFO - Running post-action listener: _resource_record_post_action 18:38:35 INFO - [mozharness: 2017-09-15 01:38:35.487942Z] Finished read-buildbot-config step (success) 18:38:35 INFO - [mozharness: 2017-09-15 01:38:35.488158Z] Running download-and-extract step. 18:38:35 INFO - Running pre-action listener: _resource_record_pre_action 18:38:35 INFO - Running main action method: download_and_extract 18:38:35 INFO - mkdir: /builds/slave/test/build/tests 18:38:35 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:38:35 INFO - trying https://queue.taskcluster.net/v1/task/dwA3zIQnSsC5sWxXs_oG_Q/artifacts/public/build/target.test_packages.json 18:38:35 INFO - Downloading https://queue.taskcluster.net/v1/task/dwA3zIQnSsC5sWxXs_oG_Q/artifacts/public/build/target.test_packages.json to /builds/slave/test/build/target.test_packages.json 18:38:35 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/dwA3zIQnSsC5sWxXs_oG_Q/artifacts/public/build/target.test_packages.json', 'file_name': '/builds/slave/test/build/target.test_packages.json'}, attempt #1 18:38:36 INFO - Downloaded 989 bytes. 18:38:36 INFO - Reading from file /builds/slave/test/build/target.test_packages.json 18:38:36 INFO - Using the following test package requirements: 18:38:36 INFO - {u'awsy': [u'target.common.tests.zip', u'target.awsy.tests.zip'], 18:38:36 INFO - u'common': [u'target.common.tests.zip'], 18:38:36 INFO - u'cppunittest': [u'target.common.tests.zip', u'target.cppunittest.tests.zip'], 18:38:36 INFO - u'gtest': [u'target.common.tests.zip', u'target.gtest.tests.zip'], 18:38:36 INFO - u'jittest': [u'target.common.tests.zip', u'target.jsshell.zip'], 18:38:36 INFO - u'mochitest': [u'target.common.tests.zip', u'target.mochitest.tests.zip'], 18:38:36 INFO - u'mozbase': [u'target.common.tests.zip'], 18:38:36 INFO - u'reftest': [u'target.common.tests.zip', u'target.reftest.tests.zip'], 18:38:36 INFO - u'talos': [u'target.common.tests.zip', u'target.talos.tests.zip'], 18:38:36 INFO - u'web-platform': [u'target.common.tests.zip', 18:38:36 INFO - u'target.web-platform.tests.tar.gz'], 18:38:36 INFO - u'xpcshell': [u'target.common.tests.zip', u'target.xpcshell.tests.zip']} 18:38:36 INFO - Downloading packages: [u'target.common.tests.zip', u'target.talos.tests.zip'] for test suite categories: ['common', 'talos'] 18:38:36 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/dwA3zIQnSsC5sWxXs_oG_Q/artifacts/public/build/target.common.tests.zip 18:38:36 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/dwA3zIQnSsC5sWxXs_oG_Q/artifacts/public/build/target.common.tests.zip'}, attempt #1 18:38:36 INFO - Fetch https://queue.taskcluster.net/v1/task/dwA3zIQnSsC5sWxXs_oG_Q/artifacts/public/build/target.common.tests.zip into memory 18:38:51 INFO - Content-Length response header: 55176513 18:38:51 INFO - Bytes received: 55176513 18:39:01 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/dwA3zIQnSsC5sWxXs_oG_Q/artifacts/public/build/target.talos.tests.zip 18:39:01 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/dwA3zIQnSsC5sWxXs_oG_Q/artifacts/public/build/target.talos.tests.zip'}, attempt #1 18:39:01 INFO - Fetch https://queue.taskcluster.net/v1/task/dwA3zIQnSsC5sWxXs_oG_Q/artifacts/public/build/target.talos.tests.zip into memory 18:39:18 INFO - Content-Length response header: 14500356 18:39:18 INFO - Bytes received: 14500356 18:39:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:39:19 INFO - trying https://queue.taskcluster.net/v1/task/dwA3zIQnSsC5sWxXs_oG_Q/artifacts/public/build/target.tar.bz2 18:39:19 INFO - Downloading https://queue.taskcluster.net/v1/task/dwA3zIQnSsC5sWxXs_oG_Q/artifacts/public/build/target.tar.bz2 to /builds/slave/test/build/target.tar.bz2 18:39:19 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/dwA3zIQnSsC5sWxXs_oG_Q/artifacts/public/build/target.tar.bz2', 'file_name': '/builds/slave/test/build/target.tar.bz2'}, attempt #1 18:39:28 INFO - Downloaded 53419307 bytes. 18:39:28 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/dwA3zIQnSsC5sWxXs_oG_Q/artifacts/public/build/target.tar.bz2 18:39:28 INFO - mkdir: /builds/slave/test/properties 18:39:28 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 18:39:28 INFO - Writing to file /builds/slave/test/properties/build_url 18:39:28 INFO - Contents: 18:39:28 INFO - build_url:https://queue.taskcluster.net/v1/task/dwA3zIQnSsC5sWxXs_oG_Q/artifacts/public/build/target.tar.bz2 18:39:28 INFO - Running post-action listener: _resource_record_post_action 18:39:28 INFO - Running post-action listener: find_tests_for_verification 18:39:28 INFO - Running post-action listener: set_extra_try_arguments 18:39:28 INFO - [mozharness: 2017-09-15 01:39:28.610639Z] Finished download-and-extract step (success) 18:39:28 INFO - [mozharness: 2017-09-15 01:39:28.610865Z] Running populate-webroot step. 18:39:28 INFO - Running pre-action listener: _resource_record_pre_action 18:39:28 INFO - Running main action method: populate_webroot 18:39:28 INFO - {'suites': {'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 18:39:28 INFO - 'chromez-stylo-disabled-e10s': {'talos_options': ['--disable-stylo'], 18:39:28 INFO - 'tests': ['tresize', 18:39:28 INFO - 'tcanvasmark']}, 18:39:28 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 18:39:28 INFO - 'dromaeojs-stylo-disabled-e10s': {'talos_options': ['--disable-stylo'], 18:39:28 INFO - 'tests': ['dromaeo_css', 18:39:28 INFO - 'kraken']}, 18:39:28 INFO - 'g1-e10s': {'pagesets_name': 'tp5n.zip', 18:39:28 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 18:39:28 INFO - 'g1-stylo-disabled-e10s': {'pagesets_name': 'tp5n.zip', 18:39:28 INFO - 'talos_options': ['--disable-stylo'], 18:39:28 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 18:39:28 INFO - 'g2-e10s': {'pagesets_name': 'tp5n.zip', 18:39:28 INFO - 'tests': ['damp', 'tps']}, 18:39:28 INFO - 'g2-stylo-disabled-e10s': {'pagesets_name': 'tp5n.zip', 18:39:28 INFO - 'talos_options': ['--disable-stylo'], 18:39:28 INFO - 'tests': ['damp', 'tps']}, 18:39:28 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 18:39:28 INFO - 'g3-stylo-disabled-e10s': {'talos_options': ['--disable-stylo'], 18:39:28 INFO - 'tests': ['dromaeo_dom']}, 18:39:28 INFO - 'g4-e10s': {'tests': ['basic_compositor_video', 'glvideo']}, 18:39:28 INFO - 'g4-stylo-disabled-e10s': {'talos_options': ['--disable-stylo'], 18:39:28 INFO - 'tests': ['basic_compositor_video', 18:39:28 INFO - 'glvideo']}, 18:39:28 INFO - 'g5-e10s': {'pagesets_name': 'tp5n.zip', 18:39:28 INFO - 'tests': ['ts_paint_webext', 'tp5o_webext']}, 18:39:28 INFO - 'g5-stylo-disabled-e10s': {'pagesets_name': 'tp5n.zip', 18:39:28 INFO - 'talos_options': ['--disable-stylo'], 18:39:28 INFO - 'tests': ['ts_paint_webext', 18:39:28 INFO - 'tp5o_webext']}, 18:39:28 INFO - 'other-e10s': {'tests': ['a11yr', 18:39:28 INFO - 'ts_paint', 18:39:28 INFO - 'tpaint', 18:39:28 INFO - 'sessionrestore', 18:39:28 INFO - 'sessionrestore_many_windows', 18:39:28 INFO - 'sessionrestore_no_auto_restore', 18:39:28 INFO - 'tabpaint']}, 18:39:28 INFO - 'other-stylo-disabled-e10s': {'talos_options': ['--disable-stylo'], 18:39:28 INFO - 'tests': ['a11yr', 18:39:28 INFO - 'ts_paint', 18:39:28 INFO - 'tpaint', 18:39:28 INFO - 'sessionrestore', 18:39:28 INFO - 'sessionrestore_many_windows', 18:39:28 INFO - 'sessionrestore_no_auto_restore', 18:39:28 INFO - 'tabpaint']}, 18:39:28 INFO - 'perf-reftest-e10s': {'tests': ['bloom_basic']}, 18:39:28 INFO - 'perf-reftest-singletons-e10s': {'tests': ['bloom_basic_singleton']}, 18:39:28 INFO - 'perf-reftest-singletons-stylo-disabled-e10s': {'talos_options': ['--disable-stylo'], 18:39:28 INFO - 'tests': ['bloom_basic_singleton']}, 18:39:28 INFO - 'perf-reftest-stylo-disabled-e10s': {'talos_options': ['--disable-stylo'], 18:39:28 INFO - 'tests': ['bloom_basic']}, 18:39:28 INFO - 'svgr-e10s': {'tests': ['tsvgx', 18:39:28 INFO - 'tsvgr_opacity', 18:39:28 INFO - 'tart', 18:39:28 INFO - 'tscrollx', 18:39:28 INFO - 'tsvg_static']}, 18:39:28 INFO - 'svgr-stylo-disabled-e10s': {'talos_options': ['--disable-stylo'], 18:39:28 INFO - 'tests': ['tsvgx', 18:39:28 INFO - 'tsvgr_opacity', 18:39:28 INFO - 'tart', 18:39:28 INFO - 'tscrollx', 18:39:28 INFO - 'tsvg_static']}, 18:39:28 INFO - 'tp5o-e10s': {'pagesets_name': 'tp5n.zip', 'tests': ['tp5o']}, 18:39:28 INFO - 'tp5o-stylo-disabled-e10s': {'pagesets_name': 'tp5n.zip', 18:39:28 INFO - 'talos_options': ['--disable-stylo'], 18:39:28 INFO - 'tests': ['tp5o']}, 18:39:28 INFO - 'tp6-e10s': {'mitmproxy_recording_set': 'mitmproxy-recording-set-win10.zip', 18:39:28 INFO - 'talos_options': ['--mitmproxy', 18:39:28 INFO - 'mitmproxy-recording-google.mp mitmproxy-recording-youtube.mp mitmproxy-recording-amazon.mp mitmproxy-recording-facebook.mp', 18:39:28 INFO - '--firstNonBlankPaint'], 18:39:28 INFO - 'tests': ['tp6_google', 18:39:28 INFO - 'tp6_youtube', 18:39:28 INFO - 'tp6_amazon', 18:39:28 INFO - 'tp6_facebook']}, 18:39:28 INFO - 'tp6-stylo-disabled-e10s': {'mitmproxy_recording_set': 'mitmproxy-recording-set-win10.zip', 18:39:28 INFO - 'talos_options': ['--disable-stylo', 18:39:28 INFO - '--mitmproxy', 18:39:28 INFO - 'mitmproxy-recording-google.mp mitmproxy-recording-youtube.mp mitmproxy-recording-amazon.mp mitmproxy-recording-facebook.mp', 18:39:28 INFO - '--firstNonBlankPaint'], 18:39:28 INFO - 'tests': ['tp6_google', 18:39:28 INFO - 'tp6_youtube', 18:39:28 INFO - 'tp6_amazon', 18:39:28 INFO - 'tp6_facebook']}, 18:39:28 INFO - 'tp6-stylo-threads-e10s': {'mitmproxy_recording_set': 'mitmproxy-recording-set-win10.zip', 18:39:28 INFO - 'talos_options': ['--stylo-threads=1', 18:39:28 INFO - '--mitmproxy', 18:39:28 INFO - 'mitmproxy-recording-google.mp mitmproxy-recording-youtube.mp mitmproxy-recording-amazon.mp mitmproxy-recording-facebook.mp', 18:39:28 INFO - '--firstNonBlankPaint'], 18:39:28 INFO - 'tests': ['tp6_google', 18:39:28 INFO - 'tp6_youtube', 18:39:28 INFO - 'tp6_amazon', 18:39:28 INFO - 'tp6_facebook']}, 18:39:28 INFO - 'xperf-e10s': {'pagesets_name': 'tp5n.zip', 18:39:28 INFO - 'talos_options': ['--xperf_path', 18:39:28 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 18:39:28 INFO - 'tests': ['tp5n']}, 18:39:28 INFO - 'xperf-stylo-disabled-e10s': {'pagesets_name': 'tp5n.zip', 18:39:28 INFO - 'talos_options': ['--disable-stylo', 18:39:28 INFO - '--xperf_path', 18:39:28 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 18:39:28 INFO - 'tests': ['tp5n']}}} 18:39:28 INFO - Running post-action listener: _resource_record_post_action 18:39:28 INFO - [mozharness: 2017-09-15 01:39:28.627227Z] Finished populate-webroot step (success) 18:39:28 INFO - [mozharness: 2017-09-15 01:39:28.627316Z] Running create-virtualenv step. 18:39:28 INFO - Running pre-action listener: _resource_record_pre_action 18:39:28 INFO - Running main action method: create_virtualenv 18:39:28 INFO - Creating virtualenv /builds/slave/test/build/venv 18:39:28 INFO - Running command: ['virtualenv', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 18:39:28 INFO - Copy/paste: virtualenv --no-site-packages --distribute /builds/slave/test/build/venv 18:39:28 INFO - Using partial env: {'VIRTUALENV_NO_DOWNLOAD': '1'} 18:39:28 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 18:39:28 INFO - New python executable in /builds/slave/test/build/venv/bin/python 18:39:29 INFO - Installing distribute.............................................................................................................................................................................................done. 18:39:29 INFO - Installing pip...............done. 18:39:29 INFO - Return code: 0 18:39:29 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 18:39:29 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 18:39:29 INFO - Reading from file tmpfile_stdout 18:39:29 INFO - Output received: 18:39:29 INFO - pip 1.1 from /builds/slave/test/build/venv/lib/python2.7/site-packages/pip-1.1-py2.7.egg (python 2.7) 18:39:29 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 18:39:29 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:39:29 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:39:29 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:39:29 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:39:29 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x12831f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x144ba80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x15eea60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15f2090>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15f2d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x15ecf90>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1505437288.179532-1377774891', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 18:39:29 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 18:39:29 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 18:39:29 INFO - Using env: {'DISPLAY': ':0', 18:39:29 INFO - 'HOME': '/home/cltbld', 18:39:29 INFO - 'LANG': 'en_US.UTF-8', 18:39:29 INFO - 'LANGUAGE': 'en_US:en', 18:39:29 INFO - 'LOGNAME': 'cltbld', 18:39:29 INFO - 'MAIL': '/var/mail/cltbld', 18:39:29 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:39:29 INFO - 'MOZ_NO_REMOTE': '1', 18:39:29 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:39:29 INFO - 'NO_EM_RESTART': '1', 18:39:29 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:39:29 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:39:29 INFO - 'PWD': '/builds/slave/test', 18:39:29 INFO - 'SHELL': '/bin/bash', 18:39:29 INFO - 'SHLVL': '1', 18:39:29 INFO - 'TERM': 'linux', 18:39:29 INFO - 'TMOUT': '86400', 18:39:29 INFO - 'USER': 'cltbld', 18:39:29 INFO - 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1505437288.179532-1377774891', 18:39:29 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:39:29 INFO - '_': '/tools/buildbot/bin/python'} 18:39:30 INFO - Ignoring indexes: http://pypi.python.org/simple/ 18:39:30 INFO - Downloading/unpacking pip>=1.5 18:39:30 INFO - Running setup.py egg_info for package pip 18:39:30 INFO - warning: no files found matching 'pip/cacert.pem' 18:39:30 INFO - warning: no files found matching '*.html' under directory 'docs' 18:39:30 INFO - warning: no previously-included files matching '*.rst' found under directory 'docs/_build' 18:39:30 INFO - no previously-included directories found matching 'docs/_build/_sources' 18:39:30 INFO - Installing collected packages: pip 18:39:30 INFO - Found existing installation: pip 1.1 18:39:30 INFO - Uninstalling pip: 18:39:30 INFO - Successfully uninstalled pip 18:39:30 INFO - Running setup.py install for pip 18:39:30 INFO - warning: no files found matching 'pip/cacert.pem' 18:39:30 INFO - warning: no files found matching '*.html' under directory 'docs' 18:39:30 INFO - warning: no previously-included files matching '*.rst' found under directory 'docs/_build' 18:39:30 INFO - no previously-included directories found matching 'docs/_build/_sources' 18:39:30 INFO - Installing pip script to /builds/slave/test/build/venv/bin 18:39:30 INFO - Installing pip2.7 script to /builds/slave/test/build/venv/bin 18:39:30 INFO - Installing pip2 script to /builds/slave/test/build/venv/bin 18:39:30 INFO - Successfully installed pip 18:39:30 INFO - Cleaning up... 18:39:30 INFO - Return code: 0 18:39:30 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 18:39:30 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:39:30 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:39:30 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:39:30 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:39:30 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x12831f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x144ba80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x15eea60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15f2090>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15f2d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x15ecf90>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1505437288.179532-1377774891', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 18:39:30 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1'] in /builds/slave/test/build 18:39:30 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 18:39:30 INFO - Using env: {'DISPLAY': ':0', 18:39:30 INFO - 'HOME': '/home/cltbld', 18:39:30 INFO - 'LANG': 'en_US.UTF-8', 18:39:30 INFO - 'LANGUAGE': 'en_US:en', 18:39:30 INFO - 'LOGNAME': 'cltbld', 18:39:30 INFO - 'MAIL': '/var/mail/cltbld', 18:39:30 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:39:30 INFO - 'MOZ_NO_REMOTE': '1', 18:39:30 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:39:30 INFO - 'NO_EM_RESTART': '1', 18:39:30 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:39:30 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:39:30 INFO - 'PWD': '/builds/slave/test', 18:39:30 INFO - 'SHELL': '/bin/bash', 18:39:30 INFO - 'SHLVL': '1', 18:39:30 INFO - 'TERM': 'linux', 18:39:30 INFO - 'TMOUT': '86400', 18:39:30 INFO - 'USER': 'cltbld', 18:39:30 INFO - 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1505437288.179532-1377774891', 18:39:30 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:39:30 INFO - '_': '/tools/buildbot/bin/python'} 18:39:31 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:39:31 INFO - Downloading/unpacking psutil>=3.1.1 18:39:31 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:39:31 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:39:31 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:39:31 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:39:32 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 18:39:32 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 18:39:32 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 18:39:32 INFO - Installing collected packages: psutil 18:39:32 INFO - Running setup.py install for psutil 18:39:32 INFO - building 'psutil._psutil_linux' extension 18:39:32 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -DPSUTIL_VERSION=311 -I/usr/include/python2.7 -c psutil/_psutil_linux.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o 18:39:32 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_linux.so 18:39:32 INFO - building 'psutil._psutil_posix' extension 18:39:32 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o 18:39:32 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_posix.so 18:39:32 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 18:39:32 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 18:39:32 INFO - Successfully installed psutil 18:39:32 INFO - Cleaning up... 18:39:32 INFO - Return code: 0 18:39:32 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 18:39:32 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:39:32 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:39:32 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:39:32 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:39:32 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x12831f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x144ba80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x15eea60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15f2090>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15f2d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x15ecf90>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1505437288.179532-1377774891', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 18:39:32 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3'] in /builds/slave/test/build 18:39:32 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.3 18:39:32 INFO - Using env: {'DISPLAY': ':0', 18:39:32 INFO - 'HOME': '/home/cltbld', 18:39:32 INFO - 'LANG': 'en_US.UTF-8', 18:39:32 INFO - 'LANGUAGE': 'en_US:en', 18:39:32 INFO - 'LOGNAME': 'cltbld', 18:39:32 INFO - 'MAIL': '/var/mail/cltbld', 18:39:32 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:39:32 INFO - 'MOZ_NO_REMOTE': '1', 18:39:32 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:39:32 INFO - 'NO_EM_RESTART': '1', 18:39:32 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:39:32 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:39:32 INFO - 'PWD': '/builds/slave/test', 18:39:32 INFO - 'SHELL': '/bin/bash', 18:39:32 INFO - 'SHLVL': '1', 18:39:32 INFO - 'TERM': 'linux', 18:39:32 INFO - 'TMOUT': '86400', 18:39:32 INFO - 'USER': 'cltbld', 18:39:32 INFO - 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1505437288.179532-1377774891', 18:39:32 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:39:32 INFO - '_': '/tools/buildbot/bin/python'} 18:39:33 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:39:33 INFO - Downloading/unpacking mozsystemmonitor==0.3 18:39:33 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:39:33 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:39:33 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:39:33 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:39:34 INFO - Downloading mozsystemmonitor-0.3.tar.gz 18:39:34 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 18:39:34 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 18:39:34 INFO - Installing collected packages: mozsystemmonitor 18:39:34 INFO - Running setup.py install for mozsystemmonitor 18:39:34 INFO - Successfully installed mozsystemmonitor 18:39:34 INFO - Cleaning up... 18:39:34 INFO - Return code: 0 18:39:34 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 18:39:34 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:39:34 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:39:34 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:39:34 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:39:34 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x12831f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x144ba80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x15eea60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15f2090>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15f2d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x15ecf90>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1505437288.179532-1377774891', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 18:39:34 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1'] in /builds/slave/test/build 18:39:34 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema==2.5.1 18:39:34 INFO - Using env: {'DISPLAY': ':0', 18:39:34 INFO - 'HOME': '/home/cltbld', 18:39:34 INFO - 'LANG': 'en_US.UTF-8', 18:39:34 INFO - 'LANGUAGE': 'en_US:en', 18:39:34 INFO - 'LOGNAME': 'cltbld', 18:39:34 INFO - 'MAIL': '/var/mail/cltbld', 18:39:34 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:39:34 INFO - 'MOZ_NO_REMOTE': '1', 18:39:34 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:39:34 INFO - 'NO_EM_RESTART': '1', 18:39:34 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:39:34 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:39:34 INFO - 'PWD': '/builds/slave/test', 18:39:34 INFO - 'SHELL': '/bin/bash', 18:39:34 INFO - 'SHLVL': '1', 18:39:34 INFO - 'TERM': 'linux', 18:39:34 INFO - 'TMOUT': '86400', 18:39:34 INFO - 'USER': 'cltbld', 18:39:34 INFO - 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1505437288.179532-1377774891', 18:39:34 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:39:34 INFO - '_': '/tools/buildbot/bin/python'} 18:39:34 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:39:34 INFO - Downloading/unpacking jsonschema==2.5.1 18:39:34 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:39:34 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:39:34 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:39:34 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:39:35 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 18:39:35 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 18:39:35 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:39:35 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:39:35 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:39:35 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:39:35 INFO - Downloading functools32-3.2.3-2.tar.gz 18:39:35 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 18:39:35 INFO - warning: no files found matching '*.txt' 18:39:35 INFO - no previously-included directories found matching 'build' 18:39:35 INFO - no previously-included directories found matching 'dist' 18:39:35 INFO - no previously-included directories found matching '.git*' 18:39:35 INFO - Installing collected packages: jsonschema, functools32 18:39:35 INFO - Running setup.py install for functools32 18:39:36 INFO - warning: no files found matching '*.txt' 18:39:36 INFO - no previously-included directories found matching 'build' 18:39:36 INFO - no previously-included directories found matching 'dist' 18:39:36 INFO - no previously-included directories found matching '.git*' 18:39:36 INFO - Successfully installed jsonschema functools32 18:39:36 INFO - Cleaning up... 18:39:36 INFO - Return code: 0 18:39:36 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 18:39:36 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:39:36 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:39:36 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:39:36 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:39:36 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x12831f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x144ba80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x15eea60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15f2090>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15f2d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x15ecf90>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1505437288.179532-1377774891', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 18:39:36 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2'] in /builds/slave/test/build 18:39:36 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub functools32==3.2.3-2 18:39:36 INFO - Using env: {'DISPLAY': ':0', 18:39:36 INFO - 'HOME': '/home/cltbld', 18:39:36 INFO - 'LANG': 'en_US.UTF-8', 18:39:36 INFO - 'LANGUAGE': 'en_US:en', 18:39:36 INFO - 'LOGNAME': 'cltbld', 18:39:36 INFO - 'MAIL': '/var/mail/cltbld', 18:39:36 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:39:36 INFO - 'MOZ_NO_REMOTE': '1', 18:39:36 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:39:36 INFO - 'NO_EM_RESTART': '1', 18:39:36 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:39:36 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:39:36 INFO - 'PWD': '/builds/slave/test', 18:39:36 INFO - 'SHELL': '/bin/bash', 18:39:36 INFO - 'SHLVL': '1', 18:39:36 INFO - 'TERM': 'linux', 18:39:36 INFO - 'TMOUT': '86400', 18:39:36 INFO - 'USER': 'cltbld', 18:39:36 INFO - 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1505437288.179532-1377774891', 18:39:36 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:39:36 INFO - '_': '/tools/buildbot/bin/python'} 18:39:36 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:39:36 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 18:39:36 INFO - Cleaning up... 18:39:36 INFO - Return code: 0 18:39:36 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 18:39:36 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:39:36 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:39:36 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:39:36 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:39:36 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x12831f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x144ba80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x15eea60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15f2090>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15f2d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x15ecf90>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1505437288.179532-1377774891', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 18:39:36 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 18:39:36 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 18:39:36 INFO - Using env: {'DISPLAY': ':0', 18:39:36 INFO - 'HOME': '/home/cltbld', 18:39:36 INFO - 'LANG': 'en_US.UTF-8', 18:39:36 INFO - 'LANGUAGE': 'en_US:en', 18:39:36 INFO - 'LOGNAME': 'cltbld', 18:39:36 INFO - 'MAIL': '/var/mail/cltbld', 18:39:36 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:39:36 INFO - 'MOZ_NO_REMOTE': '1', 18:39:36 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:39:36 INFO - 'NO_EM_RESTART': '1', 18:39:36 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:39:36 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:39:36 INFO - 'PWD': '/builds/slave/test', 18:39:36 INFO - 'SHELL': '/bin/bash', 18:39:36 INFO - 'SHLVL': '1', 18:39:36 INFO - 'TERM': 'linux', 18:39:36 INFO - 'TMOUT': '86400', 18:39:36 INFO - 'USER': 'cltbld', 18:39:36 INFO - 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1505437288.179532-1377774891', 18:39:36 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:39:36 INFO - '_': '/tools/buildbot/bin/python'} 18:39:36 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:39:36 INFO - Downloading/unpacking blobuploader==1.2.4 18:39:36 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:39:36 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:39:36 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:39:36 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:39:37 INFO - Downloading blobuploader-1.2.4.tar.gz 18:39:37 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 18:39:37 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 18:39:37 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:39:37 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:39:37 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:39:37 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:39:37 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 18:39:38 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 18:39:38 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:39:38 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:39:38 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:39:38 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:39:38 INFO - Downloading docopt-0.6.1.tar.gz 18:39:38 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 18:39:38 INFO - Installing collected packages: blobuploader, requests, docopt 18:39:38 INFO - Running setup.py install for blobuploader 18:39:38 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 18:39:38 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 18:39:38 INFO - Running setup.py install for requests 18:39:38 INFO - Running setup.py install for docopt 18:39:38 INFO - Successfully installed blobuploader requests docopt 18:39:38 INFO - Cleaning up... 18:39:38 INFO - Return code: 0 18:39:38 INFO - Installing None into virtualenv /builds/slave/test/build/venv 18:39:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:39:38 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:39:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:39:38 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:39:38 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x12831f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x144ba80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x15eea60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15f2090>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15f2d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x15ecf90>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1505437288.179532-1377774891', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 18:39:38 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 18:39:38 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 18:39:38 INFO - Using env: {'DISPLAY': ':0', 18:39:38 INFO - 'HOME': '/home/cltbld', 18:39:38 INFO - 'LANG': 'en_US.UTF-8', 18:39:38 INFO - 'LANGUAGE': 'en_US:en', 18:39:38 INFO - 'LOGNAME': 'cltbld', 18:39:38 INFO - 'MAIL': '/var/mail/cltbld', 18:39:38 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:39:38 INFO - 'MOZ_NO_REMOTE': '1', 18:39:38 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:39:38 INFO - 'NO_EM_RESTART': '1', 18:39:38 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:39:38 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:39:38 INFO - 'PWD': '/builds/slave/test', 18:39:38 INFO - 'SHELL': '/bin/bash', 18:39:38 INFO - 'SHLVL': '1', 18:39:38 INFO - 'TERM': 'linux', 18:39:38 INFO - 'TMOUT': '86400', 18:39:38 INFO - 'USER': 'cltbld', 18:39:38 INFO - 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1505437288.179532-1377774891', 18:39:38 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:39:38 INFO - '_': '/tools/buildbot/bin/python'} 18:39:39 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:39:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 18:39:39 INFO - Running setup.py (path:/tmp/pip-yvef02-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 18:39:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 18:39:39 INFO - Running setup.py (path:/tmp/pip-ttBrxV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 18:39:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 18:39:39 INFO - Running setup.py (path:/tmp/pip-diUZD2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 18:39:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 18:39:39 INFO - Running setup.py (path:/tmp/pip-Hd0Nvb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 18:39:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 18:39:39 INFO - Running setup.py (path:/tmp/pip-MyVuN8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 18:39:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 18:39:39 INFO - Running setup.py (path:/tmp/pip-h_rYeT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 18:39:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 18:39:39 INFO - Running setup.py (path:/tmp/pip-HkNr4B-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 18:39:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 18:39:39 INFO - Running setup.py (path:/tmp/pip-V2icG9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 18:39:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 18:39:39 INFO - Running setup.py (path:/tmp/pip-XmA_VZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 18:39:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 18:39:39 INFO - Running setup.py (path:/tmp/pip-fTMddZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 18:39:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 18:39:39 INFO - Running setup.py (path:/tmp/pip-Fqn4kW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 18:39:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 18:39:39 INFO - Running setup.py (path:/tmp/pip-j9zNI9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 18:39:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 18:39:39 INFO - Running setup.py (path:/tmp/pip-b2dNyF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 18:39:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 18:39:40 INFO - Running setup.py (path:/tmp/pip-QdaNQv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 18:39:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 18:39:40 INFO - Running setup.py (path:/tmp/pip-ii9x0q-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 18:39:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 18:39:40 INFO - Running setup.py (path:/tmp/pip-n1igfL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 18:39:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 18:39:40 INFO - Running setup.py (path:/tmp/pip-vxjU72-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 18:39:40 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 18:39:40 INFO - Running setup.py install for manifestparser 18:39:40 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 18:39:40 INFO - Running setup.py install for mozcrash 18:39:40 INFO - Running setup.py install for mozdebug 18:39:40 INFO - Running setup.py install for mozdevice 18:39:40 INFO - Installing dm script to /builds/slave/test/build/venv/bin 18:39:40 INFO - Running setup.py install for mozfile 18:39:40 INFO - Running setup.py install for mozhttpd 18:39:40 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 18:39:40 INFO - Running setup.py install for mozinfo 18:39:40 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 18:39:40 INFO - Running setup.py install for mozInstall 18:39:41 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 18:39:41 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 18:39:41 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 18:39:41 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 18:39:41 INFO - Running setup.py install for mozleak 18:39:41 INFO - Running setup.py install for mozlog 18:39:41 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 18:39:41 INFO - Running setup.py install for moznetwork 18:39:41 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 18:39:41 INFO - Running setup.py install for mozprocess 18:39:41 INFO - Running setup.py install for mozprofile 18:39:41 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 18:39:41 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 18:39:41 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 18:39:41 INFO - Running setup.py install for mozrunner 18:39:41 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 18:39:41 INFO - Running setup.py install for mozscreenshot 18:39:41 INFO - Running setup.py install for moztest 18:39:41 INFO - Running setup.py install for mozversion 18:39:42 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 18:39:42 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 18:39:42 INFO - Cleaning up... 18:39:42 INFO - Return code: 0 18:39:42 INFO - Installing None into virtualenv /builds/slave/test/build/venv 18:39:42 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:39:42 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:39:42 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:39:42 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:39:42 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x12831f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x144ba80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x15eea60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15f2090>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15f2d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x15ecf90>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1505437288.179532-1377774891', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 18:39:42 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 18:39:42 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 18:39:42 INFO - Using env: {'DISPLAY': ':0', 18:39:42 INFO - 'HOME': '/home/cltbld', 18:39:42 INFO - 'LANG': 'en_US.UTF-8', 18:39:42 INFO - 'LANGUAGE': 'en_US:en', 18:39:42 INFO - 'LOGNAME': 'cltbld', 18:39:42 INFO - 'MAIL': '/var/mail/cltbld', 18:39:42 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:39:42 INFO - 'MOZ_NO_REMOTE': '1', 18:39:42 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:39:42 INFO - 'NO_EM_RESTART': '1', 18:39:42 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:39:42 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:39:42 INFO - 'PWD': '/builds/slave/test', 18:39:42 INFO - 'SHELL': '/bin/bash', 18:39:42 INFO - 'SHLVL': '1', 18:39:42 INFO - 'TERM': 'linux', 18:39:42 INFO - 'TMOUT': '86400', 18:39:42 INFO - 'USER': 'cltbld', 18:39:42 INFO - 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1505437288.179532-1377774891', 18:39:42 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:39:42 INFO - '_': '/tools/buildbot/bin/python'} 18:39:42 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:39:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 18:39:42 INFO - Running setup.py (path:/tmp/pip-8RdZkK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 18:39:42 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test/build/tests/mozbase/manifestparser in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 1)) 18:39:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 18:39:42 INFO - Running setup.py (path:/tmp/pip-Q_SyGP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 18:39:42 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==1.0 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 18:39:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 18:39:42 INFO - Running setup.py (path:/tmp/pip-A7bzYw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 18:39:42 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test/build/tests/mozbase/mozdebug in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 18:39:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 18:39:42 INFO - Running setup.py (path:/tmp/pip-L1Vf6O-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 18:39:42 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.51 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 18:39:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 18:39:42 INFO - Running setup.py (path:/tmp/pip-0PUX4A-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 18:39:42 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test/build/tests/mozbase/mozfile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 5)) 18:39:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 18:39:42 INFO - Running setup.py (path:/tmp/pip-4wY3SQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 18:39:42 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test/build/tests/mozbase/mozhttpd in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 6)) 18:39:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 18:39:42 INFO - Running setup.py (path:/tmp/pip-7QcHgD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 18:39:42 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.10 from file:///builds/slave/test/build/tests/mozbase/mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 7)) 18:39:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 18:39:42 INFO - Running setup.py (path:/tmp/pip-C9xfYL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 18:39:42 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.13 from file:///builds/slave/test/build/tests/mozbase/mozinstall in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 18:39:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 18:39:42 INFO - Running setup.py (path:/tmp/pip-GNVCeV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 18:39:42 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test/build/tests/mozbase/mozleak in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 9)) 18:39:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 18:39:42 INFO - Running setup.py (path:/tmp/pip-0uE7VM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 18:39:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.5 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 18:39:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 18:39:43 INFO - Running setup.py (path:/tmp/pip-9E6pZX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 18:39:43 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test/build/tests/mozbase/moznetwork in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 11)) 18:39:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 18:39:43 INFO - Running setup.py (path:/tmp/pip-tPzkWs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 18:39:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.25 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 18:39:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 18:39:43 INFO - Running setup.py (path:/tmp/pip-c4olYA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 18:39:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 from file:///builds/slave/test/build/tests/mozbase/mozprofile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 13)) 18:39:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 18:39:43 INFO - Running setup.py (path:/tmp/pip-viMe_v-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 18:39:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.13 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 18:39:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 18:39:43 INFO - Running setup.py (path:/tmp/pip-v62NkH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 18:39:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test/build/tests/mozbase/mozscreenshot in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 15)) 18:39:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 18:39:43 INFO - Running setup.py (path:/tmp/pip-QdJCDo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 18:39:43 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.8 from file:///builds/slave/test/build/tests/mozbase/moztest in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 16)) 18:39:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 18:39:43 INFO - Running setup.py (path:/tmp/pip-kdLZuK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 18:39:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test/build/tests/mozbase/mozversion in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 17)) 18:39:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 18:39:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 18:39:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 18:39:43 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.51->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 18:39:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.51->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 18:39:43 INFO - Requirement already satisfied (use --upgrade to upgrade): requests in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozInstall==1.13->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 18:39:43 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.5->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 18:39:43 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:39:43 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:39:43 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:39:43 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:39:44 INFO - Downloading blessings-1.6.tar.gz 18:39:44 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 18:39:44 INFO - Installing collected packages: blessings 18:39:44 INFO - Running setup.py install for blessings 18:39:44 INFO - Successfully installed blessings 18:39:44 INFO - Cleaning up... 18:39:44 INFO - Return code: 0 18:39:44 INFO - Done creating virtualenv /builds/slave/test/build/venv. 18:39:44 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 18:39:44 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 18:39:45 INFO - Reading from file tmpfile_stdout 18:39:45 INFO - Current package versions: 18:39:45 INFO - argparse == 1.2.1 18:39:45 INFO - blessings == 1.6 18:39:45 INFO - blobuploader == 1.2.4 18:39:45 INFO - docopt == 0.6.1 18:39:45 INFO - functools32 == 3.2.3-2 18:39:45 INFO - jsonschema == 2.5.1 18:39:45 INFO - manifestparser == 1.1 18:39:45 INFO - mozInstall == 1.13 18:39:45 INFO - mozcrash == 1.0 18:39:45 INFO - mozdebug == 0.1 18:39:45 INFO - mozdevice == 0.51 18:39:45 INFO - mozfile == 1.2 18:39:45 INFO - mozhttpd == 0.7 18:39:45 INFO - mozinfo == 0.10 18:39:45 INFO - mozleak == 0.1 18:39:45 INFO - mozlog == 3.5 18:39:45 INFO - moznetwork == 0.27 18:39:45 INFO - mozprocess == 0.25 18:39:45 INFO - mozprofile == 0.28 18:39:45 INFO - mozrunner == 6.13 18:39:45 INFO - mozscreenshot == 0.1 18:39:45 INFO - mozsystemmonitor == 0.3 18:39:45 INFO - moztest == 0.8 18:39:45 INFO - mozversion == 1.4 18:39:45 INFO - psutil == 3.1.1 18:39:45 INFO - requests == 1.2.3 18:39:45 INFO - wsgiref == 0.1.2 18:39:45 INFO - Installing None into virtualenv /builds/slave/test/build/venv 18:39:45 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:39:45 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:39:45 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:39:45 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:39:45 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x12831f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x144ba80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x15eea60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15f2090>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15f2d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x15ecf90>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/talos', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1505437288.179532-1377774891', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 18:39:45 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/talos 18:39:45 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 18:39:45 INFO - Using env: {'DISPLAY': ':0', 18:39:45 INFO - 'HOME': '/home/cltbld', 18:39:45 INFO - 'LANG': 'en_US.UTF-8', 18:39:45 INFO - 'LANGUAGE': 'en_US:en', 18:39:45 INFO - 'LOGNAME': 'cltbld', 18:39:45 INFO - 'MAIL': '/var/mail/cltbld', 18:39:45 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:39:45 INFO - 'MOZ_NO_REMOTE': '1', 18:39:45 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:39:45 INFO - 'NO_EM_RESTART': '1', 18:39:45 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:39:45 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:39:45 INFO - 'PWD': '/builds/slave/test', 18:39:45 INFO - 'SHELL': '/bin/bash', 18:39:45 INFO - 'SHLVL': '1', 18:39:45 INFO - 'TERM': 'linux', 18:39:45 INFO - 'TMOUT': '86400', 18:39:45 INFO - 'USER': 'cltbld', 18:39:45 INFO - 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1505437288.179532-1377774891', 18:39:45 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:39:45 INFO - '_': '/tools/buildbot/bin/python'} 18:39:45 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:39:45 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 18:39:45 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 2)) 18:39:45 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 18:39:45 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 18:39:45 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 5)) 18:39:45 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 6)) 18:39:45 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 7)) 18:39:45 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 8)) 18:39:45 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 9)) 18:39:45 INFO - Downloading/unpacking simplejson>=2.1.1 (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 10)) 18:39:45 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:39:45 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:39:45 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:39:45 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:39:46 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/simplejson/setup.py) egg_info for package simplejson 18:39:46 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozlog>=3.1->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 18:39:46 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 18:39:46 INFO - Installing collected packages: simplejson 18:39:46 INFO - Running setup.py install for simplejson 18:39:46 INFO - building 'simplejson._speedups' extension 18:39:46 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c simplejson/_speedups.c -o build/temp.linux-x86_64-2.7/simplejson/_speedups.o 18:39:47 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/simplejson/_speedups.o -o build/lib.linux-x86_64-2.7/simplejson/_speedups.so 18:39:47 INFO - Successfully installed simplejson 18:39:47 INFO - Cleaning up... 18:39:47 INFO - Return code: 0 18:39:47 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 18:39:47 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:39:47 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:39:47 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:39:47 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:39:47 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x12831f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x144ba80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x15eea60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15f2090>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15f2d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x15ecf90>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1505437288.179532-1377774891', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 18:39:47 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 18:39:47 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 18:39:47 INFO - Using env: {'DISPLAY': ':0', 18:39:47 INFO - 'HOME': '/home/cltbld', 18:39:47 INFO - 'LANG': 'en_US.UTF-8', 18:39:47 INFO - 'LANGUAGE': 'en_US:en', 18:39:47 INFO - 'LOGNAME': 'cltbld', 18:39:47 INFO - 'MAIL': '/var/mail/cltbld', 18:39:47 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:39:47 INFO - 'MOZ_NO_REMOTE': '1', 18:39:47 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:39:47 INFO - 'NO_EM_RESTART': '1', 18:39:47 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:39:47 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:39:47 INFO - 'PWD': '/builds/slave/test', 18:39:47 INFO - 'SHELL': '/bin/bash', 18:39:47 INFO - 'SHLVL': '1', 18:39:47 INFO - 'TERM': 'linux', 18:39:47 INFO - 'TMOUT': '86400', 18:39:47 INFO - 'USER': 'cltbld', 18:39:47 INFO - 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1505437288.179532-1377774891', 18:39:47 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:39:47 INFO - '_': '/tools/buildbot/bin/python'} 18:39:47 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:39:47 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 18:39:47 INFO - Cleaning up... 18:39:47 INFO - Return code: 0 18:39:47 INFO - Running post-action listener: _resource_record_post_action 18:39:47 INFO - Running post-action listener: _start_resource_monitoring 18:39:47 INFO - Starting resource monitoring. 18:39:47 INFO - [mozharness: 2017-09-15 01:39:47.758158Z] Finished create-virtualenv step (success) 18:39:47 INFO - [mozharness: 2017-09-15 01:39:47.758630Z] Running install step. 18:39:47 INFO - Running pre-action listener: _resource_record_pre_action 18:39:47 INFO - Running main action method: install 18:39:47 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 18:39:47 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 18:39:47 INFO - Reading from file tmpfile_stdout 18:39:47 INFO - Detecting whether we're running mozinstall >=1.0... 18:39:47 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 18:39:47 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 18:39:48 INFO - Reading from file tmpfile_stdout 18:39:48 INFO - Output received: 18:39:48 INFO - Usage: mozinstall [options] installer 18:39:48 INFO - Options: 18:39:48 INFO - -h, --help show this help message and exit 18:39:48 INFO - -d DEST, --destination=DEST 18:39:48 INFO - Directory to install application into. [default: 18:39:48 INFO - "/builds/slave/test"] 18:39:48 INFO - --app=APP Application being installed. [default: firefox] 18:39:48 INFO - mkdir: /builds/slave/test/build/application 18:39:48 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/target.tar.bz2', '--destination', '/builds/slave/test/build/application'] 18:39:48 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/target.tar.bz2 --destination /builds/slave/test/build/application 18:40:02 INFO - Reading from file tmpfile_stdout 18:40:02 INFO - Output received: 18:40:02 INFO - /builds/slave/test/build/application/firefox/firefox 18:40:02 INFO - Running post-action listener: _resource_record_post_action 18:40:02 INFO - [mozharness: 2017-09-15 01:40:02.623156Z] Finished install step (success) 18:40:02 INFO - [mozharness: 2017-09-15 01:40:02.623408Z] Running setup-mitmproxy step. 18:40:02 INFO - Running pre-action listener: _resource_record_pre_action 18:40:02 INFO - Running main action method: setup_mitmproxy 18:40:02 INFO - Skipping: mitmproxy is not required 18:40:02 INFO - Running post-action listener: _resource_record_post_action 18:40:02 INFO - [mozharness: 2017-09-15 01:40:02.624542Z] Finished setup-mitmproxy step (success) 18:40:02 INFO - [mozharness: 2017-09-15 01:40:02.624762Z] Running run-tests step. 18:40:02 INFO - Running pre-action listener: _resource_record_pre_action 18:40:02 INFO - Running pre-action listener: _set_gcov_prefix 18:40:02 INFO - Running main action method: run_tests 18:40:02 WARNING - Try message not found. 18:40:02 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 18:40:02 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 18:40:02 INFO - Python 2.7.3 18:40:02 INFO - Return code: 0 18:40:02 INFO - grabbing minidump binary from tooltool 18:40:02 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:40:02 INFO - retry: Calling run_command with args: (['/tools/tooltool.py', '--url', 'https://tooltool.mozilla-releng.net/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'],), kwargs: {'output_timeout': 600, 'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15f2090>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15f2d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x15ecf90>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 18:40:02 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://tooltool.mozilla-releng.net/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test/build 18:40:02 INFO - Copy/paste: /tools/tooltool.py --url https://tooltool.mozilla-releng.net/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest -o -c /builds/tooltool_cache 18:40:02 INFO - Calling ['/tools/tooltool.py', '--url', 'https://tooltool.mozilla-releng.net/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] with output_timeout 600 18:40:02 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 18:40:02 INFO - Return code: 0 18:40:02 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 18:40:02 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 18:40:02 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 18:40:02 INFO - ENV: RUST_BACKTRACE is now full 18:40:02 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 18:40:02 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 18:40:02 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Beta-Non-PGO', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/dwA3zIQnSsC5sWxXs_oG_Q/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-057', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test/build 18:40:02 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Mozilla-Beta-Non-PGO --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/dwA3zIQnSsC5sWxXs_oG_Q/artifacts/public/build/target.crashreporter-symbols.zip --title talos-linux64-ix-057 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log 18:40:02 INFO - Using env: {'DISPLAY': ':0', 18:40:02 INFO - 'HOME': '/home/cltbld', 18:40:02 INFO - 'LANG': 'en_US.UTF-8', 18:40:02 INFO - 'LANGUAGE': 'en_US:en', 18:40:02 INFO - 'LOGNAME': 'cltbld', 18:40:02 INFO - 'MAIL': '/var/mail/cltbld', 18:40:02 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 18:40:02 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 18:40:02 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:40:02 INFO - 'MOZ_NO_REMOTE': '1', 18:40:02 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 18:40:02 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:40:02 INFO - 'NO_EM_RESTART': '1', 18:40:02 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:40:02 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:40:02 INFO - 'PWD': '/builds/slave/test', 18:40:02 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 18:40:02 INFO - 'RUST_BACKTRACE': 'full', 18:40:02 INFO - 'SCRIPTSPATH': '/builds/slave/test/scripts', 18:40:02 INFO - 'SHELL': '/bin/bash', 18:40:02 INFO - 'SHLVL': '1', 18:40:02 INFO - 'TERM': 'linux', 18:40:02 INFO - 'TMOUT': '86400', 18:40:02 INFO - 'USER': 'cltbld', 18:40:02 INFO - 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1505437288.179532-1377774891', 18:40:02 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:40:02 INFO - '_': '/tools/buildbot/bin/python'} 18:40:02 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Beta-Non-PGO', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/dwA3zIQnSsC5sWxXs_oG_Q/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-057', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 18:40:03 INFO - mozversion application_buildid: 20170915001952 18:40:03 INFO - mozversion application_changeset: c38455951db4121afd705adadadebe55f039578d 18:40:03 INFO - mozversion application_display_name: Firefox 18:40:03 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 18:40:03 INFO - mozversion application_name: Firefox 18:40:03 INFO - mozversion application_remotingname: firefox 18:40:03 INFO - mozversion application_repository: https://hg.mozilla.org/releases/mozilla-beta 18:40:03 INFO - mozversion application_vendor: Mozilla 18:40:03 INFO - mozversion application_version: 57.0 18:40:03 INFO - mozversion platform_buildid: 20170915001952 18:40:03 INFO - mozversion platform_changeset: c38455951db4121afd705adadadebe55f039578d 18:40:03 INFO - mozversion platform_repository: https://hg.mozilla.org/releases/mozilla-beta 18:40:03 INFO - mozversion platform_version: 57.0 18:40:03 INFO - using testdate: 1505439602 18:40:03 INFO - actual date: 1505439602 18:40:03 INFO - starting webserver on 'localhost:46577' 18:40:03 INFO - SUITE-START | Running 2 tests 18:40:03 INFO - TEST-START | dromaeo_css 18:40:03 INFO - Initialising browser for dromaeo_css test... 18:40:03 INFO - Application command: /builds/slave/test/build/application/firefox/firefox http://localhost:46577/getInfo.html -profile /tmp/tmpW82c_j/profile 18:40:03 INFO - TEST-INFO | started process 8447 (/builds/slave/test/build/application/firefox/firefox http://localhost:46577/getInfo.html) 18:40:08 INFO - TEST-INFO | 8447: exit 0 18:40:08 INFO - Browser initialized. 18:40:08 INFO - Running cycle 1/1 for dromaeo_css test... 18:40:08 INFO - Using env: {'DISPLAY': ':0', 18:40:08 INFO - 'HOME': '/home/cltbld', 18:40:08 INFO - 'JSGC_DISABLE_POISONING': '1', 18:40:08 INFO - 'LANG': 'en_US.UTF-8', 18:40:08 INFO - 'LANGUAGE': 'en_US:en', 18:40:08 INFO - 'LD_LIBRARY_PATH': '/builds/slave/test/build/application/firefox', 18:40:08 INFO - 'LOGNAME': 'cltbld', 18:40:08 INFO - 'MAIL': '/var/mail/cltbld', 18:40:08 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 18:40:08 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 18:40:08 INFO - 'MOZ_CRASHREPORTER': '1', 18:40:08 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:40:08 INFO - 'MOZ_DISABLE_NONLOCAL_CONNECTIONS': '1', 18:40:08 INFO - 'MOZ_NO_REMOTE': '1', 18:40:08 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 18:40:08 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:40:08 INFO - 'NO_EM_RESTART': '1', 18:40:08 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:40:08 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:40:08 INFO - 'PWD': '/builds/slave/test', 18:40:08 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 18:40:08 INFO - 'RUST_BACKTRACE': 'full', 18:40:08 INFO - 'SCRIPTSPATH': '/builds/slave/test/scripts', 18:40:08 INFO - 'SHELL': '/bin/bash', 18:40:08 INFO - 'SHLVL': '1', 18:40:08 INFO - 'TERM': 'linux', 18:40:08 INFO - 'TMOUT': '86400', 18:40:08 INFO - 'USER': 'cltbld', 18:40:08 INFO - 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1505437288.179532-1377774891', 18:40:08 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:40:08 INFO - '_': '/tools/buildbot/bin/python'} 18:40:08 INFO - TEST-INFO | started process 8636 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpW82c_j/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpnoisy -tpcycles 1 -tppagecycles 1) 18:40:19 INFO - PID 8636 | RSS: Main: 162344960 18:40:19 INFO - PID 8636 | 18:43:16 INFO - PID 8636 | Cycle 1(1): loaded http://localhost:46577/tests/dromaeo/cssquery-dojo.html (next: http://localhost:46577/tests/dromaeo/cssquery-ext.html) 18:43:17 INFO - PID 8636 | RSS: Main: 166727680 18:43:17 INFO - PID 8636 | 18:46:19 INFO - PID 8636 | Cycle 1(1): loaded http://localhost:46577/tests/dromaeo/cssquery-ext.html (next: http://localhost:46577/tests/dromaeo/cssquery-jquery.html) 18:46:19 INFO - PID 8636 | RSS: Main: 162775040 18:46:19 INFO - PID 8636 | 18:49:21 INFO - PID 8636 | Cycle 1(1): loaded http://localhost:46577/tests/dromaeo/cssquery-jquery.html (next: http://localhost:46577/tests/dromaeo/cssquery-mootools.html) 18:49:22 INFO - PID 8636 | RSS: Main: 164159488 18:49:22 INFO - PID 8636 | 18:52:23 INFO - PID 8636 | Cycle 1(1): loaded http://localhost:46577/tests/dromaeo/cssquery-mootools.html (next: http://localhost:46577/tests/dromaeo/cssquery-prototype.html) 18:52:24 INFO - PID 8636 | RSS: Main: 164081664 18:52:24 INFO - PID 8636 | 18:55:27 INFO - PID 8636 | Cycle 1(1): loaded http://localhost:46577/tests/dromaeo/cssquery-prototype.html (next: http://localhost:46577/tests/dromaeo/cssquery-yui.html) 18:55:27 INFO - PID 8636 | RSS: Main: 165515264 18:55:27 INFO - PID 8636 | 18:58:29 INFO - PID 8636 | Cycle 1(1): loaded http://localhost:46577/tests/dromaeo/cssquery-yui.html (next: http://localhost:46577/tests/dromaeo/cssquery-dojo.html) 18:58:29 INFO - PID 8636 | RSS: Main: 168361984 18:58:29 INFO - PID 8636 | 18:58:29 INFO - PID 8636 | __start_tp_report 18:58:29 INFO - PID 8636 | _x_x_mozilla_page_load 18:58:29 INFO - PID 8636 | _x_x_mozilla_page_load_details 18:58:29 INFO - PID 8636 | |i|pagename|runs| 18:58:29 INFO - PID 8636 | |0;dojo.html;3963.960360396396;3981.6416522512977;4007.6393124618817;4009.619086186813;4037.636612704856;6386.105945167675;6396.360363963613;6432.742690292389;6448.290688024319;6532.771353002646;6416.647084410356;6452.7096280667365;6522.70647820848;6526.021096835465;6534.477241820655;5771.913421298684;5773.9422605773925;5826.796062137826;5836.9124463133085;5861.267341582302;5802.245708057946;5839.861227060725;5855.063189889618;5906.11408288758;5907.995640741085;5742.1099729541775;5767.826965191051;5872;5892.734826932777;5895.823125306248;5753.769849206027;5800.419958004208;5849.883002339972;5851.356350801409;5878.265216847894;5678.403767604384;5711;5729.541636669056;5839.474447299764;5846.327672317695;6312.684365781693;6360;6390.680465976682;6431.5819471734185;6473.870522589522;7031.82420439488;7049.365557099834;7050.330218629222;7060.0468936693405;7070.434365250819;7058.61177635235;7072;7075.433965282765;7112.9644351778425;7132;6365.172527571386;6428.71070801815;6503.447206987412;6555.475561955032;6591.901121483182;7207.531510451804;7224.74713385029;7228.38558722504;7232.638368081575;7250.60121693312;6735.461163106939;6777.6272305023695;6845.965770171118;6917;6935.653217339112;6968.895466568006;7050.118735158106;7054.894176587355;7067.752628658075;7075.469339799535;6881.690323935435;6882.8967565486555;6905.654717264117;6987.475939304572;7003.019577259188;6838.008488769101;6899.793006209822;6914.515983881181;6955.860882782316;7023.438124949992;5203.687778733288;5209;5232.476752324813;5240;5255.816046438356;4697.224957881979;4761.6904901181315;4773.069251495925;4820.228763397839;4824.807007719722;6405.231372235362;6526.673666316665;6539.607623542603;6617.139771829728;6619.437347825488;6867.450603951672;7004.15950085993;7041.225465198824;7051.858962820715;7055.647217639097;6575.210974683068;6597.60414375139;6606.669666516751;6608.372204640552;6609.5703779255155;5755.050416681284;5766.221560089418;5774.509166720875;5826.388229235954;5842.824715258549;7177.246389129066;7221.783346499614;7222.133343998754;7316.926830731731;7336.156342020736;6960.443164546926;6998.440124790106;7049.7885063448175;7070.36366726997;7082.504224704221;7275.854482910418;7284.235155308616;7343.118825740731;7373.152087510005;7375.446841486802;6875;6875.724971001104;6892.758753443605;6973.65131743421;6979.022936788955;6801.387875091265;6887.483438742014;6896.517243792886;6896.896546551706;6907.6891539879825;6666.6000039995815;6709.060731497691;6716.5634233774645;6718.798436046926;6725.899111513233;6704.229013663491;6766.695498702472;6795.116634837439;6815.69329380189;6820.35206655367;6730.8653826924165;6782.626955517494;6789.947558128498;6793.558418702769;6807.829804254933;6679.599224046573;6807.625580593115;6861.931380686129;6886.552374095668;6890.621015844176;6542.378474044958;6588.011798230304;6589.868202636017;6594.967025164843;6689.063531105552 18:58:29 INFO - PID 8636 | |1;ext.html;912.2975309012061;958.1855422890544;971.1745016735775;1011.0597144655468;1014.3254735600826;47536.524634753645;48404.757976210116;48438.27342589855;48492;48497.272540911916;44707;45145.7742711286;45423.77288113555;45502.08995820081;45537.089258214815;7491.662875170617;7630.122535908358;7635.847283054336;7636.045494313211;7639.541627502367;7427.071616047994;7476.66355014023;7481.476296659236;7492.587907665076;7492.812679682997;8380.161983801632;8413.28487078596;8413.368997325195;8419.621117049748;8451;8293;8347.12355202704;8368.079511253758;8370.748877533653;8438.915610843875;8241.134680858484;8326.084130745614;8339.666413343459;8343.791405214857;8349.624266908004;41853.16293674109;41965.790171048946;41993.79003104965;42143.57856421458;42152.78923605393;3839.0786211309364;3858.266929283427;3869.7678139311734;3873.32216862048;3875.7093218008763;34263.4860477093;34353.484697729305;34440;34532;34640.82679586611;5481.862953426156;5641.576881733846;5676.716164191816;5717.914231286534;5741.19623252745;229195;229639;241594;241599;242490;55843.72078139583;56086;56147.438525615034;56237.437625624036;56332.43667563354;57642.13536796952;58016.41983580195;58072;58083.41916580865;58329.4167058324;18200.81799182018;18489.81510184908;18511.259549617866;18533.351332703292;18865.90567047156;15581.220938953007;15627;15641.530754077396;15643.608909777118;15650.295736691876;15848.76226856598;15940.282687279101;16017.119058451664;16068;16099.678006439806;6138.447539721446;6139.3553676863285;6160.568760186744;6335.271443784024;6392.296847346881;1093.6937657455926;1095.5782023920847;1103.5530610102921;1122.180808010157;1126.8140756775203;25823.483530329664;25859.0949316773;26061.17571769996;26232.08187713421;26403.867980659972;1196.1985469735298;1240.0761432732672;1245.0102168775845;1247.9937600311941;1249.7562975219926;13694.520691775939;13709;13769.724605507834;13821.170729756246;13927.65180870466;296511;309286;311300;327183;328435;66666.66666666635;67240.6637966807;67283.3271667277;67293;67410.66294668496;1521.117751704009;1554.4792494514238;1556.330777765549;1562.0783737594872;1566.8354822743447;31337.686623133475;31536.36927261396;31686.68313316837;32094.518582221754;32242.516362254115;44540;45023.549764501935;45042.099158017314;45074;45088.54911450844;270780;271144;271190;271535;271878;38104.80947595244;39291.410628841164;39607.60392396039;39884.80057599693;40116.59591914386;50017.74991125021;50387.24419133789;51622.74188629033;51677;51837.740811295705;35949.28101438009;36223.45664815082;36242.09394765152;36394.8180259097;37214.8139259302;35959.82020089988;36442.8177859109;36570.26859462849;36586;36887.63112368949;43774.562254378325;43793;43872.78063609661;44167;44222;34358.4061963507;34670;34862.82568587141;34890.12774680653;35465.64534354623;25610.615840762777;25960.350991224615;26078;26183.083592074185;26295.605565916143 18:58:29 INFO - PID 8636 | |2;jquery.html;547.8274343581771;596.1653684841222;605.5276884030452;610.5817515002224;631.7915088020952;23041;23900.88049559752;23996.5200695986;24008.87995560024;24018.75981240187;24767.13315033974;26842.46315073702;27107.45785084297;27219;27251.86374068127;6723.260441351447;6787.694553745068;6791.626460544668;6806.897896531556;6822.317768223163;6708.060871477997;6922.48081393895;6935.618540980244;6937.375636192742;6965.477589180831;6850.965745171292;6873.072135261726;6884.827879303008;6885.139357580302;6903.240643529208;6860.176778786577;6892.896606550856;6895.896561551581;6896.241413444517;6920.377166055054;6428.485721142298;6431.8392040198905;6442.420182183626;6459.806205813833;6470.417662410406;19346.4196074118;19590.314338998065;19820.10809513561;24975.876085576194;30371;2297.6438652008965;2325.476767727248;2331.4521087544413;2331.5103828196097;2344.284993077111;20609.175632974664;21119.3664190073;21149.25977590792;21167.576648467097;21175.36473905785;2487.2289590226906;2533;2560.4495033567687;2561.154818909774;2569.987150064256;144001.27999359937;148032;149758;152668.2366588171;161511.3848861508;15948.441804536786;16190.838091619169;16340.346386144658;16391.344346226255;16600.750988734937;26139.477210455683;26185;26214.606780898303;26221.737782622313;26269.605955910676;10879.782404351869;11077;11095;11131.610393636345;11367.658970230907;10074.244431667654;10096.495175241356;10208.081272685495;10240.743981400376;10269.229807764448;9777.364471309342;9807.215422766161;9811.901880981242;9948.507723841338;10182.389056656477;2974.628171478565;3007.29328607777;3056.1119741843745;3091.6908309168903;3098.3338582204933;1028.0107991037366;1050.4170185547096;1054.536004158168;1063.9574417023387;1069.4545781651414;21104.78895211059;21924.123035078737;22033.77966220317;22122.44693882666;22424.21515246991;1147.6958605969426;1150.6030419505257;1151.3840095548842;1152.458344578047;1170.3387586013876;11942.16404851652;12102.273863568214;12160.270383777002;12239.816402753966;12294.877051229552;573728;584632;585886;600345;606513;130848.3457582706;132612.3369383147;133497;138548;139867;1171.1509155862102;1225.6874497003207;1264.9557265495664;1273.2424207596466;1348.2651954684525;23155.884220578788;23349;23656.763432365457;23922.40193995164;23949.16177933764;64977;66304;67470.32529674837;69070.65464672644;71749.64125179341;84515.5774221125;84747;87805.56097219473;88882;89907.55046224727;21390.679139813226;21886.452838678524;21979.890100549394;22017.559648807255;22062;24213.273601791974;24472.265832025067;24510;24552.754472455046;24799.50400991934;19817.603647926673;19894.70157947661;20042.799572004093;20073.79926200778;20179.697304540736;17230.483085507454;17771.644567108844;17942.37201697934;18359.81640183581;18400.723989140442;19981.900090499454;20247;20445.897770511052;20592.691109633666;20769.68845467289;21240.89379553154;21263.574728505653;21304.254351097636;21435.46411339729;21438.356849294545;19506.122224500214;19526.8047319525;19577.8042219576;19722.802771972096;19726.30957916466 18:58:29 INFO - PID 8636 | |3;mootools.html;1408.7393832141054;1434.8206474190727;1466.8313143988444;1468.7503124468842;1469.1332114052714;16967.745483817736;17684.911575442122;17725.468235952943;17767.822321776777;17782.555436114104;17169.141542922836;17401.3039478421;17436.04101774402;17475.126243687828;17538;2646.179684297869;2782.6939036705944;2783.92818764776;2784.693683694792;2788.9721102789017;2893.9726397129034;3035.1805012646573;3044.3302473455806;3044.9847750761214;3055.144559523337;2984.224101733554;3055.0834749575038;3086.213015680998;3106.4718997770433;3111.206642306209;2996.550517422382;3016.457037733207;3024.758019358446;3038.0885734279736;3062.8315442650646;2926.25380527964;2943.2053345596782;2947.955780663292;2962.2890506278554;2973.36072744361;16619.335226590923;16748.58128546784;17033.659326813395;17256.827431725647;17274.913625431916;8803.735887923373;9104.8634270486;9105.908940910573;9107.408018478778;9118.680846170419;5755.65466072037;5923.644581325091;5951.137085122633;6041.939580604182;6135.754569817202;2053.260826102602;2101.5901899129676;2113.8520303578603;2147.5490147069136;2155.7628660847295;31782;32085.358292834248;32177.51733723996;32185.517217241526;32214.677853221638;7480.5885676287235;7515.549067055994;7544.170141284454;7604.961975190088;7686.9231307686205;20121.295754648516;20242.89878550598;20361.287354942506;20368.59262814765;20380;8702.04277529484;8925.776855578662;8926;8975.057618949917;8984.955075224712;8110.391720620977;8147.144549822302;8166.877496837434;8173.5504547250475;8184.54984975832;5778.8266352009505;6042.154098426224;6115.785947491905;6122.846928826815;6189.721462534197;1543.2515230113386;1606.7429211326132;1649.2023694173408;1655.7847479827544;1702.3360889253202;911.3119594705954;936.8922573904089;942.9669961551313;950.6007476859736;957.7461972577272;9242.21441177494;9294.814103717888;9352.438853668802;9485.478298693639;9559.474228917476;805.7502174325978;814.7637185216221;821.1788211788212;821.5974172655475;876.268315956171;5663.688497132614;5803.361630220672;5921.407859214044;5944.167816505693;6026.789062382795;25346.366340841625;26304.947802087703;26734.197974060808;26803.86598067036;26902.730972690413;25753.8712306441;25816.74183258181;25834.35414114662;26019.479610408063;26200.08299709501;12932.806007909889;13007;13129.803052954214;13153.73692526144;13243.470261189444;8884.111588841064;9103.635854565744;9120.224780893433;9166;9284.814303714023;21088;22100;22114.889425553414;22226.222082227043;23231.419214519774;22834.543309134056;23059.192928248103;23115.306540803802;23491;23959;12789.232646041268;12995.350232488527;13007.414666339848;13012.349382531025;13014.414351354022;16104.194790260675;16142.757858631894;16191.838081619504;16210.108444035219;16214.675706485568;13001.934990324988;13066.54267100647;13119.081664283409;13190.73618527605;13506.527271545448;12872.09895307357;12916.483340666267;12991.545295914597;13077.476900923857;13194.076414650883;11394.316341019565;11680.357580333164;11723.941380293385;11731.061515078944;11740.295582265091;8092.79768005781;8200.302974247255;8213.096559378344;8221.342292616697;8282.875756863772;8071.273585377344;8165.632546535539;8232.053313868983;8284.46151000183;8326.417150799385 18:58:29 INFO - PID 8636 | |4;prototype.html;548.4049805960535;572.5419664268584;573.5067841656177;582.7523302596397;587.2483221476512;5950.315713692921;6135;6268.840264551061;6271.749130034805;6289.622622642633;6302.747890084391;6323.367663233675;6348.36516348365;6354.68226588671;6361.964171465133;5274.92087618686;5279.86800329991;5296.258523806651;5299.33758280215;5299.54953828925;4947.18371468709;5051.747412629354;5056.696598204101;5070.163423035213;5274.103402421579;4993.375828021497;5009.924851127218;5021.799128034892;5027.974860125694;5051.747412629372;4998.90002199954;5006.374203224597;5011.1481048221885;5011.899762004776;5018.9559492709595;4566.474855391606;4579.511658710932;4594.173048851206;4598.310253461974;4621.584057434847;6190.350013248634;6197.597156184834;6201.906971395432;6211.285702144266;6220.978182090838;5808.419158084158;5815.476607105381;5847.327557330919;5892.175095486636;5894.204282421861;6584.144061272052;6625.768098116591;6648.634325112117;6650.800475985729;6706.26231114577;4934.235193545006;5060.291559181717;5087.49125087492;5090.796368145269;5118.411382691001;6845.760398386033;6873.621950792704;6945.576156887826;6978.511504194708;6986.476014298948;5267;5273.393559740679;5274.314339135888;5282.2340760589495;5291.841244762663;5353.544948679328;5353.732313384316;5353.929214157184;5361.115415956401;5382.138857782814;5928.377520360386;5934.495567876779;5944;5950.7917222896995;5963.7912673056235;6647.434968027772;6681.298463661343;6714.731410743516;6714.932850671528;6731.091302674175;1809.6199798042296;1809.80092189859;1822.2255541394854;1830.5972686009056;1838.7955888892798;1255.24057944942;1304.7194853106628;1307.2744626732256;1316.4799904037852;1324.265032906746;6148.723307451175;6268;6279.246490421087;6282;6327.4938004959495;6567.704453299613;6687.130673012477;6749.763758268536;6782.559133656297;6819.5908245505425;6027.306859711101;6144.17053697754;6213.105002974046;6276.843078922972;6287.528435367366;3512.947305790415;3530.3292374448774;3538.4515400113023;3542.982285088558;3580.4987301777774;7025.332593403721;7048.718051277891;7049.400800931979;7081;7088.007678924954;6727.730890764413;6934.7226110955;6940.861182776417;6961.547499412522;7035.381862171729;6962.060121883582;6970.268121847234;7013.894791578028;7056.611886346198;7064.187618423947;6630.7679231226675;6638.502112341497;6667.466602671871;6727.93272067273;6738.9217725163735;6642.335766423319;6671.699773510107;6697.564658297195;6698;6719.664016799238;6866;6962.930370696228;6977.406920411822;6993.440524758109;7004.754833580801;5131.3842338918075;5161.380634323755;5217.582593392443;5227.660202086852;5245.606579506629;6520.217573891164;6559.540832141704;6737.831554210988;6762.932370676427;6833.384995350442;6474.3166776639355;6512.6743662815725;6520.152380190545;6614.570052946543;6614.834629134118;6460.289368169591;6489.1888513935755;6508.60948343101;6543.280239173782;6553.737850486118;6419.807405777648;6450.129692286887;6516.609003459618;6531.746547441126;6604.273529911609;6434.967825160844;6524.380183882524;6531.804045878631;6556.246031706224;6644;6326.398992095744;6342.23893132827;6447.9032814508755;6470.320616335405;6509.4792416605615 18:58:29 INFO - PID 8636 | |5;yui.html;986.4278718343362;1017.8727659042619;1028.3469996552192;1028.5628607841666;1052.8473371361154;20952.37142885712;21526.569468610618;21549.784502154955;21565.784342156574;21578.784212157872;17386.304547818072;17555;19708.211671533158;20382.286619968305;20474.795252047512;1068.727474494003;1082.566973210718;1085.6525911708256;1086.473060565625;1088.8312311591676;1031.7369070886914;1065.8241390170613;1111.0223003756682;1114.4316398636713;1119.2109562758235;1180.339010154312;1186.5194596188558;1190.8749581293969;1191.3090407563636;1197.407283394721;1184.579474286633;1186.6558697977575;1187.6971372300052;1193.0276824388095;1193.7851186786374;865.6018231613465;866.0906048648957;867.4274978514213;871.4248595926658;876.0976194519654;19300.80699193018;20691.793082069136;21800.236991705213;22044.33866983993;22061.11755529777;21996.670049949265;22368;22369.88815055914;22380.216692415688;22853.20013799509;18077.819221807746;18335;18478.907605461885;18551.072446377628;18651.347202847835;3893.6495715385468;4037.6971727120585;4162.666986641061;4162.895927601804;4174.70777045607;150784.24607877;152662;153389.23305383514;158312;164626;18781.530461738294;19139.712904306445;19242.903785480983;19266.229350826092;19287.132079056475;34585.48121778175;35004.299914002084;35500.28999419997;35653.28693426117;35672.821635891654;10098.747531311628;10156.339837910513;10192.643257485952;10310.175185985103;10336.741581460523;4965.602751779849;4966.379202599675;4977.701337919736;5008.424031236382;5013.548780609763;6025.698715064229;6029.698515074228;6113.021916493429;6129.570930034854;6151.507879369729;1231.3904617214537;1235.6663700800914;1266.392131776734;1269.8349214602042;1270.1553466944563;764.9273319034683;770.1220608506195;780.5979920341028;790.3992965346263;794.3605397654943;12893.226406415644;13861.584152475441;14131.858681413054;14287.499937502345;14405.711885762226;766.7042697840632;769.97690069298;788.286600626434;792.4294507954264;795.236572890032;6543.247526534509;6555.770548030796;6665.333466653393;6700.128983232149;6751.987201919751;149787;151120;152762;153069.23465382602;153955;104183.47908260561;130042;130203;132345;139996.30001849926;114646.42676786563;114894;115526;116072;120323;14408.351624176728;14501.752228404614;14547.127172369692;14679.48621798232;14820.62948426298;55060.44939550553;55661.721691391285;56632.71683641555;57402.7129864348;57487.42512574988;72892;75379;75736.24263757291;75964.24035759793;77647.83528247193;18074.096295184925;18090.18594163292;18244.635107298047;18386.264549417872;18437.26250949947;24165;24295.392615184763;24427.755722442547;24526.754732452446;24536.6319505204;22356.441088972904;22455.77544224537;22519.099236030375;22536.887315563315;22904.885475572515;21385.78614213838;21403.571928561654;21701.131954722267;21832.23587174441;21874.671879921494;21893.124275028822;21941.451463713536;21991.560168796856;22082.33752987413;22188.001539930417;12978.545750898673;13168.868311316764;13286.335683215608;13305.600831975056;13306.667333316744;14634.634134146732;14718.926405367905;14770.63073423173;14851.925740371229;15045.924770376078 18:58:29 INFO - PID 8636 | __end_tp_report 18:58:29 INFO - PID 8636 | __start_cc_report 18:58:29 INFO - PID 8636 | _x_x_mozilla_cycle_collect,327 18:58:29 INFO - PID 8636 | __end_cc_report 18:58:29 INFO - PID 8636 | __startTimestamp1505440709554__endTimestamp 18:58:29 INFO - PID 8636 | 18:58:29 INFO - PID 8636 | ------- Summary: start ------- 18:58:29 INFO - PID 8636 | Number of tests: 6 18:58:29 INFO - PID 8636 | 18:58:29 INFO - PID 8636 | [#0] dojo.html Cycles:165 Average:6456.90 Median:6704.23 stddev:742.99 (11.1%) stddev-sans-first:719.07 18:58:29 INFO - PID 8636 | Values: 3964.0 3981.6 4007.6 4009.6 4037.6 6386.1 6396.4 6432.7 6448.3 6532.8 6416.6 6452.7 6522.7 6526.0 6534.5 5771.9 5773.9 5826.8 5836.9 5861.3 5802.2 5839.9 5855.1 5906.1 5908.0 5742.1 5767.8 5872.0 5892.7 5895.8 5753.8 5800.4 5849.9 5851.4 5878.3 5678.4 5711.0 5729.5 5839.5 5846.3 6312.7 6360.0 6390.7 6431.6 6473.9 7031.8 7049.4 7050.3 7060.0 7070.4 7058.6 7072.0 7075.4 7113.0 7132.0 6365.2 6428.7 6503.4 6555.5 6591.9 7207.5 7224.7 7228.4 7232.6 7250.6 6735.5 6777.6 6846.0 6917.0 6935.7 6968.9 7050.1 7054.9 7067.8 7075.5 6881.7 6882.9 6905.7 6987.5 7003.0 6838.0 6899.8 6914.5 6955.9 7023.4 5203.7 5209.0 5232.5 5240.0 5255.8 4697.2 4761.7 4773.1 4820.2 4824.8 6405.2 6526.7 6539.6 6617.1 6619.4 6867.5 7004.2 7041.2 7051.9 7055.6 6575.2 6597.6 6606.7 6608.4 6609.6 5755.1 5766.2 5774.5 5826.4 5842.8 7177.2 7221.8 7222.1 7316.9 7336.2 6960.4 6998.4 7049.8 7070.4 7082.5 7275.9 7284.2 7343.1 7373.2 7375.4 6875.0 6875.7 6892.8 6973.7 6979.0 6801.4 6887.5 6896.5 6896.9 6907.7 6666.6 6709.1 6716.6 6718.8 6725.9 6704.2 6766.7 6795.1 6815.7 6820.4 6730.9 6782.6 6789.9 6793.6 6807.8 6679.6 6807.6 6861.9 6886.6 6890.6 6542.4 6588.0 6589.9 6595.0 6689.1 18:58:29 INFO - PID 8636 | 18:58:29 INFO - PID 8636 | [#1] ext.html Cycles:180 Average:46385.37 Median:3871.54 stddev:71994.79 (1859.6%) stddev-sans-first:72115.80 18:58:29 INFO - PID 8636 | Values: 912.3 958.2 971.2 1011.1 1014.3 47536.5 48404.8 48438.3 48492.0 48497.3 44707.0 45145.8 45423.8 45502.1 45537.1 7491.7 7630.1 7635.8 7636.0 7639.5 7427.1 7476.7 7481.5 7492.6 7492.8 8380.2 8413.3 8413.4 8419.6 8451.0 8293.0 8347.1 8368.1 8370.7 8438.9 8241.1 8326.1 8339.7 8343.8 8349.6 41853.2 41965.8 41993.8 42143.6 42152.8 3839.1 3858.3 3869.8 3873.3 3875.7 34263.5 34353.5 34440.0 34532.0 34640.8 5481.9 5641.6 5676.7 5717.9 5741.2 229195.0 229639.0 241594.0 241599.0 242490.0 55843.7 56086.0 56147.4 56237.4 56332.4 57642.1 58016.4 58072.0 58083.4 58329.4 18200.8 18489.8 18511.3 18533.4 18865.9 15581.2 15627.0 15641.5 15643.6 15650.3 15848.8 15940.3 16017.1 16068.0 16099.7 6138.4 6139.4 6160.6 6335.3 6392.3 1093.7 1095.6 1103.6 1122.2 1126.8 25823.5 25859.1 26061.2 26232.1 26403.9 1196.2 1240.1 1245.0 1248.0 1249.8 13694.5 13709.0 13769.7 13821.2 13927.7 296511.0 309286.0 311300.0 327183.0 328435.0 66666.7 67240.7 67283.3 67293.0 67410.7 1521.1 1554.5 1556.3 1562.1 1566.8 31337.7 31536.4 31686.7 32094.5 32242.5 44540.0 45023.5 45042.1 45074.0 45088.5 270780.0 271144.0 271190.0 271535.0 271878.0 38104.8 39291.4 39607.6 39884.8 40116.6 50017.7 50387.2 51622.7 51677.0 51837.7 35949.3 36223.5 36242.1 36394.8 37214.8 35959.8 36442.8 36570.3 36586.0 36887.6 43774.6 43793.0 43872.8 44167.0 44222.0 34358.4 34670.0 34862.8 34890.1 35465.6 25610.6 25960.4 26078.0 26183.1 26295.6 18:58:29 INFO - PID 8636 | 18:58:29 INFO - PID 8636 | [#2] jquery.html Cycles:180 Average:40244.25 Median:23098.44 stddev:99102.31 (429.0%) stddev-sans-first:99335.50 18:58:29 INFO - PID 8636 | Values: 547.8 596.2 605.5 610.6 631.8 23041.0 23900.9 23996.5 24008.9 24018.8 24767.1 26842.5 27107.5 27219.0 27251.9 6723.3 6787.7 6791.6 6806.9 6822.3 6708.1 6922.5 6935.6 6937.4 6965.5 6851.0 6873.1 6884.8 6885.1 6903.2 6860.2 6892.9 6895.9 6896.2 6920.4 6428.5 6431.8 6442.4 6459.8 6470.4 19346.4 19590.3 19820.1 24975.9 30371.0 2297.6 2325.5 2331.5 2331.5 2344.3 20609.2 21119.4 21149.3 21167.6 21175.4 2487.2 2533.0 2560.4 2561.2 2570.0 144001.3 148032.0 149758.0 152668.2 161511.4 15948.4 16190.8 16340.3 16391.3 16600.8 26139.5 26185.0 26214.6 26221.7 26269.6 10879.8 11077.0 11095.0 11131.6 11367.7 10074.2 10096.5 10208.1 10240.7 10269.2 9777.4 9807.2 9811.9 9948.5 10182.4 2974.6 3007.3 3056.1 3091.7 3098.3 1028.0 1050.4 1054.5 1064.0 1069.5 21104.8 21924.1 22033.8 22122.4 22424.2 1147.7 1150.6 1151.4 1152.5 1170.3 11942.2 12102.3 12160.3 12239.8 12294.9 573728.0 584632.0 585886.0 600345.0 606513.0 130848.3 132612.3 133497.0 138548.0 139867.0 1171.2 1225.7 1265.0 1273.2 1348.3 23155.9 23349.0 23656.8 23922.4 23949.2 64977.0 66304.0 67470.3 69070.7 71749.6 84515.6 84747.0 87805.6 88882.0 89907.6 21390.7 21886.5 21979.9 22017.6 22062.0 24213.3 24472.3 24510.0 24552.8 24799.5 19817.6 19894.7 20042.8 20073.8 20179.7 17230.5 17771.6 17942.4 18359.8 18400.7 19981.9 20247.0 20445.9 20592.7 20769.7 21240.9 21263.6 21304.3 21435.5 21438.4 19506.1 19526.8 19577.8 19722.8 19726.3 18:58:29 INFO - PID 8636 | 18:58:29 INFO - PID 8636 | [#3] mootools.html Cycles:180 Average:10846.52 Median:2910.11 stddev:8091.07 (278.0%) stddev-sans-first:8082.70 18:58:29 INFO - PID 8636 | Values: 1408.7 1434.8 1466.8 1468.8 1469.1 16967.7 17684.9 17725.5 17767.8 17782.6 17169.1 17401.3 17436.0 17475.1 17538.0 2646.2 2782.7 2783.9 2784.7 2789.0 2894.0 3035.2 3044.3 3045.0 3055.1 2984.2 3055.1 3086.2 3106.5 3111.2 2996.6 3016.5 3024.8 3038.1 3062.8 2926.3 2943.2 2948.0 2962.3 2973.4 16619.3 16748.6 17033.7 17256.8 17274.9 8803.7 9104.9 9105.9 9107.4 9118.7 5755.7 5923.6 5951.1 6041.9 6135.8 2053.3 2101.6 2113.9 2147.5 2155.8 31782.0 32085.4 32177.5 32185.5 32214.7 7480.6 7515.5 7544.2 7605.0 7686.9 20121.3 20242.9 20361.3 20368.6 20380.0 8702.0 8925.8 8926.0 8975.1 8985.0 8110.4 8147.1 8166.9 8173.6 8184.5 5778.8 6042.2 6115.8 6122.8 6189.7 1543.3 1606.7 1649.2 1655.8 1702.3 911.3 936.9 943.0 950.6 957.7 9242.2 9294.8 9352.4 9485.5 9559.5 805.8 814.8 821.2 821.6 876.3 5663.7 5803.4 5921.4 5944.2 6026.8 25346.4 26304.9 26734.2 26803.9 26902.7 25753.9 25816.7 25834.4 26019.5 26200.1 12932.8 13007.0 13129.8 13153.7 13243.5 8884.1 9103.6 9120.2 9166.0 9284.8 21088.0 22100.0 22114.9 22226.2 23231.4 22834.5 23059.2 23115.3 23491.0 23959.0 12789.2 12995.4 13007.4 13012.3 13014.4 16104.2 16142.8 16191.8 16210.1 16214.7 13001.9 13066.5 13119.1 13190.7 13506.5 12872.1 12916.5 12991.5 13077.5 13194.1 11394.3 11680.4 11723.9 11731.1 11740.3 8092.8 8200.3 8213.1 8221.3 8282.9 8071.3 8165.6 8232.1 8284.5 8326.4 18:58:29 INFO - PID 8636 | 18:58:29 INFO - PID 8636 | [#4] prototype.html Cycles:180 Average:5655.75 Median:6280.62 stddev:1566.13 (24.9%) stddev-sans-first:1522.89 18:58:29 INFO - PID 8636 | Values: 548.4 572.5 573.5 582.8 587.2 5950.3 6135.0 6268.8 6271.7 6289.6 6302.7 6323.4 6348.4 6354.7 6362.0 5274.9 5279.9 5296.3 5299.3 5299.5 4947.2 5051.7 5056.7 5070.2 5274.1 4993.4 5009.9 5021.8 5028.0 5051.7 4998.9 5006.4 5011.1 5011.9 5019.0 4566.5 4579.5 4594.2 4598.3 4621.6 6190.4 6197.6 6201.9 6211.3 6221.0 5808.4 5815.5 5847.3 5892.2 5894.2 6584.1 6625.8 6648.6 6650.8 6706.3 4934.2 5060.3 5087.5 5090.8 5118.4 6845.8 6873.6 6945.6 6978.5 6986.5 5267.0 5273.4 5274.3 5282.2 5291.8 5353.5 5353.7 5353.9 5361.1 5382.1 5928.4 5934.5 5944.0 5950.8 5963.8 6647.4 6681.3 6714.7 6714.9 6731.1 1809.6 1809.8 1822.2 1830.6 1838.8 1255.2 1304.7 1307.3 1316.5 1324.3 6148.7 6268.0 6279.2 6282.0 6327.5 6567.7 6687.1 6749.8 6782.6 6819.6 6027.3 6144.2 6213.1 6276.8 6287.5 3512.9 3530.3 3538.5 3543.0 3580.5 7025.3 7048.7 7049.4 7081.0 7088.0 6727.7 6934.7 6940.9 6961.5 7035.4 6962.1 6970.3 7013.9 7056.6 7064.2 6630.8 6638.5 6667.5 6727.9 6738.9 6642.3 6671.7 6697.6 6698.0 6719.7 6866.0 6962.9 6977.4 6993.4 7004.8 5131.4 5161.4 5217.6 5227.7 5245.6 6520.2 6559.5 6737.8 6762.9 6833.4 6474.3 6512.7 6520.2 6614.6 6614.8 6460.3 6489.2 6508.6 6543.3 6553.7 6419.8 6450.1 6516.6 6531.7 6604.3 6435.0 6524.4 6531.8 6556.2 6644.0 6326.4 6342.2 6447.9 6470.3 6509.5 18:58:29 INFO - PID 8636 | 18:58:29 INFO - PID 8636 | [#5] yui.html Cycles:180 Average:29092.28 Median:19293.97 stddev:41939.77 (217.4%) stddev-sans-first:42004.33 18:58:29 INFO - PID 8636 | Values: 986.4 1017.9 1028.3 1028.6 1052.8 20952.4 21526.6 21549.8 21565.8 21578.8 17386.3 17555.0 19708.2 20382.3 20474.8 1068.7 1082.6 1085.7 1086.5 1088.8 1031.7 1065.8 1111.0 1114.4 1119.2 1180.3 1186.5 1190.9 1191.3 1197.4 1184.6 1186.7 1187.7 1193.0 1193.8 865.6 866.1 867.4 871.4 876.1 19300.8 20691.8 21800.2 22044.3 22061.1 21996.7 22368.0 22369.9 22380.2 22853.2 18077.8 18335.0 18478.9 18551.1 18651.3 3893.6 4037.7 4162.7 4162.9 4174.7 150784.2 152662.0 153389.2 158312.0 164626.0 18781.5 19139.7 19242.9 19266.2 19287.1 34585.5 35004.3 35500.3 35653.3 35672.8 10098.7 10156.3 10192.6 10310.2 10336.7 4965.6 4966.4 4977.7 5008.4 5013.5 6025.7 6029.7 6113.0 6129.6 6151.5 1231.4 1235.7 1266.4 1269.8 1270.2 764.9 770.1 780.6 790.4 794.4 12893.2 13861.6 14131.9 14287.5 14405.7 766.7 770.0 788.3 792.4 795.2 6543.2 6555.8 6665.3 6700.1 6752.0 149787.0 151120.0 152762.0 153069.2 153955.0 104183.5 130042.0 130203.0 132345.0 139996.3 114646.4 114894.0 115526.0 116072.0 120323.0 14408.4 14501.8 14547.1 14679.5 14820.6 55060.4 55661.7 56632.7 57402.7 57487.4 72892.0 75379.0 75736.2 75964.2 77647.8 18074.1 18090.2 18244.6 18386.3 18437.3 24165.0 24295.4 24427.8 24526.8 24536.6 22356.4 22455.8 22519.1 22536.9 22904.9 21385.8 21403.6 21701.1 21832.2 21874.7 21893.1 21941.5 21991.6 22082.3 22188.0 12978.5 13168.9 13286.3 13305.6 13306.7 14634.6 14718.9 14770.6 14851.9 15045.9 18:58:29 INFO - PID 8636 | -------- Summary: end -------- 18:58:29 INFO - PID 8636 | 18:58:30 INFO - TEST-INFO | 8636: exit 0 18:58:30 INFO - TEST-OK | dromaeo_css | took 1107252ms 18:58:30 INFO - TEST-START | kraken 18:58:30 INFO - Initialising browser for kraken test... 18:58:30 INFO - Application command: /builds/slave/test/build/application/firefox/firefox http://localhost:46577/getInfo.html -profile /tmp/tmp_wcGiw/profile 18:58:30 INFO - TEST-INFO | started process 9006 (/builds/slave/test/build/application/firefox/firefox http://localhost:46577/getInfo.html) 18:58:35 INFO - TEST-INFO | 9006: exit 0 18:58:35 INFO - Browser initialized. 18:58:35 INFO - Running cycle 1/1 for kraken test... 18:58:35 INFO - Using env: {'DISPLAY': ':0', 18:58:35 INFO - 'HOME': '/home/cltbld', 18:58:35 INFO - 'JSGC_DISABLE_POISONING': '1', 18:58:35 INFO - 'LANG': 'en_US.UTF-8', 18:58:35 INFO - 'LANGUAGE': 'en_US:en', 18:58:35 INFO - 'LD_LIBRARY_PATH': '/builds/slave/test/build/application/firefox', 18:58:35 INFO - 'LOGNAME': 'cltbld', 18:58:35 INFO - 'MAIL': '/var/mail/cltbld', 18:58:35 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 18:58:35 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 18:58:35 INFO - 'MOZ_CRASHREPORTER': '1', 18:58:35 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:58:35 INFO - 'MOZ_DISABLE_NONLOCAL_CONNECTIONS': '1', 18:58:35 INFO - 'MOZ_NO_REMOTE': '1', 18:58:35 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 18:58:35 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:58:35 INFO - 'NO_EM_RESTART': '1', 18:58:35 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:58:35 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:58:35 INFO - 'PWD': '/builds/slave/test', 18:58:35 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 18:58:35 INFO - 'RUST_BACKTRACE': 'full', 18:58:35 INFO - 'SCRIPTSPATH': '/builds/slave/test/scripts', 18:58:35 INFO - 'SHELL': '/bin/bash', 18:58:35 INFO - 'SHLVL': '1', 18:58:35 INFO - 'TERM': 'linux', 18:58:35 INFO - 'TMOUT': '86400', 18:58:35 INFO - 'USER': 'cltbld', 18:58:35 INFO - 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1505437288.179532-1377774891', 18:58:35 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:58:35 INFO - '_': '/tools/buildbot/bin/python'} 18:58:35 INFO - TEST-INFO | started process 9191 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp_wcGiw/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpnoisy -tpcycles 1 -tppagecycles 1) 18:58:46 INFO - PID 9191 | RSS: Main: 162779136 18:58:46 INFO - PID 9191 | 18:58:49 INFO - PID 9191 | Cycle 1(1): loaded http://localhost:46577/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:46577/tests/kraken/driver.html?testName=audio-beat-detection) 18:58:50 INFO - PID 9191 | RSS: Main: 168075264 18:58:50 INFO - PID 9191 | 18:58:52 INFO - PID 9191 | Cycle 1(1): loaded http://localhost:46577/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:46577/tests/kraken/driver.html?testName=audio-dft) 18:58:53 INFO - PID 9191 | RSS: Main: 168452096 18:58:53 INFO - PID 9191 | 18:58:56 INFO - PID 9191 | Cycle 1(1): loaded http://localhost:46577/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:46577/tests/kraken/driver.html?testName=audio-fft) 18:58:56 INFO - PID 9191 | RSS: Main: 169734144 18:58:56 INFO - PID 9191 | 18:58:58 INFO - PID 9191 | Cycle 1(1): loaded http://localhost:46577/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:46577/tests/kraken/driver.html?testName=audio-oscillator) 18:58:59 INFO - PID 9191 | RSS: Main: 170270720 18:58:59 INFO - PID 9191 | 18:59:01 INFO - PID 9191 | Cycle 1(1): loaded http://localhost:46577/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:46577/tests/kraken/driver.html?testName=imaging-gaussian-blur) 18:59:02 INFO - PID 9191 | RSS: Main: 169648128 18:59:02 INFO - PID 9191 | 18:59:05 INFO - PID 9191 | Cycle 1(1): loaded http://localhost:46577/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:46577/tests/kraken/driver.html?testName=imaging-darkroom) 18:59:05 INFO - PID 9191 | RSS: Main: 170037248 18:59:05 INFO - PID 9191 | 18:59:09 INFO - PID 9191 | Cycle 1(1): loaded http://localhost:46577/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:46577/tests/kraken/driver.html?testName=imaging-desaturate) 18:59:09 INFO - PID 9191 | RSS: Main: 170786816 18:59:09 INFO - PID 9191 | 18:59:12 INFO - PID 9191 | Cycle 1(1): loaded http://localhost:46577/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:46577/tests/kraken/driver.html?testName=json-parse-financial) 18:59:13 INFO - PID 9191 | RSS: Main: 171929600 18:59:13 INFO - PID 9191 | 18:59:14 INFO - PID 9191 | Cycle 1(1): loaded http://localhost:46577/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:46577/tests/kraken/driver.html?testName=json-stringify-tinderbox) 18:59:15 INFO - PID 9191 | RSS: Main: 172007424 18:59:15 INFO - PID 9191 | 18:59:17 INFO - PID 9191 | Cycle 1(1): loaded http://localhost:46577/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:46577/tests/kraken/driver.html?testName=stanford-crypto-aes) 18:59:17 INFO - PID 9191 | RSS: Main: 172167168 18:59:17 INFO - PID 9191 | 18:59:19 INFO - PID 9191 | Cycle 1(1): loaded http://localhost:46577/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:46577/tests/kraken/driver.html?testName=stanford-crypto-ccm) 18:59:20 INFO - PID 9191 | RSS: Main: 168951808 18:59:20 INFO - PID 9191 | 18:59:22 INFO - PID 9191 | Cycle 1(1): loaded http://localhost:46577/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:46577/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 18:59:23 INFO - PID 9191 | RSS: Main: 169140224 18:59:23 INFO - PID 9191 | 18:59:26 INFO - PID 9191 | Cycle 1(1): loaded http://localhost:46577/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:46577/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 18:59:26 INFO - PID 9191 | RSS: Main: 169992192 18:59:26 INFO - PID 9191 | 18:59:28 INFO - PID 9191 | Cycle 1(1): loaded http://localhost:46577/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:46577/tests/kraken/driver.html?testName=ai-astar) 18:59:28 INFO - PID 9191 | RSS: Main: 171532288 18:59:28 INFO - PID 9191 | 18:59:28 INFO - PID 9191 | __start_tp_report 18:59:28 INFO - PID 9191 | _x_x_mozilla_page_load 18:59:28 INFO - PID 9191 | _x_x_mozilla_page_load_details 18:59:28 INFO - PID 9191 | |i|pagename|runs| 18:59:28 INFO - PID 9191 | |0;ai-astar;106;105;106;105;106;107;107;106;104;105 18:59:28 INFO - PID 9191 | |1;audio-beat-detection;110;112;109;114;114;111;111;114;112;136 18:59:28 INFO - PID 9191 | |2;audio-dft;160;165;161;162;163;162;162;161;164;161 18:59:28 INFO - PID 9191 | |3;audio-fft;74;73;73;73;72;73;73;74;78;73 18:59:28 INFO - PID 9191 | |4;audio-oscillator;77;77;78;77;77;78;82;77;77;77 18:59:28 INFO - PID 9191 | |5;imaging-gaussian-blur;119;113;114;114;113;114;113;113;113;114 18:59:28 INFO - PID 9191 | |6;imaging-darkroom;148;150;151;149;151;151;149;149;148;148 18:59:28 INFO - PID 9191 | |7;imaging-desaturate;94;95;94;94;99;98;95;94;95;94 18:59:28 INFO - PID 9191 | |8;json-parse-financial;43;44;45;44;43;43;42;43;42;44 18:59:28 INFO - PID 9191 | |9;json-stringify-tinderbox;35;35;35;35;35;35;36;35;35;36 18:59:28 INFO - PID 9191 | |10;stanford-crypto-aes;72;71;69;72;72;71;73;73;72;73 18:59:28 INFO - PID 9191 | |11;stanford-crypto-ccm;100;108;108;105;106;101;102;103;103;105 18:59:28 INFO - PID 9191 | |12;stanford-crypto-pbkdf2;150;148;150;154;148;156;149;149;149;147 18:59:28 INFO - PID 9191 | |13;stanford-crypto-sha256-iterative;62;59;58;60;66;57;57;59;58;58 18:59:28 INFO - PID 9191 | __end_tp_report 18:59:28 INFO - PID 9191 | __start_cc_report 18:59:28 INFO - PID 9191 | _x_x_mozilla_cycle_collect,861 18:59:28 INFO - PID 9191 | __end_cc_report 18:59:28 INFO - PID 9191 | __startTimestamp1505440768600__endTimestamp 18:59:28 INFO - PID 9191 | 18:59:28 INFO - PID 9191 | ------- Summary: start ------- 18:59:28 INFO - PID 9191 | Number of tests: 14 18:59:28 INFO - PID 9191 | 18:59:28 INFO - PID 9191 | [#0] ai-astar Cycles:10 Average:105.70 Median:106.00 stddev:0.95 (0.9%) stddev-sans-first:1.00 18:59:28 INFO - PID 9191 | Values: 106.0 105.0 106.0 105.0 106.0 107.0 107.0 106.0 104.0 105.0 18:59:28 INFO - PID 9191 | 18:59:28 INFO - PID 9191 | [#1] audio-beat-detection Cycles:10 Average:114.30 Median:113.00 stddev:7.82 (6.9%) stddev-sans-first:8.14 18:59:28 INFO - PID 9191 | Values: 110.0 112.0 109.0 114.0 114.0 111.0 111.0 114.0 112.0 136.0 18:59:28 INFO - PID 9191 | 18:59:28 INFO - PID 9191 | [#2] audio-dft Cycles:10 Average:162.10 Median:162.00 stddev:1.52 (0.9%) stddev-sans-first:1.41 18:59:28 INFO - PID 9191 | Values: 160.0 165.0 161.0 162.0 163.0 162.0 162.0 161.0 164.0 161.0 18:59:28 INFO - PID 9191 | 18:59:28 INFO - PID 9191 | [#3] audio-fft Cycles:10 Average:73.60 Median:73.00 stddev:1.65 (2.3%) stddev-sans-first:1.74 18:59:28 INFO - PID 9191 | Values: 74.0 73.0 73.0 73.0 72.0 73.0 73.0 74.0 78.0 73.0 18:59:28 INFO - PID 9191 | 18:59:28 INFO - PID 9191 | [#4] audio-oscillator Cycles:10 Average:77.70 Median:77.00 stddev:1.57 (2.0%) stddev-sans-first:1.64 18:59:28 INFO - PID 9191 | Values: 77.0 77.0 78.0 77.0 77.0 78.0 82.0 77.0 77.0 77.0 18:59:28 INFO - PID 9191 | 18:59:28 INFO - PID 9191 | [#5] imaging-gaussian-blur Cycles:10 Average:114.00 Median:114.00 stddev:1.83 (1.6%) stddev-sans-first:0.53 18:59:28 INFO - PID 9191 | Values: 119.0 113.0 114.0 114.0 113.0 114.0 113.0 113.0 113.0 114.0 18:59:28 INFO - PID 9191 | 18:59:28 INFO - PID 9191 | [#6] imaging-darkroom Cycles:10 Average:149.40 Median:149.50 stddev:1.26 (0.8%) stddev-sans-first:1.24 18:59:28 INFO - PID 9191 | Values: 148.0 150.0 151.0 149.0 151.0 151.0 149.0 149.0 148.0 148.0 18:59:28 INFO - PID 9191 | 18:59:28 INFO - PID 9191 | [#7] imaging-desaturate Cycles:10 Average:95.20 Median:95.00 stddev:1.81 (1.9%) stddev-sans-first:1.87 18:59:28 INFO - PID 9191 | Values: 94.0 95.0 94.0 94.0 99.0 98.0 95.0 94.0 95.0 94.0 18:59:28 INFO - PID 9191 | 18:59:28 INFO - PID 9191 | [#8] json-parse-financial Cycles:10 Average:43.30 Median:43.50 stddev:0.95 (2.2%) stddev-sans-first:1.00 18:59:28 INFO - PID 9191 | Values: 43.0 44.0 45.0 44.0 43.0 43.0 42.0 43.0 42.0 44.0 18:59:28 INFO - PID 9191 | 18:59:28 INFO - PID 9191 | [#9] json-stringify-tinderbox Cycles:10 Average:35.20 Median:35.00 stddev:0.42 (1.2%) stddev-sans-first:0.44 18:59:28 INFO - PID 9191 | Values: 35.0 35.0 35.0 35.0 35.0 35.0 36.0 35.0 35.0 36.0 18:59:28 INFO - PID 9191 | 18:59:28 INFO - PID 9191 | [#10] stanford-crypto-aes Cycles:10 Average:71.80 Median:72.00 stddev:1.23 (1.7%) stddev-sans-first:1.30 18:59:28 INFO - PID 9191 | Values: 72.0 71.0 69.0 72.0 72.0 71.0 73.0 73.0 72.0 73.0 18:59:28 INFO - PID 9191 | 18:59:28 INFO - PID 9191 | [#11] stanford-crypto-ccm Cycles:10 Average:104.10 Median:105.00 stddev:2.77 (2.6%) stddev-sans-first:2.51 18:59:28 INFO - PID 9191 | Values: 100.0 108.0 108.0 105.0 106.0 101.0 102.0 103.0 103.0 105.0 18:59:28 INFO - PID 9191 | 18:59:28 INFO - PID 9191 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:150.00 Median:149.50 stddev:2.83 (1.9%) stddev-sans-first:3.00 18:59:28 INFO - PID 9191 | Values: 150.0 148.0 150.0 154.0 148.0 156.0 149.0 149.0 149.0 147.0 18:59:28 INFO - PID 9191 | 18:59:28 INFO - PID 9191 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:59.40 Median:59.00 stddev:2.76 (4.7%) stddev-sans-first:2.76 18:59:28 INFO - PID 9191 | Values: 62.0 59.0 58.0 60.0 66.0 57.0 57.0 59.0 58.0 58.0 18:59:28 INFO - PID 9191 | -------- Summary: end -------- 18:59:28 INFO - PID 9191 | 18:59:28 INFO - PID 9191 | *** UTM:SVC TimerManager:registerTimer called after profile-before-change notification. Ignoring timer registration for id: telemetry_modules_ping 18:59:29 INFO - TEST-INFO | 9191: exit 0 18:59:29 INFO - TEST-OK | kraken | took 59002ms 18:59:29 INFO - SUITE-END | took 1166s 18:59:29 INFO - Completed test suite (00:19:26) 18:59:29 INFO - javascript benchmark 18:59:29 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 9394.199423245731, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3963.960360396396, 3981.6416522512977, 4007.6393124618817, 4009.619086186813, 4037.636612704856, 6386.105945167675, 6396.360363963613, 6432.742690292389, 6448.290688024319, 6532.771353002646, 6416.647084410356, 6452.7096280667365, 6522.70647820848, 6526.021096835465, 6534.477241820655, 5771.913421298684, 5773.9422605773925, 5826.796062137826, 5836.9124463133085, 5861.267341582302, 5802.245708057946, 5839.861227060725, 5855.063189889618, 5906.11408288758, 5907.995640741085, 5742.1099729541775, 5767.826965191051, 5872.0, 5892.734826932777, 5895.823125306248, 5753.769849206027, 5800.419958004208, 5849.883002339972, 5851.356350801409, 5878.265216847894, 5678.403767604384, 5711.0, 5729.541636669056, 5839.474447299764, 5846.327672317695, 6312.684365781693, 6360.0, 6390.680465976682, 6431.5819471734185, 6473.870522589522, 7031.82420439488, 7049.365557099834, 7050.330218629222, 7060.0468936693405, 7070.434365250819, 7058.61177635235, 7072.0, 7075.433965282765, 7112.9644351778425, 7132.0, 6365.172527571386, 6428.71070801815, 6503.447206987412, 6555.475561955032, 6591.901121483182, 7207.531510451804, 7224.74713385029, 7228.38558722504, 7232.638368081575, 7250.60121693312, 6735.461163106939, 6777.6272305023695, 6845.965770171118, 6917.0, 6935.653217339112, 6968.895466568006, 7050.118735158106, 7054.894176587355, 7067.752628658075, 7075.469339799535, 6881.690323935435, 6882.8967565486555, 6905.654717264117, 6987.475939304572, 7003.019577259188, 6838.008488769101, 6899.793006209822, 6914.515983881181, 6955.860882782316, 7023.438124949992, 5203.687778733288, 5209.0, 5232.476752324813, 5240.0, 5255.816046438356, 4697.224957881979, 4761.6904901181315, 4773.069251495925, 4820.228763397839, 4824.807007719722, 6405.231372235362, 6526.673666316665, 6539.607623542603, 6617.139771829728, 6619.437347825488, 6867.450603951672, 7004.15950085993, 7041.225465198824, 7051.858962820715, 7055.647217639097, 6575.210974683068, 6597.60414375139, 6606.669666516751, 6608.372204640552, 6609.5703779255155, 5755.050416681284, 5766.221560089418, 5774.509166720875, 5826.388229235954, 5842.824715258549, 7177.246389129066, 7221.783346499614, 7222.133343998754, 7316.926830731731, 7336.156342020736, 6960.443164546926, 6998.440124790106, 7049.7885063448175, 7070.36366726997, 7082.504224704221, 7275.854482910418, 7284.235155308616, 7343.118825740731, 7373.152087510005, 7375.446841486802, 6875.0, 6875.724971001104, 6892.758753443605, 6973.65131743421, 6979.022936788955, 6801.387875091265, 6887.483438742014, 6896.517243792886, 6896.896546551706, 6907.6891539879825, 6666.6000039995815, 6709.060731497691, 6716.5634233774645, 6718.798436046926, 6725.899111513233, 6704.229013663491, 6766.695498702472, 6795.116634837439, 6815.69329380189, 6820.35206655367, 6730.8653826924165, 6782.626955517494, 6789.947558128498, 6793.558418702769, 6807.829804254933, 6679.599224046573, 6807.625580593115, 6861.931380686129, 6886.552374095668, 6890.621015844176, 6542.378474044958, 6588.011798230304, 6589.868202636017, 6594.967025164843, 6689.063531105552], "value": 6408.072546466433, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [912.2975309012061, 958.1855422890544, 971.1745016735775, 1011.0597144655468, 1014.3254735600826, 47536.524634753645, 48404.757976210116, 48438.27342589855, 48492.0, 48497.272540911916, 44707.0, 45145.7742711286, 45423.77288113555, 45502.08995820081, 45537.089258214815, 7491.662875170617, 7630.122535908358, 7635.847283054336, 7636.045494313211, 7639.541627502367, 7427.071616047994, 7476.66355014023, 7481.476296659236, 7492.587907665076, 7492.812679682997, 8380.161983801632, 8413.28487078596, 8413.368997325195, 8419.621117049748, 8451.0, 8293.0, 8347.12355202704, 8368.079511253758, 8370.748877533653, 8438.915610843875, 8241.134680858484, 8326.084130745614, 8339.666413343459, 8343.791405214857, 8349.624266908004, 41853.16293674109, 41965.790171048946, 41993.79003104965, 42143.57856421458, 42152.78923605393, 3839.0786211309364, 3858.266929283427, 3869.7678139311734, 3873.32216862048, 3875.7093218008763, 34263.4860477093, 34353.484697729305, 34440.0, 34532.0, 34640.82679586611, 5481.862953426156, 5641.576881733846, 5676.716164191816, 5717.914231286534, 5741.19623252745, 229195.0, 229639.0, 241594.0, 241599.0, 242490.0, 55843.72078139583, 56086.0, 56147.438525615034, 56237.437625624036, 56332.43667563354, 57642.13536796952, 58016.41983580195, 58072.0, 58083.41916580865, 58329.4167058324, 18200.81799182018, 18489.81510184908, 18511.259549617866, 18533.351332703292, 18865.90567047156, 15581.220938953007, 15627.0, 15641.530754077396, 15643.608909777118, 15650.295736691876, 15848.76226856598, 15940.282687279101, 16017.119058451664, 16068.0, 16099.678006439806, 6138.447539721446, 6139.3553676863285, 6160.568760186744, 6335.271443784024, 6392.296847346881, 1093.6937657455926, 1095.5782023920847, 1103.5530610102921, 1122.180808010157, 1126.8140756775203, 25823.483530329664, 25859.0949316773, 26061.17571769996, 26232.08187713421, 26403.867980659972, 1196.1985469735298, 1240.0761432732672, 1245.0102168775845, 1247.9937600311941, 1249.7562975219926, 13694.520691775939, 13709.0, 13769.724605507834, 13821.170729756246, 13927.65180870466, 296511.0, 309286.0, 311300.0, 327183.0, 328435.0, 66666.66666666635, 67240.6637966807, 67283.3271667277, 67293.0, 67410.66294668496, 1521.117751704009, 1554.4792494514238, 1556.330777765549, 1562.0783737594872, 1566.8354822743447, 31337.686623133475, 31536.36927261396, 31686.68313316837, 32094.518582221754, 32242.516362254115, 44540.0, 45023.549764501935, 45042.099158017314, 45074.0, 45088.54911450844, 270780.0, 271144.0, 271190.0, 271535.0, 271878.0, 38104.80947595244, 39291.410628841164, 39607.60392396039, 39884.80057599693, 40116.59591914386, 50017.74991125021, 50387.24419133789, 51622.74188629033, 51677.0, 51837.740811295705, 35949.28101438009, 36223.45664815082, 36242.09394765152, 36394.8180259097, 37214.8139259302, 35959.82020089988, 36442.8177859109, 36570.26859462849, 36586.0, 36887.63112368949, 43774.562254378325, 43793.0, 43872.78063609661, 44167.0, 44222.0, 34358.4061963507, 34670.0, 34862.82568587141, 34890.12774680653, 35465.64534354623, 25610.615840762777, 25960.350991224615, 26078.0, 26183.083592074185, 26295.605565916143], "value": 19602.911736855636, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [547.8274343581771, 596.1653684841222, 605.5276884030452, 610.5817515002224, 631.7915088020952, 23041.0, 23900.88049559752, 23996.5200695986, 24008.87995560024, 24018.75981240187, 24767.13315033974, 26842.46315073702, 27107.45785084297, 27219.0, 27251.86374068127, 6723.260441351447, 6787.694553745068, 6791.626460544668, 6806.897896531556, 6822.317768223163, 6708.060871477997, 6922.48081393895, 6935.618540980244, 6937.375636192742, 6965.477589180831, 6850.965745171292, 6873.072135261726, 6884.827879303008, 6885.139357580302, 6903.240643529208, 6860.176778786577, 6892.896606550856, 6895.896561551581, 6896.241413444517, 6920.377166055054, 6428.485721142298, 6431.8392040198905, 6442.420182183626, 6459.806205813833, 6470.417662410406, 19346.4196074118, 19590.314338998065, 19820.10809513561, 24975.876085576194, 30371.0, 2297.6438652008965, 2325.476767727248, 2331.4521087544413, 2331.5103828196097, 2344.284993077111, 20609.175632974664, 21119.3664190073, 21149.25977590792, 21167.576648467097, 21175.36473905785, 2487.2289590226906, 2533.0, 2560.4495033567687, 2561.154818909774, 2569.987150064256, 144001.27999359937, 148032.0, 149758.0, 152668.2366588171, 161511.3848861508, 15948.441804536786, 16190.838091619169, 16340.346386144658, 16391.344346226255, 16600.750988734937, 26139.477210455683, 26185.0, 26214.606780898303, 26221.737782622313, 26269.605955910676, 10879.782404351869, 11077.0, 11095.0, 11131.610393636345, 11367.658970230907, 10074.244431667654, 10096.495175241356, 10208.081272685495, 10240.743981400376, 10269.229807764448, 9777.364471309342, 9807.215422766161, 9811.901880981242, 9948.507723841338, 10182.389056656477, 2974.628171478565, 3007.29328607777, 3056.1119741843745, 3091.6908309168903, 3098.3338582204933, 1028.0107991037366, 1050.4170185547096, 1054.536004158168, 1063.9574417023387, 1069.4545781651414, 21104.78895211059, 21924.123035078737, 22033.77966220317, 22122.44693882666, 22424.21515246991, 1147.6958605969426, 1150.6030419505257, 1151.3840095548842, 1152.458344578047, 1170.3387586013876, 11942.16404851652, 12102.273863568214, 12160.270383777002, 12239.816402753966, 12294.877051229552, 573728.0, 584632.0, 585886.0, 600345.0, 606513.0, 130848.3457582706, 132612.3369383147, 133497.0, 138548.0, 139867.0, 1171.1509155862102, 1225.6874497003207, 1264.9557265495664, 1273.2424207596466, 1348.2651954684525, 23155.884220578788, 23349.0, 23656.763432365457, 23922.40193995164, 23949.16177933764, 64977.0, 66304.0, 67470.32529674837, 69070.65464672644, 71749.64125179341, 84515.5774221125, 84747.0, 87805.56097219473, 88882.0, 89907.55046224727, 21390.679139813226, 21886.452838678524, 21979.890100549394, 22017.559648807255, 22062.0, 24213.273601791974, 24472.265832025067, 24510.0, 24552.754472455046, 24799.50400991934, 19817.603647926673, 19894.70157947661, 20042.799572004093, 20073.79926200778, 20179.697304540736, 17230.483085507454, 17771.644567108844, 17942.37201697934, 18359.81640183581, 18400.723989140442, 19981.900090499454, 20247.0, 20445.897770511052, 20592.691109633666, 20769.68845467289, 21240.89379553154, 21263.574728505653, 21304.254351097636, 21435.46411339729, 21438.356849294545, 19506.122224500214, 19526.8047319525, 19577.8042219576, 19722.802771972096, 19726.30957916466], "value": 13253.998578271261, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1408.7393832141054, 1434.8206474190727, 1466.8313143988444, 1468.7503124468842, 1469.1332114052714, 16967.745483817736, 17684.911575442122, 17725.468235952943, 17767.822321776777, 17782.555436114104, 17169.141542922836, 17401.3039478421, 17436.04101774402, 17475.126243687828, 17538.0, 2646.179684297869, 2782.6939036705944, 2783.92818764776, 2784.693683694792, 2788.9721102789017, 2893.9726397129034, 3035.1805012646573, 3044.3302473455806, 3044.9847750761214, 3055.144559523337, 2984.224101733554, 3055.0834749575038, 3086.213015680998, 3106.4718997770433, 3111.206642306209, 2996.550517422382, 3016.457037733207, 3024.758019358446, 3038.0885734279736, 3062.8315442650646, 2926.25380527964, 2943.2053345596782, 2947.955780663292, 2962.2890506278554, 2973.36072744361, 16619.335226590923, 16748.58128546784, 17033.659326813395, 17256.827431725647, 17274.913625431916, 8803.735887923373, 9104.8634270486, 9105.908940910573, 9107.408018478778, 9118.680846170419, 5755.65466072037, 5923.644581325091, 5951.137085122633, 6041.939580604182, 6135.754569817202, 2053.260826102602, 2101.5901899129676, 2113.8520303578603, 2147.5490147069136, 2155.7628660847295, 31782.0, 32085.358292834248, 32177.51733723996, 32185.517217241526, 32214.677853221638, 7480.5885676287235, 7515.549067055994, 7544.170141284454, 7604.961975190088, 7686.9231307686205, 20121.295754648516, 20242.89878550598, 20361.287354942506, 20368.59262814765, 20380.0, 8702.04277529484, 8925.776855578662, 8926.0, 8975.057618949917, 8984.955075224712, 8110.391720620977, 8147.144549822302, 8166.877496837434, 8173.5504547250475, 8184.54984975832, 5778.8266352009505, 6042.154098426224, 6115.785947491905, 6122.846928826815, 6189.721462534197, 1543.2515230113386, 1606.7429211326132, 1649.2023694173408, 1655.7847479827544, 1702.3360889253202, 911.3119594705954, 936.8922573904089, 942.9669961551313, 950.6007476859736, 957.7461972577272, 9242.21441177494, 9294.814103717888, 9352.438853668802, 9485.478298693639, 9559.474228917476, 805.7502174325978, 814.7637185216221, 821.1788211788212, 821.5974172655475, 876.268315956171, 5663.688497132614, 5803.361630220672, 5921.407859214044, 5944.167816505693, 6026.789062382795, 25346.366340841625, 26304.947802087703, 26734.197974060808, 26803.86598067036, 26902.730972690413, 25753.8712306441, 25816.74183258181, 25834.35414114662, 26019.479610408063, 26200.08299709501, 12932.806007909889, 13007.0, 13129.803052954214, 13153.73692526144, 13243.470261189444, 8884.111588841064, 9103.635854565744, 9120.224780893433, 9166.0, 9284.814303714023, 21088.0, 22100.0, 22114.889425553414, 22226.222082227043, 23231.419214519774, 22834.543309134056, 23059.192928248103, 23115.306540803802, 23491.0, 23959.0, 12789.232646041268, 12995.350232488527, 13007.414666339848, 13012.349382531025, 13014.414351354022, 16104.194790260675, 16142.757858631894, 16191.838081619504, 16210.108444035219, 16214.675706485568, 13001.934990324988, 13066.54267100647, 13119.081664283409, 13190.73618527605, 13506.527271545448, 12872.09895307357, 12916.483340666267, 12991.545295914597, 13077.476900923857, 13194.076414650883, 11394.316341019565, 11680.357580333164, 11723.941380293385, 11731.061515078944, 11740.295582265091, 8092.79768005781, 8200.302974247255, 8213.096559378344, 8221.342292616697, 8282.875756863772, 8071.273585377344, 8165.632546535539, 8232.053313868983, 8284.46151000183, 8326.417150799385], "value": 7522.642921638944, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [548.4049805960535, 572.5419664268584, 573.5067841656177, 582.7523302596397, 587.2483221476512, 5950.315713692921, 6135.0, 6268.840264551061, 6271.749130034805, 6289.622622642633, 6302.747890084391, 6323.367663233675, 6348.36516348365, 6354.68226588671, 6361.964171465133, 5274.92087618686, 5279.86800329991, 5296.258523806651, 5299.33758280215, 5299.54953828925, 4947.18371468709, 5051.747412629354, 5056.696598204101, 5070.163423035213, 5274.103402421579, 4993.375828021497, 5009.924851127218, 5021.799128034892, 5027.974860125694, 5051.747412629372, 4998.90002199954, 5006.374203224597, 5011.1481048221885, 5011.899762004776, 5018.9559492709595, 4566.474855391606, 4579.511658710932, 4594.173048851206, 4598.310253461974, 4621.584057434847, 6190.350013248634, 6197.597156184834, 6201.906971395432, 6211.285702144266, 6220.978182090838, 5808.419158084158, 5815.476607105381, 5847.327557330919, 5892.175095486636, 5894.204282421861, 6584.144061272052, 6625.768098116591, 6648.634325112117, 6650.800475985729, 6706.26231114577, 4934.235193545006, 5060.291559181717, 5087.49125087492, 5090.796368145269, 5118.411382691001, 6845.760398386033, 6873.621950792704, 6945.576156887826, 6978.511504194708, 6986.476014298948, 5267.0, 5273.393559740679, 5274.314339135888, 5282.2340760589495, 5291.841244762663, 5353.544948679328, 5353.732313384316, 5353.929214157184, 5361.115415956401, 5382.138857782814, 5928.377520360386, 5934.495567876779, 5944.0, 5950.7917222896995, 5963.7912673056235, 6647.434968027772, 6681.298463661343, 6714.731410743516, 6714.932850671528, 6731.091302674175, 1809.6199798042296, 1809.80092189859, 1822.2255541394854, 1830.5972686009056, 1838.7955888892798, 1255.24057944942, 1304.7194853106628, 1307.2744626732256, 1316.4799904037852, 1324.265032906746, 6148.723307451175, 6268.0, 6279.246490421087, 6282.0, 6327.4938004959495, 6567.704453299613, 6687.130673012477, 6749.763758268536, 6782.559133656297, 6819.5908245505425, 6027.306859711101, 6144.17053697754, 6213.105002974046, 6276.843078922972, 6287.528435367366, 3512.947305790415, 3530.3292374448774, 3538.4515400113023, 3542.982285088558, 3580.4987301777774, 7025.332593403721, 7048.718051277891, 7049.400800931979, 7081.0, 7088.007678924954, 6727.730890764413, 6934.7226110955, 6940.861182776417, 6961.547499412522, 7035.381862171729, 6962.060121883582, 6970.268121847234, 7013.894791578028, 7056.611886346198, 7064.187618423947, 6630.7679231226675, 6638.502112341497, 6667.466602671871, 6727.93272067273, 6738.9217725163735, 6642.335766423319, 6671.699773510107, 6697.564658297195, 6698.0, 6719.664016799238, 6866.0, 6962.930370696228, 6977.406920411822, 6993.440524758109, 7004.754833580801, 5131.3842338918075, 5161.380634323755, 5217.582593392443, 5227.660202086852, 5245.606579506629, 6520.217573891164, 6559.540832141704, 6737.831554210988, 6762.932370676427, 6833.384995350442, 6474.3166776639355, 6512.6743662815725, 6520.152380190545, 6614.570052946543, 6614.834629134118, 6460.289368169591, 6489.1888513935755, 6508.60948343101, 6543.280239173782, 6553.737850486118, 6419.807405777648, 6450.129692286887, 6516.609003459618, 6531.746547441126, 6604.273529911609, 6434.967825160844, 6524.380183882524, 6531.804045878631, 6556.246031706224, 6644.0, 6326.398992095744, 6342.23893132827, 6447.9032814508755, 6470.320616335405, 6509.4792416605615], "value": 5206.744738070075, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [986.4278718343362, 1017.8727659042619, 1028.3469996552192, 1028.5628607841666, 1052.8473371361154, 20952.37142885712, 21526.569468610618, 21549.784502154955, 21565.784342156574, 21578.784212157872, 17386.304547818072, 17555.0, 19708.211671533158, 20382.286619968305, 20474.795252047512, 1068.727474494003, 1082.566973210718, 1085.6525911708256, 1086.473060565625, 1088.8312311591676, 1031.7369070886914, 1065.8241390170613, 1111.0223003756682, 1114.4316398636713, 1119.2109562758235, 1180.339010154312, 1186.5194596188558, 1190.8749581293969, 1191.3090407563636, 1197.407283394721, 1184.579474286633, 1186.6558697977575, 1187.6971372300052, 1193.0276824388095, 1193.7851186786374, 865.6018231613465, 866.0906048648957, 867.4274978514213, 871.4248595926658, 876.0976194519654, 19300.80699193018, 20691.793082069136, 21800.236991705213, 22044.33866983993, 22061.11755529777, 21996.670049949265, 22368.0, 22369.88815055914, 22380.216692415688, 22853.20013799509, 18077.819221807746, 18335.0, 18478.907605461885, 18551.072446377628, 18651.347202847835, 3893.6495715385468, 4037.6971727120585, 4162.666986641061, 4162.895927601804, 4174.70777045607, 150784.24607877, 152662.0, 153389.23305383514, 158312.0, 164626.0, 18781.530461738294, 19139.712904306445, 19242.903785480983, 19266.229350826092, 19287.132079056475, 34585.48121778175, 35004.299914002084, 35500.28999419997, 35653.28693426117, 35672.821635891654, 10098.747531311628, 10156.339837910513, 10192.643257485952, 10310.175185985103, 10336.741581460523, 4965.602751779849, 4966.379202599675, 4977.701337919736, 5008.424031236382, 5013.548780609763, 6025.698715064229, 6029.698515074228, 6113.021916493429, 6129.570930034854, 6151.507879369729, 1231.3904617214537, 1235.6663700800914, 1266.392131776734, 1269.8349214602042, 1270.1553466944563, 764.9273319034683, 770.1220608506195, 780.5979920341028, 790.3992965346263, 794.3605397654943, 12893.226406415644, 13861.584152475441, 14131.858681413054, 14287.499937502345, 14405.711885762226, 766.7042697840632, 769.97690069298, 788.286600626434, 792.4294507954264, 795.236572890032, 6543.247526534509, 6555.770548030796, 6665.333466653393, 6700.128983232149, 6751.987201919751, 149787.0, 151120.0, 152762.0, 153069.23465382602, 153955.0, 104183.47908260561, 130042.0, 130203.0, 132345.0, 139996.30001849926, 114646.42676786563, 114894.0, 115526.0, 116072.0, 120323.0, 14408.351624176728, 14501.752228404614, 14547.127172369692, 14679.48621798232, 14820.62948426298, 55060.44939550553, 55661.721691391285, 56632.71683641555, 57402.7129864348, 57487.42512574988, 72892.0, 75379.0, 75736.24263757291, 75964.24035759793, 77647.83528247193, 18074.096295184925, 18090.18594163292, 18244.635107298047, 18386.264549417872, 18437.26250949947, 24165.0, 24295.392615184763, 24427.755722442547, 24526.754732452446, 24536.6319505204, 22356.441088972904, 22455.77544224537, 22519.099236030375, 22536.887315563315, 22904.885475572515, 21385.78614213838, 21403.571928561654, 21701.131954722267, 21832.23587174441, 21874.671879921494, 21893.124275028822, 21941.451463713536, 21991.560168796856, 22082.33752987413, 22188.001539930417, 12978.545750898673, 13168.868311316764, 13286.335683215608, 13305.600831975056, 13306.667333316744, 14634.634134146732, 14718.926405367905, 14770.63073423173, 14851.925740371229, 15045.924770376078], "value": 10538.99832155643, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1355.8000000000002, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [106.0, 105.0, 106.0, 105.0, 106.0, 107.0, 107.0, 106.0, 104.0, 105.0], "value": 105.7, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [110.0, 112.0, 109.0, 114.0, 114.0, 111.0, 111.0, 114.0, 112.0, 136.0], "value": 114.3, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [160.0, 165.0, 161.0, 162.0, 163.0, 162.0, 162.0, 161.0, 164.0, 161.0], "value": 162.1, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [74.0, 73.0, 73.0, 73.0, 72.0, 73.0, 73.0, 74.0, 78.0, 73.0], "value": 73.6, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [77.0, 77.0, 78.0, 77.0, 77.0, 78.0, 82.0, 77.0, 77.0, 77.0], "value": 77.7, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [119.0, 113.0, 114.0, 114.0, 113.0, 114.0, 113.0, 113.0, 113.0, 114.0], "value": 114.0, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [148.0, 150.0, 151.0, 149.0, 151.0, 151.0, 149.0, 149.0, 148.0, 148.0], "value": 149.4, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [94.0, 95.0, 94.0, 94.0, 99.0, 98.0, 95.0, 94.0, 95.0, 94.0], "value": 95.2, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [43.0, 44.0, 45.0, 44.0, 43.0, 43.0, 42.0, 43.0, 42.0, 44.0], "value": 43.3, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [35.0, 35.0, 35.0, 35.0, 35.0, 35.0, 36.0, 35.0, 35.0, 36.0], "value": 35.2, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [72.0, 71.0, 69.0, 72.0, 72.0, 71.0, 73.0, 73.0, 72.0, 73.0], "value": 71.8, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [100.0, 108.0, 108.0, 105.0, 106.0, 101.0, 102.0, 103.0, 103.0, 105.0], "value": 104.1, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [150.0, 148.0, 150.0, 154.0, 148.0, 156.0, 149.0, 149.0, 149.0, 147.0], "value": 150.0, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [62.0, 59.0, 58.0, 60.0, 66.0, 57.0, 57.0, 59.0, 58.0, 58.0], "value": 59.4, "unit": "score"}]}]} 18:59:29 INFO - Return code: 0 18:59:29 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 18:59:29 INFO - # TBPL SUCCESS # 18:59:29 INFO - Running post-action listener: _package_coverage_data 18:59:29 INFO - Running post-action listener: _resource_record_post_action 18:59:29 INFO - [mozharness: 2017-09-15 01:59:29.408803Z] Finished run-tests step (success) 18:59:29 INFO - Running post-run listener: _resource_record_post_run 18:59:29 INFO - Total resource usage - Wall time: 1181s; CPU: 13.0%; Read bytes: 8192; Write bytes: 366288896; Read time: 100; Write time: 172972 18:59:29 INFO - TinderboxPrint: CPU usage
13.0% 18:59:29 INFO - TinderboxPrint: I/O read bytes / time
8,192 / 100 18:59:29 INFO - TinderboxPrint: I/O write bytes / time
366,288,896 / 172,972 18:59:29 INFO - TinderboxPrint: CPU idle
8,186.5 (86.9%) 18:59:29 INFO - TinderboxPrint: CPU user
1,179.0 (12.5%) 18:59:29 INFO - TinderboxPrint: Swap in / out
0 / 0 18:59:29 INFO - install - Wall time: 15s; CPU: 13.0%; Read bytes: 0; Write bytes: 85696512; Read time: 0; Write time: 47656 18:59:29 INFO - setup-mitmproxy - Wall time: 0s; CPU: Can't collect data; Read bytes: 0; Write bytes: 0; Read time: 0; Write time: 0 18:59:29 INFO - run-tests - Wall time: 1167s; CPU: 13.0%; Read bytes: 8192; Write bytes: 268623872; Read time: 100; Write time: 122440 18:59:30 INFO - Running post-run listener: _upload_blobber_files 18:59:30 INFO - Blob upload gear active. 18:59:30 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 18:59:30 INFO - Files from /builds/slave/test/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 18:59:30 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Mozilla-Beta-Non-PGO', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 18:59:30 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Mozilla-Beta-Non-PGO -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 18:59:30 INFO - (blobuploader) - INFO - Open directory for files ... 18:59:30 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/perfherder-data.json ... 18:59:30 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 18:59:30 INFO - (blobuploader) - INFO - Uploading, attempt #1. 18:59:31 INFO - (blobuploader) - INFO - TinderboxPrint: perfherder-data.json: uploaded 18:59:31 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 18:59:31 INFO - (blobuploader) - INFO - Done attempting. 18:59:31 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 18:59:31 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 18:59:31 INFO - (blobuploader) - INFO - Uploading, attempt #1. 18:59:38 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 18:59:38 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 18:59:38 INFO - (blobuploader) - INFO - Done attempting. 18:59:38 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 18:59:38 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 18:59:38 INFO - (blobuploader) - INFO - Uploading, attempt #1. 18:59:39 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 18:59:39 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 18:59:39 INFO - (blobuploader) - INFO - Done attempting. 18:59:39 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 18:59:39 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 18:59:39 INFO - (blobuploader) - INFO - Uploading, attempt #1. 18:59:40 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 18:59:40 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 18:59:40 INFO - (blobuploader) - INFO - Done attempting. 18:59:40 INFO - (blobuploader) - INFO - Iteration through files over. 18:59:40 INFO - Return code: 0 18:59:40 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 18:59:40 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 18:59:40 INFO - Setting buildbot property blobber_files to {"perfherder-data.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta-Non-PGO/sha512/dd2ab881b5f2648c6ffdd535f1658365417fc90950203321a1cf6a2237126bd1db237c7d921ee0c01924ee97b15da3e6e39e05eea5b8ed401d2f592c89aba8b7", "resource-usage.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta-Non-PGO/sha512/a1c4b06a4cc8ce81ae6d4e0e0d20a4fac0bb2a4ef60d8577b2ac515131693012a06ae19e59e5ffb65e08f1115ea3f200925f4e92727a6b1f5c5c1460214cbcff", "dromaeojs-e10s_errorsummary.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta-Non-PGO/sha512/dd3d1a2d84e2f81a9e5b7c277f6fbd554a743f7baeaef9bc785487a64bb71d7ede9be846951fd2df145d89033090c8966ef2f05207a5ef902894d760e3cb1f39", "dromaeojs-e10s_raw.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta-Non-PGO/sha512/d2a8552f93f47109cead8bb0195548a411ecce75cbc9b1676a1e2cc94d8e394f3f2ae7726b81e0ba1a889b74fa333024e84933ce74df104c3849b0d20e12debd"} 18:59:40 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 18:59:40 INFO - Writing to file /builds/slave/test/properties/blobber_files 18:59:40 INFO - Contents: 18:59:40 INFO - blobber_files:{"perfherder-data.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta-Non-PGO/sha512/dd2ab881b5f2648c6ffdd535f1658365417fc90950203321a1cf6a2237126bd1db237c7d921ee0c01924ee97b15da3e6e39e05eea5b8ed401d2f592c89aba8b7", "resource-usage.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta-Non-PGO/sha512/a1c4b06a4cc8ce81ae6d4e0e0d20a4fac0bb2a4ef60d8577b2ac515131693012a06ae19e59e5ffb65e08f1115ea3f200925f4e92727a6b1f5c5c1460214cbcff", "dromaeojs-e10s_errorsummary.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta-Non-PGO/sha512/dd3d1a2d84e2f81a9e5b7c277f6fbd554a743f7baeaef9bc785487a64bb71d7ede9be846951fd2df145d89033090c8966ef2f05207a5ef902894d760e3cb1f39", "dromaeojs-e10s_raw.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta-Non-PGO/sha512/d2a8552f93f47109cead8bb0195548a411ecce75cbc9b1676a1e2cc94d8e394f3f2ae7726b81e0ba1a889b74fa333024e84933ce74df104c3849b0d20e12debd"} 18:59:40 INFO - Running post-run listener: copy_logs_to_upload_dir 18:59:40 INFO - Copying logs to upload dir... 18:59:40 INFO - mkdir: /builds/slave/test/build/upload/logs 18:59:40 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1268.312393 ========= master_lag: 0.04 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 8 secs) (at 2017-09-14 18:59:40.391392) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-09-14 18:59:40.395291) ========= bash -c 'for file in `ls -1`; do cat $file; done' in dir /builds/slave/test/properties (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'for file in `ls -1`; do cat $file; done'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test/properties SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=934fc3100db09dcb9af4d4b6000001ab-1505437288.179532-1377774891 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"perfherder-data.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta-Non-PGO/sha512/dd2ab881b5f2648c6ffdd535f1658365417fc90950203321a1cf6a2237126bd1db237c7d921ee0c01924ee97b15da3e6e39e05eea5b8ed401d2f592c89aba8b7", "resource-usage.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta-Non-PGO/sha512/a1c4b06a4cc8ce81ae6d4e0e0d20a4fac0bb2a4ef60d8577b2ac515131693012a06ae19e59e5ffb65e08f1115ea3f200925f4e92727a6b1f5c5c1460214cbcff", "dromaeojs-e10s_errorsummary.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta-Non-PGO/sha512/dd3d1a2d84e2f81a9e5b7c277f6fbd554a743f7baeaef9bc785487a64bb71d7ede9be846951fd2df145d89033090c8966ef2f05207a5ef902894d760e3cb1f39", "dromaeojs-e10s_raw.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta-Non-PGO/sha512/d2a8552f93f47109cead8bb0195548a411ecce75cbc9b1676a1e2cc94d8e394f3f2ae7726b81e0ba1a889b74fa333024e84933ce74df104c3849b0d20e12debd"} build_url:https://queue.taskcluster.net/v1/task/dwA3zIQnSsC5sWxXs_oG_Q/artifacts/public/build/target.tar.bz2 program finished with exit code 0 elapsedTime=0.011349 build_url: 'https://queue.taskcluster.net/v1/task/dwA3zIQnSsC5sWxXs_oG_Q/artifacts/public/build/target.tar.bz2' blobber_files: '{"perfherder-data.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta-Non-PGO/sha512/dd2ab881b5f2648c6ffdd535f1658365417fc90950203321a1cf6a2237126bd1db237c7d921ee0c01924ee97b15da3e6e39e05eea5b8ed401d2f592c89aba8b7", "resource-usage.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta-Non-PGO/sha512/a1c4b06a4cc8ce81ae6d4e0e0d20a4fac0bb2a4ef60d8577b2ac515131693012a06ae19e59e5ffb65e08f1115ea3f200925f4e92727a6b1f5c5c1460214cbcff", "dromaeojs-e10s_errorsummary.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta-Non-PGO/sha512/dd3d1a2d84e2f81a9e5b7c277f6fbd554a743f7baeaef9bc785487a64bb71d7ede9be846951fd2df145d89033090c8966ef2f05207a5ef902894d760e3cb1f39", "dromaeojs-e10s_raw.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta-Non-PGO/sha512/d2a8552f93f47109cead8bb0195548a411ecce75cbc9b1676a1e2cc94d8e394f3f2ae7726b81e0ba1a889b74fa333024e84933ce74df104c3849b0d20e12debd"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-09-14 18:59:40.426802) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-09-14 18:59:40.427344) ========= rm -f oauth.txt in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-f', 'oauth.txt'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=934fc3100db09dcb9af4d4b6000001ab-1505437288.179532-1377774891 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004518 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-09-14 18:59:40.509302) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2017-09-14 18:59:40.509637) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2017-09-14 18:59:40.509955) ========= ========= Total master_lag: 0.21 =========