builder: mozilla-aurora_ubuntu64_hw_test-dromaeojs-e10s slave: talos-linux64-ix-018 starttime: 1486540044.0 results: success (0) revision: 82c75fd3a2de796351296592c459ab4aa4cd0baf ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2017-02-07 23:47:24.000785) ========= master: http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2017-02-07 23:47:24.001816) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-02-07 23:47:24.002491) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-02-07 23:47:24.019187) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-02-07 23:47:24.019491) ========= 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=62c568580acbfdaac3eec7be000001dc-1486540043.589840-737819103 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2017-02-07 23:47:24-- 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% 114M=0s 2017-02-07 23:47:24 (114 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.125204 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-02-07 23:47:24.158322) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-02-07 23:47:24.158695) ========= 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=62c568580acbfdaac3eec7be000001dc-1486540043.589840-737819103 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.015602 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-02-07 23:47:24.208644) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-02-07 23:47:24.209014) ========= bash -c 'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev 82c75fd3a2de796351296592c459ab4aa4cd0baf --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev 82c75fd3a2de796351296592c459ab4aa4cd0baf --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=62c568580acbfdaac3eec7be000001dc-1486540043.589840-737819103 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2017-02-07 23:47:24,426 truncating revision to first 12 chars 2017-02-07 23:47:24,426 Setting DEBUG logging. 2017-02-07 23:47:24,426 attempt 1/10 2017-02-07 23:47:24,426 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/releases/mozilla-aurora/82c75fd3a2de?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2017-02-07 23:47:24,993 unpacking tar archive at: mozilla-aurora-82c75fd3a2de/testing/mozharness/ program finished with exit code 0 elapsedTime=0.927987 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-02-07 23:47:25.150300) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-02-07 23:47:25.150683) ========= script_repo_revision: 82c75fd3a2de796351296592c459ab4aa4cd0baf ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-02-07 23:47:25.151096) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-02-07 23:47:25.151412) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-02-07 23:47:25.160820) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 33 secs) (at 2017-02-07 23:47:25.161198) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Aurora-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora-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-Aurora-Non-PGO', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-Aurora-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=62c568580acbfdaac3eec7be000001dc-1486540043.589840-737819103 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 23:47:25 INFO - MultiFileLogger online at 20170207 23:47:25 in /builds/slave/test 23:47:25 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Aurora-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora-Non-PGO 23:47:25 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 23:47:25 INFO - {'append_to_log': False, 23:47:25 INFO - 'base_work_dir': '/builds/slave/test', 23:47:25 INFO - 'blob_upload_branch': 'Mozilla-Aurora-Non-PGO', 23:47:25 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 23:47:25 INFO - 'branch': 'Mozilla-Aurora-Non-PGO', 23:47:25 INFO - 'buildbot_json_path': 'buildprops.json', 23:47:25 INFO - 'config_files': ('talos/linux_config.py',), 23:47:25 INFO - 'default_actions': ('clobber', 23:47:25 INFO - 'read-buildbot-config', 23:47:25 INFO - 'download-and-extract', 23:47:25 INFO - 'populate-webroot', 23:47:25 INFO - 'create-virtualenv', 23:47:25 INFO - 'install', 23:47:25 INFO - 'run-tests'), 23:47:25 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 23:47:25 INFO - 'download_minidump_stackwalk': True, 23:47:25 INFO - 'download_symbols': 'ondemand', 23:47:25 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 23:47:25 INFO - 'tooltool.py': '/tools/tooltool.py', 23:47:25 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 23:47:25 INFO - '/tools/misc-python/virtualenv.py')}, 23:47:25 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 23:47:25 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 23:47:25 INFO - 'installer_path': 'installer.exe', 23:47:25 INFO - 'log_level': 'info', 23:47:25 INFO - 'log_name': 'talos', 23:47:25 INFO - 'log_to_console': True, 23:47:25 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 23:47:25 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 23:47:25 INFO - 'opt_config_files': (), 23:47:25 INFO - 'pip_index': False, 23:47:25 INFO - 'sps_profile': False, 23:47:25 INFO - 'sps_profile_interval': 0, 23:47:25 INFO - 'suite': 'dromaeojs-e10s', 23:47:25 INFO - 'system_bits': '32', 23:47:25 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 23:47:25 INFO - 'title': 'talos-linux64-ix-018', 23:47:25 INFO - 'tooltool_cache': '/builds/tooltool_cache', 23:47:25 INFO - 'use_talos_json': True, 23:47:25 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 23:47:25 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 23:47:25 INFO - 'work_dir': 'build'} 23:47:25 INFO - [mozharness: 2017-02-08 07:47:25.477136Z] Running clobber step. 23:47:25 INFO - Running pre-action listener: _resource_record_pre_action 23:47:25 INFO - Running main action method: clobber 23:47:25 INFO - rmtree: /builds/slave/test/build 23:47:25 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 23:47:25 INFO - Running post-action listener: _resource_record_post_action 23:47:25 INFO - [mozharness: 2017-02-08 07:47:25.947152Z] Finished clobber step (success) 23:47:25 INFO - [mozharness: 2017-02-08 07:47:25.947253Z] Running read-buildbot-config step. 23:47:25 INFO - Running pre-action listener: _resource_record_pre_action 23:47:25 INFO - Running main action method: read_buildbot_config 23:47:25 INFO - Using buildbot properties: 23:47:25 INFO - { 23:47:25 INFO - "project": "", 23:47:25 INFO - "product": "firefox", 23:47:25 INFO - "who": "hikezoe@mozilla.com", 23:47:25 INFO - "installer_path": "public/build/target.tar.bz2", 23:47:25 INFO - "builddir": "mozilla-aurora_ubuntu64_hw_test-dromaeojs-e10s", 23:47:25 INFO - "repository": "https://hg.mozilla.org/releases/mozilla-aurora/", 23:47:25 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-aurora talos dromaeojs-e10s", 23:47:25 INFO - "stage_platform": "linux64", 23:47:25 INFO - "basedir": "/builds/slave/test", 23:47:25 INFO - "buildnumber": 19, 23:47:25 INFO - "platform": "ubuntu64_hw", 23:47:25 INFO - "master": "http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/", 23:47:25 INFO - "slavebuilddir": "test", 23:47:25 INFO - "taskId": "JVN-7N2CQoqTHnHQxiCplw", 23:47:25 INFO - "branch": "mozilla-aurora", 23:47:25 INFO - "script_repo_revision": "production", 23:47:25 INFO - "revision": "82c75fd3a2de796351296592c459ab4aa4cd0baf", 23:47:25 INFO - "slavename": "talos-linux64-ix-018", 23:47:25 INFO - "repo_path": "releases/mozilla-aurora" 23:47:25 INFO - } 23:47:25 INFO - Finding installer, test and symbols from parent task. 23:47:25 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/JVN-7N2CQoqTHnHQxiCplw'}, attempt #1 23:47:26 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/JVN-7N2CQoqTHnHQxiCplw'}, attempt #1 23:47:26 INFO - Task dependencies: FXxDmAlYRxWRkiMnCupXTw 23:47:26 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/FXxDmAlYRxWRkiMnCupXTw'}, attempt #1 23:47:27 INFO - Set installer_url: https://queue.taskcluster.net/v1/task/FXxDmAlYRxWRkiMnCupXTw/artifacts/public/build/target.tar.bz2 23:47:27 INFO - Set test_url: https://queue.taskcluster.net/v1/task/FXxDmAlYRxWRkiMnCupXTw/artifacts/public/build/test_packages.json 23:47:27 INFO - Set symbols_url: https://queue.taskcluster.net/v1/task/FXxDmAlYRxWRkiMnCupXTw/artifacts/public/build/target.crashreporter-symbols.zip 23:47:27 INFO - Running post-action listener: _resource_record_post_action 23:47:27 INFO - [mozharness: 2017-02-08 07:47:27.346065Z] Finished read-buildbot-config step (success) 23:47:27 INFO - [mozharness: 2017-02-08 07:47:27.346284Z] Running download-and-extract step. 23:47:27 INFO - Running pre-action listener: _resource_record_pre_action 23:47:27 INFO - Running main action method: download_and_extract 23:47:27 INFO - mkdir: /builds/slave/test/build/tests 23:47:27 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 23:47:27 INFO - trying https://queue.taskcluster.net/v1/task/FXxDmAlYRxWRkiMnCupXTw/artifacts/public/build/target.test_packages.json 23:47:27 INFO - Downloading https://queue.taskcluster.net/v1/task/FXxDmAlYRxWRkiMnCupXTw/artifacts/public/build/target.test_packages.json to /builds/slave/test/build/target.test_packages.json 23:47:27 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/FXxDmAlYRxWRkiMnCupXTw/artifacts/public/build/target.test_packages.json', 'file_name': '/builds/slave/test/build/target.test_packages.json'}, attempt #1 23:47:27 INFO - Downloaded 896 bytes. 23:47:27 INFO - Reading from file /builds/slave/test/build/target.test_packages.json 23:47:27 INFO - Using the following test package requirements: 23:47:27 INFO - {u'common': [u'target.common.tests.zip'], 23:47:27 INFO - u'cppunittest': [u'target.common.tests.zip', u'target.cppunittest.tests.zip'], 23:47:27 INFO - u'gtest': [u'target.common.tests.zip', u'target.gtest.tests.zip'], 23:47:27 INFO - u'jittest': [u'target.common.tests.zip', u'target.jsshell.zip'], 23:47:27 INFO - u'mochitest': [u'target.common.tests.zip', u'target.mochitest.tests.zip'], 23:47:27 INFO - u'mozbase': [u'target.common.tests.zip'], 23:47:27 INFO - u'reftest': [u'target.common.tests.zip', u'target.reftest.tests.zip'], 23:47:27 INFO - u'talos': [u'target.common.tests.zip', u'target.talos.tests.zip'], 23:47:27 INFO - u'web-platform': [u'target.common.tests.zip', 23:47:27 INFO - u'target.web-platform.tests.zip'], 23:47:27 INFO - u'xpcshell': [u'target.common.tests.zip', u'target.xpcshell.tests.zip']} 23:47:27 INFO - Downloading packages: [u'target.common.tests.zip'] for test suite category: common 23:47:27 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/FXxDmAlYRxWRkiMnCupXTw/artifacts/public/build/target.common.tests.zip 23:47:27 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/FXxDmAlYRxWRkiMnCupXTw/artifacts/public/build/target.common.tests.zip'}, attempt #1 23:47:27 INFO - Fetch https://queue.taskcluster.net/v1/task/FXxDmAlYRxWRkiMnCupXTw/artifacts/public/build/target.common.tests.zip into memory 23:47:28 INFO - Expected file size: 21861365 23:47:28 INFO - Obtained file size: 21861365 23:47:32 INFO - Downloading packages: [u'target.common.tests.zip', u'target.talos.tests.zip'] for test suite category: talos 23:47:32 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/FXxDmAlYRxWRkiMnCupXTw/artifacts/public/build/target.common.tests.zip 23:47:32 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/FXxDmAlYRxWRkiMnCupXTw/artifacts/public/build/target.common.tests.zip'}, attempt #1 23:47:32 INFO - Fetch https://queue.taskcluster.net/v1/task/FXxDmAlYRxWRkiMnCupXTw/artifacts/public/build/target.common.tests.zip into memory 23:47:33 INFO - Expected file size: 21861365 23:47:33 INFO - Obtained file size: 21861365 23:47:37 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/FXxDmAlYRxWRkiMnCupXTw/artifacts/public/build/target.talos.tests.zip 23:47:37 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/FXxDmAlYRxWRkiMnCupXTw/artifacts/public/build/target.talos.tests.zip'}, attempt #1 23:47:37 INFO - Fetch https://queue.taskcluster.net/v1/task/FXxDmAlYRxWRkiMnCupXTw/artifacts/public/build/target.talos.tests.zip into memory 23:47:38 INFO - Expected file size: 14403485 23:47:38 INFO - Obtained file size: 14403485 23:47:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 23:47:38 INFO - trying https://queue.taskcluster.net/v1/task/FXxDmAlYRxWRkiMnCupXTw/artifacts/public/build/target.tar.bz2 23:47:38 INFO - Downloading https://queue.taskcluster.net/v1/task/FXxDmAlYRxWRkiMnCupXTw/artifacts/public/build/target.tar.bz2 to /builds/slave/test/build/target.tar.bz2 23:47:38 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/FXxDmAlYRxWRkiMnCupXTw/artifacts/public/build/target.tar.bz2', 'file_name': '/builds/slave/test/build/target.tar.bz2'}, attempt #1 23:47:40 INFO - Downloaded 66225259 bytes. 23:47:40 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/FXxDmAlYRxWRkiMnCupXTw/artifacts/public/build/target.tar.bz2 23:47:40 INFO - mkdir: /builds/slave/test/properties 23:47:40 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 23:47:40 INFO - Writing to file /builds/slave/test/properties/build_url 23:47:40 INFO - Contents: 23:47:40 INFO - build_url:https://queue.taskcluster.net/v1/task/FXxDmAlYRxWRkiMnCupXTw/artifacts/public/build/target.tar.bz2 23:47:40 INFO - Running post-action listener: _resource_record_post_action 23:47:40 INFO - Running post-action listener: set_extra_try_arguments 23:47:40 INFO - [mozharness: 2017-02-08 07:47:40.009979Z] Finished download-and-extract step (success) 23:47:40 INFO - [mozharness: 2017-02-08 07:47:40.010075Z] Running populate-webroot step. 23:47:40 INFO - Running pre-action listener: _resource_record_pre_action 23:47:40 INFO - Running main action method: populate_webroot 23:47:40 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 23:47:40 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 23:47:40 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 23:47:40 INFO - '--tppagecycles', 23:47:40 INFO - '7'], 23:47:40 INFO - 'tests': ['tsvgm']}}, 23:47:40 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 23:47:40 INFO - 'tests': ['tresize', 'tcanvasmark']}, 23:47:40 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 23:47:40 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 23:47:40 INFO - 'tests': ['dromaeo_css', 'kraken']}, 23:47:40 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 23:47:40 INFO - 'g1': {'pagesets_name': 'tp5n.zip', 23:47:40 INFO - 'talos_options': ['--disable-e10s'], 23:47:40 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 23:47:40 INFO - 'g1-e10s': {'pagesets_name': 'tp5n.zip', 23:47:40 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 23:47:40 INFO - 'g2': {'pagesets_name': 'tp5n.zip', 23:47:40 INFO - 'talos_options': ['--disable-e10s'], 23:47:40 INFO - 'tests': ['damp', 'tps']}, 23:47:40 INFO - 'g2-e10s': {'pagesets_name': 'tp5n.zip', 23:47:40 INFO - 'tests': ['damp', 'tps']}, 23:47:40 INFO - 'g3': {'talos_options': ['--disable-e10s'], 23:47:40 INFO - 'tests': ['dromaeo_dom']}, 23:47:40 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 23:47:40 INFO - 'g4': {'talos_options': ['--disable-e10s'], 23:47:40 INFO - 'tests': ['basic_compositor_video']}, 23:47:40 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 23:47:40 INFO - 'other': {'talos_options': ['--disable-e10s'], 23:47:40 INFO - 'tests': ['a11yr', 23:47:40 INFO - 'ts_paint', 23:47:40 INFO - 'tpaint', 23:47:40 INFO - 'sessionrestore', 23:47:40 INFO - 'sessionrestore_no_auto_restore', 23:47:40 INFO - 'tabpaint']}, 23:47:40 INFO - 'other-e10s': {'tests': ['a11yr', 23:47:40 INFO - 'ts_paint', 23:47:40 INFO - 'tpaint', 23:47:40 INFO - 'sessionrestore', 23:47:40 INFO - 'sessionrestore_no_auto_restore', 23:47:40 INFO - 'tabpaint']}, 23:47:40 INFO - 'other-e10s_l64': {'tests': ['a11yr', 23:47:40 INFO - 'ts_paint', 23:47:40 INFO - 'tpaint', 23:47:40 INFO - 'sessionrestore', 23:47:40 INFO - 'sessionrestore_no_auto_restore', 23:47:40 INFO - 'tabpaint']}, 23:47:40 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 23:47:40 INFO - 'ts_paint', 23:47:40 INFO - 'tpaint', 23:47:40 INFO - 'sessionrestore', 23:47:40 INFO - 'sessionrestore_no_auto_restore', 23:47:40 INFO - 'tabpaint']}, 23:47:40 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 23:47:40 INFO - 'tests': ['a11yr', 23:47:40 INFO - 'ts_paint', 23:47:40 INFO - 'tpaint', 23:47:40 INFO - 'sessionrestore', 23:47:40 INFO - 'sessionrestore_no_auto_restore', 23:47:40 INFO - 'tabpaint']}, 23:47:40 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 23:47:40 INFO - 'tests': ['a11yr', 23:47:40 INFO - 'ts_paint', 23:47:40 INFO - 'tpaint', 23:47:40 INFO - 'sessionrestore', 23:47:40 INFO - 'sessionrestore_no_auto_restore', 23:47:40 INFO - 'tabpaint']}, 23:47:40 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 23:47:40 INFO - 'tests': ['tsvgx', 23:47:40 INFO - 'tsvgr_opacity', 23:47:40 INFO - 'tart', 23:47:40 INFO - 'tscrollx', 23:47:40 INFO - 'cart', 23:47:40 INFO - 'tsvg_static']}, 23:47:40 INFO - 'svgr-e10s': {'tests': ['tsvgx', 23:47:40 INFO - 'tsvgr_opacity', 23:47:40 INFO - 'tart', 23:47:40 INFO - 'tscrollx', 23:47:40 INFO - 'cart', 23:47:40 INFO - 'tsvg_static']}, 23:47:40 INFO - 'tp5o': {'pagesets_name': 'tp5n.zip', 23:47:40 INFO - 'talos_options': ['--disable-e10s'], 23:47:40 INFO - 'tests': ['tp5o']}, 23:47:40 INFO - 'tp5o-e10s': {'pagesets_name': 'tp5n.zip', 'tests': ['tp5o']}, 23:47:40 INFO - 'xperf': {'pagesets_name': 'tp5n.zip', 23:47:40 INFO - 'talos_options': ['--disable-e10s', 23:47:40 INFO - '--xperf_path', 23:47:40 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 23:47:40 INFO - 'tests': ['tp5n']}, 23:47:40 INFO - 'xperf-e10s': {'pagesets_name': 'tp5n.zip', 23:47:40 INFO - 'talos_options': ['--xperf_path', 23:47:40 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 23:47:40 INFO - 'tests': ['tp5n']}}, 23:47:40 INFO - 'talos.zip': {'path': '', 23:47:40 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 23:47:40 INFO - Running post-action listener: _resource_record_post_action 23:47:40 INFO - [mozharness: 2017-02-08 07:47:40.023320Z] Finished populate-webroot step (success) 23:47:40 INFO - [mozharness: 2017-02-08 07:47:40.023411Z] Running create-virtualenv step. 23:47:40 INFO - Running pre-action listener: _resource_record_pre_action 23:47:40 INFO - Running main action method: create_virtualenv 23:47:40 INFO - Creating virtualenv /builds/slave/test/build/venv 23:47:40 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 23:47:40 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 23:47:40 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 23:47:40 INFO - Using real prefix '/usr' 23:47:40 INFO - New python executable in /builds/slave/test/build/venv/bin/python 23:47:40 INFO - Installing distribute.............................................................................................................................................................................................done. 23:47:42 INFO - Installing pip.................done. 23:47:42 INFO - Return code: 0 23:47:42 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 23:47:42 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 23:47:42 INFO - Reading from file tmpfile_stdout 23:47:42 INFO - Output received: 23:47:42 INFO - pip 1.5.5 from /builds/slave/test/build/venv/local/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg (python 2.7) 23:47:42 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 23:47:42 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 23:47:42 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:47:42 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:47:42 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 23:47:42 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:47:42 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:47:42 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x18a91f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a76a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1c1b980>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c18d00>, '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 0x1c19a00>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1c19eb0>, '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': '62c568580acbfdaac3eec7be000001dc-1486540043.589840-737819103', '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 23:47:42 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 23:47:42 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 23:47:42 INFO - Using env: {'DISPLAY': ':0', 23:47:42 INFO - 'HOME': '/home/cltbld', 23:47:42 INFO - 'LANG': 'en_US.UTF-8', 23:47:42 INFO - 'LANGUAGE': 'en_US:en', 23:47:42 INFO - 'LOGNAME': 'cltbld', 23:47:42 INFO - 'MAIL': '/var/mail/cltbld', 23:47:42 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:47:42 INFO - 'MOZ_NO_REMOTE': '1', 23:47:42 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:47:42 INFO - 'NO_EM_RESTART': '1', 23:47:42 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:47:42 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 23:47:42 INFO - 'PWD': '/builds/slave/test', 23:47:42 INFO - 'SHELL': '/bin/bash', 23:47:42 INFO - 'SHLVL': '1', 23:47:42 INFO - 'TERM': 'linux', 23:47:42 INFO - 'TMOUT': '86400', 23:47:42 INFO - 'USER': 'cltbld', 23:47:42 INFO - 'XDG_SESSION_COOKIE': '62c568580acbfdaac3eec7be000001dc-1486540043.589840-737819103', 23:47:42 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:47:42 INFO - '_': '/tools/buildbot/bin/python'} 23:47:43 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:47:43 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 23:47:43 INFO - Cleaning up... 23:47:43 INFO - Return code: 0 23:47:43 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 23:47:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 23:47:43 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:47:43 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:47:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 23:47:43 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:47:43 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:47:43 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x18a91f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a76a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1c1b980>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c18d00>, '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 0x1c19a00>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1c19eb0>, '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': '62c568580acbfdaac3eec7be000001dc-1486540043.589840-737819103', '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 23:47:43 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 23:47:43 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 23:47:43 INFO - Using env: {'DISPLAY': ':0', 23:47:43 INFO - 'HOME': '/home/cltbld', 23:47:43 INFO - 'LANG': 'en_US.UTF-8', 23:47:43 INFO - 'LANGUAGE': 'en_US:en', 23:47:43 INFO - 'LOGNAME': 'cltbld', 23:47:43 INFO - 'MAIL': '/var/mail/cltbld', 23:47:43 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:47:43 INFO - 'MOZ_NO_REMOTE': '1', 23:47:43 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:47:43 INFO - 'NO_EM_RESTART': '1', 23:47:43 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:47:43 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 23:47:43 INFO - 'PWD': '/builds/slave/test', 23:47:43 INFO - 'SHELL': '/bin/bash', 23:47:43 INFO - 'SHLVL': '1', 23:47:43 INFO - 'TERM': 'linux', 23:47:43 INFO - 'TMOUT': '86400', 23:47:43 INFO - 'USER': 'cltbld', 23:47:43 INFO - 'XDG_SESSION_COOKIE': '62c568580acbfdaac3eec7be000001dc-1486540043.589840-737819103', 23:47:43 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:47:43 INFO - '_': '/tools/buildbot/bin/python'} 23:47:43 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:47:43 INFO - Downloading/unpacking psutil>=3.1.1 23:47: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 23:47: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 23:47:43 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:47:43 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:47: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 23:47: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 23:47:45 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 23:47:45 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 23:47:45 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 23:47:45 INFO - Installing collected packages: psutil 23:47:45 INFO - Running setup.py install for psutil 23:47:45 INFO - building 'psutil._psutil_linux' extension 23:47:45 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 23:47:45 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 23:47:45 INFO - building 'psutil._psutil_posix' extension 23:47:45 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 23:47:45 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 23:47:45 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 23:47:45 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 23:47:45 INFO - Successfully installed psutil 23:47:45 INFO - Cleaning up... 23:47:45 INFO - Return code: 0 23:47:45 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 23:47:45 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 23:47:45 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:47:45 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:47:45 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 23:47:45 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:47:45 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:47:45 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x18a91f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a76a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1c1b980>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c18d00>, '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 0x1c19a00>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1c19eb0>, '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': '62c568580acbfdaac3eec7be000001dc-1486540043.589840-737819103', '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 23:47:45 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 23:47:45 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.3 23:47:45 INFO - Using env: {'DISPLAY': ':0', 23:47:45 INFO - 'HOME': '/home/cltbld', 23:47:45 INFO - 'LANG': 'en_US.UTF-8', 23:47:45 INFO - 'LANGUAGE': 'en_US:en', 23:47:45 INFO - 'LOGNAME': 'cltbld', 23:47:45 INFO - 'MAIL': '/var/mail/cltbld', 23:47:45 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:47:45 INFO - 'MOZ_NO_REMOTE': '1', 23:47:45 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:47:45 INFO - 'NO_EM_RESTART': '1', 23:47:45 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:47:45 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 23:47:45 INFO - 'PWD': '/builds/slave/test', 23:47:45 INFO - 'SHELL': '/bin/bash', 23:47:45 INFO - 'SHLVL': '1', 23:47:45 INFO - 'TERM': 'linux', 23:47:45 INFO - 'TMOUT': '86400', 23:47:45 INFO - 'USER': 'cltbld', 23:47:45 INFO - 'XDG_SESSION_COOKIE': '62c568580acbfdaac3eec7be000001dc-1486540043.589840-737819103', 23:47:45 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:47:45 INFO - '_': '/tools/buildbot/bin/python'} 23:47:46 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:47:46 INFO - Downloading/unpacking mozsystemmonitor==0.3 23:47:46 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 23:47:46 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 23:47:46 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:47:46 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:47:46 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 23:47:46 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 23:47:48 INFO - Downloading mozsystemmonitor-0.3.tar.gz 23:47:48 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 23:47:48 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 23:47:48 INFO - Installing collected packages: mozsystemmonitor 23:47:48 INFO - Running setup.py install for mozsystemmonitor 23:47:48 INFO - Successfully installed mozsystemmonitor 23:47:48 INFO - Cleaning up... 23:47:48 INFO - Return code: 0 23:47:48 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 23:47:48 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 23:47:48 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:47:48 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:47:48 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 23:47:48 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:47:48 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:47:48 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x18a91f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a76a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1c1b980>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c18d00>, '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 0x1c19a00>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1c19eb0>, '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': '62c568580acbfdaac3eec7be000001dc-1486540043.589840-737819103', '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 23:47:48 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 23:47:48 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema==2.5.1 23:47:48 INFO - Using env: {'DISPLAY': ':0', 23:47:48 INFO - 'HOME': '/home/cltbld', 23:47:48 INFO - 'LANG': 'en_US.UTF-8', 23:47:48 INFO - 'LANGUAGE': 'en_US:en', 23:47:48 INFO - 'LOGNAME': 'cltbld', 23:47:48 INFO - 'MAIL': '/var/mail/cltbld', 23:47:48 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:47:48 INFO - 'MOZ_NO_REMOTE': '1', 23:47:48 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:47:48 INFO - 'NO_EM_RESTART': '1', 23:47:48 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:47:48 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 23:47:48 INFO - 'PWD': '/builds/slave/test', 23:47:48 INFO - 'SHELL': '/bin/bash', 23:47:48 INFO - 'SHLVL': '1', 23:47:48 INFO - 'TERM': 'linux', 23:47:48 INFO - 'TMOUT': '86400', 23:47:48 INFO - 'USER': 'cltbld', 23:47:48 INFO - 'XDG_SESSION_COOKIE': '62c568580acbfdaac3eec7be000001dc-1486540043.589840-737819103', 23:47:48 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:47:48 INFO - '_': '/tools/buildbot/bin/python'} 23:47:48 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:47:48 INFO - Downloading/unpacking jsonschema==2.5.1 23:47:48 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 23:47:48 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 23:47:48 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:47:48 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:47:48 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 23:47:48 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 23:47:50 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 23:47:50 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 23:47:50 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 23:47:50 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 23:47:50 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:47:50 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:47:50 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 23:47:50 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 23:47:50 INFO - Downloading functools32-3.2.3-2.tar.gz 23:47:50 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 23:47:50 INFO - warning: no files found matching '*.txt' 23:47:50 INFO - no previously-included directories found matching 'build' 23:47:50 INFO - no previously-included directories found matching 'dist' 23:47:50 INFO - no previously-included directories found matching '.git*' 23:47:50 INFO - Installing collected packages: jsonschema, functools32 23:47:50 INFO - Running setup.py install for functools32 23:47:50 INFO - warning: no files found matching '*.txt' 23:47:50 INFO - no previously-included directories found matching 'build' 23:47:50 INFO - no previously-included directories found matching 'dist' 23:47:50 INFO - no previously-included directories found matching '.git*' 23:47:50 INFO - Successfully installed jsonschema functools32 23:47:50 INFO - Cleaning up... 23:47:51 INFO - Return code: 0 23:47:51 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 23:47:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 23:47:51 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:47:51 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:47:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 23:47:51 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:47:51 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:47:51 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x18a91f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a76a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1c1b980>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c18d00>, '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 0x1c19a00>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1c19eb0>, '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': '62c568580acbfdaac3eec7be000001dc-1486540043.589840-737819103', '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 23:47:51 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 23:47:51 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub functools32==3.2.3-2 23:47:51 INFO - Using env: {'DISPLAY': ':0', 23:47:51 INFO - 'HOME': '/home/cltbld', 23:47:51 INFO - 'LANG': 'en_US.UTF-8', 23:47:51 INFO - 'LANGUAGE': 'en_US:en', 23:47:51 INFO - 'LOGNAME': 'cltbld', 23:47:51 INFO - 'MAIL': '/var/mail/cltbld', 23:47:51 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:47:51 INFO - 'MOZ_NO_REMOTE': '1', 23:47:51 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:47:51 INFO - 'NO_EM_RESTART': '1', 23:47:51 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:47:51 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 23:47:51 INFO - 'PWD': '/builds/slave/test', 23:47:51 INFO - 'SHELL': '/bin/bash', 23:47:51 INFO - 'SHLVL': '1', 23:47:51 INFO - 'TERM': 'linux', 23:47:51 INFO - 'TMOUT': '86400', 23:47:51 INFO - 'USER': 'cltbld', 23:47:51 INFO - 'XDG_SESSION_COOKIE': '62c568580acbfdaac3eec7be000001dc-1486540043.589840-737819103', 23:47:51 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:47:51 INFO - '_': '/tools/buildbot/bin/python'} 23:47:51 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:47:51 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 23:47:51 INFO - Cleaning up... 23:47:51 INFO - Return code: 0 23:47:51 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 23:47:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 23:47:51 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:47:51 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:47:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 23:47:51 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:47:51 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:47:51 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x18a91f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a76a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1c1b980>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c18d00>, '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 0x1c19a00>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1c19eb0>, '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': '62c568580acbfdaac3eec7be000001dc-1486540043.589840-737819103', '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 23:47:51 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 23:47:51 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 23:47:51 INFO - Using env: {'DISPLAY': ':0', 23:47:51 INFO - 'HOME': '/home/cltbld', 23:47:51 INFO - 'LANG': 'en_US.UTF-8', 23:47:51 INFO - 'LANGUAGE': 'en_US:en', 23:47:51 INFO - 'LOGNAME': 'cltbld', 23:47:51 INFO - 'MAIL': '/var/mail/cltbld', 23:47:51 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:47:51 INFO - 'MOZ_NO_REMOTE': '1', 23:47:51 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:47:51 INFO - 'NO_EM_RESTART': '1', 23:47:51 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:47:51 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 23:47:51 INFO - 'PWD': '/builds/slave/test', 23:47:51 INFO - 'SHELL': '/bin/bash', 23:47:51 INFO - 'SHLVL': '1', 23:47:51 INFO - 'TERM': 'linux', 23:47:51 INFO - 'TMOUT': '86400', 23:47:51 INFO - 'USER': 'cltbld', 23:47:51 INFO - 'XDG_SESSION_COOKIE': '62c568580acbfdaac3eec7be000001dc-1486540043.589840-737819103', 23:47:51 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:47:51 INFO - '_': '/tools/buildbot/bin/python'} 23:47:51 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:47:51 INFO - Downloading/unpacking blobuploader==1.2.4 23:47:51 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 23:47:51 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 23:47:51 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:47:51 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:47:51 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 23:47:51 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 23:47:53 INFO - Downloading blobuploader-1.2.4.tar.gz 23:47:53 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 23:47:53 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 23:47:53 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 23:47:53 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 23:47:53 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:47:53 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:47:53 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 23:47:53 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 23:47:53 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 23:47:53 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 23:47:53 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 23:47:53 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 23:47:53 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:47:53 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:47:53 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 23:47:53 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 23:47:54 INFO - Downloading docopt-0.6.1.tar.gz 23:47:54 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 23:47:54 INFO - Installing collected packages: blobuploader, requests, docopt 23:47:54 INFO - Running setup.py install for blobuploader 23:47:54 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 23:47:54 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 23:47:54 INFO - Running setup.py install for requests 23:47:54 INFO - Running setup.py install for docopt 23:47:54 INFO - Successfully installed blobuploader requests docopt 23:47:54 INFO - Cleaning up... 23:47:54 INFO - Return code: 0 23:47:54 INFO - Installing None into virtualenv /builds/slave/test/build/venv 23:47:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 23:47:54 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:47:54 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:47:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 23:47:54 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:47:54 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:47:54 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x18a91f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a76a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1c1b980>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c18d00>, '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 0x1c19a00>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1c19eb0>, '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': '62c568580acbfdaac3eec7be000001dc-1486540043.589840-737819103', '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 23:47:54 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 23:47:54 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.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 23:47:54 INFO - Using env: {'DISPLAY': ':0', 23:47:54 INFO - 'HOME': '/home/cltbld', 23:47:54 INFO - 'LANG': 'en_US.UTF-8', 23:47:54 INFO - 'LANGUAGE': 'en_US:en', 23:47:54 INFO - 'LOGNAME': 'cltbld', 23:47:54 INFO - 'MAIL': '/var/mail/cltbld', 23:47:54 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:47:54 INFO - 'MOZ_NO_REMOTE': '1', 23:47:54 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:47:54 INFO - 'NO_EM_RESTART': '1', 23:47:54 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:47:54 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 23:47:54 INFO - 'PWD': '/builds/slave/test', 23:47:54 INFO - 'SHELL': '/bin/bash', 23:47:54 INFO - 'SHLVL': '1', 23:47:54 INFO - 'TERM': 'linux', 23:47:54 INFO - 'TMOUT': '86400', 23:47:54 INFO - 'USER': 'cltbld', 23:47:54 INFO - 'XDG_SESSION_COOKIE': '62c568580acbfdaac3eec7be000001dc-1486540043.589840-737819103', 23:47:54 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:47:54 INFO - '_': '/tools/buildbot/bin/python'} 23:47:55 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:47:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 23:47:55 INFO - Running setup.py (path:/tmp/pip-mxpWK1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 23:47:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 23:47:55 INFO - Running setup.py (path:/tmp/pip-iunvyJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 23:47:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 23:47:55 INFO - Running setup.py (path:/tmp/pip-8nB1hC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 23:47:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 23:47:55 INFO - Running setup.py (path:/tmp/pip-8Z7SAp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 23:47:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 23:47:55 INFO - Running setup.py (path:/tmp/pip-_rqMYB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 23:47:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 23:47:55 INFO - Running setup.py (path:/tmp/pip-PI59Of-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 23:47:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 23:47:55 INFO - Running setup.py (path:/tmp/pip-D34zZa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 23:47:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 23:47:55 INFO - Running setup.py (path:/tmp/pip-RETVy9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 23:47:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 23:47:55 INFO - Running setup.py (path:/tmp/pip-5x04j7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 23:47:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 23:47:55 INFO - Running setup.py (path:/tmp/pip-jD1iAt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 23:47:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 23:47:55 INFO - Running setup.py (path:/tmp/pip-MItLhx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 23:47:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 23:47:55 INFO - Running setup.py (path:/tmp/pip-BbnBHR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 23:47:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 23:47:55 INFO - Running setup.py (path:/tmp/pip-YMbMPj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 23:47:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 23:47:56 INFO - Running setup.py (path:/tmp/pip-eozyNX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 23:47:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 23:47:56 INFO - Running setup.py (path:/tmp/pip-LHckoo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 23:47:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 23:47:56 INFO - Running setup.py (path:/tmp/pip-rtnQRa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 23:47:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 23:47:56 INFO - Running setup.py (path:/tmp/pip-TGefsp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 23:47:56 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 23:47:56 INFO - Running setup.py install for manifestparser 23:47:56 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 23:47:56 INFO - Running setup.py install for mozcrash 23:47:56 INFO - Running setup.py install for mozdebug 23:47:56 INFO - Running setup.py install for mozdevice 23:47:56 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 23:47:56 INFO - Installing dm script to /builds/slave/test/build/venv/bin 23:47:56 INFO - Running setup.py install for mozfile 23:47:56 INFO - Running setup.py install for mozhttpd 23:47:56 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 23:47:56 INFO - Running setup.py install for mozinfo 23:47:57 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 23:47:57 INFO - Running setup.py install for mozInstall 23:47:57 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 23:47:57 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 23:47:57 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 23:47:57 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 23:47:57 INFO - Running setup.py install for mozleak 23:47:57 INFO - Running setup.py install for mozlog 23:47:57 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 23:47:57 INFO - Running setup.py install for moznetwork 23:47:57 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 23:47:57 INFO - Running setup.py install for mozprocess 23:47:57 INFO - Running setup.py install for mozprofile 23:47:57 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 23:47:57 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 23:47:57 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 23:47:57 INFO - Running setup.py install for mozrunner 23:47:57 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 23:47:57 INFO - Running setup.py install for mozscreenshot 23:47:57 INFO - Running setup.py install for moztest 23:47:58 INFO - Running setup.py install for mozversion 23:47:58 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 23:47:58 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 23:47:58 INFO - Cleaning up... 23:47:58 INFO - Return code: 0 23:47:58 INFO - Installing None into virtualenv /builds/slave/test/build/venv 23:47:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 23:47:58 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:47:58 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:47:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 23:47:58 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:47:58 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:47:58 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x18a91f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a76a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1c1b980>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c18d00>, '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 0x1c19a00>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1c19eb0>, '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': '62c568580acbfdaac3eec7be000001dc-1486540043.589840-737819103', '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 23:47:58 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 23:47:58 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.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 23:47:58 INFO - Using env: {'DISPLAY': ':0', 23:47:58 INFO - 'HOME': '/home/cltbld', 23:47:58 INFO - 'LANG': 'en_US.UTF-8', 23:47:58 INFO - 'LANGUAGE': 'en_US:en', 23:47:58 INFO - 'LOGNAME': 'cltbld', 23:47:58 INFO - 'MAIL': '/var/mail/cltbld', 23:47:58 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:47:58 INFO - 'MOZ_NO_REMOTE': '1', 23:47:58 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:47:58 INFO - 'NO_EM_RESTART': '1', 23:47:58 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:47:58 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 23:47:58 INFO - 'PWD': '/builds/slave/test', 23:47:58 INFO - 'SHELL': '/bin/bash', 23:47:58 INFO - 'SHLVL': '1', 23:47:58 INFO - 'TERM': 'linux', 23:47:58 INFO - 'TMOUT': '86400', 23:47:58 INFO - 'USER': 'cltbld', 23:47:58 INFO - 'XDG_SESSION_COOKIE': '62c568580acbfdaac3eec7be000001dc-1486540043.589840-737819103', 23:47:58 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:47:58 INFO - '_': '/tools/buildbot/bin/python'} 23:47:58 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:47:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 23:47:58 INFO - Running setup.py (path:/tmp/pip-jvtbPh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 23:47:58 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)) 23:47:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 23:47:58 INFO - Running setup.py (path:/tmp/pip-n7Tf9l-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 23:47:58 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)) 23:47:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 23:47:58 INFO - Running setup.py (path:/tmp/pip-S74bw9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 23:47:58 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)) 23:47:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 23:47:58 INFO - Running setup.py (path:/tmp/pip-X_Trwo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 23:47:58 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.49 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)) 23:47:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 23:47:58 INFO - Running setup.py (path:/tmp/pip-6GhEvO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 23:47:58 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)) 23:47:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 23:47:58 INFO - Running setup.py (path:/tmp/pip-1SDI1j-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 23:47:58 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)) 23:47:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 23:47:58 INFO - Running setup.py (path:/tmp/pip-bS39V7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 23:47:58 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.9 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)) 23:47:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 23:47:58 INFO - Running setup.py (path:/tmp/pip-hiNxZd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 23:47:58 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.12 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)) 23:47:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 23:47:58 INFO - Running setup.py (path:/tmp/pip-rP2KJf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 23:47:58 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)) 23:47:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 23:47:59 INFO - Running setup.py (path:/tmp/pip-dODWov-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 23:47:59 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.4 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)) 23:47:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 23:47:59 INFO - Running setup.py (path:/tmp/pip-L_Qfmm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 23:47:59 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)) 23:47:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 23:47:59 INFO - Running setup.py (path:/tmp/pip-bkppTw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 23:47:59 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.24 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)) 23:47:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 23:47:59 INFO - Running setup.py (path:/tmp/pip-RuFdbe-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 23:47:59 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)) 23:47:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 23:47:59 INFO - Running setup.py (path:/tmp/pip-1CslPV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 23:47:59 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)) 23:47:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 23:47:59 INFO - Running setup.py (path:/tmp/pip-5D_tul-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 23:47:59 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)) 23:47:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 23:47:59 INFO - Running setup.py (path:/tmp/pip-XZjhS4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 23:47:59 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)) 23:47:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 23:47:59 INFO - Running setup.py (path:/tmp/pip-nDXmvO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 23:47:59 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)) 23:47:59 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)) 23:47:59 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)) 23:47:59 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)) 23:47:59 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.49->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 23:47:59 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.49->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 23:47:59 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 23:47:59 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 23:47:59 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 23:47:59 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:47:59 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:47:59 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 23:47:59 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 23:48:01 INFO - Downloading blessings-1.6.tar.gz 23:48:01 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 23:48:01 INFO - Installing collected packages: blessings 23:48:01 INFO - Running setup.py install for blessings 23:48:01 INFO - Successfully installed blessings 23:48:01 INFO - Cleaning up... 23:48:01 INFO - Return code: 0 23:48:01 INFO - Done creating virtualenv /builds/slave/test/build/venv. 23:48:01 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 23:48:01 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 23:48:02 INFO - Reading from file tmpfile_stdout 23:48:02 INFO - Current package versions: 23:48:02 INFO - argparse == 1.2.1 23:48:02 INFO - blessings == 1.6 23:48:02 INFO - blobuploader == 1.2.4 23:48:02 INFO - docopt == 0.6.1 23:48:02 INFO - functools32 == 3.2.3-2 23:48:02 INFO - jsonschema == 2.5.1 23:48:02 INFO - manifestparser == 1.1 23:48:02 INFO - mozInstall == 1.12 23:48:02 INFO - mozcrash == 1.0 23:48:02 INFO - mozdebug == 0.1 23:48:02 INFO - mozdevice == 0.49 23:48:02 INFO - mozfile == 1.2 23:48:02 INFO - mozhttpd == 0.7 23:48:02 INFO - mozinfo == 0.9 23:48:02 INFO - mozleak == 0.1 23:48:02 INFO - mozlog == 3.4 23:48:02 INFO - moznetwork == 0.27 23:48:02 INFO - mozprocess == 0.24 23:48:02 INFO - mozprofile == 0.28 23:48:02 INFO - mozrunner == 6.13 23:48:02 INFO - mozscreenshot == 0.1 23:48:02 INFO - mozsystemmonitor == 0.3 23:48:02 INFO - moztest == 0.8 23:48:02 INFO - mozversion == 1.4 23:48:02 INFO - psutil == 3.1.1 23:48:02 INFO - requests == 1.2.3 23:48:02 INFO - wsgiref == 0.1.2 23:48:02 INFO - Installing None into virtualenv /builds/slave/test/build/venv 23:48:02 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 23:48:02 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:48:02 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:48:02 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 23:48:02 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:48:02 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:48:02 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x18a91f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a76a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1c1b980>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c18d00>, '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 0x1c19a00>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1c19eb0>, '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': '62c568580acbfdaac3eec7be000001dc-1486540043.589840-737819103', '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 23:48:02 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 23:48:02 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.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 23:48:02 INFO - Using env: {'DISPLAY': ':0', 23:48:02 INFO - 'HOME': '/home/cltbld', 23:48:02 INFO - 'LANG': 'en_US.UTF-8', 23:48:02 INFO - 'LANGUAGE': 'en_US:en', 23:48:02 INFO - 'LOGNAME': 'cltbld', 23:48:02 INFO - 'MAIL': '/var/mail/cltbld', 23:48:02 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:48:02 INFO - 'MOZ_NO_REMOTE': '1', 23:48:02 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:48:02 INFO - 'NO_EM_RESTART': '1', 23:48:02 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:48:02 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 23:48:02 INFO - 'PWD': '/builds/slave/test', 23:48:02 INFO - 'SHELL': '/bin/bash', 23:48:02 INFO - 'SHLVL': '1', 23:48:02 INFO - 'TERM': 'linux', 23:48:02 INFO - 'TMOUT': '86400', 23:48:02 INFO - 'USER': 'cltbld', 23:48:02 INFO - 'XDG_SESSION_COOKIE': '62c568580acbfdaac3eec7be000001dc-1486540043.589840-737819103', 23:48:02 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:48:02 INFO - '_': '/tools/buildbot/bin/python'} 23:48:02 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:48:02 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)) 23:48:02 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)) 23:48:02 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)) 23:48:02 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)) 23:48:02 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)) 23:48:02 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)) 23:48:02 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)) 23:48:02 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)) 23:48:02 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)) 23:48:02 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)) 23:48:02 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)) 23:48:02 INFO - Cleaning up... 23:48:02 INFO - Return code: 0 23:48:02 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 23:48:02 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 23:48:02 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:48:02 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:48:02 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 23:48:02 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:48:02 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:48:02 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x18a91f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a76a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1c1b980>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c18d00>, '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 0x1c19a00>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1c19eb0>, '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': '62c568580acbfdaac3eec7be000001dc-1486540043.589840-737819103', '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 23:48:02 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 23:48:02 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 23:48:02 INFO - Using env: {'DISPLAY': ':0', 23:48:02 INFO - 'HOME': '/home/cltbld', 23:48:02 INFO - 'LANG': 'en_US.UTF-8', 23:48:02 INFO - 'LANGUAGE': 'en_US:en', 23:48:02 INFO - 'LOGNAME': 'cltbld', 23:48:02 INFO - 'MAIL': '/var/mail/cltbld', 23:48:02 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:48:02 INFO - 'MOZ_NO_REMOTE': '1', 23:48:02 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:48:02 INFO - 'NO_EM_RESTART': '1', 23:48:02 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:48:02 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 23:48:02 INFO - 'PWD': '/builds/slave/test', 23:48:02 INFO - 'SHELL': '/bin/bash', 23:48:02 INFO - 'SHLVL': '1', 23:48:02 INFO - 'TERM': 'linux', 23:48:02 INFO - 'TMOUT': '86400', 23:48:02 INFO - 'USER': 'cltbld', 23:48:02 INFO - 'XDG_SESSION_COOKIE': '62c568580acbfdaac3eec7be000001dc-1486540043.589840-737819103', 23:48:02 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:48:02 INFO - '_': '/tools/buildbot/bin/python'} 23:48:02 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:48:02 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 23:48:02 INFO - Cleaning up... 23:48:02 INFO - Return code: 0 23:48:02 INFO - Running post-action listener: _resource_record_post_action 23:48:02 INFO - Running post-action listener: _start_resource_monitoring 23:48:02 INFO - Starting resource monitoring. 23:48:02 INFO - [mozharness: 2017-02-08 07:48:02.594338Z] Finished create-virtualenv step (success) 23:48:02 INFO - [mozharness: 2017-02-08 07:48:02.594785Z] Running install step. 23:48:02 INFO - Running pre-action listener: _resource_record_pre_action 23:48:02 INFO - Running main action method: install 23:48:02 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 23:48:02 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 23:48:02 INFO - Reading from file tmpfile_stdout 23:48:02 INFO - Detecting whether we're running mozinstall >=1.0... 23:48:02 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 23:48:02 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 23:48:02 INFO - Reading from file tmpfile_stdout 23:48:02 INFO - Output received: 23:48:02 INFO - Usage: mozinstall [options] installer 23:48:02 INFO - Options: 23:48:02 INFO - -h, --help show this help message and exit 23:48:02 INFO - -d DEST, --destination=DEST 23:48:02 INFO - Directory to install application into. [default: 23:48:02 INFO - "/builds/slave/test"] 23:48:02 INFO - --app=APP Application being installed. [default: firefox] 23:48:02 INFO - mkdir: /builds/slave/test/build/application 23:48:02 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'] 23:48:02 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/target.tar.bz2 --destination /builds/slave/test/build/application 23:48:19 INFO - Reading from file tmpfile_stdout 23:48:19 INFO - Output received: 23:48:19 INFO - /builds/slave/test/build/application/firefox/firefox 23:48:19 INFO - Running post-action listener: _resource_record_post_action 23:48:19 INFO - [mozharness: 2017-02-08 07:48:19.402759Z] Finished install step (success) 23:48:19 INFO - [mozharness: 2017-02-08 07:48:19.403030Z] Running run-tests step. 23:48:19 INFO - Running pre-action listener: _resource_record_pre_action 23:48:19 INFO - Running main action method: run_tests 23:48:19 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 23:48:19 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 23:48:19 INFO - Python 2.7.3 23:48:19 INFO - Return code: 0 23:48:19 INFO - grabbing minidump binary from tooltool 23:48:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 23:48:19 INFO - retry: Calling run_command with args: (['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--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 0x1c18d00>, '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 0x1c19a00>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1c19eb0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 23:48:19 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--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 23:48:19 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest -o -c /builds/tooltool_cache 23:48:19 INFO - Calling ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--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 23:48:19 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 23:48:19 INFO - Return code: 0 23:48:19 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 23:48:19 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 23:48:19 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 23:48:19 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 23:48:19 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 23:48:19 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Aurora-Non-PGO', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/FXxDmAlYRxWRkiMnCupXTw/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-018', '--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 23:48:19 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Mozilla-Aurora-Non-PGO --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/FXxDmAlYRxWRkiMnCupXTw/artifacts/public/build/target.crashreporter-symbols.zip --title talos-linux64-ix-018 --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 23:48:19 INFO - Using env: {'DISPLAY': ':0', 23:48:19 INFO - 'HOME': '/home/cltbld', 23:48:19 INFO - 'LANG': 'en_US.UTF-8', 23:48:19 INFO - 'LANGUAGE': 'en_US:en', 23:48:19 INFO - 'LOGNAME': 'cltbld', 23:48:19 INFO - 'MAIL': '/var/mail/cltbld', 23:48:19 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 23:48:19 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 23:48:19 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:48:19 INFO - 'MOZ_NO_REMOTE': '1', 23:48:19 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 23:48:19 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:48:19 INFO - 'NO_EM_RESTART': '1', 23:48:19 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:48:19 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 23:48:19 INFO - 'PWD': '/builds/slave/test', 23:48:19 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 23:48:19 INFO - 'SHELL': '/bin/bash', 23:48:19 INFO - 'SHLVL': '1', 23:48:19 INFO - 'TERM': 'linux', 23:48:19 INFO - 'TMOUT': '86400', 23:48:19 INFO - 'USER': 'cltbld', 23:48:19 INFO - 'XDG_SESSION_COOKIE': '62c568580acbfdaac3eec7be000001dc-1486540043.589840-737819103', 23:48:19 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:48:19 INFO - '_': '/tools/buildbot/bin/python'} 23:48:19 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Aurora-Non-PGO', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/FXxDmAlYRxWRkiMnCupXTw/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-018', '--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 23:48:19 INFO - mozversion application_buildid: 20170208065056 23:48:19 INFO - mozversion application_changeset: 82c75fd3a2de796351296592c459ab4aa4cd0baf 23:48:19 INFO - mozversion application_display_name: FirefoxDeveloperEdition 23:48:19 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 23:48:19 INFO - mozversion application_name: Firefox 23:48:19 INFO - mozversion application_remotingname: firefox-dev 23:48:19 INFO - mozversion application_repository: https://hg.mozilla.org/releases/mozilla-aurora 23:48:19 INFO - mozversion application_vendor: Mozilla 23:48:19 INFO - mozversion application_version: 53.0a2 23:48:19 INFO - mozversion platform_buildid: 20170208065056 23:48:19 INFO - mozversion platform_changeset: 82c75fd3a2de796351296592c459ab4aa4cd0baf 23:48:19 INFO - mozversion platform_repository: https://hg.mozilla.org/releases/mozilla-aurora 23:48:19 INFO - mozversion platform_version: 53.0a2 23:48:19 INFO - using testdate: 1486540099 23:48:19 INFO - actual date: 1486540099 23:48:19 INFO - starting webserver on 'localhost:48451' 23:48:19 INFO - SUITE-START | Running 2 tests 23:48:19 INFO - TEST-START | dromaeo_css 23:48:19 INFO - operating with platform_type : linux_ 23:48:19 INFO - Initialising browser for dromaeo_css test... 23:48:19 INFO - TEST-INFO | started process 12497 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpsPlE3a/profile http://localhost:48451/getInfo.html) 23:48:24 INFO - PROCESS | 12497 | __metrics Screen width/height:1600/1200 23:48:24 INFO - PROCESS | 12497 | colorDepth:24 23:48:24 INFO - PROCESS | 12497 | Browser inner width/height: 1024/697 23:48:24 INFO - PROCESS | 12497 | __metrics 23:48:24 INFO - PROCESS | 12497 | 1486540104346 addons.xpi WARN Exception running bootstrap method shutdown on shield-recipe-client@mozilla.org: ReferenceError: LogManager is not defined (resource://gre/modules/addons/XPIProvider.jsm -> jar:file:///builds/slave/test/build/application/firefox/browser/features/shield-recipe-client@mozilla.org.xpi!/bootstrap.js:65:3) JS Stack trace: this.shutdown@resource://gre/modules/addons/XPIProvider.jsm -> jar:file:///builds/slave/test/build/application/firefox/browser/features/shield-recipe-client@bootstrap.js:65:3 < callBootstrapMethod@XPIProvider.jsm:4903:11 < observe@XPIProvider.jsm:2884:15 < permitUnload@remote-browser.xml:353:13 < CanCloseWindow@browser.js:6277:36 < canClose@browser.js:5143:12 < forceQuit@jar:file:///tmp/tmpsPlE3a/profile/extensions/talos-powers@TalosPowersService.js:238:7 < whenDone@jar:file:///tmp/tmpsPlE3a/profile/extensions/talos-powers@TalosPowersService.js:223:9 < promise callback*forceQuit@jar:file:///tmp/tmpsPlE3a/profile/extensions/talos-powers@TalosPowersService.js:225:7 < receiveMessage@jar:file:///tmp/tmpsPlE3a/profile/extensions/talos-powers@TalosPowersService.js:55:9 23:48:24 ERROR - PROCESS | 12497 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 3280: TypeError: this.tabs is undefined 23:48:25 INFO - TEST-INFO | 12497: exit 0 23:48:25 INFO - Browser initialized. 23:48:25 INFO - Running cycle 1/1 for dromaeo_css test... 23:48:25 INFO - TEST-INFO | started process 12628 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpsPlE3a/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 23:48:37 INFO - PROCESS | 12628 | RSS: Main: 144629760 23:48:37 INFO - PROCESS | 12628 | 23:51:35 INFO - PROCESS | 12628 | Cycle 1(1): loaded http://localhost:48451/tests/dromaeo/cssquery-dojo.html (next: http://localhost:48451/tests/dromaeo/cssquery-ext.html) 23:51:37 INFO - PROCESS | 12628 | RSS: Main: 154861568 23:51:37 INFO - PROCESS | 12628 | 23:53:25 INFO - PROCESS | 12628 | ************************* 23:53:25 INFO - PROCESS | 12628 | A coding exception was thrown and uncaught in a Task. 23:53:25 INFO - PROCESS | 12628 | 23:53:25 ERROR - PROCESS | 12628 | Full message: TypeError: NetworkError when attempting to fetch resource. 23:53:25 INFO - PROCESS | 12628 | Full stack: 23:53:25 INFO - PROCESS | 12628 | ************************* 23:54:39 INFO - PROCESS | 12628 | Cycle 1(1): loaded http://localhost:48451/tests/dromaeo/cssquery-ext.html (next: http://localhost:48451/tests/dromaeo/cssquery-jquery.html) 23:54:40 INFO - PROCESS | 12628 | RSS: Main: 149647360 23:54:40 INFO - PROCESS | 12628 | 23:57:41 INFO - PROCESS | 12628 | Cycle 1(1): loaded http://localhost:48451/tests/dromaeo/cssquery-jquery.html (next: http://localhost:48451/tests/dromaeo/cssquery-mootools.html) 23:57:42 INFO - PROCESS | 12628 | RSS: Main: 153534464 23:57:42 INFO - PROCESS | 12628 | 00:00:44 INFO - PROCESS | 12628 | Cycle 1(1): loaded http://localhost:48451/tests/dromaeo/cssquery-mootools.html (next: http://localhost:48451/tests/dromaeo/cssquery-prototype.html) 00:00:44 INFO - PROCESS | 12628 | RSS: Main: 152436736 00:00:44 INFO - PROCESS | 12628 | 00:03:47 INFO - PROCESS | 12628 | Cycle 1(1): loaded http://localhost:48451/tests/dromaeo/cssquery-prototype.html (next: http://localhost:48451/tests/dromaeo/cssquery-yui.html) 00:03:47 INFO - PROCESS | 12628 | RSS: Main: 155062272 00:03:47 INFO - PROCESS | 12628 | 00:06:50 INFO - PROCESS | 12628 | Cycle 1(1): loaded http://localhost:48451/tests/dromaeo/cssquery-yui.html (next: http://localhost:48451/tests/dromaeo/cssquery-dojo.html) 00:06:50 INFO - PROCESS | 12628 | RSS: Main: 152264704 00:06:50 INFO - PROCESS | 12628 | 00:06:50 INFO - PROCESS | 12628 | __start_tp_report 00:06:50 INFO - PROCESS | 12628 | _x_x_mozilla_page_load 00:06:50 INFO - PROCESS | 12628 | _x_x_mozilla_page_load_details 00:06:50 INFO - PROCESS | 12628 | |i|pagename|runs| 00:06:50 INFO - PROCESS | 12628 | |0;dojo.html;3324.7007769300767;3354.781939173955;3357.865685372586;3382.036119705884;3390.4575267957116;5446.264754258179;5514.09017512111;5518.724063796809;5532.44675532447;5536.197251398545;5484.095124304495;5523.696196709179;5558.666480011202;5561.77752889885;5584.274044374226;4930.876728081791;4969.676970996892;5031.899362012758;5034.748262586874;5080.237964305346;5034.949650503485;5048.192289233723;5075.619328550355;5088.465711100318;5095.847124586268;4888.095702295069;4898.093852637274;5084.669496482717;5088.1350170471105;5088.821891233789;4916.778744956468;4949.059678661043;4953.529414705597;4966.081274964125;5055.443901170905;4935.087008903364;4952.801887924478;4979.153543897546;4981.750912454399;4989.052080104769;5458.4541545845495;5468.316460442445;5526.861828454281;5544.1960915667405;5548.167774833767;5772.07646776518;5799.304083509964;5802.361740208574;5825.242718446575;5861.120831875252;5928.229330187091;5973;5980.611260268069;5984.581079324449;6016.75932962681;5566.638168519074;5571.637843540157;5573.916391254134;5574.303212098488;5575.581831362623;5822.184894114827;5851.093080572433;5868.413158684098;5886.676232807236;6015.428534289235;5690.658560486384;5742.368339482654;5754.4533269339345;5768.105943578752;5778.191053252548;5808.244928159313;5852.619579727304;5860.736266867916;5864.2083318752275;5874.265716785402;5768.913466298009;5815.854603634943;5819.563532735062;5842.766289348378;5850.707464626752;5892.970535147297;5932;5947.1376650385455;5967.283925928829;5982.790602328898;4584.3352713856975;4587.564181402761;4588.541145885385;4605.40129783126;4616.053708989649;3928.3910993796007;3944.230874979409;4107.466029416157;4108.794560271975;4114.0948991221885;5724.16999535065;5755.827325180251;5801.1878337032;5845.473907348274;5879.941200587939;5987.730552125165;6029;6043.244594425697;6047.365026672224;6047.576669633084;5613.7193140342815;5629.43705629442;5713.371529131792;5815.098659707752;5825.417458254141;5060.443351231362;5095.133827249377;5123.436421993652;5144.794208231704;5151.459096794858;6267.874642507124;6273.341299163522;6282;6282.4974002079725;6291.811245662546;5858.7070646466655;5910.497607703393;6015.368386319374;6018;6025.939740602713;6118.010103775157;6141.815745527641;6155.876882462236;6233.345498722751;6234.781782637586;5766.625169363978;5837.474627283565;5860.560457965585;5888.735006924784;5893.6463812171405;5767.942320576741;5833.183354330312;5903.852403689943;5956.97021514907;5976.103584462366;5728.369879313355;5747;5759.539236860957;5765.4522820332;5776.884462310814;5826.82519524415;5835.708214589338;5836.854078647898;5837.912431313619;5862.824115276549;5831.387704291158;5835.9708201458725;5839.5036421904615;5847.619904706181;5850.473457388855;5627.803026894039;5745.712714364348;5806.361300256884;5814.767409303749;5899.528037756883;5724.513416359656;5737.053386191232;5781.017227071492;5793.594448388572;5800.6809625471005 00:06:50 INFO - PROCESS | 12628 | |1;ext.html;559.4768891086834;603.1254680712966;627.2974268818923;698.2354322017393;698.5005720909548;44355.33466997997;45521.31718024228;48820;48848.2672759908;49202.507974920285;49258.50741492584;50357.244641330406;50379.74810125953;50406.495935040635;50456;9274.304427167956;10781.946090269537;11063.446827658585;11121.888781112206;11487.885121148807;11013.118950483982;11098.944505277503;11128;11128.554857805679;11142.108631309517;11266.380349080797;11314.094872410229;11340.943295283512;11343.716407089807;11356.545738170464;11166.609168679099;11210.327380357123;11218.99999999996;11227.101831853432;11259;11067.114630829514;11071.16966227536;11134.721631959266;11154.665360039131;11160.16298777595;41749.165016699495;42249;42395.788021060005;42463.57536424627;42490.57509424928;4446.888827779299;4470.687051906368;4529.977350113229;4613.21575332191;4630.560096790799;32393.6760632393;32502.83748581242;32886.506702399485;33077.503837442455;34022.14944626379;4642.53574642533;4707.529247075299;4727.621790256771;4743.407074115736;4771.71369717818;156388;157298;157336;157796.21101894416;158402;62359.6882015587;62691.05963410553;63128;63164;63495.04757428642;64911.35088649148;64918.67540662361;64930;65245;65363.67318163474;16796.496105116865;17027.65944681124;17210.82789172092;17238.569035773955;17375.218115184845;12970.416331265116;13034.478620855249;13088.607341779762;13088.738225235442;13129.934350328187;20090.69863952042;20259.392218233475;20376.898115509328;20533.178672853217;20709.68935465969;7378.704851805975;7666.769996900102;7677.30904218623;7684.308412242814;7814.101378341564;1002.7793885345212;1017.1913328903539;1017.3590637898077;1029.953652085658;1058.2169194795795;33641.66358336385;34778.30443391118;35089.47365789515;35190.64809351925;35345.29309413849;1092.355510248941;1173.9413029348668;1174.7767924094394;1201.7956947318803;1213.04775751035;17743.822561774476;18290.542736431697;18290.908545457452;18366.449006529827;18426;602598;606015;608607;609060;610189;72920.63539682374;73263.26736732565;73599.26400735923;73902.63048684722;73974;1547.4119834463056;1556.2763315058326;1580.3046659470026;1596.289651105247;1601.3354457900075;33764.662353377134;34365.312693746484;34527.82736086404;34626.65373346234;34688.132796680286;60547.69726151341;62145.68927155516;62546;62635.37364626478;62714.686426567576;352245;353316;353581;353612;356575;29618.851905741194;30578.235544111576;30588;32472.83763581167;32519;49334.75332623314;49483.75258123686;50105;51147.74426127846;51416.48583514117;41024;42166.57833421627;42236.57763422449;42412.36381454219;42670.57329426666;40349.79825100856;42077;42224.57775422329;42330.88679820268;42377.57622423736;39382.803085984386;40528.98677533085;40682;41517.79241103775;41633;35979.64020359763;36263.81868090643;36769.448458273684;36819.63180368162;36821;27157.185284441497;27434.45131097327;27638.585421218297;27693.446131077668;27808.44383112286 00:06:50 INFO - PROCESS | 12628 | |2;jquery.html;439.7449479302005;449.78859935830167;456.5959126173337;459.6047399236656;463.12469432772065;20182.697259541117;20438.2846600369;22405.327840164802;22710.772892271074;22829;23173.65239521404;23284.65073023906;23754.40613984647;24018.87990560049;24065;6107.4197951194565;6130.17242672238;6206.534509911752;6344.460720838734;6362.0456931460185;6134.877302453949;6189.38106189382;6232.875342493147;6239.65681887496;6244.875102497947;6043.758249670008;6146.508279337665;6166.84582885427;6174.10475481055;6198.938010619881;6031.547633927473;6123.295820980599;6132;6141.662208578527;6174.783882564111;5552.167174923753;5585.832425027255;5587.776488940438;5592.217089607459;5610.579206559524;21833.126674932984;23743.643845342332;26571.867140664366;26861.328466788487;26905.461890762075;3241.2707140893344;3339.0650617827046;3373.696367326928;3400.557927469438;3416.692497675221;15758.842411575852;16220.752492656864;16337.18314084291;16870.578235544086;16981.15094245295;2071.0887209627867;2083.1146762625976;2112.3979665795173;2116.6930795034787;2120.7879212078824;83315;97958.51020744922;99700.50149749278;100376.49811750968;100410.99999999927;11850.88149118515;12590.433430495466;12602;12636.178648387826;12738.490460381667;17296.394626188023;17357.13214339278;17376.13119344053;17384.565385865455;17420.303187872596;9060.093990600888;9136.360454768102;9311.394759340621;9423.293253005915;9473.763155921157;8893.244074253631;8949.865752013726;8957.283417326598;9086.409383390059;9135.31485138604;7615.885761713579;7695.884096805932;7739.264769846855;7932.643031063616;7999.480033797785;2167.3606286145623;2198.3404978506705;2212.413710366754;2218.367765186914;2253.447905263188;964.3587014635189;966.8743063401854;967.3373738988815;990.1781521337273;995.1789773436943;21947.244220462642;21975;22125.225617103326;22202.55594888093;22456.32631021072;1000.2598077422655;1003.1222680154865;1006.074411541369;1012.336919317848;1031.2832581356035;12426.502939882303;12451.879330860085;12629.11596188258;12705.42825572833;12740.554080607135;266074;353375;739096;743250;750211;85778;86654.56672716596;101237.49381253046;103711;116688.41655791667;1149.4425203776161;1161.4773351991637;1174.8531433570804;1182.869884312725;1196.9341686207167;19231.80768192356;19383.612327753082;19399.709004365228;19587.902060489607;19663.213471461553;46891.76554117344;47112.52887471081;48524.757376212896;51918.74040629773;52052;68776;68977.31022689909;69380.30619693738;69505;70303.64848175932;9752.707418777449;9795.65715199993;10153.289269751047;10167.593296268067;10179.236557258384;12634.684132896751;15314.846851531787;15338.923305383401;15830.60423489422;15908.602284942968;13357.799633005317;13430.664233393853;13477.932610336886;13491.25798081115;13493.257870817199;12565;13057.934710326768;13104.73790524165;13111.60665180046;13221.206727596375;12514.812277815658;13061.804072939103;13282.86717132855;13310.267935263653;13774.173549587056;9623.663171788954;9788.510574471105;9945.552450139616;9960.402375857471;10064.39613623185;12084.214526055779;12479.376031198222;12482.56311029146;12554.121211515107;12646.30445325516 00:06:50 INFO - PROCESS | 12628 | |3;mootools.html;1458.256289292461;1506.088816266159;1519.0809560216069;1525.5270866031524;1545.8299587045426;7708.691652333914;7933.286004259616;8200.26197642212;8686.174813392734;8702;8204.179582041792;8355.331573474123;8383.580820958958;8610.956945215281;8621.224089831914;2417.7340492545804;2449.8530088194766;2490.8754562271906;2493.114944194812;2496.1762618335997;2469.1604854349516;2498.650188973545;2504.4365017870923;2517.483915797257;2526.6715327007555;2474.8267621266427;2475.7895578875728;2485.540175067609;2501.537215615108;2508.8996440142373;2420.5037967216676;2428.5628586854273;2443.9022439102505;2451.9754802451926;2458.2256589174353;2405.1822380390577;2413.1553956115217;2435.585950388438;2453.668754718126;2453.84050036747;8301.418900676956;8316;8356.749297521084;8375.120612335739;8381.58092095399;5411.404745477994;5533.6956467394275;5542.002439560877;5574.47042530963;5580.023495888244;3491.5460990071383;3586.964130358715;3620.4931309616672;3631.727620428452;3645.179834537208;1365.4742923974243;1393.6933874547583;1437.9424823007066;1451.470213372122;1490.4783325835979;11139.164562657834;11485.770284594344;11571.305721656643;11611.4194290286;11643.476043578059;4779.593734532534;4799.968006878538;4820.3492528508905;4861.51384861511;4941.851744447672;9824.4105353679;9897.059779320953;9924.702258932244;9931.056549627774;9971.152452041657;5398.568114550826;5437.755301011464;5442.829791594826;5446.21029950655;5451.318585176853;4944.184209605375;4975.029869175476;5128.076946149654;5190;5228.189630607262;4104.369373577276;4120.979395103065;4132.772697501606;4164.06308580573;4182;1287.3241548187277;1303.5111833062601;1309.1621362328117;1318.8813006829432;1319.0568743348551;941.3504681769557;976.9804603907882;978.3640633588225;979.0552117206929;985.9556319965619;5702.771889124471;5731.598788084794;5771.076627739541;5775.855603609859;5873.471387575139;644.3878315600199;650.5348675696899;655.806537071565;656.0356276273869;656.1732217406008;3937.3109705801944;4186.246475634415;4206.600372964564;4221.746695198298;4225.366195070703;9690.079442452956;9976.102150806317;9982.401055936667;9990.200783937267;10033.147182489423;9791.559379827782;9864.161546268504;9868.21054315653;9882.764654418197;9904.207663387057;7592.81017974555;7821.765347039598;7949.682012719542;7960.164182760726;7968.482048666702;6004.639721616717;6074.574779765374;6095.8780824382375;6205.906911396423;6217.378262173746;9387.29595280343;9408.858867116862;9445.905540944503;9458.574364153492;9489.57296921654;9270.953645232;9685.176759975198;9686.32195746291;9735.318527702993;9737.707868763948;7049.753258635923;7315.707371705073;7431.702731890664;7575.734849280248;7749.8837517438415;8182.509049457051;8436.746897593082;8488.70289539888;8497.702580409656;8497.83004339922;7532.435067370079;7565.167831538416;7573.734919277799;7591.316781489692;7850.136484986533;7483.476156668981;7514.812129696801;7526.5107767994905;7588.468807183444;7600.1639819618695;6505.707243173973;6625.701843416961;6634.237062737654;6641.302663220292;6642.136522252076;5122.334096567422;5240.868978275574;5275.393329766973;5372.435894231206;5417.83746487606;5190.117679994334;5200.401953775364;5238.738063096754;5254.527092561535;5294.602904782079 00:06:50 INFO - PROCESS | 12628 | |4;prototype.html;395.20366461579937;418.8115348093357;420.60253060857485;431.03018209029676;432.94577703292487;5345.342943687459;5442.829791594806;5464.781408743651;5501.449855014502;5509.201165830962;5251.422343542207;5406.729663516819;5413.188021796723;5431.321084864392;5448.45515448455;4208.821529971613;4229.915401691972;4248.915021699564;4273.230818452677;4275.123599662062;4058.5941405859326;4210.852620158295;4234.428352172464;4277.951901784068;4293.763842988635;4178.603032711888;4192.937105943413;4206.663466922654;4224.8732538023905;4231.153769246163;4231.1114665920195;4245.2783026885345;4261.509926358477;4263.658907287409;4270.38079478477;3657.122290650251;3819.4843696100947;3830.80845957701;3847.0574709196426;3861.864834730771;5329.813456529042;5341.839744807662;5350.491703288181;5360.624756267063;5403.216533602645;4847.248676455155;4924.990376972712;4934.55588996992;4935.9753201234125;4939.370007897385;5508.14623733322;5663.915041274384;5693.743781529841;5699.316082070137;5726.940516004553;4216.219999300109;4217.873463796091;4226.598473145046;4245.341971994346;4249.128928569636;5929.495992840613;5944.554158438091;5946.226990491208;5960;5965.970170149165;4096.40602112692;4301.698881078357;4310.202612516695;4319.179355922364;4323.740575565476;4344.109457561192;4348.695391382573;4358.585934336233;4365.515724653633;4377.715448495837;4913.553234322872;4932.309476673268;4933.802647894044;4937.247277216608;4947.975260123749;5592.217089607459;5732.9394062098645;5756.597038207369;5767.596268261265;5782.479576838105;1437.8640873709653;1471.8896082793833;1473.4179998900588;1484.6288427893028;1488.605519537302;994.880614326271;1006.9345492542961;1017.8015287019108;1020.505055048301;1047.7852040331713;5394.190871369326;5394.433584473652;5407.215953686693;5554.805581804618;5576;5741.8564535886935;5751;5769.68266745333;5771.614812444983;5772.797952071742;5348.9732551337775;5476.864023031021;5528.806491772769;5594.496495315441;5678.858028549319;3016.8642411091555;3051.2829485070993;3051.435484435342;3061.0409338023683;3075.185075954874;5664.971675141598;5962.552808539377;6005.849853753691;6006.387221558636;6040.982746473546;5781.311690064141;5784.132380143013;5791.511578526675;5793.710314484343;5800.535957123504;5968.313643930916;6004.42957918997;6024.246969128859;6038;6046.7278972445465;5525.889482210253;5638.23883775685;5686.77252909879;5695.857603559944;5749.9712501437225;5627.21219029328;5628.690422026664;5655.773769049192;5692.345380281155;5715.257016587817;5755.971220143872;5967.970160149345;5993.670348130895;5996.910046349221;6014.849628759316;4163.208990291835;4199.307114326224;4216.620504154518;4226.809793559236;4227.217964676544;5745.770169193353;5832.133717210452;5833.241678581757;5833.329167145833;5837.503812176013;5407.972485227794;5610.298712660918;5629.943700562942;5638.323401191883;5663.348714897839;5601.915971260353;5613.242212301287;5625.915611265752;5628.240187574625;5643;5550.722463876709;5552.7778888843995;5577.844505843173;5607.495325420732;5624.381318054929;5320.680759154463;5503.284573005483;5566.415526369835;5567.582431317586;5582.692951887685;5390.353157621111;5431;5463.197144942239;5500.642458240201;5543.588538985554 00:06:50 INFO - PROCESS | 12628 | |5;yui.html;783.8001309666031;812.1269635142223;819.860623693972;884.6549845560232;929.5677509957868;16330.510084697464;16854.662906741858;16997.49007529773;17090.31638734449;17453.82546174538;16277.674446511062;16604.252808623613;16665.083420411873;16859.662806743858;16896.746548801777;806.2501873257868;822.6832669422286;829.0217543298905;831.268483734313;834.203335814299;779.4232268121577;835.9038710548274;836.0803116571752;838.1283465196219;841.1756478650926;881.607684580362;888.706726780161;889.3063410539756;890.0565400675305;893.803363260085;872.8385248728941;880.5201165364891;881.1628952495091;881.2157180109707;883.3904605821995;640.282883170847;645.5803727577065;646.2051676438008;646.3730181723721;648.6918713611044;16926.576835579086;17218.31126754928;17245.568860778454;17456.65086698259;17522.12389380526;14665.26673666323;15680.137592432411;15745.134017629025;15875.206239688085;16136.112513811735;14271.57185284443;14704.191269480174;14897;14912.925435372754;15036.548903532803;4797.136515427222;4832.202686556714;4838.516148385169;4951.158303088484;5032.194848824207;79691.6015419925;80515.19484805135;81519.18480815235;81665;83114.16885831124;12319.384030798425;12343.382830858422;12347.10201810432;12454.501819927102;12518.687032824253;22854.200102996314;22986.655200172012;22992.080316787476;23120.884395577916;23179.536409272056;8781;8824.338174636929;8894.46633201997;8982.281417486585;9044.8643270351;4908.133748133169;5027.874303142377;5077.517635824591;5113.181890897438;5155.9742201288755;3692.48305237267;3712.554493460748;3766.8116594170183;3769.830357633913;3790.128270497801;669.8760729265101;674;678.8302924268933;683.1767719897512;690.5890994858051;793.0285400384598;799.9280064794197;801.6072124658991;801.7795106345685;815.355868863603;10755.83866242007;11243.60647377338;11358.488868000959;11387.259828111146;11561.595344163083;790.2492631999623;799.4044436894551;810.4893916832358;813.4143416739938;834.9206825351582;5248.9737551312;5318.22885681574;5342.866428339323;5355.30381050461;5416.7020813855615;80419.59790201012;83231;83662.16337836544;83968;86728.56635716782;67175.3282467169;69322.3067769326;70198;70233;72915;65245;66049.66975165189;66507;66605;67950.3204967944;9919.851202232117;9991.300608957594;10235.385876847413;10252.58989640406;10255.487225638539;44288;44423.555764443234;44873.775631121636;45119;45546;55556.16665750098;55916.72041639766;55983.72008140096;56173.43826561682;56858.431415685314;12374.62876113718;12430.627081187578;12472.812907806572;12605.684857878627;12843.550475733304;14081.295935203403;14111.929440352733;14115.717685646436;14337.784933225801;14411.567652970427;13061.281629510468;13187.736245275233;13304.201747895157;13352.933235333761;13666.52167174144;13504.45982160742;13533;13614.31928403556;13641.931790340985;13813.102148360324;12891.484340626645;12920.160189587647;13200.273984930922;13232.13991090576;13352.866471335163;10556.577736890746;10903.781924361627;10923.726906827074;10966;11019.779604408028;10702.411367374869;10964.122870170526;10983.39591322485;11092;11093.833592495957 00:06:50 INFO - PROCESS | 12628 | __end_tp_report 00:06:50 INFO - PROCESS | 12628 | __start_cc_report 00:06:50 INFO - PROCESS | 12628 | _x_x_mozilla_cycle_collect,324 00:06:50 INFO - PROCESS | 12628 | __end_cc_report 00:06:50 INFO - PROCESS | 12628 | __startTimestamp1486541210259__endTimestamp 00:06:50 INFO - PROCESS | 12628 | 00:06:50 INFO - PROCESS | 12628 | ------- Summary: start ------- 00:06:50 INFO - PROCESS | 12628 | Number of tests: 6 00:06:50 INFO - PROCESS | 12628 | 00:06:50 INFO - PROCESS | 12628 | [#0] dojo.html Cycles:165 Average:5515.29 Median:5767.94 stddev:613.73 (10.6%) stddev-sans-first:591.07 00:06:50 INFO - PROCESS | 12628 | Values: 3324.7 3354.8 3357.9 3382.0 3390.5 5446.3 5514.1 5518.7 5532.4 5536.2 5484.1 5523.7 5558.7 5561.8 5584.3 4930.9 4969.7 5031.9 5034.7 5080.2 5034.9 5048.2 5075.6 5088.5 5095.8 4888.1 4898.1 5084.7 5088.1 5088.8 4916.8 4949.1 4953.5 4966.1 5055.4 4935.1 4952.8 4979.2 4981.8 4989.1 5458.5 5468.3 5526.9 5544.2 5548.2 5772.1 5799.3 5802.4 5825.2 5861.1 5928.2 5973.0 5980.6 5984.6 6016.8 5566.6 5571.6 5573.9 5574.3 5575.6 5822.2 5851.1 5868.4 5886.7 6015.4 5690.7 5742.4 5754.5 5768.1 5778.2 5808.2 5852.6 5860.7 5864.2 5874.3 5768.9 5815.9 5819.6 5842.8 5850.7 5893.0 5932.0 5947.1 5967.3 5982.8 4584.3 4587.6 4588.5 4605.4 4616.1 3928.4 3944.2 4107.5 4108.8 4114.1 5724.2 5755.8 5801.2 5845.5 5879.9 5987.7 6029.0 6043.2 6047.4 6047.6 5613.7 5629.4 5713.4 5815.1 5825.4 5060.4 5095.1 5123.4 5144.8 5151.5 6267.9 6273.3 6282.0 6282.5 6291.8 5858.7 5910.5 6015.4 6018.0 6025.9 6118.0 6141.8 6155.9 6233.3 6234.8 5766.6 5837.5 5860.6 5888.7 5893.6 5767.9 5833.2 5903.9 5957.0 5976.1 5728.4 5747.0 5759.5 5765.5 5776.9 5826.8 5835.7 5836.9 5837.9 5862.8 5831.4 5836.0 5839.5 5847.6 5850.5 5627.8 5745.7 5806.4 5814.8 5899.5 5724.5 5737.1 5781.0 5793.6 5800.7 00:06:50 INFO - PROCESS | 12628 | 00:06:50 INFO - PROCESS | 12628 | [#1] ext.html Cycles:180 Average:56670.71 Median:194463.15 stddev:111293.53 (57.2%) stddev-sans-first:111526.00 00:06:50 INFO - PROCESS | 12628 | Values: 559.5 603.1 627.3 698.2 698.5 44355.3 45521.3 48820.0 48848.3 49202.5 49258.5 50357.2 50379.7 50406.5 50456.0 9274.3 10781.9 11063.4 11121.9 11487.9 11013.1 11098.9 11128.0 11128.6 11142.1 11266.4 11314.1 11340.9 11343.7 11356.5 11166.6 11210.3 11219.0 11227.1 11259.0 11067.1 11071.2 11134.7 11154.7 11160.2 41749.2 42249.0 42395.8 42463.6 42490.6 4446.9 4470.7 4530.0 4613.2 4630.6 32393.7 32502.8 32886.5 33077.5 34022.1 4642.5 4707.5 4727.6 4743.4 4771.7 156388.0 157298.0 157336.0 157796.2 158402.0 62359.7 62691.1 63128.0 63164.0 63495.0 64911.4 64918.7 64930.0 65245.0 65363.7 16796.5 17027.7 17210.8 17238.6 17375.2 12970.4 13034.5 13088.6 13088.7 13129.9 20090.7 20259.4 20376.9 20533.2 20709.7 7378.7 7666.8 7677.3 7684.3 7814.1 1002.8 1017.2 1017.4 1030.0 1058.2 33641.7 34778.3 35089.5 35190.6 35345.3 1092.4 1173.9 1174.8 1201.8 1213.0 17743.8 18290.5 18290.9 18366.4 18426.0 602598.0 606015.0 608607.0 609060.0 610189.0 72920.6 73263.3 73599.3 73902.6 73974.0 1547.4 1556.3 1580.3 1596.3 1601.3 33764.7 34365.3 34527.8 34626.7 34688.1 60547.7 62145.7 62546.0 62635.4 62714.7 352245.0 353316.0 353581.0 353612.0 356575.0 29618.9 30578.2 30588.0 32472.8 32519.0 49334.8 49483.8 50105.0 51147.7 51416.5 41024.0 42166.6 42236.6 42412.4 42670.6 40349.8 42077.0 42224.6 42330.9 42377.6 39382.8 40529.0 40682.0 41517.8 41633.0 35979.6 36263.8 36769.4 36819.6 36821.0 27157.2 27434.5 27638.6 27693.4 27808.4 00:06:50 INFO - PROCESS | 12628 | 00:06:50 INFO - PROCESS | 12628 | [#2] jquery.html Cycles:180 Average:33609.03 Median:23229.15 stddev:100586.37 (433.0%) stddev-sans-first:100837.71 00:06:50 INFO - PROCESS | 12628 | Values: 439.7 449.8 456.6 459.6 463.1 20182.7 20438.3 22405.3 22710.8 22829.0 23173.7 23284.7 23754.4 24018.9 24065.0 6107.4 6130.2 6206.5 6344.5 6362.0 6134.9 6189.4 6232.9 6239.7 6244.9 6043.8 6146.5 6166.8 6174.1 6198.9 6031.5 6123.3 6132.0 6141.7 6174.8 5552.2 5585.8 5587.8 5592.2 5610.6 21833.1 23743.6 26571.9 26861.3 26905.5 3241.3 3339.1 3373.7 3400.6 3416.7 15758.8 16220.8 16337.2 16870.6 16981.2 2071.1 2083.1 2112.4 2116.7 2120.8 83315.0 97958.5 99700.5 100376.5 100411.0 11850.9 12590.4 12602.0 12636.2 12738.5 17296.4 17357.1 17376.1 17384.6 17420.3 9060.1 9136.4 9311.4 9423.3 9473.8 8893.2 8949.9 8957.3 9086.4 9135.3 7615.9 7695.9 7739.3 7932.6 7999.5 2167.4 2198.3 2212.4 2218.4 2253.4 964.4 966.9 967.3 990.2 995.2 21947.2 21975.0 22125.2 22202.6 22456.3 1000.3 1003.1 1006.1 1012.3 1031.3 12426.5 12451.9 12629.1 12705.4 12740.6 266074.0 353375.0 739096.0 743250.0 750211.0 85778.0 86654.6 101237.5 103711.0 116688.4 1149.4 1161.5 1174.9 1182.9 1196.9 19231.8 19383.6 19399.7 19587.9 19663.2 46891.8 47112.5 48524.8 51918.7 52052.0 68776.0 68977.3 69380.3 69505.0 70303.6 9752.7 9795.7 10153.3 10167.6 10179.2 12634.7 15314.8 15338.9 15830.6 15908.6 13357.8 13430.7 13477.9 13491.3 13493.3 12565.0 13057.9 13104.7 13111.6 13221.2 12514.8 13061.8 13282.9 13310.3 13774.2 9623.7 9788.5 9945.6 9960.4 10064.4 12084.2 12479.4 12482.6 12554.1 12646.3 00:06:50 INFO - PROCESS | 12628 | 00:06:50 INFO - PROCESS | 12628 | [#3] mootools.html Cycles:180 Average:5671.42 Median:5641.40 stddev:3019.52 (53.5%) stddev-sans-first:3011.39 00:06:50 INFO - PROCESS | 12628 | Values: 1458.3 1506.1 1519.1 1525.5 1545.8 7708.7 7933.3 8200.3 8686.2 8702.0 8204.2 8355.3 8383.6 8611.0 8621.2 2417.7 2449.9 2490.9 2493.1 2496.2 2469.2 2498.7 2504.4 2517.5 2526.7 2474.8 2475.8 2485.5 2501.5 2508.9 2420.5 2428.6 2443.9 2452.0 2458.2 2405.2 2413.2 2435.6 2453.7 2453.8 8301.4 8316.0 8356.7 8375.1 8381.6 5411.4 5533.7 5542.0 5574.5 5580.0 3491.5 3587.0 3620.5 3631.7 3645.2 1365.5 1393.7 1437.9 1451.5 1490.5 11139.2 11485.8 11571.3 11611.4 11643.5 4779.6 4800.0 4820.3 4861.5 4941.9 9824.4 9897.1 9924.7 9931.1 9971.2 5398.6 5437.8 5442.8 5446.2 5451.3 4944.2 4975.0 5128.1 5190.0 5228.2 4104.4 4121.0 4132.8 4164.1 4182.0 1287.3 1303.5 1309.2 1318.9 1319.1 941.4 977.0 978.4 979.1 986.0 5702.8 5731.6 5771.1 5775.9 5873.5 644.4 650.5 655.8 656.0 656.2 3937.3 4186.2 4206.6 4221.7 4225.4 9690.1 9976.1 9982.4 9990.2 10033.1 9791.6 9864.2 9868.2 9882.8 9904.2 7592.8 7821.8 7949.7 7960.2 7968.5 6004.6 6074.6 6095.9 6205.9 6217.4 9387.3 9408.9 9445.9 9458.6 9489.6 9271.0 9685.2 9686.3 9735.3 9737.7 7049.8 7315.7 7431.7 7575.7 7749.9 8182.5 8436.7 8488.7 8497.7 8497.8 7532.4 7565.2 7573.7 7591.3 7850.1 7483.5 7514.8 7526.5 7588.5 7600.2 6505.7 6625.7 6634.2 6641.3 6642.1 5122.3 5240.9 5275.4 5372.4 5417.8 5190.1 5200.4 5238.7 5254.5 5294.6 00:06:50 INFO - PROCESS | 12628 | 00:06:50 INFO - PROCESS | 12628 | [#4] prototype.html Cycles:180 Average:4791.29 Median:5431.16 stddev:1373.73 (25.3%) stddev-sans-first:1337.37 00:06:50 INFO - PROCESS | 12628 | Values: 395.2 418.8 420.6 431.0 432.9 5345.3 5442.8 5464.8 5501.4 5509.2 5251.4 5406.7 5413.2 5431.3 5448.5 4208.8 4229.9 4248.9 4273.2 4275.1 4058.6 4210.9 4234.4 4278.0 4293.8 4178.6 4192.9 4206.7 4224.9 4231.2 4231.1 4245.3 4261.5 4263.7 4270.4 3657.1 3819.5 3830.8 3847.1 3861.9 5329.8 5341.8 5350.5 5360.6 5403.2 4847.2 4925.0 4934.6 4936.0 4939.4 5508.1 5663.9 5693.7 5699.3 5726.9 4216.2 4217.9 4226.6 4245.3 4249.1 5929.5 5944.6 5946.2 5960.0 5966.0 4096.4 4301.7 4310.2 4319.2 4323.7 4344.1 4348.7 4358.6 4365.5 4377.7 4913.6 4932.3 4933.8 4937.2 4948.0 5592.2 5732.9 5756.6 5767.6 5782.5 1437.9 1471.9 1473.4 1484.6 1488.6 994.9 1006.9 1017.8 1020.5 1047.8 5394.2 5394.4 5407.2 5554.8 5576.0 5741.9 5751.0 5769.7 5771.6 5772.8 5349.0 5476.9 5528.8 5594.5 5678.9 3016.9 3051.3 3051.4 3061.0 3075.2 5665.0 5962.6 6005.8 6006.4 6041.0 5781.3 5784.1 5791.5 5793.7 5800.5 5968.3 6004.4 6024.2 6038.0 6046.7 5525.9 5638.2 5686.8 5695.9 5750.0 5627.2 5628.7 5655.8 5692.3 5715.3 5756.0 5968.0 5993.7 5996.9 6014.8 4163.2 4199.3 4216.6 4226.8 4227.2 5745.8 5832.1 5833.2 5833.3 5837.5 5408.0 5610.3 5629.9 5638.3 5663.3 5601.9 5613.2 5625.9 5628.2 5643.0 5550.7 5552.8 5577.8 5607.5 5624.4 5320.7 5503.3 5566.4 5567.6 5582.7 5390.4 5431.0 5463.2 5500.6 5543.6 00:06:50 INFO - PROCESS | 12628 | 00:06:50 INFO - PROCESS | 12628 | [#5] yui.html Cycles:180 Average:18448.93 Median:4873.32 stddev:23265.42 (477.4%) stddev-sans-first:23292.87 00:06:50 INFO - PROCESS | 12628 | Values: 783.8 812.1 819.9 884.7 929.6 16330.5 16854.7 16997.5 17090.3 17453.8 16277.7 16604.3 16665.1 16859.7 16896.7 806.3 822.7 829.0 831.3 834.2 779.4 835.9 836.1 838.1 841.2 881.6 888.7 889.3 890.1 893.8 872.8 880.5 881.2 881.2 883.4 640.3 645.6 646.2 646.4 648.7 16926.6 17218.3 17245.6 17456.7 17522.1 14665.3 15680.1 15745.1 15875.2 16136.1 14271.6 14704.2 14897.0 14912.9 15036.5 4797.1 4832.2 4838.5 4951.2 5032.2 79691.6 80515.2 81519.2 81665.0 83114.2 12319.4 12343.4 12347.1 12454.5 12518.7 22854.2 22986.7 22992.1 23120.9 23179.5 8781.0 8824.3 8894.5 8982.3 9044.9 4908.1 5027.9 5077.5 5113.2 5156.0 3692.5 3712.6 3766.8 3769.8 3790.1 669.9 674.0 678.8 683.2 690.6 793.0 799.9 801.6 801.8 815.4 10755.8 11243.6 11358.5 11387.3 11561.6 790.2 799.4 810.5 813.4 834.9 5249.0 5318.2 5342.9 5355.3 5416.7 80419.6 83231.0 83662.2 83968.0 86728.6 67175.3 69322.3 70198.0 70233.0 72915.0 65245.0 66049.7 66507.0 66605.0 67950.3 9919.9 9991.3 10235.4 10252.6 10255.5 44288.0 44423.6 44873.8 45119.0 45546.0 55556.2 55916.7 55983.7 56173.4 56858.4 12374.6 12430.6 12472.8 12605.7 12843.6 14081.3 14111.9 14115.7 14337.8 14411.6 13061.3 13187.7 13304.2 13352.9 13666.5 13504.5 13533.0 13614.3 13641.9 13813.1 12891.5 12920.2 13200.3 13232.1 13352.9 10556.6 10903.8 10923.7 10966.0 11019.8 10702.4 10964.1 10983.4 11092.0 11093.8 00:06:50 INFO - PROCESS | 12628 | -------- Summary: end -------- 00:06:50 INFO - PROCESS | 12628 | 00:06:51 INFO - TEST-INFO | 12628: exit 0 00:06:51 INFO - TEST-OK | dromaeo_css | took 1111348ms 00:06:51 INFO - TEST-START | kraken 00:06:51 INFO - operating with platform_type : linux_ 00:06:51 INFO - Initialising browser for kraken test... 00:06:51 INFO - TEST-INFO | started process 13002 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpkTg8w6/profile http://localhost:48451/getInfo.html) 00:06:55 INFO - PROCESS | 13002 | __metrics Screen width/height:1600/1200 00:06:55 INFO - PROCESS | 13002 | colorDepth:24 00:06:55 INFO - PROCESS | 13002 | Browser inner width/height: 1024/697 00:06:55 INFO - PROCESS | 13002 | __metrics 00:06:55 INFO - PROCESS | 13002 | 1486541215469 addons.xpi WARN Exception running bootstrap method shutdown on shield-recipe-client@mozilla.org: ReferenceError: LogManager is not defined (resource://gre/modules/addons/XPIProvider.jsm -> jar:file:///builds/slave/test/build/application/firefox/browser/features/shield-recipe-client@mozilla.org.xpi!/bootstrap.js:65:3) JS Stack trace: this.shutdown@resource://gre/modules/addons/XPIProvider.jsm -> jar:file:///builds/slave/test/build/application/firefox/browser/features/shield-recipe-client@bootstrap.js:65:3 < callBootstrapMethod@XPIProvider.jsm:4903:11 < observe@XPIProvider.jsm:2884:15 < permitUnload@remote-browser.xml:353:13 < CanCloseWindow@browser.js:6277:36 < canClose@browser.js:5143:12 < forceQuit@jar:file:///tmp/tmpkTg8w6/profile/extensions/talos-powers@TalosPowersService.js:238:7 < whenDone@jar:file:///tmp/tmpkTg8w6/profile/extensions/talos-powers@TalosPowersService.js:223:9 < promise callback*forceQuit@jar:file:///tmp/tmpkTg8w6/profile/extensions/talos-powers@TalosPowersService.js:225:7 < receiveMessage@jar:file:///tmp/tmpkTg8w6/profile/extensions/talos-powers@TalosPowersService.js:55:9 00:06:55 ERROR - PROCESS | 13002 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 3280: TypeError: this.tabs is undefined 00:06:56 INFO - TEST-INFO | 13002: exit 0 00:06:56 INFO - Browser initialized. 00:06:56 INFO - Running cycle 1/1 for kraken test... 00:06:56 INFO - TEST-INFO | started process 13130 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpkTg8w6/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 00:07:08 INFO - PROCESS | 13130 | RSS: Main: 145096704 00:07:08 INFO - PROCESS | 13130 | 00:07:10 INFO - PROCESS | 13130 | Cycle 1(1): loaded http://localhost:48451/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:48451/tests/kraken/driver.html?testName=audio-beat-detection) 00:07:11 INFO - PROCESS | 13130 | RSS: Main: 151568384 00:07:11 INFO - PROCESS | 13130 | 00:07:14 INFO - PROCESS | 13130 | Cycle 1(1): loaded http://localhost:48451/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:48451/tests/kraken/driver.html?testName=audio-dft) 00:07:14 INFO - PROCESS | 13130 | RSS: Main: 150552576 00:07:14 INFO - PROCESS | 13130 | 00:07:17 INFO - PROCESS | 13130 | Cycle 1(1): loaded http://localhost:48451/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:48451/tests/kraken/driver.html?testName=audio-fft) 00:07:18 INFO - PROCESS | 13130 | RSS: Main: 151298048 00:07:18 INFO - PROCESS | 13130 | 00:07:20 INFO - PROCESS | 13130 | Cycle 1(1): loaded http://localhost:48451/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:48451/tests/kraken/driver.html?testName=audio-oscillator) 00:07:20 INFO - PROCESS | 13130 | RSS: Main: 151138304 00:07:20 INFO - PROCESS | 13130 | 00:07:22 INFO - PROCESS | 13130 | Cycle 1(1): loaded http://localhost:48451/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:48451/tests/kraken/driver.html?testName=imaging-gaussian-blur) 00:07:23 INFO - PROCESS | 13130 | RSS: Main: 150827008 00:07:23 INFO - PROCESS | 13130 | 00:07:26 INFO - PROCESS | 13130 | Cycle 1(1): loaded http://localhost:48451/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:48451/tests/kraken/driver.html?testName=imaging-darkroom) 00:07:27 INFO - PROCESS | 13130 | RSS: Main: 154419200 00:07:27 INFO - PROCESS | 13130 | 00:07:30 INFO - PROCESS | 13130 | Cycle 1(1): loaded http://localhost:48451/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:48451/tests/kraken/driver.html?testName=imaging-desaturate) 00:07:31 INFO - PROCESS | 13130 | RSS: Main: 153591808 00:07:31 INFO - PROCESS | 13130 | 00:07:33 INFO - PROCESS | 13130 | Cycle 1(1): loaded http://localhost:48451/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:48451/tests/kraken/driver.html?testName=json-parse-financial) 00:07:34 INFO - PROCESS | 13130 | RSS: Main: 152735744 00:07:34 INFO - PROCESS | 13130 | 00:07:36 INFO - PROCESS | 13130 | Cycle 1(1): loaded http://localhost:48451/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:48451/tests/kraken/driver.html?testName=json-stringify-tinderbox) 00:07:36 INFO - PROCESS | 13130 | RSS: Main: 152391680 00:07:36 INFO - PROCESS | 13130 | 00:07:38 INFO - PROCESS | 13130 | Cycle 1(1): loaded http://localhost:48451/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:48451/tests/kraken/driver.html?testName=stanford-crypto-aes) 00:07:39 INFO - PROCESS | 13130 | RSS: Main: 152866816 00:07:39 INFO - PROCESS | 13130 | 00:07:41 INFO - PROCESS | 13130 | Cycle 1(1): loaded http://localhost:48451/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:48451/tests/kraken/driver.html?testName=stanford-crypto-ccm) 00:07:41 INFO - PROCESS | 13130 | RSS: Main: 153010176 00:07:41 INFO - PROCESS | 13130 | 00:07:44 INFO - PROCESS | 13130 | Cycle 1(1): loaded http://localhost:48451/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:48451/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 00:07:45 INFO - PROCESS | 13130 | RSS: Main: 152461312 00:07:45 INFO - PROCESS | 13130 | 00:07:47 INFO - PROCESS | 13130 | Cycle 1(1): loaded http://localhost:48451/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:48451/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 00:07:48 INFO - PROCESS | 13130 | RSS: Main: 152604672 00:07:48 INFO - PROCESS | 13130 | 00:07:50 INFO - PROCESS | 13130 | Cycle 1(1): loaded http://localhost:48451/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:48451/tests/kraken/driver.html?testName=ai-astar) 00:07:50 INFO - PROCESS | 13130 | RSS: Main: 154025984 00:07:50 INFO - PROCESS | 13130 | 00:07:50 INFO - PROCESS | 13130 | __start_tp_report 00:07:50 INFO - PROCESS | 13130 | _x_x_mozilla_page_load 00:07:50 INFO - PROCESS | 13130 | _x_x_mozilla_page_load_details 00:07:50 INFO - PROCESS | 13130 | |i|pagename|runs| 00:07:50 INFO - PROCESS | 13130 | |0;ai-astar;105;114;113;116;113;112;114;114;113;115 00:07:50 INFO - PROCESS | 13130 | |1;audio-beat-detection;145;121;122;153;119;118;118;118;135;117 00:07:50 INFO - PROCESS | 13130 | |2;audio-dft;163;162;163;162;161;162;165;163;162;161 00:07:50 INFO - PROCESS | 13130 | |3;audio-fft;76;75;76;108;75;75;75;75;96;75 00:07:50 INFO - PROCESS | 13130 | |4;audio-oscillator;84;82;111;93;84;82;91;83;83;101 00:07:50 INFO - PROCESS | 13130 | |5;imaging-gaussian-blur;118;118;118;117;117;118;117;117;118;118 00:07:50 INFO - PROCESS | 13130 | |6;imaging-darkroom;149;147;148;148;149;149;148;147;148;147 00:07:50 INFO - PROCESS | 13130 | |7;imaging-desaturate;96;96;96;96;96;96;96;96;97;96 00:07:50 INFO - PROCESS | 13130 | |8;json-parse-financial;57;57;59;59;63;57;59;60;57;57 00:07:50 INFO - PROCESS | 13130 | |9;json-stringify-tinderbox;65;65;65;65;68;65;64;65;65;67 00:07:50 INFO - PROCESS | 13130 | |10;stanford-crypto-aes;79;76;81;77;79;82;76;76;75;77 00:07:50 INFO - PROCESS | 13130 | |11;stanford-crypto-ccm;122;128;137;119;122;127;128;123;162;129 00:07:50 INFO - PROCESS | 13130 | |12;stanford-crypto-pbkdf2;161;160;161;161;159;158;156;161;160;158 00:07:50 INFO - PROCESS | 13130 | |13;stanford-crypto-sha256-iterative;61;64;62;60;63;63;60;61;61;61 00:07:50 INFO - PROCESS | 13130 | __end_tp_report 00:07:50 INFO - PROCESS | 13130 | __start_cc_report 00:07:50 INFO - PROCESS | 13130 | _x_x_mozilla_cycle_collect,710 00:07:50 INFO - PROCESS | 13130 | __end_cc_report 00:07:50 INFO - PROCESS | 13130 | __startTimestamp1486541270356__endTimestamp 00:07:50 INFO - PROCESS | 13130 | 00:07:50 INFO - PROCESS | 13130 | ------- Summary: start ------- 00:07:50 INFO - PROCESS | 13130 | Number of tests: 14 00:07:50 INFO - PROCESS | 13130 | 00:07:50 INFO - PROCESS | 13130 | [#0] ai-astar Cycles:10 Average:112.90 Median:114.00 stddev:3.00 (2.6%) stddev-sans-first:1.20 00:07:50 INFO - PROCESS | 13130 | Values: 105.0 114.0 113.0 116.0 113.0 112.0 114.0 114.0 113.0 115.0 00:07:50 INFO - PROCESS | 13130 | 00:07:50 INFO - PROCESS | 13130 | [#1] audio-beat-detection Cycles:10 Average:126.60 Median:121.50 stddev:13.04 (10.7%) stddev-sans-first:12.01 00:07:50 INFO - PROCESS | 13130 | Values: 145.0 121.0 122.0 153.0 119.0 118.0 118.0 118.0 135.0 117.0 00:07:50 INFO - PROCESS | 13130 | 00:07:50 INFO - PROCESS | 13130 | [#2] audio-dft Cycles:10 Average:162.40 Median:162.50 stddev:1.17 (0.7%) stddev-sans-first:1.22 00:07:50 INFO - PROCESS | 13130 | Values: 163.0 162.0 163.0 162.0 161.0 162.0 165.0 163.0 162.0 161.0 00:07:50 INFO - PROCESS | 13130 | 00:07:50 INFO - PROCESS | 13130 | [#3] audio-fft Cycles:10 Average:80.60 Median:75.00 stddev:11.64 (15.5%) stddev-sans-first:12.22 00:07:50 INFO - PROCESS | 13130 | Values: 76.0 75.0 76.0 108.0 75.0 75.0 75.0 75.0 96.0 75.0 00:07:50 INFO - PROCESS | 13130 | 00:07:50 INFO - PROCESS | 13130 | [#4] audio-oscillator Cycles:10 Average:89.40 Median:83.50 stddev:9.81 (11.8%) stddev-sans-first:10.21 00:07:50 INFO - PROCESS | 13130 | Values: 84.0 82.0 111.0 93.0 84.0 82.0 91.0 83.0 83.0 101.0 00:07:50 INFO - PROCESS | 13130 | 00:07:50 INFO - PROCESS | 13130 | [#5] imaging-gaussian-blur Cycles:10 Average:117.60 Median:118.00 stddev:0.52 (0.4%) stddev-sans-first:0.53 00:07:50 INFO - PROCESS | 13130 | Values: 118.0 118.0 118.0 117.0 117.0 118.0 117.0 117.0 118.0 118.0 00:07:50 INFO - PROCESS | 13130 | 00:07:50 INFO - PROCESS | 13130 | [#6] imaging-darkroom Cycles:10 Average:148.00 Median:148.00 stddev:0.82 (0.6%) stddev-sans-first:0.78 00:07:50 INFO - PROCESS | 13130 | Values: 149.0 147.0 148.0 148.0 149.0 149.0 148.0 147.0 148.0 147.0 00:07:50 INFO - PROCESS | 13130 | 00:07:50 INFO - PROCESS | 13130 | [#7] imaging-desaturate Cycles:10 Average:96.10 Median:96.00 stddev:0.32 (0.3%) stddev-sans-first:0.33 00:07:50 INFO - PROCESS | 13130 | Values: 96.0 96.0 96.0 96.0 96.0 96.0 96.0 96.0 97.0 96.0 00:07:50 INFO - PROCESS | 13130 | 00:07:50 INFO - PROCESS | 13130 | [#8] json-parse-financial Cycles:10 Average:58.50 Median:59.00 stddev:1.96 (3.3%) stddev-sans-first:2.00 00:07:50 INFO - PROCESS | 13130 | Values: 57.0 57.0 59.0 59.0 63.0 57.0 59.0 60.0 57.0 57.0 00:07:50 INFO - PROCESS | 13130 | 00:07:50 INFO - PROCESS | 13130 | [#9] json-stringify-tinderbox Cycles:10 Average:65.40 Median:65.00 stddev:1.17 (1.8%) stddev-sans-first:1.24 00:07:50 INFO - PROCESS | 13130 | Values: 65.0 65.0 65.0 65.0 68.0 65.0 64.0 65.0 65.0 67.0 00:07:50 INFO - PROCESS | 13130 | 00:07:50 INFO - PROCESS | 13130 | [#10] stanford-crypto-aes Cycles:10 Average:77.80 Median:78.00 stddev:2.35 (3.0%) stddev-sans-first:2.45 00:07:50 INFO - PROCESS | 13130 | Values: 79.0 76.0 81.0 77.0 79.0 82.0 76.0 76.0 75.0 77.0 00:07:50 INFO - PROCESS | 13130 | 00:07:50 INFO - PROCESS | 13130 | [#11] stanford-crypto-ccm Cycles:10 Average:129.70 Median:128.00 stddev:12.42 (9.7%) stddev-sans-first:12.86 00:07:50 INFO - PROCESS | 13130 | Values: 122.0 128.0 137.0 119.0 122.0 127.0 128.0 123.0 162.0 129.0 00:07:50 INFO - PROCESS | 13130 | 00:07:50 INFO - PROCESS | 13130 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:159.50 Median:160.50 stddev:1.72 (1.1%) stddev-sans-first:1.73 00:07:50 INFO - PROCESS | 13130 | Values: 161.0 160.0 161.0 161.0 159.0 158.0 156.0 161.0 160.0 158.0 00:07:50 INFO - PROCESS | 13130 | 00:07:50 INFO - PROCESS | 13130 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:61.60 Median:61.50 stddev:1.35 (2.2%) stddev-sans-first:1.41 00:07:50 INFO - PROCESS | 13130 | Values: 61.0 64.0 62.0 60.0 63.0 63.0 60.0 61.0 61.0 61.0 00:07:50 INFO - PROCESS | 13130 | -------- Summary: end -------- 00:07:50 INFO - PROCESS | 13130 | 00:07:51 INFO - TEST-INFO | 13130: exit 0 00:07:51 INFO - TEST-OK | kraken | took 60370ms 00:07:51 INFO - SUITE-END | took 1171s 00:07:51 INFO - Completed test suite (00:19:31) 00:07:51 INFO - javascript benchmark 00:07:51 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 7606.011211835137, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3324.7007769300767, 3354.781939173955, 3357.865685372586, 3382.036119705884, 3390.4575267957116, 5446.264754258179, 5514.09017512111, 5518.724063796809, 5532.44675532447, 5536.197251398545, 5484.095124304495, 5523.696196709179, 5558.666480011202, 5561.77752889885, 5584.274044374226, 4930.876728081791, 4969.676970996892, 5031.899362012758, 5034.748262586874, 5080.237964305346, 5034.949650503485, 5048.192289233723, 5075.619328550355, 5088.465711100318, 5095.847124586268, 4888.095702295069, 4898.093852637274, 5084.669496482717, 5088.1350170471105, 5088.821891233789, 4916.778744956468, 4949.059678661043, 4953.529414705597, 4966.081274964125, 5055.443901170905, 4935.087008903364, 4952.801887924478, 4979.153543897546, 4981.750912454399, 4989.052080104769, 5458.4541545845495, 5468.316460442445, 5526.861828454281, 5544.1960915667405, 5548.167774833767, 5772.07646776518, 5799.304083509964, 5802.361740208574, 5825.242718446575, 5861.120831875252, 5928.229330187091, 5973.0, 5980.611260268069, 5984.581079324449, 6016.75932962681, 5566.638168519074, 5571.637843540157, 5573.916391254134, 5574.303212098488, 5575.581831362623, 5822.184894114827, 5851.093080572433, 5868.413158684098, 5886.676232807236, 6015.428534289235, 5690.658560486384, 5742.368339482654, 5754.4533269339345, 5768.105943578752, 5778.191053252548, 5808.244928159313, 5852.619579727304, 5860.736266867916, 5864.2083318752275, 5874.265716785402, 5768.913466298009, 5815.854603634943, 5819.563532735062, 5842.766289348378, 5850.707464626752, 5892.970535147297, 5932.0, 5947.1376650385455, 5967.283925928829, 5982.790602328898, 4584.3352713856975, 4587.564181402761, 4588.541145885385, 4605.40129783126, 4616.053708989649, 3928.3910993796007, 3944.230874979409, 4107.466029416157, 4108.794560271975, 4114.0948991221885, 5724.16999535065, 5755.827325180251, 5801.1878337032, 5845.473907348274, 5879.941200587939, 5987.730552125165, 6029.0, 6043.244594425697, 6047.365026672224, 6047.576669633084, 5613.7193140342815, 5629.43705629442, 5713.371529131792, 5815.098659707752, 5825.417458254141, 5060.443351231362, 5095.133827249377, 5123.436421993652, 5144.794208231704, 5151.459096794858, 6267.874642507124, 6273.341299163522, 6282.0, 6282.4974002079725, 6291.811245662546, 5858.7070646466655, 5910.497607703393, 6015.368386319374, 6018.0, 6025.939740602713, 6118.010103775157, 6141.815745527641, 6155.876882462236, 6233.345498722751, 6234.781782637586, 5766.625169363978, 5837.474627283565, 5860.560457965585, 5888.735006924784, 5893.6463812171405, 5767.942320576741, 5833.183354330312, 5903.852403689943, 5956.97021514907, 5976.103584462366, 5728.369879313355, 5747.0, 5759.539236860957, 5765.4522820332, 5776.884462310814, 5826.82519524415, 5835.708214589338, 5836.854078647898, 5837.912431313619, 5862.824115276549, 5831.387704291158, 5835.9708201458725, 5839.5036421904615, 5847.619904706181, 5850.473457388855, 5627.803026894039, 5745.712714364348, 5806.361300256884, 5814.767409303749, 5899.528037756883, 5724.513416359656, 5737.053386191232, 5781.017227071492, 5793.594448388572, 5800.6809625471005], "value": 5475.546191603692, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [559.4768891086834, 603.1254680712966, 627.2974268818923, 698.2354322017393, 698.5005720909548, 44355.33466997997, 45521.31718024228, 48820.0, 48848.2672759908, 49202.507974920285, 49258.50741492584, 50357.244641330406, 50379.74810125953, 50406.495935040635, 50456.0, 9274.304427167956, 10781.946090269537, 11063.446827658585, 11121.888781112206, 11487.885121148807, 11013.118950483982, 11098.944505277503, 11128.0, 11128.554857805679, 11142.108631309517, 11266.380349080797, 11314.094872410229, 11340.943295283512, 11343.716407089807, 11356.545738170464, 11166.609168679099, 11210.327380357123, 11218.99999999996, 11227.101831853432, 11259.0, 11067.114630829514, 11071.16966227536, 11134.721631959266, 11154.665360039131, 11160.16298777595, 41749.165016699495, 42249.0, 42395.788021060005, 42463.57536424627, 42490.57509424928, 4446.888827779299, 4470.687051906368, 4529.977350113229, 4613.21575332191, 4630.560096790799, 32393.6760632393, 32502.83748581242, 32886.506702399485, 33077.503837442455, 34022.14944626379, 4642.53574642533, 4707.529247075299, 4727.621790256771, 4743.407074115736, 4771.71369717818, 156388.0, 157298.0, 157336.0, 157796.21101894416, 158402.0, 62359.6882015587, 62691.05963410553, 63128.0, 63164.0, 63495.04757428642, 64911.35088649148, 64918.67540662361, 64930.0, 65245.0, 65363.67318163474, 16796.496105116865, 17027.65944681124, 17210.82789172092, 17238.569035773955, 17375.218115184845, 12970.416331265116, 13034.478620855249, 13088.607341779762, 13088.738225235442, 13129.934350328187, 20090.69863952042, 20259.392218233475, 20376.898115509328, 20533.178672853217, 20709.68935465969, 7378.704851805975, 7666.769996900102, 7677.30904218623, 7684.308412242814, 7814.101378341564, 1002.7793885345212, 1017.1913328903539, 1017.3590637898077, 1029.953652085658, 1058.2169194795795, 33641.66358336385, 34778.30443391118, 35089.47365789515, 35190.64809351925, 35345.29309413849, 1092.355510248941, 1173.9413029348668, 1174.7767924094394, 1201.7956947318803, 1213.04775751035, 17743.822561774476, 18290.542736431697, 18290.908545457452, 18366.449006529827, 18426.0, 602598.0, 606015.0, 608607.0, 609060.0, 610189.0, 72920.63539682374, 73263.26736732565, 73599.26400735923, 73902.63048684722, 73974.0, 1547.4119834463056, 1556.2763315058326, 1580.3046659470026, 1596.289651105247, 1601.3354457900075, 33764.662353377134, 34365.312693746484, 34527.82736086404, 34626.65373346234, 34688.132796680286, 60547.69726151341, 62145.68927155516, 62546.0, 62635.37364626478, 62714.686426567576, 352245.0, 353316.0, 353581.0, 353612.0, 356575.0, 29618.851905741194, 30578.235544111576, 30588.0, 32472.83763581167, 32519.0, 49334.75332623314, 49483.75258123686, 50105.0, 51147.74426127846, 51416.48583514117, 41024.0, 42166.57833421627, 42236.57763422449, 42412.36381454219, 42670.57329426666, 40349.79825100856, 42077.0, 42224.57775422329, 42330.88679820268, 42377.57622423736, 39382.803085984386, 40528.98677533085, 40682.0, 41517.79241103775, 41633.0, 35979.64020359763, 36263.81868090643, 36769.448458273684, 36819.63180368162, 36821.0, 27157.185284441497, 27434.45131097327, 27638.585421218297, 27693.446131077668, 27808.44383112286], "value": 21403.598271588904, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [439.7449479302005, 449.78859935830167, 456.5959126173337, 459.6047399236656, 463.12469432772065, 20182.697259541117, 20438.2846600369, 22405.327840164802, 22710.772892271074, 22829.0, 23173.65239521404, 23284.65073023906, 23754.40613984647, 24018.87990560049, 24065.0, 6107.4197951194565, 6130.17242672238, 6206.534509911752, 6344.460720838734, 6362.0456931460185, 6134.877302453949, 6189.38106189382, 6232.875342493147, 6239.65681887496, 6244.875102497947, 6043.758249670008, 6146.508279337665, 6166.84582885427, 6174.10475481055, 6198.938010619881, 6031.547633927473, 6123.295820980599, 6132.0, 6141.662208578527, 6174.783882564111, 5552.167174923753, 5585.832425027255, 5587.776488940438, 5592.217089607459, 5610.579206559524, 21833.126674932984, 23743.643845342332, 26571.867140664366, 26861.328466788487, 26905.461890762075, 3241.2707140893344, 3339.0650617827046, 3373.696367326928, 3400.557927469438, 3416.692497675221, 15758.842411575852, 16220.752492656864, 16337.18314084291, 16870.578235544086, 16981.15094245295, 2071.0887209627867, 2083.1146762625976, 2112.3979665795173, 2116.6930795034787, 2120.7879212078824, 83315.0, 97958.51020744922, 99700.50149749278, 100376.49811750968, 100410.99999999927, 11850.88149118515, 12590.433430495466, 12602.0, 12636.178648387826, 12738.490460381667, 17296.394626188023, 17357.13214339278, 17376.13119344053, 17384.565385865455, 17420.303187872596, 9060.093990600888, 9136.360454768102, 9311.394759340621, 9423.293253005915, 9473.763155921157, 8893.244074253631, 8949.865752013726, 8957.283417326598, 9086.409383390059, 9135.31485138604, 7615.885761713579, 7695.884096805932, 7739.264769846855, 7932.643031063616, 7999.480033797785, 2167.3606286145623, 2198.3404978506705, 2212.413710366754, 2218.367765186914, 2253.447905263188, 964.3587014635189, 966.8743063401854, 967.3373738988815, 990.1781521337273, 995.1789773436943, 21947.244220462642, 21975.0, 22125.225617103326, 22202.55594888093, 22456.32631021072, 1000.2598077422655, 1003.1222680154865, 1006.074411541369, 1012.336919317848, 1031.2832581356035, 12426.502939882303, 12451.879330860085, 12629.11596188258, 12705.42825572833, 12740.554080607135, 266074.0, 353375.0, 739096.0, 743250.0, 750211.0, 85778.0, 86654.56672716596, 101237.49381253046, 103711.0, 116688.41655791667, 1149.4425203776161, 1161.4773351991637, 1174.8531433570804, 1182.869884312725, 1196.9341686207167, 19231.80768192356, 19383.612327753082, 19399.709004365228, 19587.902060489607, 19663.213471461553, 46891.76554117344, 47112.52887471081, 48524.757376212896, 51918.74040629773, 52052.0, 68776.0, 68977.31022689909, 69380.30619693738, 69505.0, 70303.64848175932, 9752.707418777449, 9795.65715199993, 10153.289269751047, 10167.593296268067, 10179.236557258384, 12634.684132896751, 15314.846851531787, 15338.923305383401, 15830.60423489422, 15908.602284942968, 13357.799633005317, 13430.664233393853, 13477.932610336886, 13491.25798081115, 13493.257870817199, 12565.0, 13057.934710326768, 13104.73790524165, 13111.60665180046, 13221.206727596375, 12514.812277815658, 13061.804072939103, 13282.86717132855, 13310.267935263653, 13774.173549587056, 9623.663171788954, 9788.510574471105, 9945.552450139616, 9960.402375857471, 10064.39613623185, 12084.214526055779, 12479.376031198222, 12482.56311029146, 12554.121211515107, 12646.30445325516], "value": 10616.73350990019, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1458.256289292461, 1506.088816266159, 1519.0809560216069, 1525.5270866031524, 1545.8299587045426, 7708.691652333914, 7933.286004259616, 8200.26197642212, 8686.174813392734, 8702.0, 8204.179582041792, 8355.331573474123, 8383.580820958958, 8610.956945215281, 8621.224089831914, 2417.7340492545804, 2449.8530088194766, 2490.8754562271906, 2493.114944194812, 2496.1762618335997, 2469.1604854349516, 2498.650188973545, 2504.4365017870923, 2517.483915797257, 2526.6715327007555, 2474.8267621266427, 2475.7895578875728, 2485.540175067609, 2501.537215615108, 2508.8996440142373, 2420.5037967216676, 2428.5628586854273, 2443.9022439102505, 2451.9754802451926, 2458.2256589174353, 2405.1822380390577, 2413.1553956115217, 2435.585950388438, 2453.668754718126, 2453.84050036747, 8301.418900676956, 8316.0, 8356.749297521084, 8375.120612335739, 8381.58092095399, 5411.404745477994, 5533.6956467394275, 5542.002439560877, 5574.47042530963, 5580.023495888244, 3491.5460990071383, 3586.964130358715, 3620.4931309616672, 3631.727620428452, 3645.179834537208, 1365.4742923974243, 1393.6933874547583, 1437.9424823007066, 1451.470213372122, 1490.4783325835979, 11139.164562657834, 11485.770284594344, 11571.305721656643, 11611.4194290286, 11643.476043578059, 4779.593734532534, 4799.968006878538, 4820.3492528508905, 4861.51384861511, 4941.851744447672, 9824.4105353679, 9897.059779320953, 9924.702258932244, 9931.056549627774, 9971.152452041657, 5398.568114550826, 5437.755301011464, 5442.829791594826, 5446.21029950655, 5451.318585176853, 4944.184209605375, 4975.029869175476, 5128.076946149654, 5190.0, 5228.189630607262, 4104.369373577276, 4120.979395103065, 4132.772697501606, 4164.06308580573, 4182.0, 1287.3241548187277, 1303.5111833062601, 1309.1621362328117, 1318.8813006829432, 1319.0568743348551, 941.3504681769557, 976.9804603907882, 978.3640633588225, 979.0552117206929, 985.9556319965619, 5702.771889124471, 5731.598788084794, 5771.076627739541, 5775.855603609859, 5873.471387575139, 644.3878315600199, 650.5348675696899, 655.806537071565, 656.0356276273869, 656.1732217406008, 3937.3109705801944, 4186.246475634415, 4206.600372964564, 4221.746695198298, 4225.366195070703, 9690.079442452956, 9976.102150806317, 9982.401055936667, 9990.200783937267, 10033.147182489423, 9791.559379827782, 9864.161546268504, 9868.21054315653, 9882.764654418197, 9904.207663387057, 7592.81017974555, 7821.765347039598, 7949.682012719542, 7960.164182760726, 7968.482048666702, 6004.639721616717, 6074.574779765374, 6095.8780824382375, 6205.906911396423, 6217.378262173746, 9387.29595280343, 9408.858867116862, 9445.905540944503, 9458.574364153492, 9489.57296921654, 9270.953645232, 9685.176759975198, 9686.32195746291, 9735.318527702993, 9737.707868763948, 7049.753258635923, 7315.707371705073, 7431.702731890664, 7575.734849280248, 7749.8837517438415, 8182.509049457051, 8436.746897593082, 8488.70289539888, 8497.702580409656, 8497.83004339922, 7532.435067370079, 7565.167831538416, 7573.734919277799, 7591.316781489692, 7850.136484986533, 7483.476156668981, 7514.812129696801, 7526.5107767994905, 7588.468807183444, 7600.1639819618695, 6505.707243173973, 6625.701843416961, 6634.237062737654, 6641.302663220292, 6642.136522252076, 5122.334096567422, 5240.868978275574, 5275.393329766973, 5372.435894231206, 5417.83746487606, 5190.117679994334, 5200.401953775364, 5238.738063096754, 5254.527092561535, 5294.602904782079], "value": 4613.981865595829, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [395.20366461579937, 418.8115348093357, 420.60253060857485, 431.03018209029676, 432.94577703292487, 5345.342943687459, 5442.829791594806, 5464.781408743651, 5501.449855014502, 5509.201165830962, 5251.422343542207, 5406.729663516819, 5413.188021796723, 5431.321084864392, 5448.45515448455, 4208.821529971613, 4229.915401691972, 4248.915021699564, 4273.230818452677, 4275.123599662062, 4058.5941405859326, 4210.852620158295, 4234.428352172464, 4277.951901784068, 4293.763842988635, 4178.603032711888, 4192.937105943413, 4206.663466922654, 4224.8732538023905, 4231.153769246163, 4231.1114665920195, 4245.2783026885345, 4261.509926358477, 4263.658907287409, 4270.38079478477, 3657.122290650251, 3819.4843696100947, 3830.80845957701, 3847.0574709196426, 3861.864834730771, 5329.813456529042, 5341.839744807662, 5350.491703288181, 5360.624756267063, 5403.216533602645, 4847.248676455155, 4924.990376972712, 4934.55588996992, 4935.9753201234125, 4939.370007897385, 5508.14623733322, 5663.915041274384, 5693.743781529841, 5699.316082070137, 5726.940516004553, 4216.219999300109, 4217.873463796091, 4226.598473145046, 4245.341971994346, 4249.128928569636, 5929.495992840613, 5944.554158438091, 5946.226990491208, 5960.0, 5965.970170149165, 4096.40602112692, 4301.698881078357, 4310.202612516695, 4319.179355922364, 4323.740575565476, 4344.109457561192, 4348.695391382573, 4358.585934336233, 4365.515724653633, 4377.715448495837, 4913.553234322872, 4932.309476673268, 4933.802647894044, 4937.247277216608, 4947.975260123749, 5592.217089607459, 5732.9394062098645, 5756.597038207369, 5767.596268261265, 5782.479576838105, 1437.8640873709653, 1471.8896082793833, 1473.4179998900588, 1484.6288427893028, 1488.605519537302, 994.880614326271, 1006.9345492542961, 1017.8015287019108, 1020.505055048301, 1047.7852040331713, 5394.190871369326, 5394.433584473652, 5407.215953686693, 5554.805581804618, 5576.0, 5741.8564535886935, 5751.0, 5769.68266745333, 5771.614812444983, 5772.797952071742, 5348.9732551337775, 5476.864023031021, 5528.806491772769, 5594.496495315441, 5678.858028549319, 3016.8642411091555, 3051.2829485070993, 3051.435484435342, 3061.0409338023683, 3075.185075954874, 5664.971675141598, 5962.552808539377, 6005.849853753691, 6006.387221558636, 6040.982746473546, 5781.311690064141, 5784.132380143013, 5791.511578526675, 5793.710314484343, 5800.535957123504, 5968.313643930916, 6004.42957918997, 6024.246969128859, 6038.0, 6046.7278972445465, 5525.889482210253, 5638.23883775685, 5686.77252909879, 5695.857603559944, 5749.9712501437225, 5627.21219029328, 5628.690422026664, 5655.773769049192, 5692.345380281155, 5715.257016587817, 5755.971220143872, 5967.970160149345, 5993.670348130895, 5996.910046349221, 6014.849628759316, 4163.208990291835, 4199.307114326224, 4216.620504154518, 4226.809793559236, 4227.217964676544, 5745.770169193353, 5832.133717210452, 5833.241678581757, 5833.329167145833, 5837.503812176013, 5407.972485227794, 5610.298712660918, 5629.943700562942, 5638.323401191883, 5663.348714897839, 5601.915971260353, 5613.242212301287, 5625.915611265752, 5628.240187574625, 5643.0, 5550.722463876709, 5552.7778888843995, 5577.844505843173, 5607.495325420732, 5624.381318054929, 5320.680759154463, 5503.284573005483, 5566.415526369835, 5567.582431317586, 5582.692951887685, 5390.353157621111, 5431.0, 5463.197144942239, 5500.642458240201, 5543.588538985554], "value": 4376.452477709305, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [783.8001309666031, 812.1269635142223, 819.860623693972, 884.6549845560232, 929.5677509957868, 16330.510084697464, 16854.662906741858, 16997.49007529773, 17090.31638734449, 17453.82546174538, 16277.674446511062, 16604.252808623613, 16665.083420411873, 16859.662806743858, 16896.746548801777, 806.2501873257868, 822.6832669422286, 829.0217543298905, 831.268483734313, 834.203335814299, 779.4232268121577, 835.9038710548274, 836.0803116571752, 838.1283465196219, 841.1756478650926, 881.607684580362, 888.706726780161, 889.3063410539756, 890.0565400675305, 893.803363260085, 872.8385248728941, 880.5201165364891, 881.1628952495091, 881.2157180109707, 883.3904605821995, 640.282883170847, 645.5803727577065, 646.2051676438008, 646.3730181723721, 648.6918713611044, 16926.576835579086, 17218.31126754928, 17245.568860778454, 17456.65086698259, 17522.12389380526, 14665.26673666323, 15680.137592432411, 15745.134017629025, 15875.206239688085, 16136.112513811735, 14271.57185284443, 14704.191269480174, 14897.0, 14912.925435372754, 15036.548903532803, 4797.136515427222, 4832.202686556714, 4838.516148385169, 4951.158303088484, 5032.194848824207, 79691.6015419925, 80515.19484805135, 81519.18480815235, 81665.0, 83114.16885831124, 12319.384030798425, 12343.382830858422, 12347.10201810432, 12454.501819927102, 12518.687032824253, 22854.200102996314, 22986.655200172012, 22992.080316787476, 23120.884395577916, 23179.536409272056, 8781.0, 8824.338174636929, 8894.46633201997, 8982.281417486585, 9044.8643270351, 4908.133748133169, 5027.874303142377, 5077.517635824591, 5113.181890897438, 5155.9742201288755, 3692.48305237267, 3712.554493460748, 3766.8116594170183, 3769.830357633913, 3790.128270497801, 669.8760729265101, 674.0, 678.8302924268933, 683.1767719897512, 690.5890994858051, 793.0285400384598, 799.9280064794197, 801.6072124658991, 801.7795106345685, 815.355868863603, 10755.83866242007, 11243.60647377338, 11358.488868000959, 11387.259828111146, 11561.595344163083, 790.2492631999623, 799.4044436894551, 810.4893916832358, 813.4143416739938, 834.9206825351582, 5248.9737551312, 5318.22885681574, 5342.866428339323, 5355.30381050461, 5416.7020813855615, 80419.59790201012, 83231.0, 83662.16337836544, 83968.0, 86728.56635716782, 67175.3282467169, 69322.3067769326, 70198.0, 70233.0, 72915.0, 65245.0, 66049.66975165189, 66507.0, 66605.0, 67950.3204967944, 9919.851202232117, 9991.300608957594, 10235.385876847413, 10252.58989640406, 10255.487225638539, 44288.0, 44423.555764443234, 44873.775631121636, 45119.0, 45546.0, 55556.16665750098, 55916.72041639766, 55983.72008140096, 56173.43826561682, 56858.431415685314, 12374.62876113718, 12430.627081187578, 12472.812907806572, 12605.684857878627, 12843.550475733304, 14081.295935203403, 14111.929440352733, 14115.717685646436, 14337.784933225801, 14411.567652970427, 13061.281629510468, 13187.736245275233, 13304.201747895157, 13352.933235333761, 13666.52167174144, 13504.45982160742, 13533.0, 13614.31928403556, 13641.931790340985, 13813.102148360324, 12891.484340626645, 12920.160189587647, 13200.273984930922, 13232.13991090576, 13352.866471335163, 10556.577736890746, 10903.781924361627, 10923.726906827074, 10966.0, 11019.779604408028, 10702.411367374869, 10964.122870170526, 10983.39591322485, 11092.0, 11093.833592495957], "value": 7705.323604872659, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1486.1, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [105.0, 114.0, 113.0, 116.0, 113.0, 112.0, 114.0, 114.0, 113.0, 115.0], "value": 112.9, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [145.0, 121.0, 122.0, 153.0, 119.0, 118.0, 118.0, 118.0, 135.0, 117.0], "value": 126.6, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [163.0, 162.0, 163.0, 162.0, 161.0, 162.0, 165.0, 163.0, 162.0, 161.0], "value": 162.4, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [76.0, 75.0, 76.0, 108.0, 75.0, 75.0, 75.0, 75.0, 96.0, 75.0], "value": 80.6, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [84.0, 82.0, 111.0, 93.0, 84.0, 82.0, 91.0, 83.0, 83.0, 101.0], "value": 89.4, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [118.0, 118.0, 118.0, 117.0, 117.0, 118.0, 117.0, 117.0, 118.0, 118.0], "value": 117.6, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [149.0, 147.0, 148.0, 148.0, 149.0, 149.0, 148.0, 147.0, 148.0, 147.0], "value": 148.0, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [96.0, 96.0, 96.0, 96.0, 96.0, 96.0, 96.0, 96.0, 97.0, 96.0], "value": 96.1, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [57.0, 57.0, 59.0, 59.0, 63.0, 57.0, 59.0, 60.0, 57.0, 57.0], "value": 58.5, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [65.0, 65.0, 65.0, 65.0, 68.0, 65.0, 64.0, 65.0, 65.0, 67.0], "value": 65.4, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [79.0, 76.0, 81.0, 77.0, 79.0, 82.0, 76.0, 76.0, 75.0, 77.0], "value": 77.8, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [122.0, 128.0, 137.0, 119.0, 122.0, 127.0, 128.0, 123.0, 162.0, 129.0], "value": 129.7, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [161.0, 160.0, 161.0, 161.0, 159.0, 158.0, 156.0, 161.0, 160.0, 158.0], "value": 159.5, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [61.0, 64.0, 62.0, 60.0, 63.0, 63.0, 60.0, 61.0, 61.0, 61.0], "value": 61.6, "unit": "score"}]}]} 00:07:51 INFO - Return code: 0 00:07:51 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 00:07:51 ERROR - # TBPL SUCCESS # 00:07:51 INFO - Running post-action listener: _resource_record_post_action 00:07:51 INFO - [mozharness: 2017-02-08 08:07:51.685030Z] Finished run-tests step (success) 00:07:51 INFO - Running post-run listener: _resource_record_post_run 00:07:51 INFO - Total resource usage - Wall time: 1189s; CPU: 13.0%; Read bytes: 266240; Write bytes: 366747648; Read time: 28; Write time: 221288 00:07:51 INFO - TinderboxPrint: CPU usage
13.3% 00:07:51 INFO - TinderboxPrint: I/O read bytes / time
266,240 / 28 00:07:51 INFO - TinderboxPrint: I/O write bytes / time
366,747,648 / 221,288 00:07:51 INFO - TinderboxPrint: CPU idle
8,219.7 (86.6%) 00:07:51 INFO - TinderboxPrint: CPU user
1,210.7 (12.8%) 00:07:51 INFO - TinderboxPrint: Swap in / out
0 / 0 00:07:51 INFO - install - Wall time: 17s; CPU: 13.0%; Read bytes: 0; Write bytes: 109473792; Read time: 0; Write time: 60636 00:07:51 INFO - run-tests - Wall time: 1172s; CPU: 13.0%; Read bytes: 266240; Write bytes: 256311296; Read time: 28; Write time: 160632 00:07:52 INFO - Running post-run listener: _upload_blobber_files 00:07:52 INFO - Blob upload gear active. 00:07:52 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 00:07:52 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 00:07:52 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-Aurora-Non-PGO', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 00:07:52 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-Aurora-Non-PGO -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 00:07:52 INFO - (blobuploader) - INFO - Open directory for files ... 00:07:52 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 00:07:52 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 00:07:52 INFO - (blobuploader) - INFO - Uploading, attempt #1. 00:07:53 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 00:07:53 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 00:07:53 INFO - (blobuploader) - INFO - Done attempting. 00:07:53 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 00:07:53 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 00:07:53 INFO - (blobuploader) - INFO - Uploading, attempt #1. 00:07:54 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 00:07:54 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 00:07:54 INFO - (blobuploader) - INFO - Done attempting. 00:07:54 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 00:07:54 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 00:07:54 INFO - (blobuploader) - INFO - Uploading, attempt #1. 00:07:58 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 00:07:58 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 00:07:58 INFO - (blobuploader) - INFO - Done attempting. 00:07:58 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/perfherder-data.json ... 00:07:58 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 00:07:58 INFO - (blobuploader) - INFO - Uploading, attempt #1. 00:07:59 INFO - (blobuploader) - INFO - TinderboxPrint: perfherder-data.json: uploaded 00:07:59 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 00:07:59 INFO - (blobuploader) - INFO - Done attempting. 00:07:59 INFO - (blobuploader) - INFO - Iteration through files over. 00:07:59 INFO - Return code: 0 00:07:59 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 00:07:59 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 00:07:59 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora-Non-PGO/sha512/7bf4ea371e79f85f4a447621e8f3ce145d47fe878bf96e9e8de8d7ad56c5672c1c1240e7f0f0ced7fb8ccc799bb92333bf25aa01ec135c5730efb74af42f477d", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora-Non-PGO/sha512/8bc2a24671266a858264d631b24b8f1f0b79d81f73585c25c7e131a291b79757eace17bd09409de486e9337b7fc698183cebcf1c72b72d96126d26be544ddbec", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora-Non-PGO/sha512/df20b3d7de0a972bf1ec78b27fe78002a506a857e3344c29223d7139a6c4986e3aef02bc06ea8be798a9a045f00528ebc1ca1f1e8abf20e4924297236c6ba61e", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora-Non-PGO/sha512/b21321f67955694404abf7df944230a9fedfa76ef333ad458a9aa93aa09791e7738491d916b963e57dbaf51f646635cc3e60048dea53baa2ce447227b25d653b"} 00:07:59 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 00:07:59 INFO - Writing to file /builds/slave/test/properties/blobber_files 00:07:59 INFO - Contents: 00:07:59 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora-Non-PGO/sha512/7bf4ea371e79f85f4a447621e8f3ce145d47fe878bf96e9e8de8d7ad56c5672c1c1240e7f0f0ced7fb8ccc799bb92333bf25aa01ec135c5730efb74af42f477d", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora-Non-PGO/sha512/8bc2a24671266a858264d631b24b8f1f0b79d81f73585c25c7e131a291b79757eace17bd09409de486e9337b7fc698183cebcf1c72b72d96126d26be544ddbec", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora-Non-PGO/sha512/df20b3d7de0a972bf1ec78b27fe78002a506a857e3344c29223d7139a6c4986e3aef02bc06ea8be798a9a045f00528ebc1ca1f1e8abf20e4924297236c6ba61e", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora-Non-PGO/sha512/b21321f67955694404abf7df944230a9fedfa76ef333ad458a9aa93aa09791e7738491d916b963e57dbaf51f646635cc3e60048dea53baa2ce447227b25d653b"} 00:07:59 INFO - Running post-run listener: copy_logs_to_upload_dir 00:07:59 INFO - Copying logs to upload dir... 00:07:59 INFO - mkdir: /builds/slave/test/build/upload/logs 00:07:59 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1233.885117 ========= master_lag: 0.02 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 33 secs) (at 2017-02-08 00:07:59.066680) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-02-08 00:07:59.070074) ========= 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=62c568580acbfdaac3eec7be000001dc-1486540043.589840-737819103 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora-Non-PGO/sha512/7bf4ea371e79f85f4a447621e8f3ce145d47fe878bf96e9e8de8d7ad56c5672c1c1240e7f0f0ced7fb8ccc799bb92333bf25aa01ec135c5730efb74af42f477d", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora-Non-PGO/sha512/8bc2a24671266a858264d631b24b8f1f0b79d81f73585c25c7e131a291b79757eace17bd09409de486e9337b7fc698183cebcf1c72b72d96126d26be544ddbec", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora-Non-PGO/sha512/df20b3d7de0a972bf1ec78b27fe78002a506a857e3344c29223d7139a6c4986e3aef02bc06ea8be798a9a045f00528ebc1ca1f1e8abf20e4924297236c6ba61e", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora-Non-PGO/sha512/b21321f67955694404abf7df944230a9fedfa76ef333ad458a9aa93aa09791e7738491d916b963e57dbaf51f646635cc3e60048dea53baa2ce447227b25d653b"} build_url:https://queue.taskcluster.net/v1/task/FXxDmAlYRxWRkiMnCupXTw/artifacts/public/build/target.tar.bz2 program finished with exit code 0 elapsedTime=0.011349 build_url: 'https://queue.taskcluster.net/v1/task/FXxDmAlYRxWRkiMnCupXTw/artifacts/public/build/target.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora-Non-PGO/sha512/7bf4ea371e79f85f4a447621e8f3ce145d47fe878bf96e9e8de8d7ad56c5672c1c1240e7f0f0ced7fb8ccc799bb92333bf25aa01ec135c5730efb74af42f477d", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora-Non-PGO/sha512/8bc2a24671266a858264d631b24b8f1f0b79d81f73585c25c7e131a291b79757eace17bd09409de486e9337b7fc698183cebcf1c72b72d96126d26be544ddbec", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora-Non-PGO/sha512/df20b3d7de0a972bf1ec78b27fe78002a506a857e3344c29223d7139a6c4986e3aef02bc06ea8be798a9a045f00528ebc1ca1f1e8abf20e4924297236c6ba61e", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora-Non-PGO/sha512/b21321f67955694404abf7df944230a9fedfa76ef333ad458a9aa93aa09791e7738491d916b963e57dbaf51f646635cc3e60048dea53baa2ce447227b25d653b"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-02-08 00:07:59.097674) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-02-08 00:07:59.098047) ========= 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=62c568580acbfdaac3eec7be000001dc-1486540043.589840-737819103 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004497 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-02-08 00:07:59.183127) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2017-02-08 00:07:59.183910) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2017-02-08 00:07:59.184759) ========= ========= Total master_lag: 0.18 =========