builder: mozilla-aurora_ubuntu64_hw_test-dromaeojs-pgo slave: talos-linux64-ix-077 starttime: 1488473012.8 results: success (0) revision: 71c2104babb740214d5803687337e6cb3b8978f8 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2017-03-02 08:43:32.799136) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2017-03-02 08:43:32.799600) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-03-02 08:43:32.799892) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-03-02 08:43:32.814882) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-03-02 08:43:32.815218) ========= 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=20e20d796406ba5117c4a6f1000001ba-1488472993.13859-242980632 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2017-03-02 08:43:33-- 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% 69.4M=0s 2017-03-02 08:43:33 (69.4 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.129353 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-03-02 08:43:32.958153) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-03-02 08:43:32.958497) ========= 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=20e20d796406ba5117c4a6f1000001ba-1488472993.13859-242980632 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.020276 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-03-02 08:43:33.009451) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-03-02 08:43:33.009937) ========= bash -c 'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev 71c2104babb740214d5803687337e6cb3b8978f8 --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 71c2104babb740214d5803687337e6cb3b8978f8 --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=20e20d796406ba5117c4a6f1000001ba-1488472993.13859-242980632 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2017-03-02 08:43:33,946 truncating revision to first 12 chars 2017-03-02 08:43:33,946 Setting DEBUG logging. 2017-03-02 08:43:33,946 attempt 1/10 2017-03-02 08:43:33,946 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/releases/mozilla-aurora/71c2104babb7?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2017-03-02 08:43:34,244 unpacking tar archive at: mozilla-aurora-71c2104babb7/testing/mozharness/ program finished with exit code 0 elapsedTime=0.606611 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-03-02 08:43:33.631012) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-03-02 08:43:33.631318) ========= script_repo_revision: 71c2104babb740214d5803687337e6cb3b8978f8 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-03-02 08:43:33.631876) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-03-02 08:43:33.632158) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-03-02 08:43:33.642244) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 36 secs) (at 2017-03-02 08:43:33.642656) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Aurora --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora 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', '--add-option', '--webServer,localhost', '--branch-name', 'Mozilla-Aurora', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-Aurora'] 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=20e20d796406ba5117c4a6f1000001ba-1488472993.13859-242980632 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 08:43:34 INFO - MultiFileLogger online at 20170302 08:43:34 in /builds/slave/test 08:43:34 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Aurora --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora 08:43:34 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 08:43:34 INFO - {'append_to_log': False, 08:43:34 INFO - 'base_work_dir': '/builds/slave/test', 08:43:34 INFO - 'blob_upload_branch': 'Mozilla-Aurora', 08:43:34 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 08:43:34 INFO - 'branch': 'Mozilla-Aurora', 08:43:34 INFO - 'buildbot_json_path': 'buildprops.json', 08:43:34 INFO - 'config_files': ('talos/linux_config.py',), 08:43:34 INFO - 'default_actions': ('clobber', 08:43:34 INFO - 'read-buildbot-config', 08:43:34 INFO - 'download-and-extract', 08:43:34 INFO - 'populate-webroot', 08:43:34 INFO - 'create-virtualenv', 08:43:34 INFO - 'install', 08:43:34 INFO - 'run-tests'), 08:43:34 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 08:43:34 INFO - 'download_minidump_stackwalk': True, 08:43:34 INFO - 'download_symbols': 'ondemand', 08:43:34 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 08:43:34 INFO - 'tooltool.py': '/tools/tooltool.py', 08:43:34 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 08:43:34 INFO - '/tools/misc-python/virtualenv.py')}, 08:43:34 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 08:43:34 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 08:43:34 INFO - 'installer_path': 'installer.exe', 08:43:34 INFO - 'log_level': 'info', 08:43:34 INFO - 'log_name': 'talos', 08:43:34 INFO - 'log_to_console': True, 08:43:34 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 08:43:34 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 08:43:34 INFO - 'opt_config_files': (), 08:43:34 INFO - 'pip_index': False, 08:43:34 INFO - 'sps_profile': False, 08:43:34 INFO - 'sps_profile_interval': 0, 08:43:34 INFO - 'suite': 'dromaeojs', 08:43:34 INFO - 'system_bits': '32', 08:43:34 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 08:43:34 INFO - 'title': 'talos-linux64-ix-077', 08:43:34 INFO - 'tooltool_cache': '/builds/tooltool_cache', 08:43:34 INFO - 'use_talos_json': True, 08:43:34 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 08:43:34 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 08:43:34 INFO - 'work_dir': 'build'} 08:43:34 INFO - [mozharness: 2017-03-02 16:43:34.682094Z] Running clobber step. 08:43:34 INFO - Running pre-action listener: _resource_record_pre_action 08:43:34 INFO - Running main action method: clobber 08:43:34 INFO - rmtree: /builds/slave/test/build 08:43:34 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 08:43:35 INFO - Running post-action listener: _resource_record_post_action 08:43:35 INFO - [mozharness: 2017-03-02 16:43:35.614379Z] Finished clobber step (success) 08:43:35 INFO - [mozharness: 2017-03-02 16:43:35.614482Z] Running read-buildbot-config step. 08:43:35 INFO - Running pre-action listener: _resource_record_pre_action 08:43:35 INFO - Running main action method: read_buildbot_config 08:43:35 INFO - Using buildbot properties: 08:43:35 INFO - { 08:43:35 INFO - "project": "", 08:43:35 INFO - "product": "firefox", 08:43:35 INFO - "who": "ffxbld@noreply.mozilla.org", 08:43:35 INFO - "installer_path": "public/build/target.tar.bz2", 08:43:35 INFO - "builddir": "mozilla-aurora_ubuntu64_hw_test-dromaeojs", 08:43:35 INFO - "repository": "https://hg.mozilla.org/releases/mozilla-aurora/", 08:43:35 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-aurora pgo talos dromaeojs", 08:43:35 INFO - "stage_platform": "linux64-pgo", 08:43:35 INFO - "basedir": "/builds/slave/test", 08:43:35 INFO - "buildnumber": 804, 08:43:35 INFO - "platform": "ubuntu64_hw", 08:43:35 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 08:43:35 INFO - "slavebuilddir": "test", 08:43:35 INFO - "taskId": "Seh7GVhuREm_AkEaWcNR0Q", 08:43:35 INFO - "branch": "mozilla-aurora", 08:43:35 INFO - "script_repo_revision": "production", 08:43:35 INFO - "revision": "71c2104babb740214d5803687337e6cb3b8978f8", 08:43:35 INFO - "slavename": "talos-linux64-ix-077", 08:43:35 INFO - "repo_path": "releases/mozilla-aurora" 08:43:35 INFO - } 08:43:35 INFO - Finding installer, test and symbols from parent task. 08:43:35 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/Seh7GVhuREm_AkEaWcNR0Q'}, attempt #1 08:43:36 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/Seh7GVhuREm_AkEaWcNR0Q'}, attempt #1 08:43:36 INFO - Task dependencies: KR-GqxOgS56ynaT1fQQ6qw 08:43:36 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/KR-GqxOgS56ynaT1fQQ6qw'}, attempt #1 08:43:37 INFO - Set installer_url: https://queue.taskcluster.net/v1/task/KR-GqxOgS56ynaT1fQQ6qw/artifacts/public/build/target.tar.bz2 08:43:37 INFO - Set test_url: https://queue.taskcluster.net/v1/task/KR-GqxOgS56ynaT1fQQ6qw/artifacts/public/build/test_packages.json 08:43:37 INFO - Set symbols_url: https://queue.taskcluster.net/v1/task/KR-GqxOgS56ynaT1fQQ6qw/artifacts/public/build/target.crashreporter-symbols.zip 08:43:37 INFO - Running post-action listener: _resource_record_post_action 08:43:37 INFO - [mozharness: 2017-03-02 16:43:37.020644Z] Finished read-buildbot-config step (success) 08:43:37 INFO - [mozharness: 2017-03-02 16:43:37.020864Z] Running download-and-extract step. 08:43:37 INFO - Running pre-action listener: _resource_record_pre_action 08:43:37 INFO - Running main action method: download_and_extract 08:43:37 INFO - mkdir: /builds/slave/test/build/tests 08:43:37 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')]} 08:43:37 INFO - trying https://queue.taskcluster.net/v1/task/KR-GqxOgS56ynaT1fQQ6qw/artifacts/public/build/target.test_packages.json 08:43:37 INFO - Downloading https://queue.taskcluster.net/v1/task/KR-GqxOgS56ynaT1fQQ6qw/artifacts/public/build/target.test_packages.json to /builds/slave/test/build/target.test_packages.json 08:43:37 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/KR-GqxOgS56ynaT1fQQ6qw/artifacts/public/build/target.test_packages.json', 'file_name': '/builds/slave/test/build/target.test_packages.json'}, attempt #1 08:43:37 INFO - Downloaded 896 bytes. 08:43:37 INFO - Reading from file /builds/slave/test/build/target.test_packages.json 08:43:37 INFO - Using the following test package requirements: 08:43:37 INFO - {u'common': [u'target.common.tests.zip'], 08:43:37 INFO - u'cppunittest': [u'target.common.tests.zip', u'target.cppunittest.tests.zip'], 08:43:37 INFO - u'gtest': [u'target.common.tests.zip', u'target.gtest.tests.zip'], 08:43:37 INFO - u'jittest': [u'target.common.tests.zip', u'target.jsshell.zip'], 08:43:37 INFO - u'mochitest': [u'target.common.tests.zip', u'target.mochitest.tests.zip'], 08:43:37 INFO - u'mozbase': [u'target.common.tests.zip'], 08:43:37 INFO - u'reftest': [u'target.common.tests.zip', u'target.reftest.tests.zip'], 08:43:37 INFO - u'talos': [u'target.common.tests.zip', u'target.talos.tests.zip'], 08:43:37 INFO - u'web-platform': [u'target.common.tests.zip', 08:43:37 INFO - u'target.web-platform.tests.zip'], 08:43:37 INFO - u'xpcshell': [u'target.common.tests.zip', u'target.xpcshell.tests.zip']} 08:43:37 INFO - Downloading packages: [u'target.common.tests.zip'] for test suite category: common 08:43:37 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/KR-GqxOgS56ynaT1fQQ6qw/artifacts/public/build/target.common.tests.zip 08:43:37 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/KR-GqxOgS56ynaT1fQQ6qw/artifacts/public/build/target.common.tests.zip'}, attempt #1 08:43:37 INFO - Fetch https://queue.taskcluster.net/v1/task/KR-GqxOgS56ynaT1fQQ6qw/artifacts/public/build/target.common.tests.zip into memory 08:43:38 INFO - Expected file size: 21861900 08:43:38 INFO - Obtained file size: 21861900 08:43:42 INFO - Downloading packages: [u'target.common.tests.zip', u'target.talos.tests.zip'] for test suite category: talos 08:43:42 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/KR-GqxOgS56ynaT1fQQ6qw/artifacts/public/build/target.common.tests.zip 08:43:42 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/KR-GqxOgS56ynaT1fQQ6qw/artifacts/public/build/target.common.tests.zip'}, attempt #1 08:43:42 INFO - Fetch https://queue.taskcluster.net/v1/task/KR-GqxOgS56ynaT1fQQ6qw/artifacts/public/build/target.common.tests.zip into memory 08:43:43 INFO - Expected file size: 21861900 08:43:43 INFO - Obtained file size: 21861900 08:43:48 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/KR-GqxOgS56ynaT1fQQ6qw/artifacts/public/build/target.talos.tests.zip 08:43:48 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/KR-GqxOgS56ynaT1fQQ6qw/artifacts/public/build/target.talos.tests.zip'}, attempt #1 08:43:48 INFO - Fetch https://queue.taskcluster.net/v1/task/KR-GqxOgS56ynaT1fQQ6qw/artifacts/public/build/target.talos.tests.zip into memory 08:43:48 INFO - Expected file size: 14403472 08:43:48 INFO - Obtained file size: 14403472 08:43:49 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')]} 08:43:49 INFO - trying https://queue.taskcluster.net/v1/task/KR-GqxOgS56ynaT1fQQ6qw/artifacts/public/build/target.tar.bz2 08:43:49 INFO - Downloading https://queue.taskcluster.net/v1/task/KR-GqxOgS56ynaT1fQQ6qw/artifacts/public/build/target.tar.bz2 to /builds/slave/test/build/target.tar.bz2 08:43:49 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/KR-GqxOgS56ynaT1fQQ6qw/artifacts/public/build/target.tar.bz2', 'file_name': '/builds/slave/test/build/target.tar.bz2'}, attempt #1 08:43:50 INFO - Downloaded 66165205 bytes. 08:43:50 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/KR-GqxOgS56ynaT1fQQ6qw/artifacts/public/build/target.tar.bz2 08:43:50 INFO - mkdir: /builds/slave/test/properties 08:43:50 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 08:43:50 INFO - Writing to file /builds/slave/test/properties/build_url 08:43:50 INFO - Contents: 08:43:50 INFO - build_url:https://queue.taskcluster.net/v1/task/KR-GqxOgS56ynaT1fQQ6qw/artifacts/public/build/target.tar.bz2 08:43:50 INFO - Running post-action listener: _resource_record_post_action 08:43:50 INFO - Running post-action listener: set_extra_try_arguments 08:43:50 INFO - [mozharness: 2017-03-02 16:43:50.405691Z] Finished download-and-extract step (success) 08:43:50 INFO - [mozharness: 2017-03-02 16:43:50.405789Z] Running populate-webroot step. 08:43:50 INFO - Running pre-action listener: _resource_record_pre_action 08:43:50 INFO - Running main action method: populate_webroot 08:43:50 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 08:43:50 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 08:43:50 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 08:43:50 INFO - '--tppagecycles', 08:43:50 INFO - '7'], 08:43:50 INFO - 'tests': ['tsvgm']}}, 08:43:50 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 08:43:50 INFO - 'tests': ['tresize', 'tcanvasmark']}, 08:43:50 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 08:43:50 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 08:43:50 INFO - 'tests': ['dromaeo_css', 'kraken']}, 08:43:50 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 08:43:50 INFO - 'g1': {'pagesets_name': 'tp5n.zip', 08:43:50 INFO - 'talos_options': ['--disable-e10s'], 08:43:50 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 08:43:50 INFO - 'g1-e10s': {'pagesets_name': 'tp5n.zip', 08:43:50 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 08:43:50 INFO - 'g2': {'pagesets_name': 'tp5n.zip', 08:43:50 INFO - 'talos_options': ['--disable-e10s'], 08:43:50 INFO - 'tests': ['damp', 'tps']}, 08:43:50 INFO - 'g2-e10s': {'pagesets_name': 'tp5n.zip', 08:43:50 INFO - 'tests': ['damp', 'tps']}, 08:43:50 INFO - 'g3': {'talos_options': ['--disable-e10s'], 08:43:50 INFO - 'tests': ['dromaeo_dom']}, 08:43:50 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 08:43:50 INFO - 'g4': {'talos_options': ['--disable-e10s'], 08:43:50 INFO - 'tests': ['basic_compositor_video']}, 08:43:50 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 08:43:50 INFO - 'other': {'talos_options': ['--disable-e10s'], 08:43:50 INFO - 'tests': ['a11yr', 08:43:50 INFO - 'ts_paint', 08:43:50 INFO - 'tpaint', 08:43:50 INFO - 'sessionrestore', 08:43:50 INFO - 'sessionrestore_no_auto_restore', 08:43:50 INFO - 'tabpaint']}, 08:43:50 INFO - 'other-e10s': {'tests': ['a11yr', 08:43:50 INFO - 'ts_paint', 08:43:50 INFO - 'tpaint', 08:43:50 INFO - 'sessionrestore', 08:43:50 INFO - 'sessionrestore_no_auto_restore', 08:43:50 INFO - 'tabpaint']}, 08:43:50 INFO - 'other-e10s_l64': {'tests': ['a11yr', 08:43:50 INFO - 'ts_paint', 08:43:50 INFO - 'tpaint', 08:43:50 INFO - 'sessionrestore', 08:43:50 INFO - 'sessionrestore_no_auto_restore', 08:43:50 INFO - 'tabpaint']}, 08:43:50 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 08:43:50 INFO - 'ts_paint', 08:43:50 INFO - 'tpaint', 08:43:50 INFO - 'sessionrestore', 08:43:50 INFO - 'sessionrestore_no_auto_restore', 08:43:50 INFO - 'tabpaint']}, 08:43:50 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 08:43:50 INFO - 'tests': ['a11yr', 08:43:50 INFO - 'ts_paint', 08:43:50 INFO - 'tpaint', 08:43:50 INFO - 'sessionrestore', 08:43:50 INFO - 'sessionrestore_no_auto_restore', 08:43:50 INFO - 'tabpaint']}, 08:43:50 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 08:43:50 INFO - 'tests': ['a11yr', 08:43:50 INFO - 'ts_paint', 08:43:50 INFO - 'tpaint', 08:43:50 INFO - 'sessionrestore', 08:43:50 INFO - 'sessionrestore_no_auto_restore', 08:43:50 INFO - 'tabpaint']}, 08:43:50 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 08:43:50 INFO - 'tests': ['tsvgx', 08:43:50 INFO - 'tsvgr_opacity', 08:43:50 INFO - 'tart', 08:43:50 INFO - 'tscrollx', 08:43:50 INFO - 'cart', 08:43:50 INFO - 'tsvg_static']}, 08:43:50 INFO - 'svgr-e10s': {'tests': ['tsvgx', 08:43:50 INFO - 'tsvgr_opacity', 08:43:50 INFO - 'tart', 08:43:50 INFO - 'tscrollx', 08:43:50 INFO - 'cart', 08:43:50 INFO - 'tsvg_static']}, 08:43:50 INFO - 'tp5o': {'pagesets_name': 'tp5n.zip', 08:43:50 INFO - 'talos_options': ['--disable-e10s'], 08:43:50 INFO - 'tests': ['tp5o']}, 08:43:50 INFO - 'tp5o-e10s': {'pagesets_name': 'tp5n.zip', 'tests': ['tp5o']}, 08:43:50 INFO - 'xperf': {'pagesets_name': 'tp5n.zip', 08:43:50 INFO - 'talos_options': ['--disable-e10s', 08:43:50 INFO - '--xperf_path', 08:43:50 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 08:43:50 INFO - 'tests': ['tp5n']}, 08:43:50 INFO - 'xperf-e10s': {'pagesets_name': 'tp5n.zip', 08:43:50 INFO - 'talos_options': ['--xperf_path', 08:43:50 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 08:43:50 INFO - 'tests': ['tp5n']}}, 08:43:50 INFO - 'talos.zip': {'path': '', 08:43:50 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 08:43:50 INFO - Running post-action listener: _resource_record_post_action 08:43:50 INFO - [mozharness: 2017-03-02 16:43:50.419114Z] Finished populate-webroot step (success) 08:43:50 INFO - [mozharness: 2017-03-02 16:43:50.419205Z] Running create-virtualenv step. 08:43:50 INFO - Running pre-action listener: _resource_record_pre_action 08:43:50 INFO - Running main action method: create_virtualenv 08:43:50 INFO - Creating virtualenv /builds/slave/test/build/venv 08:43:50 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 08:43:50 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 08:43:50 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 08:43:50 INFO - Using real prefix '/usr' 08:43:50 INFO - New python executable in /builds/slave/test/build/venv/bin/python 08:43:51 INFO - Installing distribute.............................................................................................................................................................................................done. 08:43:52 INFO - Installing pip.................done. 08:43:52 INFO - Return code: 0 08:43:52 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 08:43:52 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 08:43:53 INFO - Reading from file tmpfile_stdout 08:43:53 INFO - Output received: 08:43:53 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) 08:43:53 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 08:43:53 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')]} 08:43:53 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:43:53 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:43:53 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')]} 08:43:53 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:43:53 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:43:53 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 0x28981f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29a8a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2c0a630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2c93850>, '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 0x2c086d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2c08b60>, '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': '20e20d796406ba5117c4a6f1000001ba-1488472993.13859-242980632', '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 08:43:53 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 08:43:53 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 08:43:53 INFO - Using env: {'DISPLAY': ':0', 08:43:53 INFO - 'HOME': '/home/cltbld', 08:43:53 INFO - 'LANG': 'en_US.UTF-8', 08:43:53 INFO - 'LANGUAGE': 'en_US:en', 08:43:53 INFO - 'LOGNAME': 'cltbld', 08:43:53 INFO - 'MAIL': '/var/mail/cltbld', 08:43:53 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:43:53 INFO - 'MOZ_NO_REMOTE': '1', 08:43:53 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:43:53 INFO - 'NO_EM_RESTART': '1', 08:43:53 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:43:53 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:43:53 INFO - 'PWD': '/builds/slave/test', 08:43:53 INFO - 'SHELL': '/bin/bash', 08:43:53 INFO - 'SHLVL': '1', 08:43:53 INFO - 'TERM': 'linux', 08:43:53 INFO - 'TMOUT': '86400', 08:43:53 INFO - 'USER': 'cltbld', 08:43:53 INFO - 'XDG_SESSION_COOKIE': '20e20d796406ba5117c4a6f1000001ba-1488472993.13859-242980632', 08:43:53 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:43:53 INFO - '_': '/tools/buildbot/bin/python'} 08:43:53 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:43:53 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 08:43:53 INFO - Cleaning up... 08:43:53 INFO - Return code: 0 08:43:53 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 08:43:53 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')]} 08:43:53 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:43:53 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:43:53 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')]} 08:43:53 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:43:53 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:43:53 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 0x28981f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29a8a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2c0a630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2c93850>, '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 0x2c086d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2c08b60>, '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': '20e20d796406ba5117c4a6f1000001ba-1488472993.13859-242980632', '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 08:43:53 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 08:43:53 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 08:43:53 INFO - Using env: {'DISPLAY': ':0', 08:43:53 INFO - 'HOME': '/home/cltbld', 08:43:53 INFO - 'LANG': 'en_US.UTF-8', 08:43:53 INFO - 'LANGUAGE': 'en_US:en', 08:43:53 INFO - 'LOGNAME': 'cltbld', 08:43:53 INFO - 'MAIL': '/var/mail/cltbld', 08:43:53 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:43:53 INFO - 'MOZ_NO_REMOTE': '1', 08:43:53 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:43:53 INFO - 'NO_EM_RESTART': '1', 08:43:53 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:43:53 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:43:53 INFO - 'PWD': '/builds/slave/test', 08:43:53 INFO - 'SHELL': '/bin/bash', 08:43:53 INFO - 'SHLVL': '1', 08:43:53 INFO - 'TERM': 'linux', 08:43:53 INFO - 'TMOUT': '86400', 08:43:53 INFO - 'USER': 'cltbld', 08:43:53 INFO - 'XDG_SESSION_COOKIE': '20e20d796406ba5117c4a6f1000001ba-1488472993.13859-242980632', 08:43:53 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:43:53 INFO - '_': '/tools/buildbot/bin/python'} 08:43:53 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:43:53 INFO - Downloading/unpacking psutil>=3.1.1 08:43: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 08:43: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 08:43: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 08:43: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 08:43: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 08:43: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 08:43:55 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 08:43:55 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 08:43:55 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 08:43:55 INFO - Installing collected packages: psutil 08:43:55 INFO - Running setup.py install for psutil 08:43:55 INFO - building 'psutil._psutil_linux' extension 08:43:55 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 08:43:55 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 08:43:55 INFO - building 'psutil._psutil_posix' extension 08:43:55 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 08:43:56 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 08:43:56 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 08:43:56 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 08:43:56 INFO - Successfully installed psutil 08:43:56 INFO - Cleaning up... 08:43:56 INFO - Return code: 0 08:43:56 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 08:43:56 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')]} 08:43:56 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:43:56 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:43:56 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')]} 08:43:56 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:43:56 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:43:56 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 0x28981f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29a8a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2c0a630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2c93850>, '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 0x2c086d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2c08b60>, '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': '20e20d796406ba5117c4a6f1000001ba-1488472993.13859-242980632', '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 08:43:56 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 08:43:56 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 08:43:56 INFO - Using env: {'DISPLAY': ':0', 08:43:56 INFO - 'HOME': '/home/cltbld', 08:43:56 INFO - 'LANG': 'en_US.UTF-8', 08:43:56 INFO - 'LANGUAGE': 'en_US:en', 08:43:56 INFO - 'LOGNAME': 'cltbld', 08:43:56 INFO - 'MAIL': '/var/mail/cltbld', 08:43:56 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:43:56 INFO - 'MOZ_NO_REMOTE': '1', 08:43:56 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:43:56 INFO - 'NO_EM_RESTART': '1', 08:43:56 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:43:56 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:43:56 INFO - 'PWD': '/builds/slave/test', 08:43:56 INFO - 'SHELL': '/bin/bash', 08:43:56 INFO - 'SHLVL': '1', 08:43:56 INFO - 'TERM': 'linux', 08:43:56 INFO - 'TMOUT': '86400', 08:43:56 INFO - 'USER': 'cltbld', 08:43:56 INFO - 'XDG_SESSION_COOKIE': '20e20d796406ba5117c4a6f1000001ba-1488472993.13859-242980632', 08:43:56 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:43:56 INFO - '_': '/tools/buildbot/bin/python'} 08:43:56 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:43:56 INFO - Downloading/unpacking mozsystemmonitor==0.3 08:43:56 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 08:43:56 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 08:43:56 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 08:43:56 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 08:43:56 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 08:43:56 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 08:43:58 INFO - Downloading mozsystemmonitor-0.3.tar.gz 08:43:58 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 08:43:58 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 08:43:58 INFO - Installing collected packages: mozsystemmonitor 08:43:58 INFO - Running setup.py install for mozsystemmonitor 08:43:58 INFO - Successfully installed mozsystemmonitor 08:43:58 INFO - Cleaning up... 08:43:58 INFO - Return code: 0 08:43:58 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 08:43: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')]} 08:43:58 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:43:58 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:43: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')]} 08:43:58 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:43:58 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:43:58 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 0x28981f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29a8a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2c0a630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2c93850>, '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 0x2c086d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2c08b60>, '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': '20e20d796406ba5117c4a6f1000001ba-1488472993.13859-242980632', '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 08:43:58 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 08:43:58 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 08:43:58 INFO - Using env: {'DISPLAY': ':0', 08:43:58 INFO - 'HOME': '/home/cltbld', 08:43:58 INFO - 'LANG': 'en_US.UTF-8', 08:43:58 INFO - 'LANGUAGE': 'en_US:en', 08:43:58 INFO - 'LOGNAME': 'cltbld', 08:43:58 INFO - 'MAIL': '/var/mail/cltbld', 08:43:58 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:43:58 INFO - 'MOZ_NO_REMOTE': '1', 08:43:58 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:43:58 INFO - 'NO_EM_RESTART': '1', 08:43:58 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:43:58 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:43:58 INFO - 'PWD': '/builds/slave/test', 08:43:58 INFO - 'SHELL': '/bin/bash', 08:43:58 INFO - 'SHLVL': '1', 08:43:58 INFO - 'TERM': 'linux', 08:43:58 INFO - 'TMOUT': '86400', 08:43:58 INFO - 'USER': 'cltbld', 08:43:58 INFO - 'XDG_SESSION_COOKIE': '20e20d796406ba5117c4a6f1000001ba-1488472993.13859-242980632', 08:43:58 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:43:58 INFO - '_': '/tools/buildbot/bin/python'} 08:43:58 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:43:58 INFO - Downloading/unpacking jsonschema==2.5.1 08:43:58 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 08:43:58 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 08:43:58 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 08:43:58 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 08:43:58 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 08:43:58 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 08:44:00 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 08:44:00 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 08:44:00 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 08:44:00 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 08:44:00 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 08:44:00 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 08:44:00 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 08:44:00 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 08:44:01 INFO - Downloading functools32-3.2.3-2.tar.gz 08:44:01 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 08:44:01 INFO - warning: no files found matching '*.txt' 08:44:01 INFO - no previously-included directories found matching 'build' 08:44:01 INFO - no previously-included directories found matching 'dist' 08:44:01 INFO - no previously-included directories found matching '.git*' 08:44:01 INFO - Installing collected packages: jsonschema, functools32 08:44:01 INFO - Running setup.py install for functools32 08:44:01 INFO - warning: no files found matching '*.txt' 08:44:01 INFO - no previously-included directories found matching 'build' 08:44:01 INFO - no previously-included directories found matching 'dist' 08:44:01 INFO - no previously-included directories found matching '.git*' 08:44:01 INFO - Successfully installed jsonschema functools32 08:44:01 INFO - Cleaning up... 08:44:01 INFO - Return code: 0 08:44:01 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 08:44:01 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')]} 08:44:01 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:44:01 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:44:01 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')]} 08:44:01 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:44:01 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:44:01 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 0x28981f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29a8a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2c0a630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2c93850>, '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 0x2c086d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2c08b60>, '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': '20e20d796406ba5117c4a6f1000001ba-1488472993.13859-242980632', '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 08:44:01 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 08:44:01 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 08:44:01 INFO - Using env: {'DISPLAY': ':0', 08:44:01 INFO - 'HOME': '/home/cltbld', 08:44:01 INFO - 'LANG': 'en_US.UTF-8', 08:44:01 INFO - 'LANGUAGE': 'en_US:en', 08:44:01 INFO - 'LOGNAME': 'cltbld', 08:44:01 INFO - 'MAIL': '/var/mail/cltbld', 08:44:01 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:44:01 INFO - 'MOZ_NO_REMOTE': '1', 08:44:01 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:44:01 INFO - 'NO_EM_RESTART': '1', 08:44:01 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:44:01 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:44:01 INFO - 'PWD': '/builds/slave/test', 08:44:01 INFO - 'SHELL': '/bin/bash', 08:44:01 INFO - 'SHLVL': '1', 08:44:01 INFO - 'TERM': 'linux', 08:44:01 INFO - 'TMOUT': '86400', 08:44:01 INFO - 'USER': 'cltbld', 08:44:01 INFO - 'XDG_SESSION_COOKIE': '20e20d796406ba5117c4a6f1000001ba-1488472993.13859-242980632', 08:44:01 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:44:01 INFO - '_': '/tools/buildbot/bin/python'} 08:44:01 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:44:01 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 08:44:01 INFO - Cleaning up... 08:44:01 INFO - Return code: 0 08:44:01 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 08:44:01 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')]} 08:44:01 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:44:01 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:44:01 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')]} 08:44:01 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:44:01 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:44:01 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 0x28981f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29a8a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2c0a630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2c93850>, '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 0x2c086d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2c08b60>, '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': '20e20d796406ba5117c4a6f1000001ba-1488472993.13859-242980632', '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 08:44:01 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 08:44:01 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 08:44:01 INFO - Using env: {'DISPLAY': ':0', 08:44:01 INFO - 'HOME': '/home/cltbld', 08:44:01 INFO - 'LANG': 'en_US.UTF-8', 08:44:01 INFO - 'LANGUAGE': 'en_US:en', 08:44:01 INFO - 'LOGNAME': 'cltbld', 08:44:01 INFO - 'MAIL': '/var/mail/cltbld', 08:44:01 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:44:01 INFO - 'MOZ_NO_REMOTE': '1', 08:44:01 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:44:01 INFO - 'NO_EM_RESTART': '1', 08:44:01 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:44:01 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:44:01 INFO - 'PWD': '/builds/slave/test', 08:44:01 INFO - 'SHELL': '/bin/bash', 08:44:01 INFO - 'SHLVL': '1', 08:44:01 INFO - 'TERM': 'linux', 08:44:01 INFO - 'TMOUT': '86400', 08:44:01 INFO - 'USER': 'cltbld', 08:44:01 INFO - 'XDG_SESSION_COOKIE': '20e20d796406ba5117c4a6f1000001ba-1488472993.13859-242980632', 08:44:01 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:44:01 INFO - '_': '/tools/buildbot/bin/python'} 08:44:01 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:44:01 INFO - Downloading/unpacking blobuploader==1.2.4 08:44:01 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 08:44:01 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 08:44:01 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 08:44:01 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 08:44:01 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 08:44:01 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 08:44:03 INFO - Downloading blobuploader-1.2.4.tar.gz 08:44:03 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 08:44:03 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 08:44:03 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 08:44:03 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 08:44:03 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 08:44:03 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 08:44:03 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 08:44:03 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 08:44:04 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 08:44:04 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 08:44:04 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 08:44:04 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 08:44:04 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 08:44:04 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 08:44:04 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 08:44:04 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 08:44:04 INFO - Downloading docopt-0.6.1.tar.gz 08:44:04 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 08:44:04 INFO - Installing collected packages: blobuploader, requests, docopt 08:44:04 INFO - Running setup.py install for blobuploader 08:44:04 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 08:44:04 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 08:44:04 INFO - Running setup.py install for requests 08:44:05 INFO - Running setup.py install for docopt 08:44:05 INFO - Successfully installed blobuploader requests docopt 08:44:05 INFO - Cleaning up... 08:44:05 INFO - Return code: 0 08:44:05 INFO - Installing None into virtualenv /builds/slave/test/build/venv 08:44:05 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')]} 08:44:05 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:44:05 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:44:05 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')]} 08:44:05 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:44:05 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:44:05 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 0x28981f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29a8a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2c0a630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2c93850>, '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 0x2c086d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2c08b60>, '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': '20e20d796406ba5117c4a6f1000001ba-1488472993.13859-242980632', '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 08:44:05 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 08:44:05 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 08:44:05 INFO - Using env: {'DISPLAY': ':0', 08:44:05 INFO - 'HOME': '/home/cltbld', 08:44:05 INFO - 'LANG': 'en_US.UTF-8', 08:44:05 INFO - 'LANGUAGE': 'en_US:en', 08:44:05 INFO - 'LOGNAME': 'cltbld', 08:44:05 INFO - 'MAIL': '/var/mail/cltbld', 08:44:05 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:44:05 INFO - 'MOZ_NO_REMOTE': '1', 08:44:05 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:44:05 INFO - 'NO_EM_RESTART': '1', 08:44:05 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:44:05 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:44:05 INFO - 'PWD': '/builds/slave/test', 08:44:05 INFO - 'SHELL': '/bin/bash', 08:44:05 INFO - 'SHLVL': '1', 08:44:05 INFO - 'TERM': 'linux', 08:44:05 INFO - 'TMOUT': '86400', 08:44:05 INFO - 'USER': 'cltbld', 08:44:05 INFO - 'XDG_SESSION_COOKIE': '20e20d796406ba5117c4a6f1000001ba-1488472993.13859-242980632', 08:44:05 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:44:05 INFO - '_': '/tools/buildbot/bin/python'} 08:44:05 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:44:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 08:44:05 INFO - Running setup.py (path:/tmp/pip-ErThts-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 08:44:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 08:44:05 INFO - Running setup.py (path:/tmp/pip-yvStBT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 08:44:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 08:44:05 INFO - Running setup.py (path:/tmp/pip-kSGrQs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 08:44:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 08:44:05 INFO - Running setup.py (path:/tmp/pip-0h4_c1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 08:44:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 08:44:05 INFO - Running setup.py (path:/tmp/pip-UgwTS3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 08:44:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 08:44:05 INFO - Running setup.py (path:/tmp/pip-MRpUcB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 08:44:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 08:44:05 INFO - Running setup.py (path:/tmp/pip-gfA7BR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 08:44:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 08:44:06 INFO - Running setup.py (path:/tmp/pip-0sph9B-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 08:44:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 08:44:06 INFO - Running setup.py (path:/tmp/pip-wDO6yG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 08:44:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 08:44:06 INFO - Running setup.py (path:/tmp/pip-imm86s-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 08:44:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 08:44:06 INFO - Running setup.py (path:/tmp/pip-OSnZp5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 08:44:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 08:44:06 INFO - Running setup.py (path:/tmp/pip-6r6NSx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 08:44:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 08:44:06 INFO - Running setup.py (path:/tmp/pip-0eMQQd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 08:44:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 08:44:06 INFO - Running setup.py (path:/tmp/pip-vaeeV8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 08:44:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 08:44:06 INFO - Running setup.py (path:/tmp/pip-CoVSQz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 08:44:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 08:44:06 INFO - Running setup.py (path:/tmp/pip-GStohx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 08:44:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 08:44:06 INFO - Running setup.py (path:/tmp/pip-KbSB8q-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 08:44:06 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 08:44:06 INFO - Running setup.py install for manifestparser 08:44:06 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 08:44:06 INFO - Running setup.py install for mozcrash 08:44:06 INFO - Running setup.py install for mozdebug 08:44:07 INFO - Running setup.py install for mozdevice 08:44:07 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 08:44:07 INFO - Installing dm script to /builds/slave/test/build/venv/bin 08:44:07 INFO - Running setup.py install for mozfile 08:44:07 INFO - Running setup.py install for mozhttpd 08:44:07 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 08:44:07 INFO - Running setup.py install for mozinfo 08:44:07 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 08:44:07 INFO - Running setup.py install for mozInstall 08:44:07 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 08:44:07 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 08:44:07 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 08:44:07 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 08:44:07 INFO - Running setup.py install for mozleak 08:44:07 INFO - Running setup.py install for mozlog 08:44:07 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 08:44:07 INFO - Running setup.py install for moznetwork 08:44:07 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 08:44:07 INFO - Running setup.py install for mozprocess 08:44:08 INFO - Running setup.py install for mozprofile 08:44:08 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 08:44:08 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 08:44:08 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 08:44:08 INFO - Running setup.py install for mozrunner 08:44:08 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 08:44:08 INFO - Running setup.py install for mozscreenshot 08:44:08 INFO - Running setup.py install for moztest 08:44:08 INFO - Running setup.py install for mozversion 08:44:08 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 08:44:08 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 08:44:08 INFO - Cleaning up... 08:44:08 INFO - Return code: 0 08:44:08 INFO - Installing None into virtualenv /builds/slave/test/build/venv 08:44:08 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')]} 08:44:08 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:44:08 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:44:08 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')]} 08:44:08 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:44:08 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:44:08 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 0x28981f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29a8a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2c0a630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2c93850>, '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 0x2c086d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2c08b60>, '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': '20e20d796406ba5117c4a6f1000001ba-1488472993.13859-242980632', '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 08:44:08 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 08:44:08 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 08:44:08 INFO - Using env: {'DISPLAY': ':0', 08:44:08 INFO - 'HOME': '/home/cltbld', 08:44:08 INFO - 'LANG': 'en_US.UTF-8', 08:44:08 INFO - 'LANGUAGE': 'en_US:en', 08:44:08 INFO - 'LOGNAME': 'cltbld', 08:44:08 INFO - 'MAIL': '/var/mail/cltbld', 08:44:08 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:44:08 INFO - 'MOZ_NO_REMOTE': '1', 08:44:08 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:44:08 INFO - 'NO_EM_RESTART': '1', 08:44:08 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:44:08 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:44:08 INFO - 'PWD': '/builds/slave/test', 08:44:08 INFO - 'SHELL': '/bin/bash', 08:44:08 INFO - 'SHLVL': '1', 08:44:08 INFO - 'TERM': 'linux', 08:44:08 INFO - 'TMOUT': '86400', 08:44:08 INFO - 'USER': 'cltbld', 08:44:08 INFO - 'XDG_SESSION_COOKIE': '20e20d796406ba5117c4a6f1000001ba-1488472993.13859-242980632', 08:44:08 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:44:08 INFO - '_': '/tools/buildbot/bin/python'} 08:44:08 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:44:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 08:44:08 INFO - Running setup.py (path:/tmp/pip-mV5852-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 08:44:08 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)) 08:44:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 08:44:08 INFO - Running setup.py (path:/tmp/pip-qkoC6n-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 08:44:08 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)) 08:44:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 08:44:08 INFO - Running setup.py (path:/tmp/pip-AIRyHs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 08:44:09 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)) 08:44:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 08:44:09 INFO - Running setup.py (path:/tmp/pip-N3JIxV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 08:44:09 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)) 08:44:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 08:44:09 INFO - Running setup.py (path:/tmp/pip-LJa0I7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 08:44:09 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)) 08:44:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 08:44:09 INFO - Running setup.py (path:/tmp/pip-MHxg2v-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 08:44:09 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)) 08:44:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 08:44:09 INFO - Running setup.py (path:/tmp/pip-90CO2E-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 08:44:09 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)) 08:44:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 08:44:09 INFO - Running setup.py (path:/tmp/pip-lYe7TO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 08:44:09 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)) 08:44:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 08:44:09 INFO - Running setup.py (path:/tmp/pip-BvVuqa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 08:44:09 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)) 08:44:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 08:44:09 INFO - Running setup.py (path:/tmp/pip-Ei85NG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 08:44:09 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)) 08:44:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 08:44:09 INFO - Running setup.py (path:/tmp/pip-nzuy6v-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 08:44:09 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)) 08:44:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 08:44:09 INFO - Running setup.py (path:/tmp/pip-1PBYTt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 08:44:09 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)) 08:44:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 08:44:09 INFO - Running setup.py (path:/tmp/pip-4Ys1ee-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 08:44:09 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)) 08:44:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 08:44:09 INFO - Running setup.py (path:/tmp/pip-Ed9EUi-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 08:44:09 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)) 08:44:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 08:44:09 INFO - Running setup.py (path:/tmp/pip-9ttnyc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 08:44:09 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)) 08:44:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 08:44:09 INFO - Running setup.py (path:/tmp/pip-l7kqPq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 08:44:09 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)) 08:44:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 08:44:09 INFO - Running setup.py (path:/tmp/pip-7Tntb0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 08:44:10 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)) 08:44:10 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)) 08:44:10 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)) 08:44:10 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)) 08:44:10 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)) 08:44:10 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)) 08:44:10 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 08:44:10 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 08:44:10 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 08:44:10 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 08:44:10 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 08:44:10 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 08:44:10 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 08:44:12 INFO - Downloading blessings-1.6.tar.gz 08:44:12 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 08:44:12 INFO - Installing collected packages: blessings 08:44:12 INFO - Running setup.py install for blessings 08:44:12 INFO - Successfully installed blessings 08:44:12 INFO - Cleaning up... 08:44:12 INFO - Return code: 0 08:44:12 INFO - Done creating virtualenv /builds/slave/test/build/venv. 08:44:12 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 08:44:12 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 08:44:12 INFO - Reading from file tmpfile_stdout 08:44:12 INFO - Current package versions: 08:44:12 INFO - argparse == 1.2.1 08:44:12 INFO - blessings == 1.6 08:44:12 INFO - blobuploader == 1.2.4 08:44:12 INFO - docopt == 0.6.1 08:44:12 INFO - functools32 == 3.2.3-2 08:44:12 INFO - jsonschema == 2.5.1 08:44:12 INFO - manifestparser == 1.1 08:44:12 INFO - mozInstall == 1.12 08:44:12 INFO - mozcrash == 1.0 08:44:12 INFO - mozdebug == 0.1 08:44:12 INFO - mozdevice == 0.49 08:44:12 INFO - mozfile == 1.2 08:44:12 INFO - mozhttpd == 0.7 08:44:12 INFO - mozinfo == 0.9 08:44:12 INFO - mozleak == 0.1 08:44:12 INFO - mozlog == 3.4 08:44:12 INFO - moznetwork == 0.27 08:44:12 INFO - mozprocess == 0.24 08:44:12 INFO - mozprofile == 0.28 08:44:12 INFO - mozrunner == 6.13 08:44:12 INFO - mozscreenshot == 0.1 08:44:12 INFO - mozsystemmonitor == 0.3 08:44:12 INFO - moztest == 0.8 08:44:12 INFO - mozversion == 1.4 08:44:12 INFO - psutil == 3.1.1 08:44:12 INFO - requests == 1.2.3 08:44:12 INFO - wsgiref == 0.1.2 08:44:12 INFO - Installing None into virtualenv /builds/slave/test/build/venv 08:44:12 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')]} 08:44:12 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:44:12 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:44:12 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')]} 08:44:12 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:44:12 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:44:12 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 0x28981f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29a8a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2c0a630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2c93850>, '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 0x2c086d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2c08b60>, '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': '20e20d796406ba5117c4a6f1000001ba-1488472993.13859-242980632', '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 08:44:12 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 08:44:12 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 08:44:12 INFO - Using env: {'DISPLAY': ':0', 08:44:12 INFO - 'HOME': '/home/cltbld', 08:44:12 INFO - 'LANG': 'en_US.UTF-8', 08:44:12 INFO - 'LANGUAGE': 'en_US:en', 08:44:12 INFO - 'LOGNAME': 'cltbld', 08:44:12 INFO - 'MAIL': '/var/mail/cltbld', 08:44:12 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:44:12 INFO - 'MOZ_NO_REMOTE': '1', 08:44:12 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:44:12 INFO - 'NO_EM_RESTART': '1', 08:44:12 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:44:12 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:44:12 INFO - 'PWD': '/builds/slave/test', 08:44:12 INFO - 'SHELL': '/bin/bash', 08:44:12 INFO - 'SHLVL': '1', 08:44:12 INFO - 'TERM': 'linux', 08:44:12 INFO - 'TMOUT': '86400', 08:44:12 INFO - 'USER': 'cltbld', 08:44:12 INFO - 'XDG_SESSION_COOKIE': '20e20d796406ba5117c4a6f1000001ba-1488472993.13859-242980632', 08:44:12 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:44:12 INFO - '_': '/tools/buildbot/bin/python'} 08:44:12 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:44:12 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)) 08:44:12 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)) 08:44:12 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)) 08:44:12 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)) 08:44:12 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)) 08:44:12 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)) 08:44:12 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)) 08:44:12 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)) 08:44:12 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)) 08:44:12 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)) 08:44:12 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)) 08:44:12 INFO - Cleaning up... 08:44:12 INFO - Return code: 0 08:44:12 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 08:44:12 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')]} 08:44:12 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:44:12 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:44:12 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')]} 08:44:12 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:44:12 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:44:12 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 0x28981f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29a8a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2c0a630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2c93850>, '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 0x2c086d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2c08b60>, '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': '20e20d796406ba5117c4a6f1000001ba-1488472993.13859-242980632', '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 08:44:12 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 08:44:12 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 08:44:12 INFO - Using env: {'DISPLAY': ':0', 08:44:12 INFO - 'HOME': '/home/cltbld', 08:44:12 INFO - 'LANG': 'en_US.UTF-8', 08:44:12 INFO - 'LANGUAGE': 'en_US:en', 08:44:12 INFO - 'LOGNAME': 'cltbld', 08:44:12 INFO - 'MAIL': '/var/mail/cltbld', 08:44:12 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:44:12 INFO - 'MOZ_NO_REMOTE': '1', 08:44:12 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:44:12 INFO - 'NO_EM_RESTART': '1', 08:44:12 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:44:12 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:44:12 INFO - 'PWD': '/builds/slave/test', 08:44:12 INFO - 'SHELL': '/bin/bash', 08:44:12 INFO - 'SHLVL': '1', 08:44:12 INFO - 'TERM': 'linux', 08:44:12 INFO - 'TMOUT': '86400', 08:44:12 INFO - 'USER': 'cltbld', 08:44:12 INFO - 'XDG_SESSION_COOKIE': '20e20d796406ba5117c4a6f1000001ba-1488472993.13859-242980632', 08:44:12 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:44:12 INFO - '_': '/tools/buildbot/bin/python'} 08:44:12 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:44:12 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 08:44:12 INFO - Cleaning up... 08:44:13 INFO - Return code: 0 08:44:13 INFO - Running post-action listener: _resource_record_post_action 08:44:13 INFO - Running post-action listener: _start_resource_monitoring 08:44:13 INFO - Starting resource monitoring. 08:44:13 INFO - [mozharness: 2017-03-02 16:44:13.043073Z] Finished create-virtualenv step (success) 08:44:13 INFO - [mozharness: 2017-03-02 16:44:13.043530Z] Running install step. 08:44:13 INFO - Running pre-action listener: _resource_record_pre_action 08:44:13 INFO - Running main action method: install 08:44:13 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 08:44:13 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 08:44:13 INFO - Reading from file tmpfile_stdout 08:44:13 INFO - Detecting whether we're running mozinstall >=1.0... 08:44:13 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 08:44:13 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 08:44:13 INFO - Reading from file tmpfile_stdout 08:44:13 INFO - Output received: 08:44:13 INFO - Usage: mozinstall [options] installer 08:44:13 INFO - Options: 08:44:13 INFO - -h, --help show this help message and exit 08:44:13 INFO - -d DEST, --destination=DEST 08:44:13 INFO - Directory to install application into. [default: 08:44:13 INFO - "/builds/slave/test"] 08:44:13 INFO - --app=APP Application being installed. [default: firefox] 08:44:13 INFO - mkdir: /builds/slave/test/build/application 08:44:13 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'] 08:44:13 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/target.tar.bz2 --destination /builds/slave/test/build/application 08:44:29 INFO - Reading from file tmpfile_stdout 08:44:29 INFO - Output received: 08:44:29 INFO - /builds/slave/test/build/application/firefox/firefox 08:44:29 INFO - Running post-action listener: _resource_record_post_action 08:44:29 INFO - [mozharness: 2017-03-02 16:44:29.843013Z] Finished install step (success) 08:44:29 INFO - [mozharness: 2017-03-02 16:44:29.843292Z] Running run-tests step. 08:44:29 INFO - Running pre-action listener: _resource_record_pre_action 08:44:29 INFO - Running main action method: run_tests 08:44:29 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 08:44:29 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 08:44:29 INFO - Python 2.7.3 08:44:29 INFO - Return code: 0 08:44:29 INFO - grabbing minidump binary from tooltool 08:44:29 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')]} 08:44:29 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 0x2c93850>, '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 0x2c086d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2c08b60>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 08:44:29 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 08:44:29 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 08:44:29 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 08:44:29 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 08:44:29 INFO - Return code: 0 08:44:29 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 08:44:29 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 08:44:29 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 08:44:29 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 08:44:29 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 08:44:29 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Aurora', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/KR-GqxOgS56ynaT1fQQ6qw/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-077', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] in /builds/slave/test/build 08:44:29 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Mozilla-Aurora --suite dromaeojs --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/KR-GqxOgS56ynaT1fQQ6qw/artifacts/public/build/target.crashreporter-symbols.zip --title talos-linux64-ix-077 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log 08:44:29 INFO - Using env: {'DISPLAY': ':0', 08:44:29 INFO - 'HOME': '/home/cltbld', 08:44:29 INFO - 'LANG': 'en_US.UTF-8', 08:44:29 INFO - 'LANGUAGE': 'en_US:en', 08:44:29 INFO - 'LOGNAME': 'cltbld', 08:44:29 INFO - 'MAIL': '/var/mail/cltbld', 08:44:29 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 08:44:29 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 08:44:29 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:44:29 INFO - 'MOZ_NO_REMOTE': '1', 08:44:29 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 08:44:29 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:44:29 INFO - 'NO_EM_RESTART': '1', 08:44:29 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:44:29 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:44:29 INFO - 'PWD': '/builds/slave/test', 08:44:29 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 08:44:29 INFO - 'SHELL': '/bin/bash', 08:44:29 INFO - 'SHLVL': '1', 08:44:29 INFO - 'TERM': 'linux', 08:44:29 INFO - 'TMOUT': '86400', 08:44:29 INFO - 'USER': 'cltbld', 08:44:29 INFO - 'XDG_SESSION_COOKIE': '20e20d796406ba5117c4a6f1000001ba-1488472993.13859-242980632', 08:44:29 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:44:29 INFO - '_': '/tools/buildbot/bin/python'} 08:44:29 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Aurora', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/KR-GqxOgS56ynaT1fQQ6qw/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-077', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] with output_timeout 3600 08:44:30 INFO - mozversion application_buildid: 20170302154920 08:44:30 INFO - mozversion application_changeset: 71c2104babb740214d5803687337e6cb3b8978f8 08:44:30 INFO - mozversion application_display_name: FirefoxDeveloperEdition 08:44:30 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 08:44:30 INFO - mozversion application_name: Firefox 08:44:30 INFO - mozversion application_remotingname: firefox-dev 08:44:30 INFO - mozversion application_repository: https://hg.mozilla.org/releases/mozilla-aurora 08:44:30 INFO - mozversion application_vendor: Mozilla 08:44:30 INFO - mozversion application_version: 53.0a2 08:44:30 INFO - mozversion platform_buildid: 20170302154920 08:44:30 INFO - mozversion platform_changeset: 71c2104babb740214d5803687337e6cb3b8978f8 08:44:30 INFO - mozversion platform_repository: https://hg.mozilla.org/releases/mozilla-aurora 08:44:30 INFO - mozversion platform_version: 53.0a2 08:44:30 INFO - using testdate: 1488473070 08:44:30 INFO - actual date: 1488473070 08:44:30 INFO - starting webserver on 'localhost:52838' 08:44:30 INFO - SUITE-START | Running 2 tests 08:44:30 INFO - TEST-START | dromaeo_css 08:44:30 INFO - operating with platform_type : linux_ 08:44:30 INFO - Initialising browser for dromaeo_css test... 08:44:30 INFO - TEST-INFO | started process 9772 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpb7B1k_/profile http://localhost:52838/getInfo.html) 08:44:34 INFO - PROCESS | 9772 | __metrics Screen width/height:1600/1200 08:44:34 INFO - PROCESS | 9772 | colorDepth:24 08:44:34 INFO - PROCESS | 9772 | Browser inner width/height: 1024/697 08:44:34 INFO - PROCESS | 9772 | __metrics 08:44:34 INFO - PROCESS | 9772 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 692: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 08:44:34 INFO - PROCESS | 9772 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 303: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 08:44:35 INFO - TEST-INFO | 9772: exit 0 08:44:35 INFO - Browser initialized. 08:44:35 INFO - Running cycle 1/1 for dromaeo_css test... 08:44:35 INFO - TEST-INFO | started process 9866 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpb7B1k_/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 08:44:47 INFO - PROCESS | 9866 | RSS: Main: 138076160 08:44:47 INFO - PROCESS | 9866 | 08:47:47 INFO - PROCESS | 9866 | Cycle 1(1): loaded http://localhost:52838/tests/dromaeo/cssquery-dojo.html (next: http://localhost:52838/tests/dromaeo/cssquery-ext.html) 08:47:49 INFO - PROCESS | 9866 | RSS: Main: 230834176 08:47:49 INFO - PROCESS | 9866 | 08:49:37 INFO - PROCESS | 9866 | ************************* 08:49:37 INFO - PROCESS | 9866 | A coding exception was thrown and uncaught in a Task. 08:49:37 INFO - PROCESS | 9866 | 08:49:37 ERROR - PROCESS | 9866 | Full message: TypeError: NetworkError when attempting to fetch resource. 08:49:37 INFO - PROCESS | 9866 | Full stack: 08:49:37 INFO - PROCESS | 9866 | ************************* 08:50:51 INFO - PROCESS | 9866 | Cycle 1(1): loaded http://localhost:52838/tests/dromaeo/cssquery-ext.html (next: http://localhost:52838/tests/dromaeo/cssquery-jquery.html) 08:50:52 INFO - PROCESS | 9866 | RSS: Main: 225771520 08:50:52 INFO - PROCESS | 9866 | 08:53:53 INFO - PROCESS | 9866 | Cycle 1(1): loaded http://localhost:52838/tests/dromaeo/cssquery-jquery.html (next: http://localhost:52838/tests/dromaeo/cssquery-mootools.html) 08:53:54 INFO - PROCESS | 9866 | RSS: Main: 217612288 08:53:54 INFO - PROCESS | 9866 | 08:56:56 INFO - PROCESS | 9866 | Cycle 1(1): loaded http://localhost:52838/tests/dromaeo/cssquery-mootools.html (next: http://localhost:52838/tests/dromaeo/cssquery-prototype.html) 08:56:56 INFO - PROCESS | 9866 | RSS: Main: 214519808 08:56:56 INFO - PROCESS | 9866 | 08:59:59 INFO - PROCESS | 9866 | Cycle 1(1): loaded http://localhost:52838/tests/dromaeo/cssquery-prototype.html (next: http://localhost:52838/tests/dromaeo/cssquery-yui.html) 09:00:00 INFO - PROCESS | 9866 | RSS: Main: 173899776 09:00:00 INFO - PROCESS | 9866 | 09:03:02 INFO - PROCESS | 9866 | Cycle 1(1): loaded http://localhost:52838/tests/dromaeo/cssquery-yui.html (next: http://localhost:52838/tests/dromaeo/cssquery-dojo.html) 09:03:02 INFO - PROCESS | 9866 | RSS: Main: 263458816 09:03:02 INFO - PROCESS | 9866 | 09:03:02 INFO - PROCESS | 9866 | __start_tp_report 09:03:02 INFO - PROCESS | 9866 | _x_x_mozilla_page_load 09:03:02 INFO - PROCESS | 9866 | _x_x_mozilla_page_load_details 09:03:02 INFO - PROCESS | 9866 | |i|pagename|runs| 09:03:02 INFO - PROCESS | 9866 | |0;dojo.html;3272.983635081824;3290.111669849141;3323.052929914974;3325.584301962255;3348;5339.359276886774;5396.109641909085;5405.621606487547;5412.485813847688;5424.918626220609;5488.890222195554;5508.394076651565;5512.91730624041;5525.336959564847;5529.391766905637;4920.114379411704;4939.3084968104495;4971.080350135218;4998.675086119409;5014.8244811431605;4840.6369522285795;4982.975085124569;5033.748312584356;5038.269450929613;5065.924011139836;4825.420949486067;4901.362822833027;4917.188663870475;4932.383452068491;5006.2740902569285;4981.302617633534;5018.071656743477;5020.372453443338;5022.17134172861;5073.213651883964;4942.456329803718;4968.30443737877;4975.203967365241;5000.574951129159;5003.374578177728;5248.475152484759;5338.546223571001;5343.492368225013;5401.027814993299;5407.270018547524;5816.767329306823;5819;5819.621724587888;5820.592558520905;5837.3287071986415;5825.504832089235;5866.501347385477;5879.617824841372;5882.823515294548;5888.558358123158;5333.813316533902;5373.355197376301;5410;5490.478404551562;5512.586556008316;5986.281646202484;5992.191054207626;6020.668863212565;6020.789272375446;6032.969835150884;5753.252077230017;5753.367129615739;5757.251557297608;5762.366139724627;5762.567807414461;5608.943910560843;5631.774729010794;5793.507551858055;5843.123531470228;5861.384554621789;5728.341240757283;5759.913601295984;5767.961766882002;5775.855603609859;5856.795012174639;5810.244668193108;5812.070068789058;5815.709214539256;5821.621594596338;5829.59192856496;4066.79666016698;4140.399642051885;4147.087640719037;4153.7300075494995;4167.041580436456;3709.1654377765326;3710.7216958728204;3721.3859713147567;3739.0465431315383;3770.830312635938;5622.212890195376;5627.746751396197;5628.268325117709;5633.971830140823;5637.548996080303;5726.77092916287;5730.713464326767;5784.971075144597;5846.8538286542325;5868.383819698955;5474.452554744574;5489.807856724996;5502.312210973629;5590.413006634326;5602.97198514013;4955.4548999610015;4956.677815941952;4960.479149689303;4961.181405068123;4981.402231732215;5984.670843103671;5994.880102398015;5999.700014999233;6002.249718785152;6031.668258245839;5677;5713.771449141987;5755.482006619424;5771.047777116729;5803.158542011469;6048.395160483917;6049.576529642883;6057.303410107894;6076.51387888959;6093.573449858467;5696.458836410535;5707.514861236841;5749.9712501437225;5751.884962300647;5762.510186634016;5749.568782341257;5778.191053252632;5798.33319168301;5860.677662728591;5866.413358664099;5700.914486282626;5739.971300143473;5740.167675686918;5762.711864406847;5775;5706.115552089433;5706.3152421709665;5706.714664266853;5707.857303567444;5712.80005199816;5581.46976037292;5593.440655934374;5701.201831743476;5706.115552089433;5720.513756330592;5639.661620302795;5677.205191273142;5693.4021927696995;5712.7714891403875;5750.482456578928;5569.805056822992;5617.045102332531;5617.578681598815;5617.775288988395;5619.8595035124445 09:03:02 INFO - PROCESS | 9866 | |1;ext.html;581.8458108601219;593.1429084972215;626.6177631644697;627.1063734178794;648.2480322825523;36847.81576092119;48177.51822481779;49133;49147;49211;51119.23321150186;51515;51625.74187129059;51654.483455165435;51759.74120129403;8846.115388461167;9069.818603627924;9160.312976526771;9389.295802814782;9394.906050939471;10913.618023369183;11154.888451115507;11165.050970667504;11573.36346500942;11591.768164636702;11160.330380177214;11227.775444491106;11231.101511879071;11238.887611123866;11240.156988225875;11419.54321827126;11480.655580332603;11487.655370338904;11493;11498.367589782516;11270.887291127066;11360.204785665006;11361.659150225507;11368.886311136865;11372.772544549145;47688.52311476875;48334;48439.51560484385;48519.27221091687;48545;4320.935185972213;4429.313456414261;4440.53374395687;4483.30508771141;4618;28984.565231521545;30904.227394315098;31551;31584.36831263362;33181.50227746562;4519.502854685982;4616.976915115437;4638.304254361839;4659.7204167749705;4676.298555216711;380638;381376;382398;383428;384067.9999999972;61147.38852611506;61475.38524614786;61486.077708834404;61527.692361537906;61544;62427;62541;62635.68682156651;62645;62690;18227.08864556767;18679.252829886926;18692.252309907723;18702.251909923452;18713.064346782605;13262.801057984138;13594.11638243511;13968.58094257174;14126.85873141276;14466.927665361605;19882.60234795296;19958.20167193296;20000;20056.398308050782;20090.397288081087;7405.444591655647;7416.85166296671;7470.850582988419;7532.284432978859;7649.770506884803;972.4554249620236;974.4153507895348;978.1245785022365;984.7538115471132;1009.3741880034279;33883.491747623804;34651.4802277966;34673;34714;34925.82537087298;1078.9946050269855;1092.3009274064605;1121.0695123047851;1121.74199934014;1145.5131569083105;16619.252133654016;17494.562635934202;17663;17754.112294385228;17764.822351776576;540953;544906;546124;877329;880755;60848.69575652182;61494;61494.69252653708;61542;61654.69172654108;1485.9851401486062;1500.4523348977764;1522.5127959052998;1529.243024702757;1547.5280039588033;30756.84621576878;31598;31874.84062579672;32315.19212019718;32354.83822580872;53430;54193.72903135617;54218.45781542292;54285.72857135689;54287.45712542824;473887;478614;479636;480513;480987;26706.46587068209;27312.590311145745;30331.545026824173;50700.49299506958;50960;49651;53684;54273.72863135659;54704;55854;44372.334414983154;46302.53697463117;46859.53140468552;51452.742736286076;52756;47300.52699472961;47396.2890556635;48047.51963415874;48219;48322.758386207846;46616.7669161652;47660.523394767;47869;47944.520554794006;48063.75968120137;38956;40400;42025.57974420339;42064.78967605143;42902.356464653676;30324.5451318226;30390.84804575963;30657.233569160948;30851;31054.22364440817 09:03:02 INFO - PROCESS | 9866 | |2;jquery.html;432.3346568405777;435.31220671339287;435.98038088286035;439.73615830501694;454.3003774187751;20065.398038058844;20501.48746281342;21632.134714611435;21822.672659910095;21825;21955.67066494004;22594;22942.541149177006;22962.770372296272;23104;5943.940560594393;6162.291336496293;6174.259088909337;6182;6182.443580077792;6084.665343406111;6343.429091381775;6376.107344971708;6472.320406357312;6474.125992990933;6469.482441404676;6485.254195767477;6486.805395838132;6680.432163266129;6979.05782719334;7084.787456376265;7107.076080109604;7146.464015198881;7151.177614574339;7152.606606636659;6170.938290617081;6247.250329960389;6318.936810631881;6323.462505687022;6328;15588.376464941388;15591;15629.921850390789;15728.921355393264;15755.684886302324;2763.6821765497025;3180.570622965893;3206.951895721566;3218.61376634803;3224.967750322514;11316.943415282953;11759.05927525796;11765.882341176564;14552.981291309612;14876.70246595062;2002.7869204528931;2015.1234213117195;2020.2928974858828;2036.53159773253;2071.761747399038;87146.5642671789;88140;89522;91235.54382228047;92268.53865730696;12304.507819687113;12478.18891772032;12612.936935315449;12613.180143290656;12746.872531274754;17885.73171402404;17885.821141788674;17894.463166105037;17920.731189032176;17937.461876143738;9317.720468385824;9421.858672119924;9458.196053335407;9491.050894910592;9561.139497445263;9128.954355228314;9144.177024067865;9154.221891139194;9167.633294668138;9420.811583768285;5310.309659744285;5335.093034184198;5373.677579345252;5393.298871146726;5417.783288668488;2073.8963051847345;2109.820665243441;2111.4932416219995;2135.2419890938495;2137.059693734752;909.6543313540944;933.6125507914276;939.4738946190155;943.698016634684;948.6964171465065;19683.507912302306;21043.68434473484;21072;21197.36407907765;21633.675494867588;928.3269629518545;937.2970272295778;939.3143005605946;947.4694171264114;949.8907625623003;11283.768586779957;12084.395780210954;12763.106582539132;12787.61637150887;12967.740645187043;626831;688377;688427;723899;725527;106119;107402.46298768456;108708.4564577172;110451.44774276238;112382;1116.4027245423658;1132.6205721083365;1166.9299842009507;1174.9588764393204;1175.418168006842;19413.223471061563;19598;19719.507012324808;19744.30894918671;19762.604747904676;44734.3289850659;46088.769556152;46417.30374044325;46562.76718616385;46767;61965.38034619596;62184.68907655433;62751;62893.685531572046;64702.67648661727;8924.241439477717;9207.723768286962;9371.156595906401;9552.283578731483;9879.407235565888;13178.60464186076;13385.799213011618;14165;14188.148711077369;14577.416903323749;11872.940635296769;11922.284662920252;11991.22057066288;12264.448099835707;12310;12048.75902481928;12414.813777793159;12428.192167509083;12653.240805551697;12666.87333126657;12187.634370968884;12588.370581471074;12602.49590016389;12814.743705125658;13022.674433139247;9421.717348479557;9442.669506567237;9468.526573671426;9479.383840050376;9536.523173841419;10585.311954722918;11914.523419063487;12008.699782505508;12230.082743794073;12248.265104093784 09:03:02 INFO - PROCESS | 9866 | |3;mootools.html;1363.8227030486034;1489.6722721001377;1511.078242272214;1538.484607656435;1541.1523661985905;7568.318851303382;8070.91929080709;8403.705870294534;8425.283850872667;8716.910386201725;8507.36194785392;8543.65825366986;8571.828563428728;8577.31381489481;8585.828283434328;2169.652855543113;2244.3267019894047;2439.3779586205537;2479.82641215115;2483;2425.369403954967;2515.05685367987;2516.924492265235;2519.8992040318367;2529.6837895263093;2413.6862207912945;2431.1369463840347;2439.256026911791;2441.1944058460667;2444.278937713379;2416;2426.8058555315533;2450.301664025753;2454.840435371713;2464.445499762548;2436.2447641231274;2439.768222018923;2460.9753902460925;2461.59383701689;2463.137901734379;8369.707060252862;8542.74371768848;8545.871811922827;8556.229939305493;8561.801347811312;5365;5508.669479831223;5524.33707955044;5529.723513824333;5529.751161197756;3360.5631267935255;3393.9830300848585;3398.1164897126678;3425.9486107708153;3451.6893479586956;1392.227313840818;1407.859214078584;1416.964575885611;1465.7654775236017;1473.6315921019745;11075.612353567587;11448.828267575993;11633.36016519091;11656.999999999915;11660.358680272582;4470.508244093147;4635.907281854344;4785.712857228577;4788.23388257884;4789.712617242976;9470.810583788285;9479.431234125974;9490.857637135448;9495.66765163216;9495.857562136573;5402.783888644489;5408.891822163535;5409.647588102975;5418.972905135449;5419.3225846769155;4413.646908247397;4822.565969062801;5040.7731652075745;5099.464556221617;5115.360579927509;3890.902727431837;3952.110775075585;4030.435738996543;4040.2929487340184;4044.5550989391145;1242.5402601037674;1254.3790823542404;1260.9180403273758;1264.5953294945714;1271.281725824906;1051.673981065872;1063.0698139128262;1066.653337665262;1069.048546793339;1069.668402795136;5819.79630712923;5895.64626122434;5926.762929482772;5958.1062840573395;6115.785947491817;652.5790864892118;658.2528829778237;660.6729668813967;668.1147479589563;668.7224801707237;4067.3085575452246;4089.3252613319064;4106.938395924063;4157.91684166315;4192.098698779777;9940.502974851228;10145.94927025375;10239.641612543524;10286.2799604027;10287.742806429898;10149.543270552844;10201.13290370312;10230.02814732614;10267.229957753198;10277.588896444207;7522.511036782592;7836.804079897935;7839.216078392115;7945.1260361359045;8021.799455013671;5734.111212762028;5819.330776960704;5867.882642347044;5897.941020589739;5975.312839023568;9372.578233979351;9488.85766713486;9512.1439070484;9513.571889265138;9619.470929098967;9333.906660933575;9582.137607615348;9649.517524123907;9723.02769723022;9723.951380243054;7367.373773229121;7376.483646144933;7405.481616287024;7412.11054673421;7469.066366704162;7794.571298578632;7861.724839630586;7871.724489642835;7875.330596899099;7884.250996155356;7001.264867188872;7038.260982596754;7063.046488723957;7163.892541611775;7268.0914885639295;7007.334303241184;7025.859482810418;7056.929430705833;7064.646767661699;7200.927990720026;6451.580647257913;6573.079768832272;6573.211214654272;6578;6578.901316480161;5217.113090774502;5242.2922905408805;5289.6032797539565;5410.621256512007;5496.175573663822;5129.640925135204;5174.8965020700125;5181.81863634771;5196.662216955886;5346.0911645021215 09:03:02 INFO - PROCESS | 9866 | |4;prototype.html;404.19363370076667;411.15097324025885;414.20679398951006;427.9486461624605;430.41893443850785;5107.233914912756;5197.194434862602;5233.555147812436;5269.6311258211945;5326.893462130755;5114.6675466094675;5248.265242865992;5248.81901572146;5255.159174532076;5262.500062494067;4233.449651545295;4248.426462427564;4251.298535741599;4256.702030857841;4265.765382903939;4100.8974775630695;4212.684048696345;4242.766647834368;4252.4046633471335;4259.233337999174;4209.810558524874;4218.936715949263;4219.77626488318;4219.881731341197;4232.619064284214;4220.556841531626;4220.852270170544;4222;4227.365895115727;4237.724547904377;3852.460655508231;3863.478430411915;3868.5492940147446;3871.9419208711893;3875.399313106473;5021.748912554358;5136.922946155811;5139.563137133348;5146.922796158061;5155.7679904404395;4893.339399181101;4893.681910675795;4906.558409743105;4908.5336892995465;4917.360743103373;5420.457954204588;5508.3114610673665;5547.611667183299;5568.220449137124;5570.415106413809;4255.851045213402;4256.34026725858;4269.146170765828;4275.914481710349;4288.871333859989;5712.857928139548;5717.656940583578;5720.48515633595;5723.483276931616;5731.484166425;4308.590683885026;4384.772263766087;4386.232409328355;4405.118976204772;4420.248557745191;4439.178751930838;4445.488768791565;4456.732596044248;4469.7988590513505;4474.149911516802;4904.313396124546;4918.631102667314;4920.138975679313;4921.434035086011;4945.579625731782;5437.184422336602;5610.635308704921;5623.6906970116215;5634;5639.295088113986;1474;1482.7553453680239;1487.8288996765293;1491.403438624537;1492.1867582167745;1049.5854137615752;1070.373831308693;1076.8869268726828;1079.8780396520874;1082.5290998415715;5212.582993360522;5218.947810521922;5224;5233.476652334813;5239.921401178985;5444.210589464585;5445.074337362658;5462.552423607747;5501.724913754297;5502.972485137629;4990.10178167926;5212.869678258074;5240.065563284573;5242.449542798027;5260.316158899319;2857.8428186449946;2864.8970146493334;2871.4113606710575;2894.768418526513;2895.5946167536563;5566.582506311962;5616.522595579421;5635.492805647511;5662.2639056922335;5673.77304907799;5407.297051383295;5520.613557051048;5557.249771280825;5573.470520300565;5582.190582365534;5645.2096706461125;5648.8870222595315;5650.519705825051;5665.603407761417;5668.829935102036;5289.894202116013;5453.754581043783;5481.534069603968;5494.972525137348;5516.420775818642;5327.813526526553;5379;5387.545362752114;5390.245365648891;5430.945690543044;5652.491275785199;5657.32112146545;5666.2350582670815;5666.4333566644655;5683.8863222736145;4023.2154729827403;4197.643200327884;4226.323788193874;4265.701400901907;4324.35134729793;5607.719614019201;5610.579206559606;5637.238972738792;5643.915341269966;5664.348599911063;5517.586181036358;5518.365387980433;5534.446555344433;5541.916871246854;5560.527355174855;5209;5486.149646804752;5529;5538.778448862162;5556;5504.91742623869;5509.834704958857;5513.117901135959;5517.2551705519245;5525.613207075467;5358.651687640291;5555.527780138734;5557;5567.66594004361;5613.607047506635;5439.4288599696465;5441.755121019484;5443.156310771837;5446.754896029609;5473.166489226154 09:03:02 INFO - PROCESS | 9866 | |5;yui.html;779.1857508903196;811.221227621483;838.6938767349919;904.543205681131;904.6471875968372;15158.924205378971;16364.34542618294;16552.172391380413;16562.089085100313;16578.917105414486;16366;16740.497785066436;16775;16783.83216167838;16786.916065419686;710.6979533698184;731.0861423220974;817.497239197892;827.4538804389105;834.2658460554703;845.1379592815325;846.1496196322718;848.0332421040019;848.3891598049426;848.4866655673321;882;883.3507372081515;884.0099089020306;884.2439714044496;885.0706757904208;732.1470486882776;744.6425715656488;880.5421180985884;1056.4295280548572;1087.9292845964987;642.6465444005778;643.7972038807808;644.1883227133845;644.954853160279;645.5319893077528;17180.742288865677;17448.651026979518;17498.38755643559;17504;17575.20911558983;15834.129122898235;16096.597585060466;16109.83890161095;16196.83803161965;16721.66556668872;13277.336133193301;13341.332933353293;13356.933215333958;13432.194068355831;13441.19352838823;4034.495688038995;4074.164796216798;4081.877543673665;4140.627343539096;4162.937555936664;80590.5970470144;82241;82397;84444;84686.57656711739;12440.75118497625;12460.688482787822;12569.183003104768;12593.496260149675;12692.111552191258;25518.617220741704;25638.74361256401;25666.230013099637;25678.74321256801;25681.22956311314;8268.37987150966;8532.189442003;8568.742937711879;8583.742487725378;8825.823483530294;4612.169809434334;4749.857504274877;5012.1980483122525;5079.74601269935;5103.489651034941;4071.206114807643;4196.391523229115;4200.516940551875;4203.390508376329;4204.516480604709;671.9361660642231;680.6664734280266;693.9410150137295;696.5472442912046;705.7459314646723;764.9961750191325;776.3323541754087;789.7709664197433;790.1269097647132;819.6844214977276;10810.513526891309;11068.667939961813;11475.483603237873;11574.52054522134;11885.940570297265;727.4507746651244;729.669412039547;732.3994324653733;732.9706811727577;734.5262305812828;5383.407825139231;5424.349078110573;5431.592630552725;5461.644993075437;5501.257330260363;66157.33842661609;67412.662936685;69776.65111674511;80795;84672;59414.70292648509;61123.08315375273;76048.71853844394;76952;78066;67030.66484667546;68503.31496684969;68693.65653171802;70178.2982170182;71081.64459177671;10291.897081029094;10460.79078418412;10616.89383106159;10715.142788576739;10730.785384292114;44415.55584444114;45719.314210286204;45974.77012614915;46311.073778524915;46403;54337.45662543482;56996.715016424656;57113;58546.4145358558;58939.41060589339;12226.938865305616;13110.082294239312;13279;13291.80062299047;13339.132956357806;14045.227512486503;14132;14205.573832785032;14276.857231427553;14284.142951422948;12541.93729031349;12616;12861.871381286068;12883.549075782303;13025;12732.23606583608;12733.872661273268;12758.48966041348;12916.547920823103;12980.026498012498;12881.613551593467;12976.15654982423;13206.801897971345;13318.267495287851;13818.37817298244;10996.12031037531;11258.268212566158;11273.661790146309;11310.660680179608;11476.139289553485;11089.667309980714;11305.208635395444;11377.374244416305;11378.31730096197;11404.372759498307 09:03:02 INFO - PROCESS | 9866 | __end_tp_report 09:03:02 INFO - PROCESS | 9866 | __start_cc_report 09:03:02 INFO - PROCESS | 9866 | _x_x_mozilla_cycle_collect,1163 09:03:02 INFO - PROCESS | 9866 | __end_cc_report 09:03:02 INFO - PROCESS | 9866 | __startTimestamp1488474182624__endTimestamp 09:03:02 INFO - PROCESS | 9866 | 09:03:02 INFO - PROCESS | 9866 | ------- Summary: start ------- 09:03:02 INFO - PROCESS | 9866 | Number of tests: 6 09:03:02 INFO - PROCESS | 9866 | 09:03:02 INFO - PROCESS | 9866 | [#0] dojo.html Cycles:165 Average:5400.83 Median:5633.97 stddev:631.81 (11.2%) stddev-sans-first:611.29 09:03:02 INFO - PROCESS | 9866 | Values: 3273.0 3290.1 3323.1 3325.6 3348.0 5339.4 5396.1 5405.6 5412.5 5424.9 5488.9 5508.4 5512.9 5525.3 5529.4 4920.1 4939.3 4971.1 4998.7 5014.8 4840.6 4983.0 5033.7 5038.3 5065.9 4825.4 4901.4 4917.2 4932.4 5006.3 4981.3 5018.1 5020.4 5022.2 5073.2 4942.5 4968.3 4975.2 5000.6 5003.4 5248.5 5338.5 5343.5 5401.0 5407.3 5816.8 5819.0 5819.6 5820.6 5837.3 5825.5 5866.5 5879.6 5882.8 5888.6 5333.8 5373.4 5410.0 5490.5 5512.6 5986.3 5992.2 6020.7 6020.8 6033.0 5753.3 5753.4 5757.3 5762.4 5762.6 5608.9 5631.8 5793.5 5843.1 5861.4 5728.3 5759.9 5768.0 5775.9 5856.8 5810.2 5812.1 5815.7 5821.6 5829.6 4066.8 4140.4 4147.1 4153.7 4167.0 3709.2 3710.7 3721.4 3739.0 3770.8 5622.2 5627.7 5628.3 5634.0 5637.5 5726.8 5730.7 5785.0 5846.9 5868.4 5474.5 5489.8 5502.3 5590.4 5603.0 4955.5 4956.7 4960.5 4961.2 4981.4 5984.7 5994.9 5999.7 6002.2 6031.7 5677.0 5713.8 5755.5 5771.0 5803.2 6048.4 6049.6 6057.3 6076.5 6093.6 5696.5 5707.5 5750.0 5751.9 5762.5 5749.6 5778.2 5798.3 5860.7 5866.4 5700.9 5740.0 5740.2 5762.7 5775.0 5706.1 5706.3 5706.7 5707.9 5712.8 5581.5 5593.4 5701.2 5706.1 5720.5 5639.7 5677.2 5693.4 5712.8 5750.5 5569.8 5617.0 5617.6 5617.8 5619.9 09:03:02 INFO - PROCESS | 9866 | 09:03:02 INFO - PROCESS | 9866 | [#1] ext.html Cycles:180 Average:68733.59 Median:4568.24 stddev:143052.30 (3131.5%) stddev-sans-first:143362.08 09:03:02 INFO - PROCESS | 9866 | Values: 581.8 593.1 626.6 627.1 648.2 36847.8 48177.5 49133.0 49147.0 49211.0 51119.2 51515.0 51625.7 51654.5 51759.7 8846.1 9069.8 9160.3 9389.3 9394.9 10913.6 11154.9 11165.1 11573.4 11591.8 11160.3 11227.8 11231.1 11238.9 11240.2 11419.5 11480.7 11487.7 11493.0 11498.4 11270.9 11360.2 11361.7 11368.9 11372.8 47688.5 48334.0 48439.5 48519.3 48545.0 4320.9 4429.3 4440.5 4483.3 4618.0 28984.6 30904.2 31551.0 31584.4 33181.5 4519.5 4617.0 4638.3 4659.7 4676.3 380638.0 381376.0 382398.0 383428.0 384068.0 61147.4 61475.4 61486.1 61527.7 61544.0 62427.0 62541.0 62635.7 62645.0 62690.0 18227.1 18679.3 18692.3 18702.3 18713.1 13262.8 13594.1 13968.6 14126.9 14466.9 19882.6 19958.2 20000.0 20056.4 20090.4 7405.4 7416.9 7470.9 7532.3 7649.8 972.5 974.4 978.1 984.8 1009.4 33883.5 34651.5 34673.0 34714.0 34925.8 1079.0 1092.3 1121.1 1121.7 1145.5 16619.3 17494.6 17663.0 17754.1 17764.8 540953.0 544906.0 546124.0 877329.0 880755.0 60848.7 61494.0 61494.7 61542.0 61654.7 1486.0 1500.5 1522.5 1529.2 1547.5 30756.8 31598.0 31874.8 32315.2 32354.8 53430.0 54193.7 54218.5 54285.7 54287.5 473887.0 478614.0 479636.0 480513.0 480987.0 26706.5 27312.6 30331.5 50700.5 50960.0 49651.0 53684.0 54273.7 54704.0 55854.0 44372.3 46302.5 46859.5 51452.7 52756.0 47300.5 47396.3 48047.5 48219.0 48322.8 46616.8 47660.5 47869.0 47944.5 48063.8 38956.0 40400.0 42025.6 42064.8 42902.4 30324.5 30390.8 30657.2 30851.0 31054.2 09:03:02 INFO - PROCESS | 9866 | 09:03:02 INFO - PROCESS | 9866 | [#2] jquery.html Cycles:180 Average:36196.32 Median:2972.13 stddev:113516.34 (3819.4%) stddev-sans-first:113803.02 09:03:02 INFO - PROCESS | 9866 | Values: 432.3 435.3 436.0 439.7 454.3 20065.4 20501.5 21632.1 21822.7 21825.0 21955.7 22594.0 22942.5 22962.8 23104.0 5943.9 6162.3 6174.3 6182.0 6182.4 6084.7 6343.4 6376.1 6472.3 6474.1 6469.5 6485.3 6486.8 6680.4 6979.1 7084.8 7107.1 7146.5 7151.2 7152.6 6170.9 6247.3 6318.9 6323.5 6328.0 15588.4 15591.0 15629.9 15728.9 15755.7 2763.7 3180.6 3207.0 3218.6 3225.0 11316.9 11759.1 11765.9 14553.0 14876.7 2002.8 2015.1 2020.3 2036.5 2071.8 87146.6 88140.0 89522.0 91235.5 92268.5 12304.5 12478.2 12612.9 12613.2 12746.9 17885.7 17885.8 17894.5 17920.7 17937.5 9317.7 9421.9 9458.2 9491.1 9561.1 9129.0 9144.2 9154.2 9167.6 9420.8 5310.3 5335.1 5373.7 5393.3 5417.8 2073.9 2109.8 2111.5 2135.2 2137.1 909.7 933.6 939.5 943.7 948.7 19683.5 21043.7 21072.0 21197.4 21633.7 928.3 937.3 939.3 947.5 949.9 11283.8 12084.4 12763.1 12787.6 12967.7 626831.0 688377.0 688427.0 723899.0 725527.0 106119.0 107402.5 108708.5 110451.4 112382.0 1116.4 1132.6 1166.9 1175.0 1175.4 19413.2 19598.0 19719.5 19744.3 19762.6 44734.3 46088.8 46417.3 46562.8 46767.0 61965.4 62184.7 62751.0 62893.7 64702.7 8924.2 9207.7 9371.2 9552.3 9879.4 13178.6 13385.8 14165.0 14188.1 14577.4 11872.9 11922.3 11991.2 12264.4 12310.0 12048.8 12414.8 12428.2 12653.2 12666.9 12187.6 12588.4 12602.5 12814.7 13022.7 9421.7 9442.7 9468.5 9479.4 9536.5 10585.3 11914.5 12008.7 12230.1 12248.3 09:03:02 INFO - PROCESS | 9866 | 09:03:02 INFO - PROCESS | 9866 | [#3] mootools.html Cycles:180 Average:5613.31 Median:5317.85 stddev:3018.67 (56.8%) stddev-sans-first:3010.24 09:03:02 INFO - PROCESS | 9866 | Values: 1363.8 1489.7 1511.1 1538.5 1541.2 7568.3 8070.9 8403.7 8425.3 8716.9 8507.4 8543.7 8571.8 8577.3 8585.8 2169.7 2244.3 2439.4 2479.8 2483.0 2425.4 2515.1 2516.9 2519.9 2529.7 2413.7 2431.1 2439.3 2441.2 2444.3 2416.0 2426.8 2450.3 2454.8 2464.4 2436.2 2439.8 2461.0 2461.6 2463.1 8369.7 8542.7 8545.9 8556.2 8561.8 5365.0 5508.7 5524.3 5529.7 5529.8 3360.6 3394.0 3398.1 3425.9 3451.7 1392.2 1407.9 1417.0 1465.8 1473.6 11075.6 11448.8 11633.4 11657.0 11660.4 4470.5 4635.9 4785.7 4788.2 4789.7 9470.8 9479.4 9490.9 9495.7 9495.9 5402.8 5408.9 5409.6 5419.0 5419.3 4413.6 4822.6 5040.8 5099.5 5115.4 3890.9 3952.1 4030.4 4040.3 4044.6 1242.5 1254.4 1260.9 1264.6 1271.3 1051.7 1063.1 1066.7 1069.0 1069.7 5819.8 5895.6 5926.8 5958.1 6115.8 652.6 658.3 660.7 668.1 668.7 4067.3 4089.3 4106.9 4157.9 4192.1 9940.5 10145.9 10239.6 10286.3 10287.7 10149.5 10201.1 10230.0 10267.2 10277.6 7522.5 7836.8 7839.2 7945.1 8021.8 5734.1 5819.3 5867.9 5897.9 5975.3 9372.6 9488.9 9512.1 9513.6 9619.5 9333.9 9582.1 9649.5 9723.0 9724.0 7367.4 7376.5 7405.5 7412.1 7469.1 7794.6 7861.7 7871.7 7875.3 7884.3 7001.3 7038.3 7063.0 7163.9 7268.1 7007.3 7025.9 7056.9 7064.6 7200.9 6451.6 6573.1 6573.2 6578.0 6578.9 5217.1 5242.3 5289.6 5410.6 5496.2 5129.6 5174.9 5181.8 5196.7 5346.1 09:03:02 INFO - PROCESS | 9866 | 09:03:02 INFO - PROCESS | 9866 | [#4] prototype.html Cycles:180 Average:4680.48 Median:5236.74 stddev:1298.23 (24.8%) stddev-sans-first:1261.57 09:03:02 INFO - PROCESS | 9866 | Values: 404.2 411.2 414.2 427.9 430.4 5107.2 5197.2 5233.6 5269.6 5326.9 5114.7 5248.3 5248.8 5255.2 5262.5 4233.4 4248.4 4251.3 4256.7 4265.8 4100.9 4212.7 4242.8 4252.4 4259.2 4209.8 4218.9 4219.8 4219.9 4232.6 4220.6 4220.9 4222.0 4227.4 4237.7 3852.5 3863.5 3868.5 3871.9 3875.4 5021.7 5136.9 5139.6 5146.9 5155.8 4893.3 4893.7 4906.6 4908.5 4917.4 5420.5 5508.3 5547.6 5568.2 5570.4 4255.9 4256.3 4269.1 4275.9 4288.9 5712.9 5717.7 5720.5 5723.5 5731.5 4308.6 4384.8 4386.2 4405.1 4420.2 4439.2 4445.5 4456.7 4469.8 4474.1 4904.3 4918.6 4920.1 4921.4 4945.6 5437.2 5610.6 5623.7 5634.0 5639.3 1474.0 1482.8 1487.8 1491.4 1492.2 1049.6 1070.4 1076.9 1079.9 1082.5 5212.6 5218.9 5224.0 5233.5 5239.9 5444.2 5445.1 5462.6 5501.7 5503.0 4990.1 5212.9 5240.1 5242.4 5260.3 2857.8 2864.9 2871.4 2894.8 2895.6 5566.6 5616.5 5635.5 5662.3 5673.8 5407.3 5520.6 5557.2 5573.5 5582.2 5645.2 5648.9 5650.5 5665.6 5668.8 5289.9 5453.8 5481.5 5495.0 5516.4 5327.8 5379.0 5387.5 5390.2 5430.9 5652.5 5657.3 5666.2 5666.4 5683.9 4023.2 4197.6 4226.3 4265.7 4324.4 5607.7 5610.6 5637.2 5643.9 5664.3 5517.6 5518.4 5534.4 5541.9 5560.5 5209.0 5486.1 5529.0 5538.8 5556.0 5504.9 5509.8 5513.1 5517.3 5525.6 5358.7 5555.5 5557.0 5567.7 5613.6 5439.4 5441.8 5443.2 5446.8 5473.2 09:03:02 INFO - PROCESS | 9866 | 09:03:02 INFO - PROCESS | 9866 | [#5] yui.html Cycles:180 Average:18389.33 Median:4203.95 stddev:23032.32 (547.9%) stddev-sans-first:23058.96 09:03:02 INFO - PROCESS | 9866 | Values: 779.2 811.2 838.7 904.5 904.6 15158.9 16364.3 16552.2 16562.1 16578.9 16366.0 16740.5 16775.0 16783.8 16786.9 710.7 731.1 817.5 827.5 834.3 845.1 846.1 848.0 848.4 848.5 882.0 883.4 884.0 884.2 885.1 732.1 744.6 880.5 1056.4 1087.9 642.6 643.8 644.2 645.0 645.5 17180.7 17448.7 17498.4 17504.0 17575.2 15834.1 16096.6 16109.8 16196.8 16721.7 13277.3 13341.3 13356.9 13432.2 13441.2 4034.5 4074.2 4081.9 4140.6 4162.9 80590.6 82241.0 82397.0 84444.0 84686.6 12440.8 12460.7 12569.2 12593.5 12692.1 25518.6 25638.7 25666.2 25678.7 25681.2 8268.4 8532.2 8568.7 8583.7 8825.8 4612.2 4749.9 5012.2 5079.7 5103.5 4071.2 4196.4 4200.5 4203.4 4204.5 671.9 680.7 693.9 696.5 705.7 765.0 776.3 789.8 790.1 819.7 10810.5 11068.7 11475.5 11574.5 11885.9 727.5 729.7 732.4 733.0 734.5 5383.4 5424.3 5431.6 5461.6 5501.3 66157.3 67412.7 69776.7 80795.0 84672.0 59414.7 61123.1 76048.7 76952.0 78066.0 67030.7 68503.3 68693.7 70178.3 71081.6 10291.9 10460.8 10616.9 10715.1 10730.8 44415.6 45719.3 45974.8 46311.1 46403.0 54337.5 56996.7 57113.0 58546.4 58939.4 12226.9 13110.1 13279.0 13291.8 13339.1 14045.2 14132.0 14205.6 14276.9 14284.1 12541.9 12616.0 12861.9 12883.5 13025.0 12732.2 12733.9 12758.5 12916.5 12980.0 12881.6 12976.2 13206.8 13318.3 13818.4 10996.1 11258.3 11273.7 11310.7 11476.1 11089.7 11305.2 11377.4 11378.3 11404.4 09:03:02 INFO - PROCESS | 9866 | -------- Summary: end -------- 09:03:02 INFO - PROCESS | 9866 | 09:03:03 INFO - TEST-INFO | 9866: exit 0 09:03:03 INFO - TEST-OK | dromaeo_css | took 1113214ms 09:03:03 INFO - TEST-START | kraken 09:03:03 INFO - operating with platform_type : linux_ 09:03:03 INFO - Initialising browser for kraken test... 09:03:03 INFO - TEST-INFO | started process 10186 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpwpgMyp/profile http://localhost:52838/getInfo.html) 09:03:07 INFO - PROCESS | 10186 | __metrics Screen width/height:1600/1200 09:03:07 INFO - PROCESS | 10186 | colorDepth:24 09:03:07 INFO - PROCESS | 10186 | Browser inner width/height: 1024/697 09:03:07 INFO - PROCESS | 10186 | __metrics 09:03:07 INFO - PROCESS | 10186 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 692: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 09:03:07 INFO - PROCESS | 10186 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 303: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 09:03:08 INFO - TEST-INFO | 10186: exit 0 09:03:08 INFO - Browser initialized. 09:03:08 INFO - Running cycle 1/1 for kraken test... 09:03:08 INFO - TEST-INFO | started process 10281 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpwpgMyp/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 09:03:20 INFO - PROCESS | 10281 | RSS: Main: 138088448 09:03:20 INFO - PROCESS | 10281 | 09:03:23 INFO - PROCESS | 10281 | Cycle 1(1): loaded http://localhost:52838/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:52838/tests/kraken/driver.html?testName=audio-beat-detection) 09:03:24 INFO - PROCESS | 10281 | RSS: Main: 180977664 09:03:24 INFO - PROCESS | 10281 | 09:03:26 INFO - PROCESS | 10281 | Cycle 1(1): loaded http://localhost:52838/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:52838/tests/kraken/driver.html?testName=audio-dft) 09:03:27 INFO - PROCESS | 10281 | RSS: Main: 171974656 09:03:27 INFO - PROCESS | 10281 | 09:03:29 INFO - PROCESS | 10281 | Cycle 1(1): loaded http://localhost:52838/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:52838/tests/kraken/driver.html?testName=audio-fft) 09:03:30 INFO - PROCESS | 10281 | RSS: Main: 263655424 09:03:30 INFO - PROCESS | 10281 | 09:03:32 INFO - PROCESS | 10281 | Cycle 1(1): loaded http://localhost:52838/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:52838/tests/kraken/driver.html?testName=audio-oscillator) 09:03:33 INFO - PROCESS | 10281 | RSS: Main: 169730048 09:03:33 INFO - PROCESS | 10281 | 09:03:35 INFO - PROCESS | 10281 | Cycle 1(1): loaded http://localhost:52838/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:52838/tests/kraken/driver.html?testName=imaging-gaussian-blur) 09:03:35 INFO - PROCESS | 10281 | RSS: Main: 173371392 09:03:35 INFO - PROCESS | 10281 | 09:03:38 INFO - PROCESS | 10281 | Cycle 1(1): loaded http://localhost:52838/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:52838/tests/kraken/driver.html?testName=imaging-darkroom) 09:03:39 INFO - PROCESS | 10281 | RSS: Main: 211431424 09:03:39 INFO - PROCESS | 10281 | 09:03:42 INFO - PROCESS | 10281 | Cycle 1(1): loaded http://localhost:52838/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:52838/tests/kraken/driver.html?testName=imaging-desaturate) 09:03:43 INFO - PROCESS | 10281 | RSS: Main: 209555456 09:03:43 INFO - PROCESS | 10281 | 09:03:46 INFO - PROCESS | 10281 | Cycle 1(1): loaded http://localhost:52838/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:52838/tests/kraken/driver.html?testName=json-parse-financial) 09:03:46 INFO - PROCESS | 10281 | RSS: Main: 208011264 09:03:46 INFO - PROCESS | 10281 | 09:03:48 INFO - PROCESS | 10281 | Cycle 1(1): loaded http://localhost:52838/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:52838/tests/kraken/driver.html?testName=json-stringify-tinderbox) 09:03:48 INFO - PROCESS | 10281 | RSS: Main: 170332160 09:03:48 INFO - PROCESS | 10281 | 09:03:50 INFO - PROCESS | 10281 | Cycle 1(1): loaded http://localhost:52838/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:52838/tests/kraken/driver.html?testName=stanford-crypto-aes) 09:03:51 INFO - PROCESS | 10281 | RSS: Main: 178118656 09:03:51 INFO - PROCESS | 10281 | 09:03:53 INFO - PROCESS | 10281 | Cycle 1(1): loaded http://localhost:52838/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:52838/tests/kraken/driver.html?testName=stanford-crypto-ccm) 09:03:53 INFO - PROCESS | 10281 | RSS: Main: 186961920 09:03:53 INFO - PROCESS | 10281 | 09:03:56 INFO - PROCESS | 10281 | Cycle 1(1): loaded http://localhost:52838/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:52838/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 09:03:56 INFO - PROCESS | 10281 | RSS: Main: 196169728 09:03:56 INFO - PROCESS | 10281 | 09:03:59 INFO - PROCESS | 10281 | Cycle 1(1): loaded http://localhost:52838/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:52838/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 09:04:00 INFO - PROCESS | 10281 | RSS: Main: 192483328 09:04:00 INFO - PROCESS | 10281 | 09:04:01 INFO - PROCESS | 10281 | Cycle 1(1): loaded http://localhost:52838/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:52838/tests/kraken/driver.html?testName=ai-astar) 09:04:02 INFO - PROCESS | 10281 | RSS: Main: 242585600 09:04:02 INFO - PROCESS | 10281 | 09:04:02 INFO - PROCESS | 10281 | __start_tp_report 09:04:02 INFO - PROCESS | 10281 | _x_x_mozilla_page_load 09:04:02 INFO - PROCESS | 10281 | _x_x_mozilla_page_load_details 09:04:02 INFO - PROCESS | 10281 | |i|pagename|runs| 09:04:02 INFO - PROCESS | 10281 | |0;ai-astar;103;113;111;111;112;111;112;111;111;112 09:04:02 INFO - PROCESS | 10281 | |1;audio-beat-detection;148;121;121;163;117;117;121;125;132;117 09:04:02 INFO - PROCESS | 10281 | |2;audio-dft;161;160;161;161;160;161;160;160;160;159 09:04:02 INFO - PROCESS | 10281 | |3;audio-fft;75;74;76;109;76;77;77;76;103;76 09:04:02 INFO - PROCESS | 10281 | |4;audio-oscillator;84;82;108;84;82;85;95;82;83;101 09:04:02 INFO - PROCESS | 10281 | |5;imaging-gaussian-blur;116;118;117;117;116;116;117;116;117;117 09:04:02 INFO - PROCESS | 10281 | |6;imaging-darkroom;147;146;146;146;146;146;147;147;146;146 09:04:02 INFO - PROCESS | 10281 | |7;imaging-desaturate;97;96;95;96;96;95;95;95;95;95 09:04:02 INFO - PROCESS | 10281 | |8;json-parse-financial;48;52;48;48;47;47;49;50;48;49 09:04:02 INFO - PROCESS | 10281 | |9;json-stringify-tinderbox;63;63;62;63;64;63;63;64;63;63 09:04:02 INFO - PROCESS | 10281 | |10;stanford-crypto-aes;79;84;75;75;79;81;80;78;75;79 09:04:02 INFO - PROCESS | 10281 | |11;stanford-crypto-ccm;120;121;128;122;119;120;122;121;159;122 09:04:02 INFO - PROCESS | 10281 | |12;stanford-crypto-pbkdf2;156;156;154;155;161;154;155;158;159;155 09:04:02 INFO - PROCESS | 10281 | |13;stanford-crypto-sha256-iterative;63;60;61;62;62;60;59;59;59;59 09:04:02 INFO - PROCESS | 10281 | __end_tp_report 09:04:02 INFO - PROCESS | 10281 | __start_cc_report 09:04:02 INFO - PROCESS | 10281 | _x_x_mozilla_cycle_collect,1517 09:04:02 INFO - PROCESS | 10281 | __end_cc_report 09:04:02 INFO - PROCESS | 10281 | __startTimestamp1488474242075__endTimestamp 09:04:02 INFO - PROCESS | 10281 | 09:04:02 INFO - PROCESS | 10281 | ------- Summary: start ------- 09:04:02 INFO - PROCESS | 10281 | Number of tests: 14 09:04:02 INFO - PROCESS | 10281 | 09:04:02 INFO - PROCESS | 10281 | [#0] ai-astar Cycles:10 Average:110.70 Median:111.50 stddev:2.79 (2.5%) stddev-sans-first:0.73 09:04:02 INFO - PROCESS | 10281 | Values: 103.0 113.0 111.0 111.0 112.0 111.0 112.0 111.0 111.0 112.0 09:04:02 INFO - PROCESS | 10281 | 09:04:02 INFO - PROCESS | 10281 | [#1] audio-beat-detection Cycles:10 Average:128.20 Median:123.00 stddev:15.49 (12.6%) stddev-sans-first:14.68 09:04:02 INFO - PROCESS | 10281 | Values: 148.0 121.0 121.0 163.0 117.0 117.0 121.0 125.0 132.0 117.0 09:04:02 INFO - PROCESS | 10281 | 09:04:02 INFO - PROCESS | 10281 | [#2] audio-dft Cycles:10 Average:160.30 Median:160.50 stddev:0.67 (0.4%) stddev-sans-first:0.67 09:04:02 INFO - PROCESS | 10281 | Values: 161.0 160.0 161.0 161.0 160.0 161.0 160.0 160.0 160.0 159.0 09:04:02 INFO - PROCESS | 10281 | 09:04:02 INFO - PROCESS | 10281 | [#3] audio-fft Cycles:10 Average:81.90 Median:76.00 stddev:12.81 (16.9%) stddev-sans-first:13.34 09:04:02 INFO - PROCESS | 10281 | Values: 75.0 74.0 76.0 109.0 76.0 77.0 77.0 76.0 103.0 76.0 09:04:02 INFO - PROCESS | 10281 | 09:04:02 INFO - PROCESS | 10281 | [#4] audio-oscillator Cycles:10 Average:88.60 Median:83.50 stddev:9.36 (11.2%) stddev-sans-first:9.78 09:04:02 INFO - PROCESS | 10281 | Values: 84.0 82.0 108.0 84.0 82.0 85.0 95.0 82.0 83.0 101.0 09:04:02 INFO - PROCESS | 10281 | 09:04:02 INFO - PROCESS | 10281 | [#5] imaging-gaussian-blur Cycles:10 Average:116.70 Median:117.00 stddev:0.67 (0.6%) stddev-sans-first:0.67 09:04:02 INFO - PROCESS | 10281 | Values: 116.0 118.0 117.0 117.0 116.0 116.0 117.0 116.0 117.0 117.0 09:04:02 INFO - PROCESS | 10281 | 09:04:02 INFO - PROCESS | 10281 | [#6] imaging-darkroom Cycles:10 Average:146.30 Median:146.00 stddev:0.48 (0.3%) stddev-sans-first:0.44 09:04:02 INFO - PROCESS | 10281 | Values: 147.0 146.0 146.0 146.0 146.0 146.0 147.0 147.0 146.0 146.0 09:04:02 INFO - PROCESS | 10281 | 09:04:02 INFO - PROCESS | 10281 | [#7] imaging-desaturate Cycles:10 Average:95.50 Median:95.50 stddev:0.71 (0.7%) stddev-sans-first:0.50 09:04:02 INFO - PROCESS | 10281 | Values: 97.0 96.0 95.0 96.0 96.0 95.0 95.0 95.0 95.0 95.0 09:04:02 INFO - PROCESS | 10281 | 09:04:02 INFO - PROCESS | 10281 | [#8] json-parse-financial Cycles:10 Average:48.60 Median:48.50 stddev:1.51 (3.1%) stddev-sans-first:1.58 09:04:02 INFO - PROCESS | 10281 | Values: 48.0 52.0 48.0 48.0 47.0 47.0 49.0 50.0 48.0 49.0 09:04:02 INFO - PROCESS | 10281 | 09:04:02 INFO - PROCESS | 10281 | [#9] json-stringify-tinderbox Cycles:10 Average:63.10 Median:63.00 stddev:0.57 (0.9%) stddev-sans-first:0.60 09:04:02 INFO - PROCESS | 10281 | Values: 63.0 63.0 62.0 63.0 64.0 63.0 63.0 64.0 63.0 63.0 09:04:02 INFO - PROCESS | 10281 | 09:04:02 INFO - PROCESS | 10281 | [#10] stanford-crypto-aes Cycles:10 Average:78.50 Median:79.00 stddev:2.92 (3.7%) stddev-sans-first:3.09 09:04:02 INFO - PROCESS | 10281 | Values: 79.0 84.0 75.0 75.0 79.0 81.0 80.0 78.0 75.0 79.0 09:04:02 INFO - PROCESS | 10281 | 09:04:02 INFO - PROCESS | 10281 | [#11] stanford-crypto-ccm Cycles:10 Average:125.40 Median:122.00 stddev:12.06 (9.9%) stddev-sans-first:12.63 09:04:02 INFO - PROCESS | 10281 | Values: 120.0 121.0 128.0 122.0 119.0 120.0 122.0 121.0 159.0 122.0 09:04:02 INFO - PROCESS | 10281 | 09:04:02 INFO - PROCESS | 10281 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:156.30 Median:156.00 stddev:2.31 (1.5%) stddev-sans-first:2.45 09:04:02 INFO - PROCESS | 10281 | Values: 156.0 156.0 154.0 155.0 161.0 154.0 155.0 158.0 159.0 155.0 09:04:02 INFO - PROCESS | 10281 | 09:04:02 INFO - PROCESS | 10281 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:60.40 Median:60.50 stddev:1.51 (2.5%) stddev-sans-first:1.27 09:04:02 INFO - PROCESS | 10281 | Values: 63.0 60.0 61.0 62.0 62.0 60.0 59.0 59.0 59.0 59.0 09:04:02 INFO - PROCESS | 10281 | -------- Summary: end -------- 09:04:02 INFO - PROCESS | 10281 | 09:04:03 INFO - TEST-INFO | 10281: exit 0 09:04:03 INFO - TEST-OK | kraken | took 59900ms 09:04:03 INFO - SUITE-END | took 1173s 09:04:03 INFO - Completed test suite (00:19:33) 09:04:03 INFO - javascript benchmark 09:04:03 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3272.983635081824, 3290.111669849141, 3323.052929914974, 3325.584301962255, 3348.0, 5339.359276886774, 5396.109641909085, 5405.621606487547, 5412.485813847688, 5424.918626220609, 5488.890222195554, 5508.394076651565, 5512.91730624041, 5525.336959564847, 5529.391766905637, 4920.114379411704, 4939.3084968104495, 4971.080350135218, 4998.675086119409, 5014.8244811431605, 4840.6369522285795, 4982.975085124569, 5033.748312584356, 5038.269450929613, 5065.924011139836, 4825.420949486067, 4901.362822833027, 4917.188663870475, 4932.383452068491, 5006.2740902569285, 4981.302617633534, 5018.071656743477, 5020.372453443338, 5022.17134172861, 5073.213651883964, 4942.456329803718, 4968.30443737877, 4975.203967365241, 5000.574951129159, 5003.374578177728, 5248.475152484759, 5338.546223571001, 5343.492368225013, 5401.027814993299, 5407.270018547524, 5816.767329306823, 5819.0, 5819.621724587888, 5820.592558520905, 5837.3287071986415, 5825.504832089235, 5866.501347385477, 5879.617824841372, 5882.823515294548, 5888.558358123158, 5333.813316533902, 5373.355197376301, 5410.0, 5490.478404551562, 5512.586556008316, 5986.281646202484, 5992.191054207626, 6020.668863212565, 6020.789272375446, 6032.969835150884, 5753.252077230017, 5753.367129615739, 5757.251557297608, 5762.366139724627, 5762.567807414461, 5608.943910560843, 5631.774729010794, 5793.507551858055, 5843.123531470228, 5861.384554621789, 5728.341240757283, 5759.913601295984, 5767.961766882002, 5775.855603609859, 5856.795012174639, 5810.244668193108, 5812.070068789058, 5815.709214539256, 5821.621594596338, 5829.59192856496, 4066.79666016698, 4140.399642051885, 4147.087640719037, 4153.7300075494995, 4167.041580436456, 3709.1654377765326, 3710.7216958728204, 3721.3859713147567, 3739.0465431315383, 3770.830312635938, 5622.212890195376, 5627.746751396197, 5628.268325117709, 5633.971830140823, 5637.548996080303, 5726.77092916287, 5730.713464326767, 5784.971075144597, 5846.8538286542325, 5868.383819698955, 5474.452554744574, 5489.807856724996, 5502.312210973629, 5590.413006634326, 5602.97198514013, 4955.4548999610015, 4956.677815941952, 4960.479149689303, 4961.181405068123, 4981.402231732215, 5984.670843103671, 5994.880102398015, 5999.700014999233, 6002.249718785152, 6031.668258245839, 5677.0, 5713.771449141987, 5755.482006619424, 5771.047777116729, 5803.158542011469, 6048.395160483917, 6049.576529642883, 6057.303410107894, 6076.51387888959, 6093.573449858467, 5696.458836410535, 5707.514861236841, 5749.9712501437225, 5751.884962300647, 5762.510186634016, 5749.568782341257, 5778.191053252632, 5798.33319168301, 5860.677662728591, 5866.413358664099, 5700.914486282626, 5739.971300143473, 5740.167675686918, 5762.711864406847, 5775.0, 5706.115552089433, 5706.3152421709665, 5706.714664266853, 5707.857303567444, 5712.80005199816, 5581.46976037292, 5593.440655934374, 5701.201831743476, 5706.115552089433, 5720.513756330592, 5639.661620302795, 5677.205191273142, 5693.4021927696995, 5712.7714891403875, 5750.482456578928, 5569.805056822992, 5617.045102332531, 5617.578681598815, 5617.775288988395, 5619.8595035124445], "value": 5357.278230336055, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [581.8458108601219, 593.1429084972215, 626.6177631644697, 627.1063734178794, 648.2480322825523, 36847.81576092119, 48177.51822481779, 49133.0, 49147.0, 49211.0, 51119.23321150186, 51515.0, 51625.74187129059, 51654.483455165435, 51759.74120129403, 8846.115388461167, 9069.818603627924, 9160.312976526771, 9389.295802814782, 9394.906050939471, 10913.618023369183, 11154.888451115507, 11165.050970667504, 11573.36346500942, 11591.768164636702, 11160.330380177214, 11227.775444491106, 11231.101511879071, 11238.887611123866, 11240.156988225875, 11419.54321827126, 11480.655580332603, 11487.655370338904, 11493.0, 11498.367589782516, 11270.887291127066, 11360.204785665006, 11361.659150225507, 11368.886311136865, 11372.772544549145, 47688.52311476875, 48334.0, 48439.51560484385, 48519.27221091687, 48545.0, 4320.935185972213, 4429.313456414261, 4440.53374395687, 4483.30508771141, 4618.0, 28984.565231521545, 30904.227394315098, 31551.0, 31584.36831263362, 33181.50227746562, 4519.502854685982, 4616.976915115437, 4638.304254361839, 4659.7204167749705, 4676.298555216711, 380638.0, 381376.0, 382398.0, 383428.0, 384067.9999999972, 61147.38852611506, 61475.38524614786, 61486.077708834404, 61527.692361537906, 61544.0, 62427.0, 62541.0, 62635.68682156651, 62645.0, 62690.0, 18227.08864556767, 18679.252829886926, 18692.252309907723, 18702.251909923452, 18713.064346782605, 13262.801057984138, 13594.11638243511, 13968.58094257174, 14126.85873141276, 14466.927665361605, 19882.60234795296, 19958.20167193296, 20000.0, 20056.398308050782, 20090.397288081087, 7405.444591655647, 7416.85166296671, 7470.850582988419, 7532.284432978859, 7649.770506884803, 972.4554249620236, 974.4153507895348, 978.1245785022365, 984.7538115471132, 1009.3741880034279, 33883.491747623804, 34651.4802277966, 34673.0, 34714.0, 34925.82537087298, 1078.9946050269855, 1092.3009274064605, 1121.0695123047851, 1121.74199934014, 1145.5131569083105, 16619.252133654016, 17494.562635934202, 17663.0, 17754.112294385228, 17764.822351776576, 540953.0, 544906.0, 546124.0, 877329.0, 880755.0, 60848.69575652182, 61494.0, 61494.69252653708, 61542.0, 61654.69172654108, 1485.9851401486062, 1500.4523348977764, 1522.5127959052998, 1529.243024702757, 1547.5280039588033, 30756.84621576878, 31598.0, 31874.84062579672, 32315.19212019718, 32354.83822580872, 53430.0, 54193.72903135617, 54218.45781542292, 54285.72857135689, 54287.45712542824, 473887.0, 478614.0, 479636.0, 480513.0, 480987.0, 26706.46587068209, 27312.590311145745, 30331.545026824173, 50700.49299506958, 50960.0, 49651.0, 53684.0, 54273.72863135659, 54704.0, 55854.0, 44372.334414983154, 46302.53697463117, 46859.53140468552, 51452.742736286076, 52756.0, 47300.52699472961, 47396.2890556635, 48047.51963415874, 48219.0, 48322.758386207846, 46616.7669161652, 47660.523394767, 47869.0, 47944.520554794006, 48063.75968120137, 38956.0, 40400.0, 42025.57974420339, 42064.78967605143, 42902.356464653676, 30324.5451318226, 30390.84804575963, 30657.233569160948, 30851.0, 31054.22364440817], "value": 22355.50869856452, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [432.3346568405777, 435.31220671339287, 435.98038088286035, 439.73615830501694, 454.3003774187751, 20065.398038058844, 20501.48746281342, 21632.134714611435, 21822.672659910095, 21825.0, 21955.67066494004, 22594.0, 22942.541149177006, 22962.770372296272, 23104.0, 5943.940560594393, 6162.291336496293, 6174.259088909337, 6182.0, 6182.443580077792, 6084.665343406111, 6343.429091381775, 6376.107344971708, 6472.320406357312, 6474.125992990933, 6469.482441404676, 6485.254195767477, 6486.805395838132, 6680.432163266129, 6979.05782719334, 7084.787456376265, 7107.076080109604, 7146.464015198881, 7151.177614574339, 7152.606606636659, 6170.938290617081, 6247.250329960389, 6318.936810631881, 6323.462505687022, 6328.0, 15588.376464941388, 15591.0, 15629.921850390789, 15728.921355393264, 15755.684886302324, 2763.6821765497025, 3180.570622965893, 3206.951895721566, 3218.61376634803, 3224.967750322514, 11316.943415282953, 11759.05927525796, 11765.882341176564, 14552.981291309612, 14876.70246595062, 2002.7869204528931, 2015.1234213117195, 2020.2928974858828, 2036.53159773253, 2071.761747399038, 87146.5642671789, 88140.0, 89522.0, 91235.54382228047, 92268.53865730696, 12304.507819687113, 12478.18891772032, 12612.936935315449, 12613.180143290656, 12746.872531274754, 17885.73171402404, 17885.821141788674, 17894.463166105037, 17920.731189032176, 17937.461876143738, 9317.720468385824, 9421.858672119924, 9458.196053335407, 9491.050894910592, 9561.139497445263, 9128.954355228314, 9144.177024067865, 9154.221891139194, 9167.633294668138, 9420.811583768285, 5310.309659744285, 5335.093034184198, 5373.677579345252, 5393.298871146726, 5417.783288668488, 2073.8963051847345, 2109.820665243441, 2111.4932416219995, 2135.2419890938495, 2137.059693734752, 909.6543313540944, 933.6125507914276, 939.4738946190155, 943.698016634684, 948.6964171465065, 19683.507912302306, 21043.68434473484, 21072.0, 21197.36407907765, 21633.675494867588, 928.3269629518545, 937.2970272295778, 939.3143005605946, 947.4694171264114, 949.8907625623003, 11283.768586779957, 12084.395780210954, 12763.106582539132, 12787.61637150887, 12967.740645187043, 626831.0, 688377.0, 688427.0, 723899.0, 725527.0, 106119.0, 107402.46298768456, 108708.4564577172, 110451.44774276238, 112382.0, 1116.4027245423658, 1132.6205721083365, 1166.9299842009507, 1174.9588764393204, 1175.418168006842, 19413.223471061563, 19598.0, 19719.507012324808, 19744.30894918671, 19762.604747904676, 44734.3289850659, 46088.769556152, 46417.30374044325, 46562.76718616385, 46767.0, 61965.38034619596, 62184.68907655433, 62751.0, 62893.685531572046, 64702.67648661727, 8924.241439477717, 9207.723768286962, 9371.156595906401, 9552.283578731483, 9879.407235565888, 13178.60464186076, 13385.799213011618, 14165.0, 14188.148711077369, 14577.416903323749, 11872.940635296769, 11922.284662920252, 11991.22057066288, 12264.448099835707, 12310.0, 12048.75902481928, 12414.813777793159, 12428.192167509083, 12653.240805551697, 12666.87333126657, 12187.634370968884, 12588.370581471074, 12602.49590016389, 12814.743705125658, 13022.674433139247, 9421.717348479557, 9442.669506567237, 9468.526573671426, 9479.383840050376, 9536.523173841419, 10585.311954722918, 11914.523419063487, 12008.699782505508, 12230.082743794073, 12248.265104093784], "value": 10185.051398107486, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1363.8227030486034, 1489.6722721001377, 1511.078242272214, 1538.484607656435, 1541.1523661985905, 7568.318851303382, 8070.91929080709, 8403.705870294534, 8425.283850872667, 8716.910386201725, 8507.36194785392, 8543.65825366986, 8571.828563428728, 8577.31381489481, 8585.828283434328, 2169.652855543113, 2244.3267019894047, 2439.3779586205537, 2479.82641215115, 2483.0, 2425.369403954967, 2515.05685367987, 2516.924492265235, 2519.8992040318367, 2529.6837895263093, 2413.6862207912945, 2431.1369463840347, 2439.256026911791, 2441.1944058460667, 2444.278937713379, 2416.0, 2426.8058555315533, 2450.301664025753, 2454.840435371713, 2464.445499762548, 2436.2447641231274, 2439.768222018923, 2460.9753902460925, 2461.59383701689, 2463.137901734379, 8369.707060252862, 8542.74371768848, 8545.871811922827, 8556.229939305493, 8561.801347811312, 5365.0, 5508.669479831223, 5524.33707955044, 5529.723513824333, 5529.751161197756, 3360.5631267935255, 3393.9830300848585, 3398.1164897126678, 3425.9486107708153, 3451.6893479586956, 1392.227313840818, 1407.859214078584, 1416.964575885611, 1465.7654775236017, 1473.6315921019745, 11075.612353567587, 11448.828267575993, 11633.36016519091, 11656.999999999915, 11660.358680272582, 4470.508244093147, 4635.907281854344, 4785.712857228577, 4788.23388257884, 4789.712617242976, 9470.810583788285, 9479.431234125974, 9490.857637135448, 9495.66765163216, 9495.857562136573, 5402.783888644489, 5408.891822163535, 5409.647588102975, 5418.972905135449, 5419.3225846769155, 4413.646908247397, 4822.565969062801, 5040.7731652075745, 5099.464556221617, 5115.360579927509, 3890.902727431837, 3952.110775075585, 4030.435738996543, 4040.2929487340184, 4044.5550989391145, 1242.5402601037674, 1254.3790823542404, 1260.9180403273758, 1264.5953294945714, 1271.281725824906, 1051.673981065872, 1063.0698139128262, 1066.653337665262, 1069.048546793339, 1069.668402795136, 5819.79630712923, 5895.64626122434, 5926.762929482772, 5958.1062840573395, 6115.785947491817, 652.5790864892118, 658.2528829778237, 660.6729668813967, 668.1147479589563, 668.7224801707237, 4067.3085575452246, 4089.3252613319064, 4106.938395924063, 4157.91684166315, 4192.098698779777, 9940.502974851228, 10145.94927025375, 10239.641612543524, 10286.2799604027, 10287.742806429898, 10149.543270552844, 10201.13290370312, 10230.02814732614, 10267.229957753198, 10277.588896444207, 7522.511036782592, 7836.804079897935, 7839.216078392115, 7945.1260361359045, 8021.799455013671, 5734.111212762028, 5819.330776960704, 5867.882642347044, 5897.941020589739, 5975.312839023568, 9372.578233979351, 9488.85766713486, 9512.1439070484, 9513.571889265138, 9619.470929098967, 9333.906660933575, 9582.137607615348, 9649.517524123907, 9723.02769723022, 9723.951380243054, 7367.373773229121, 7376.483646144933, 7405.481616287024, 7412.11054673421, 7469.066366704162, 7794.571298578632, 7861.724839630586, 7871.724489642835, 7875.330596899099, 7884.250996155356, 7001.264867188872, 7038.260982596754, 7063.046488723957, 7163.892541611775, 7268.0914885639295, 7007.334303241184, 7025.859482810418, 7056.929430705833, 7064.646767661699, 7200.927990720026, 6451.580647257913, 6573.079768832272, 6573.211214654272, 6578.0, 6578.901316480161, 5217.113090774502, 5242.2922905408805, 5289.6032797539565, 5410.621256512007, 5496.175573663822, 5129.640925135204, 5174.8965020700125, 5181.81863634771, 5196.662216955886, 5346.0911645021215], "value": 4568.2256627255865, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [404.19363370076667, 411.15097324025885, 414.20679398951006, 427.9486461624605, 430.41893443850785, 5107.233914912756, 5197.194434862602, 5233.555147812436, 5269.6311258211945, 5326.893462130755, 5114.6675466094675, 5248.265242865992, 5248.81901572146, 5255.159174532076, 5262.500062494067, 4233.449651545295, 4248.426462427564, 4251.298535741599, 4256.702030857841, 4265.765382903939, 4100.8974775630695, 4212.684048696345, 4242.766647834368, 4252.4046633471335, 4259.233337999174, 4209.810558524874, 4218.936715949263, 4219.77626488318, 4219.881731341197, 4232.619064284214, 4220.556841531626, 4220.852270170544, 4222.0, 4227.365895115727, 4237.724547904377, 3852.460655508231, 3863.478430411915, 3868.5492940147446, 3871.9419208711893, 3875.399313106473, 5021.748912554358, 5136.922946155811, 5139.563137133348, 5146.922796158061, 5155.7679904404395, 4893.339399181101, 4893.681910675795, 4906.558409743105, 4908.5336892995465, 4917.360743103373, 5420.457954204588, 5508.3114610673665, 5547.611667183299, 5568.220449137124, 5570.415106413809, 4255.851045213402, 4256.34026725858, 4269.146170765828, 4275.914481710349, 4288.871333859989, 5712.857928139548, 5717.656940583578, 5720.48515633595, 5723.483276931616, 5731.484166425, 4308.590683885026, 4384.772263766087, 4386.232409328355, 4405.118976204772, 4420.248557745191, 4439.178751930838, 4445.488768791565, 4456.732596044248, 4469.7988590513505, 4474.149911516802, 4904.313396124546, 4918.631102667314, 4920.138975679313, 4921.434035086011, 4945.579625731782, 5437.184422336602, 5610.635308704921, 5623.6906970116215, 5634.0, 5639.295088113986, 1474.0, 1482.7553453680239, 1487.8288996765293, 1491.403438624537, 1492.1867582167745, 1049.5854137615752, 1070.373831308693, 1076.8869268726828, 1079.8780396520874, 1082.5290998415715, 5212.582993360522, 5218.947810521922, 5224.0, 5233.476652334813, 5239.921401178985, 5444.210589464585, 5445.074337362658, 5462.552423607747, 5501.724913754297, 5502.972485137629, 4990.10178167926, 5212.869678258074, 5240.065563284573, 5242.449542798027, 5260.316158899319, 2857.8428186449946, 2864.8970146493334, 2871.4113606710575, 2894.768418526513, 2895.5946167536563, 5566.582506311962, 5616.522595579421, 5635.492805647511, 5662.2639056922335, 5673.77304907799, 5407.297051383295, 5520.613557051048, 5557.249771280825, 5573.470520300565, 5582.190582365534, 5645.2096706461125, 5648.8870222595315, 5650.519705825051, 5665.603407761417, 5668.829935102036, 5289.894202116013, 5453.754581043783, 5481.534069603968, 5494.972525137348, 5516.420775818642, 5327.813526526553, 5379.0, 5387.545362752114, 5390.245365648891, 5430.945690543044, 5652.491275785199, 5657.32112146545, 5666.2350582670815, 5666.4333566644655, 5683.8863222736145, 4023.2154729827403, 4197.643200327884, 4226.323788193874, 4265.701400901907, 4324.35134729793, 5607.719614019201, 5610.579206559606, 5637.238972738792, 5643.915341269966, 5664.348599911063, 5517.586181036358, 5518.365387980433, 5534.446555344433, 5541.916871246854, 5560.527355174855, 5209.0, 5486.149646804752, 5529.0, 5538.778448862162, 5556.0, 5504.91742623869, 5509.834704958857, 5513.117901135959, 5517.2551705519245, 5525.613207075467, 5358.651687640291, 5555.527780138734, 5557.0, 5567.66594004361, 5613.607047506635, 5439.4288599696465, 5441.755121019484, 5443.156310771837, 5446.754896029609, 5473.166489226154], "value": 4294.282228182307, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [779.1857508903196, 811.221227621483, 838.6938767349919, 904.543205681131, 904.6471875968372, 15158.924205378971, 16364.34542618294, 16552.172391380413, 16562.089085100313, 16578.917105414486, 16366.0, 16740.497785066436, 16775.0, 16783.83216167838, 16786.916065419686, 710.6979533698184, 731.0861423220974, 817.497239197892, 827.4538804389105, 834.2658460554703, 845.1379592815325, 846.1496196322718, 848.0332421040019, 848.3891598049426, 848.4866655673321, 882.0, 883.3507372081515, 884.0099089020306, 884.2439714044496, 885.0706757904208, 732.1470486882776, 744.6425715656488, 880.5421180985884, 1056.4295280548572, 1087.9292845964987, 642.6465444005778, 643.7972038807808, 644.1883227133845, 644.954853160279, 645.5319893077528, 17180.742288865677, 17448.651026979518, 17498.38755643559, 17504.0, 17575.20911558983, 15834.129122898235, 16096.597585060466, 16109.83890161095, 16196.83803161965, 16721.66556668872, 13277.336133193301, 13341.332933353293, 13356.933215333958, 13432.194068355831, 13441.19352838823, 4034.495688038995, 4074.164796216798, 4081.877543673665, 4140.627343539096, 4162.937555936664, 80590.5970470144, 82241.0, 82397.0, 84444.0, 84686.57656711739, 12440.75118497625, 12460.688482787822, 12569.183003104768, 12593.496260149675, 12692.111552191258, 25518.617220741704, 25638.74361256401, 25666.230013099637, 25678.74321256801, 25681.22956311314, 8268.37987150966, 8532.189442003, 8568.742937711879, 8583.742487725378, 8825.823483530294, 4612.169809434334, 4749.857504274877, 5012.1980483122525, 5079.74601269935, 5103.489651034941, 4071.206114807643, 4196.391523229115, 4200.516940551875, 4203.390508376329, 4204.516480604709, 671.9361660642231, 680.6664734280266, 693.9410150137295, 696.5472442912046, 705.7459314646723, 764.9961750191325, 776.3323541754087, 789.7709664197433, 790.1269097647132, 819.6844214977276, 10810.513526891309, 11068.667939961813, 11475.483603237873, 11574.52054522134, 11885.940570297265, 727.4507746651244, 729.669412039547, 732.3994324653733, 732.9706811727577, 734.5262305812828, 5383.407825139231, 5424.349078110573, 5431.592630552725, 5461.644993075437, 5501.257330260363, 66157.33842661609, 67412.662936685, 69776.65111674511, 80795.0, 84672.0, 59414.70292648509, 61123.08315375273, 76048.71853844394, 76952.0, 78066.0, 67030.66484667546, 68503.31496684969, 68693.65653171802, 70178.2982170182, 71081.64459177671, 10291.897081029094, 10460.79078418412, 10616.89383106159, 10715.142788576739, 10730.785384292114, 44415.55584444114, 45719.314210286204, 45974.77012614915, 46311.073778524915, 46403.0, 54337.45662543482, 56996.715016424656, 57113.0, 58546.4145358558, 58939.41060589339, 12226.938865305616, 13110.082294239312, 13279.0, 13291.80062299047, 13339.132956357806, 14045.227512486503, 14132.0, 14205.573832785032, 14276.857231427553, 14284.142951422948, 12541.93729031349, 12616.0, 12861.871381286068, 12883.549075782303, 13025.0, 12732.23606583608, 12733.872661273268, 12758.48966041348, 12916.547920823103, 12980.026498012498, 12881.613551593467, 12976.15654982423, 13206.801897971345, 13318.267495287851, 13818.37817298244, 10996.12031037531, 11258.268212566158, 11273.661790146309, 11310.660680179608, 11476.139289553485, 11089.667309980714, 11305.208635395444, 11377.374244416305, 11378.31730096197, 11404.372759498307], "value": 7670.288378030009, "unit": "score"}], "name": "dromaeo_css", "value": 7538.738578530479, "alertThreshold": 5.0}, {"lowerIsBetter": true, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [103.0, 113.0, 111.0, 111.0, 112.0, 111.0, 112.0, 111.0, 111.0, 112.0], "value": 110.7, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [148.0, 121.0, 121.0, 163.0, 117.0, 117.0, 121.0, 125.0, 132.0, 117.0], "value": 128.2, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [161.0, 160.0, 161.0, 161.0, 160.0, 161.0, 160.0, 160.0, 160.0, 159.0], "value": 160.3, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [75.0, 74.0, 76.0, 109.0, 76.0, 77.0, 77.0, 76.0, 103.0, 76.0], "value": 81.9, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [84.0, 82.0, 108.0, 84.0, 82.0, 85.0, 95.0, 82.0, 83.0, 101.0], "value": 88.6, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [116.0, 118.0, 117.0, 117.0, 116.0, 116.0, 117.0, 116.0, 117.0, 117.0], "value": 116.7, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [147.0, 146.0, 146.0, 146.0, 146.0, 146.0, 147.0, 147.0, 146.0, 146.0], "value": 146.3, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [97.0, 96.0, 95.0, 96.0, 96.0, 95.0, 95.0, 95.0, 95.0, 95.0], "value": 95.5, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [48.0, 52.0, 48.0, 48.0, 47.0, 47.0, 49.0, 50.0, 48.0, 49.0], "value": 48.6, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [63.0, 63.0, 62.0, 63.0, 64.0, 63.0, 63.0, 64.0, 63.0, 63.0], "value": 63.1, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [79.0, 84.0, 75.0, 75.0, 79.0, 81.0, 80.0, 78.0, 75.0, 79.0], "value": 78.5, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [120.0, 121.0, 128.0, 122.0, 119.0, 120.0, 122.0, 121.0, 159.0, 122.0], "value": 125.4, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [156.0, 156.0, 154.0, 155.0, 161.0, 154.0, 155.0, 158.0, 159.0, 155.0], "value": 156.3, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [63.0, 60.0, 61.0, 62.0, 62.0, 60.0, 59.0, 59.0, 59.0, 59.0], "value": 60.4, "unit": "score"}], "name": "kraken", "value": 1460.5000000000002, "alertThreshold": 2.0}]} 09:04:03 INFO - Return code: 0 09:04:03 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 09:04:03 ERROR - # TBPL SUCCESS # 09:04:03 INFO - Running post-action listener: _resource_record_post_action 09:04:03 INFO - [mozharness: 2017-03-02 17:04:03.875536Z] Finished run-tests step (success) 09:04:03 INFO - Running post-run listener: _resource_record_post_run 09:04:03 INFO - Total resource usage - Wall time: 1190s; CPU: 13.0%; Read bytes: 0; Write bytes: 372146176; Read time: 0; Write time: 260092 09:04:03 INFO - TinderboxPrint: CPU usage
13.0% 09:04:03 INFO - TinderboxPrint: I/O read bytes / time
0 / 0 09:04:03 INFO - TinderboxPrint: I/O write bytes / time
372,146,176 / 260,092 09:04:03 INFO - TinderboxPrint: CPU idle
8,259.9 (87.0%) 09:04:03 INFO - TinderboxPrint: CPU user
1,193.4 (12.6%) 09:04:03 INFO - TinderboxPrint: Swap in / out
0 / 0 09:04:03 INFO - install - Wall time: 17s; CPU: 13.0%; Read bytes: 0; Write bytes: 116367360; Read time: 0; Write time: 118048 09:04:03 INFO - run-tests - Wall time: 1174s; CPU: 13.0%; Read bytes: 0; Write bytes: 255778816; Read time: 0; Write time: 142044 09:04:04 INFO - Running post-run listener: _upload_blobber_files 09:04:04 INFO - Blob upload gear active. 09:04:04 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 09:04:04 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 09:04:04 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', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 09:04:04 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 -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 09:04:04 INFO - (blobuploader) - INFO - Open directory for files ... 09:04:04 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 09:04:04 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 09:04:04 INFO - (blobuploader) - INFO - Uploading, attempt #1. 09:04:05 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 09:04:05 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 09:04:05 INFO - (blobuploader) - INFO - Done attempting. 09:04:05 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 09:04:05 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 09:04:05 INFO - (blobuploader) - INFO - Uploading, attempt #1. 09:04:06 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 09:04:06 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 09:04:06 INFO - (blobuploader) - INFO - Done attempting. 09:04:06 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/perfherder-data.json ... 09:04:06 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 09:04:06 INFO - (blobuploader) - INFO - Uploading, attempt #1. 09:04:07 INFO - (blobuploader) - INFO - TinderboxPrint: perfherder-data.json: uploaded 09:04:07 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 09:04:07 INFO - (blobuploader) - INFO - Done attempting. 09:04:07 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 09:04:07 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 09:04:07 INFO - (blobuploader) - INFO - Uploading, attempt #1. 09:04:10 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 09:04:10 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 09:04:10 INFO - (blobuploader) - INFO - Done attempting. 09:04:10 INFO - (blobuploader) - INFO - Iteration through files over. 09:04:10 INFO - Return code: 0 09:04:10 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 09:04:10 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 09:04:10 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/1e8f639c0cb59a3f2ffd9d83aa8a55f77f4c28b7cd45f8358a99b35d0404f46e82825aea21c023e06e28c662f7c1d885e0ccee22fd92ed8982849e810d716d3a", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/475a937d68e1be443883bbcf05ee92274f0ebd62309cb32b0b115034a9e555d13866364cd5ca8c7aa3c45822477f20b02bd2796c381a80213496f32a7ae22b48", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/eec0a66ce65dd0cfc59e3eec48ef297612510052b344d707e2ab69b61b930667e43c25d368b023a6a129467ea373e271e9bcd6618ed5542655a6a8baae47d1e5", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/fcbb3920255894172de996ad167f92cbfcf4cecabba0b708da0740cb3b3b01ae5a4efef8f91f194dbf6071390832e6835c13dacf47a10a414eebbde0f3d9c38a"} 09:04:10 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 09:04:10 INFO - Writing to file /builds/slave/test/properties/blobber_files 09:04:10 INFO - Contents: 09:04:10 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/1e8f639c0cb59a3f2ffd9d83aa8a55f77f4c28b7cd45f8358a99b35d0404f46e82825aea21c023e06e28c662f7c1d885e0ccee22fd92ed8982849e810d716d3a", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/475a937d68e1be443883bbcf05ee92274f0ebd62309cb32b0b115034a9e555d13866364cd5ca8c7aa3c45822477f20b02bd2796c381a80213496f32a7ae22b48", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/eec0a66ce65dd0cfc59e3eec48ef297612510052b344d707e2ab69b61b930667e43c25d368b023a6a129467ea373e271e9bcd6618ed5542655a6a8baae47d1e5", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/fcbb3920255894172de996ad167f92cbfcf4cecabba0b708da0740cb3b3b01ae5a4efef8f91f194dbf6071390832e6835c13dacf47a10a414eebbde0f3d9c38a"} 09:04:10 INFO - Running post-run listener: copy_logs_to_upload_dir 09:04:10 INFO - Copying logs to upload dir... 09:04:10 INFO - mkdir: /builds/slave/test/build/upload/logs 09:04:10 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1236.209246 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 36 secs) (at 2017-03-02 09:04:09.866674) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-03-02 09:04:09.870046) ========= 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=20e20d796406ba5117c4a6f1000001ba-1488472993.13859-242980632 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/1e8f639c0cb59a3f2ffd9d83aa8a55f77f4c28b7cd45f8358a99b35d0404f46e82825aea21c023e06e28c662f7c1d885e0ccee22fd92ed8982849e810d716d3a", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/475a937d68e1be443883bbcf05ee92274f0ebd62309cb32b0b115034a9e555d13866364cd5ca8c7aa3c45822477f20b02bd2796c381a80213496f32a7ae22b48", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/eec0a66ce65dd0cfc59e3eec48ef297612510052b344d707e2ab69b61b930667e43c25d368b023a6a129467ea373e271e9bcd6618ed5542655a6a8baae47d1e5", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/fcbb3920255894172de996ad167f92cbfcf4cecabba0b708da0740cb3b3b01ae5a4efef8f91f194dbf6071390832e6835c13dacf47a10a414eebbde0f3d9c38a"} build_url:https://queue.taskcluster.net/v1/task/KR-GqxOgS56ynaT1fQQ6qw/artifacts/public/build/target.tar.bz2 program finished with exit code 0 elapsedTime=0.011406 build_url: 'https://queue.taskcluster.net/v1/task/KR-GqxOgS56ynaT1fQQ6qw/artifacts/public/build/target.tar.bz2' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/1e8f639c0cb59a3f2ffd9d83aa8a55f77f4c28b7cd45f8358a99b35d0404f46e82825aea21c023e06e28c662f7c1d885e0ccee22fd92ed8982849e810d716d3a", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/475a937d68e1be443883bbcf05ee92274f0ebd62309cb32b0b115034a9e555d13866364cd5ca8c7aa3c45822477f20b02bd2796c381a80213496f32a7ae22b48", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/eec0a66ce65dd0cfc59e3eec48ef297612510052b344d707e2ab69b61b930667e43c25d368b023a6a129467ea373e271e9bcd6618ed5542655a6a8baae47d1e5", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/fcbb3920255894172de996ad167f92cbfcf4cecabba0b708da0740cb3b3b01ae5a4efef8f91f194dbf6071390832e6835c13dacf47a10a414eebbde0f3d9c38a"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-03-02 09:04:09.894930) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-03-02 09:04:09.895241) ========= 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=20e20d796406ba5117c4a6f1000001ba-1488472993.13859-242980632 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004509 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-03-02 09:04:09.979788) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2017-03-02 09:04:09.980196) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2017-03-02 09:04:09.980506) ========= ========= Total master_lag: 0.17 =========