builder: fx-team_ubuntu64_hw_test-dromaeojs slave: talos-linux64-ix-060 starttime: 1450358673.31 results: success (0) buildid: 20151217050435 builduid: cf23b603dbf7433e941078c782193655 revision: a9eaed26451a0381ed8a599597aa1c8629a2f3d1 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2015-12-17 05:24:33.307928) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2015-12-17 05:24:33.308357) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2015-12-17 05:24:33.308672) ========= bash -c pwd in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'pwd'] 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=49ca1b5d70b54a29b055e1ff000001bd-1450358129.534349-1903973253 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test program finished with exit code 0 elapsedTime=0.004546 basedir: '/builds/slave/test' ========= master_lag: 0.02 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2015-12-17 05:24:33.335423) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-12-17 05:24:33.335758) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-12-17 05:24:33.370074) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-12-17 05:24:33.370400) ========= rm -rf properties in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', '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=49ca1b5d70b54a29b055e1ff000001bd-1450358129.534349-1903973253 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004585 ========= master_lag: 0.05 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-12-17 05:24:33.429441) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-12-17 05:24:33.429771) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-12-17 05:24:33.430176) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-12-17 05:24:33.430542) ========= 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=49ca1b5d70b54a29b055e1ff000001bd-1450358129.534349-1903973253 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2015-12-17 05:24:34-- 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: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 43.7M=0s 2015-12-17 05:24:34 (43.7 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.101715 ========= master_lag: 0.03 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-12-17 05:24:33.562590) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-12-17 05:24:33.562896) ========= rm -rf scripts in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'scripts'] 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=49ca1b5d70b54a29b055e1ff000001bd-1450358129.534349-1903973253 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.015801 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-12-17 05:24:33.620396) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-12-17 05:24:33.620758) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev a9eaed26451a0381ed8a599597aa1c8629a2f3d1 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo integration/fx-team --rev a9eaed26451a0381ed8a599597aa1c8629a2f3d1 --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=49ca1b5d70b54a29b055e1ff000001bd-1450358129.534349-1903973253 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2015-12-17 05:24:34,328 truncating revision to first 12 chars 2015-12-17 05:24:34,328 Setting DEBUG logging. 2015-12-17 05:24:34,328 attempt 1/10 2015-12-17 05:24:34,328 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/a9eaed26451a?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2015-12-17 05:24:34,606 unpacking tar archive at: fx-team-a9eaed26451a/testing/mozharness/ program finished with exit code 0 elapsedTime=0.548605 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-12-17 05:24:34.185337) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-12-17 05:24:34.185670) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-12-17 05:24:34.222916) ========= ========= Started tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-12-17 05:24:34.223260) ========= TinderboxPrint: script_revlink: https://hg.mozilla.org/build/mozharness/rev/production ========= Finished tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-12-17 05:24:34.223718) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 17 secs) (at 2015-12-17 05:24:34.224033) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Fx-Team-Non-PGO --system-bits 64 --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team-Non-PGO in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs', '--add-option', '--webServer,localhost', '--branch-name', 'Fx-Team-Non-PGO', '--system-bits', '64', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Fx-Team-Non-PGO'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=49ca1b5d70b54a29b055e1ff000001bd-1450358129.534349-1903973253 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 05:24:35 INFO - MultiFileLogger online at 20151217 05:24:35 in /builds/slave/test 05:24:35 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Fx-Team-Non-PGO --system-bits 64 --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team-Non-PGO 05:24:35 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 05:24:35 INFO - {'append_to_log': False, 05:24:35 INFO - 'base_work_dir': '/builds/slave/test', 05:24:35 INFO - 'blob_upload_branch': 'Fx-Team-Non-PGO', 05:24:35 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 05:24:35 INFO - 'branch': 'Fx-Team-Non-PGO', 05:24:35 INFO - 'buildbot_json_path': 'buildprops.json', 05:24:35 INFO - 'config_files': ('talos/linux_config.py',), 05:24:35 INFO - 'default_actions': ('clobber', 05:24:35 INFO - 'read-buildbot-config', 05:24:35 INFO - 'download-and-extract', 05:24:35 INFO - 'populate-webroot', 05:24:35 INFO - 'create-virtualenv', 05:24:35 INFO - 'install', 05:24:35 INFO - 'run-tests'), 05:24:35 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 05:24:35 INFO - 'download_minidump_stackwalk': True, 05:24:35 INFO - 'download_symbols': 'ondemand', 05:24:35 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 05:24:35 INFO - 'tooltool.py': '/tools/tooltool.py', 05:24:35 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 05:24:35 INFO - '/tools/misc-python/virtualenv.py')}, 05:24:35 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 05:24:35 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 05:24:35 INFO - 'installer_path': 'installer.exe', 05:24:35 INFO - 'log_level': 'info', 05:24:35 INFO - 'log_name': 'talos', 05:24:35 INFO - 'log_to_console': True, 05:24:35 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 05:24:35 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 05:24:35 INFO - 'opt_config_files': (), 05:24:35 INFO - 'pip_index': False, 05:24:35 INFO - 'sps_profile': False, 05:24:35 INFO - 'sps_profile_interval': 0, 05:24:35 INFO - 'suite': 'dromaeojs', 05:24:35 INFO - 'system_bits': '64', 05:24:35 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 05:24:35 INFO - 'title': 'talos-linux64-ix-060', 05:24:35 INFO - 'tooltool_cache': '/builds/tooltool_cache', 05:24:35 INFO - 'use_talos_json': True, 05:24:35 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 05:24:35 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 05:24:35 INFO - 'work_dir': 'build'} 05:24:35 INFO - ##### 05:24:35 INFO - ##### Running clobber step. 05:24:35 INFO - ##### 05:24:35 INFO - Running pre-action listener: _resource_record_pre_action 05:24:35 INFO - Running main action method: clobber 05:24:35 INFO - rmtree: /builds/slave/test/build 05:24:35 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 05:24:35 INFO - Running post-action listener: _resource_record_post_action 05:24:35 INFO - ##### 05:24:35 INFO - ##### Running read-buildbot-config step. 05:24:35 INFO - ##### 05:24:35 INFO - Running pre-action listener: _resource_record_pre_action 05:24:35 INFO - Running main action method: read_buildbot_config 05:24:35 INFO - Using buildbot properties: 05:24:35 INFO - { 05:24:35 INFO - "project": "", 05:24:35 INFO - "product": "firefox", 05:24:35 INFO - "script_repo_revision": "production", 05:24:35 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs", 05:24:35 INFO - "repository": "", 05:24:35 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team talos dromaeojs", 05:24:35 INFO - "buildid": "20151217050435", 05:24:35 INFO - "pgo_build": "False", 05:24:35 INFO - "basedir": "/builds/slave/test", 05:24:35 INFO - "buildnumber": 1023, 05:24:35 INFO - "slavename": "talos-linux64-ix-060", 05:24:35 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 05:24:35 INFO - "platform": "ubuntu64_hw", 05:24:35 INFO - "scheduler": "tests-fx-team-linux64-talos", 05:24:35 INFO - "branch": "fx-team", 05:24:35 INFO - "repo_path": "integration/fx-team", 05:24:35 INFO - "revision": "a9eaed26451a0381ed8a599597aa1c8629a2f3d1", 05:24:35 INFO - "stage_platform": "linux64", 05:24:35 INFO - "builduid": "cf23b603dbf7433e941078c782193655", 05:24:35 INFO - "slavebuilddir": "test" 05:24:35 INFO - } 05:24:35 INFO - Found installer url https://queue.taskcluster.net/v1/task/GPMUu3YiSySyjdMvXjUPqQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2. 05:24:35 INFO - Running post-action listener: _resource_record_post_action 05:24:35 INFO - ##### 05:24:35 INFO - ##### Running download-and-extract step. 05:24:35 INFO - ##### 05:24:35 INFO - Running pre-action listener: _resource_record_pre_action 05:24:35 INFO - Running main action method: download_and_extract 05:24:35 INFO - mkdir: /builds/slave/test/build/tests 05:24:35 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:24:35 INFO - https://queue.taskcluster.net/v1/task/GPMUu3YiSySyjdMvXjUPqQ/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 05:24:35 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/GPMUu3YiSySyjdMvXjUPqQ/artifacts/public/build/test_packages.json 05:24:35 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/GPMUu3YiSySyjdMvXjUPqQ/artifacts/public/build/test_packages.json 05:24:35 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/GPMUu3YiSySyjdMvXjUPqQ/artifacts/public/build/test_packages.json to /builds/slave/test/build/test_packages.json 05:24:35 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/GPMUu3YiSySyjdMvXjUPqQ/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test/build/test_packages.json'}, attempt #1 05:24:43 INFO - Downloaded 1302 bytes. 05:24:43 INFO - Reading from file /builds/slave/test/build/test_packages.json 05:24:43 INFO - Using the following test package requirements: 05:24:43 INFO - {u'common': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'], 05:24:43 INFO - u'cppunittest': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 05:24:43 INFO - u'firefox-46.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 05:24:43 INFO - u'jittest': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 05:24:43 INFO - u'jsshell-linux-x86_64.zip'], 05:24:43 INFO - u'mochitest': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 05:24:43 INFO - u'firefox-46.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 05:24:43 INFO - u'mozbase': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'], 05:24:43 INFO - u'reftest': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 05:24:43 INFO - u'firefox-46.0a1.en-US.linux-x86_64.reftest.tests.zip'], 05:24:43 INFO - u'talos': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 05:24:43 INFO - u'firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip'], 05:24:43 INFO - u'web-platform': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 05:24:43 INFO - u'firefox-46.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 05:24:43 INFO - u'webapprt': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'], 05:24:43 INFO - u'xpcshell': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 05:24:43 INFO - u'firefox-46.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 05:24:43 INFO - Downloading packages: [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 05:24:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:24:43 INFO - https://queue.taskcluster.net/v1/task/GPMUu3YiSySyjdMvXjUPqQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 05:24:43 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/GPMUu3YiSySyjdMvXjUPqQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 05:24:43 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/GPMUu3YiSySyjdMvXjUPqQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 05:24:43 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/GPMUu3YiSySyjdMvXjUPqQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 05:24:43 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/GPMUu3YiSySyjdMvXjUPqQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 05:24:44 INFO - Downloaded 21871322 bytes. 05:24:44 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'] in /builds/slave/test/build/tests 05:24:44 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 05:24:44 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'] with output_timeout 1760 05:24:45 INFO - Return code: 0 05:24:45 INFO - Downloading packages: [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 05:24:45 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:24:45 INFO - https://queue.taskcluster.net/v1/task/GPMUu3YiSySyjdMvXjUPqQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 05:24:45 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/GPMUu3YiSySyjdMvXjUPqQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 05:24:45 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/GPMUu3YiSySyjdMvXjUPqQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 05:24:45 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/GPMUu3YiSySyjdMvXjUPqQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 05:24:45 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/GPMUu3YiSySyjdMvXjUPqQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 05:24:47 INFO - Downloaded 21871322 bytes. 05:24:47 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'] in /builds/slave/test/build/tests 05:24:47 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 05:24:47 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'] with output_timeout 1760 05:24:49 INFO - Return code: 0 05:24: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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:24:49 INFO - https://queue.taskcluster.net/v1/task/GPMUu3YiSySyjdMvXjUPqQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 05:24:49 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/GPMUu3YiSySyjdMvXjUPqQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip 05:24:49 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/GPMUu3YiSySyjdMvXjUPqQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip 05:24:49 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/GPMUu3YiSySyjdMvXjUPqQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip 05:24:49 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/GPMUu3YiSySyjdMvXjUPqQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 05:24:50 INFO - Downloaded 11132039 bytes. 05:24:50 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip'] in /builds/slave/test/build/tests 05:24:50 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip 05:24:50 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip'] with output_timeout 1760 05:24:50 INFO - Return code: 0 05:24:50 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:24:50 INFO - https://queue.taskcluster.net/v1/task/GPMUu3YiSySyjdMvXjUPqQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 05:24:50 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/GPMUu3YiSySyjdMvXjUPqQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 05:24:50 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/GPMUu3YiSySyjdMvXjUPqQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 05:24:50 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/GPMUu3YiSySyjdMvXjUPqQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 05:24:50 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/GPMUu3YiSySyjdMvXjUPqQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 05:24:54 INFO - Downloaded 53020768 bytes. 05:24:54 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/GPMUu3YiSySyjdMvXjUPqQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 05:24:54 INFO - mkdir: /builds/slave/test/properties 05:24:54 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 05:24:54 INFO - Writing to file /builds/slave/test/properties/build_url 05:24:54 INFO - Contents: 05:24:54 INFO - build_url:https://queue.taskcluster.net/v1/task/GPMUu3YiSySyjdMvXjUPqQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 05:24:54 INFO - Running post-action listener: _resource_record_post_action 05:24:54 INFO - Running post-action listener: set_extra_try_arguments 05:24:54 INFO - ##### 05:24:54 INFO - ##### Running populate-webroot step. 05:24:54 INFO - ##### 05:24:54 INFO - Running pre-action listener: _resource_record_pre_action 05:24:54 INFO - Running main action method: populate_webroot 05:24:54 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 05:24:54 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 05:24:54 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 05:24:54 INFO - '--tppagecycles', 05:24:54 INFO - '7'], 05:24:54 INFO - 'tests': ['tsvgm']}}, 05:24:54 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 05:24:54 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 05:24:54 INFO - 'tests': ['tresize', 'tcanvasmark']}, 05:24:54 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 05:24:54 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 05:24:54 INFO - 'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 05:24:54 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:24:54 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 05:24:54 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:24:54 INFO - 'talos_options': ['--e10s'], 05:24:54 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 05:24:54 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:24:54 INFO - 'tests': ['damp', 'tps']}, 05:24:54 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:24:54 INFO - 'talos_options': ['--e10s'], 05:24:54 INFO - 'tests': ['damp', 'tps']}, 05:24:54 INFO - 'g3': {'tests': ['dromaeo_dom']}, 05:24:54 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 05:24:54 INFO - 'other': {'tests': ['a11yr', 05:24:54 INFO - 'ts_paint', 05:24:54 INFO - 'tpaint', 05:24:54 INFO - 'sessionrestore', 05:24:54 INFO - 'sessionrestore_no_auto_restore']}, 05:24:54 INFO - 'other-e10s': {'talos_options': ['--e10s'], 05:24:54 INFO - 'tests': ['a11yr', 05:24:54 INFO - 'ts_paint', 05:24:54 INFO - 'tpaint', 05:24:54 INFO - 'sessionrestore', 05:24:54 INFO - 'sessionrestore_no_auto_restore']}, 05:24:54 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 05:24:54 INFO - 'tests': ['a11yr', 05:24:54 INFO - 'ts_paint', 05:24:54 INFO - 'tpaint', 05:24:54 INFO - 'sessionrestore', 05:24:54 INFO - 'sessionrestore_no_auto_restore']}, 05:24:54 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 05:24:54 INFO - 'tests': ['a11yr', 05:24:54 INFO - 'ts_paint', 05:24:54 INFO - 'tpaint', 05:24:54 INFO - 'sessionrestore', 05:24:54 INFO - 'sessionrestore_no_auto_restore']}, 05:24:54 INFO - 'other_l64': {'tests': ['a11yr', 05:24:54 INFO - 'ts_paint', 05:24:54 INFO - 'tpaint', 05:24:54 INFO - 'sessionrestore', 05:24:54 INFO - 'sessionrestore_no_auto_restore']}, 05:24:54 INFO - 'other_nol64': {'tests': ['a11yr', 05:24:54 INFO - 'ts_paint', 05:24:54 INFO - 'tpaint', 05:24:54 INFO - 'sessionrestore', 05:24:54 INFO - 'sessionrestore_no_auto_restore']}, 05:24:54 INFO - 'svgr': {'tests': ['tsvgx', 05:24:54 INFO - 'tsvgr_opacity', 05:24:54 INFO - 'tart', 05:24:54 INFO - 'tscrollx', 05:24:54 INFO - 'cart']}, 05:24:54 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 05:24:54 INFO - 'tests': ['tsvgx', 05:24:54 INFO - 'tsvgr_opacity', 05:24:54 INFO - 'tart', 05:24:54 INFO - 'tscrollx', 05:24:54 INFO - 'cart']}, 05:24:54 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:24:54 INFO - 'tests': ['tp5o']}, 05:24:54 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:24:54 INFO - 'talos_options': ['--e10s'], 05:24:54 INFO - 'tests': ['tp5o']}, 05:24:54 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:24:54 INFO - 'talos_options': ['--xperf_path', 05:24:54 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 05:24:54 INFO - 'tests': ['tp5n']}, 05:24:54 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:24:54 INFO - 'talos_options': ['--e10s', 05:24:54 INFO - '--xperf_path', 05:24:54 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 05:24:54 INFO - 'tests': ['tp5n']}}, 05:24:54 INFO - 'talos.zip': {'path': '', 05:24:54 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 05:24:54 INFO - Running post-action listener: _resource_record_post_action 05:24:54 INFO - ##### 05:24:54 INFO - ##### Running create-virtualenv step. 05:24:54 INFO - ##### 05:24:54 INFO - Running pre-action listener: _resource_record_pre_action 05:24:54 INFO - Running main action method: create_virtualenv 05:24:54 INFO - Creating virtualenv /builds/slave/test/build/venv 05:24:54 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 05:24:54 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 05:24:54 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 05:24:54 INFO - Using real prefix '/usr' 05:24:54 INFO - New python executable in /builds/slave/test/build/venv/bin/python 05:24:54 INFO - Installing distribute.............................................................................................................................................................................................done. 05:24:56 INFO - Installing pip.................done. 05:24:56 INFO - Return code: 0 05:24:56 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 05:24: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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:24:56 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:24:56 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:24: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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:24:56 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:24:56 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:24:56 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 0x7ffa2db35f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf2c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xffa240>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10890b0>, '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 0x1089fb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x108a440>, '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': '49ca1b5d70b54a29b055e1ff000001bd-1450358129.534349-1903973253', '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 05:24:56 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 05:24:56 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --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 05:24:56 INFO - Using env: {'DISPLAY': ':0', 05:24:56 INFO - 'HOME': '/home/cltbld', 05:24:56 INFO - 'LANG': 'en_US.UTF-8', 05:24:56 INFO - 'LANGUAGE': 'en_US:en', 05:24:56 INFO - 'LOGNAME': 'cltbld', 05:24:56 INFO - 'MAIL': '/var/mail/cltbld', 05:24:56 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:24:56 INFO - 'MOZ_NO_REMOTE': '1', 05:24:56 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:24:56 INFO - 'NO_EM_RESTART': '1', 05:24:56 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:24:56 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:24:56 INFO - 'PWD': '/builds/slave/test', 05:24:56 INFO - 'SHELL': '/bin/bash', 05:24:56 INFO - 'SHLVL': '1', 05:24:56 INFO - 'TERM': 'linux', 05:24:56 INFO - 'TMOUT': '86400', 05:24:56 INFO - 'USER': 'cltbld', 05:24:56 INFO - 'XDG_SESSION_COOKIE': '49ca1b5d70b54a29b055e1ff000001bd-1450358129.534349-1903973253', 05:24:56 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:24:56 INFO - '_': '/tools/buildbot/bin/python'} 05:24:56 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:24:56 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 05:24:56 INFO - Cleaning up... 05:24:56 INFO - Return code: 0 05:24:56 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 05:24: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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:24:56 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:24:56 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:24: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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:24:56 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:24:56 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:24:56 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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>=0.7.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ffa2db35f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf2c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xffa240>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10890b0>, '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 0x1089fb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x108a440>, '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': '49ca1b5d70b54a29b055e1ff000001bd-1450358129.534349-1903973253', '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 05:24:56 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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>=0.7.1'] in /builds/slave/test/build 05:24:56 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --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>=0.7.1 05:24:56 INFO - Using env: {'DISPLAY': ':0', 05:24:56 INFO - 'HOME': '/home/cltbld', 05:24:56 INFO - 'LANG': 'en_US.UTF-8', 05:24:56 INFO - 'LANGUAGE': 'en_US:en', 05:24:56 INFO - 'LOGNAME': 'cltbld', 05:24:56 INFO - 'MAIL': '/var/mail/cltbld', 05:24:56 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:24:56 INFO - 'MOZ_NO_REMOTE': '1', 05:24:56 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:24:56 INFO - 'NO_EM_RESTART': '1', 05:24:56 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:24:56 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:24:56 INFO - 'PWD': '/builds/slave/test', 05:24:56 INFO - 'SHELL': '/bin/bash', 05:24:56 INFO - 'SHLVL': '1', 05:24:56 INFO - 'TERM': 'linux', 05:24:56 INFO - 'TMOUT': '86400', 05:24:56 INFO - 'USER': 'cltbld', 05:24:56 INFO - 'XDG_SESSION_COOKIE': '49ca1b5d70b54a29b055e1ff000001bd-1450358129.534349-1903973253', 05:24:56 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:24:56 INFO - '_': '/tools/buildbot/bin/python'} 05:24:57 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:24:57 INFO - Downloading/unpacking psutil>=0.7.1 05:24:57 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 05:24:57 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 05:24:57 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 05:24:57 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 05:24:57 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 05:24:57 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 05:24:58 INFO - Creating supposed download cache at /builds/slave/test/build/venv/cache 05:24:58 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpsutil-3.1.1.tar.gz 05:24:58 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 05:24:58 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 05:24:58 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 05:24:58 INFO - Installing collected packages: psutil 05:24:58 INFO - Running setup.py install for psutil 05:24:59 INFO - building 'psutil._psutil_linux' extension 05:24:59 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 05:24:59 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 05:24:59 INFO - building 'psutil._psutil_posix' extension 05:24:59 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 05:24:59 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 05:24:59 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 05:24:59 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 05:24:59 INFO - Successfully installed psutil 05:24:59 INFO - Cleaning up... 05:24:59 INFO - Return code: 0 05:24:59 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 05:24:59 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:24:59 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:24:59 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:24:59 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:24:59 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:24:59 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:24:59 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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.0.0']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ffa2db35f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf2c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xffa240>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10890b0>, '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 0x1089fb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x108a440>, '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': '49ca1b5d70b54a29b055e1ff000001bd-1450358129.534349-1903973253', '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 05:24:59 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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.0.0'] in /builds/slave/test/build 05:24:59 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --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.0.0 05:24:59 INFO - Using env: {'DISPLAY': ':0', 05:24:59 INFO - 'HOME': '/home/cltbld', 05:24:59 INFO - 'LANG': 'en_US.UTF-8', 05:24:59 INFO - 'LANGUAGE': 'en_US:en', 05:24:59 INFO - 'LOGNAME': 'cltbld', 05:24:59 INFO - 'MAIL': '/var/mail/cltbld', 05:24:59 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:24:59 INFO - 'MOZ_NO_REMOTE': '1', 05:24:59 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:24:59 INFO - 'NO_EM_RESTART': '1', 05:24:59 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:24:59 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:24:59 INFO - 'PWD': '/builds/slave/test', 05:24:59 INFO - 'SHELL': '/bin/bash', 05:24:59 INFO - 'SHLVL': '1', 05:24:59 INFO - 'TERM': 'linux', 05:24:59 INFO - 'TMOUT': '86400', 05:24:59 INFO - 'USER': 'cltbld', 05:24:59 INFO - 'XDG_SESSION_COOKIE': '49ca1b5d70b54a29b055e1ff000001bd-1450358129.534349-1903973253', 05:24:59 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:24:59 INFO - '_': '/tools/buildbot/bin/python'} 05:24:59 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:24:59 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 05:24:59 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:24:59 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:24:59 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:24:59 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:24:59 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:24:59 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:25:01 INFO - Downloading mozsystemmonitor-0.0.tar.gz 05:25:01 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fmozsystemmonitor-0.0.tar.gz 05:25:01 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 05:25:01 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 05:25:01 INFO - Installing collected packages: mozsystemmonitor 05:25:01 INFO - Running setup.py install for mozsystemmonitor 05:25:01 INFO - Successfully installed mozsystemmonitor 05:25:01 INFO - Cleaning up... 05:25:01 INFO - Return code: 0 05:25:01 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 05:25: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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:25:01 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:25:01 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:25: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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:25:01 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:25:01 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:25:01 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 0x7ffa2db35f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf2c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xffa240>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10890b0>, '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 0x1089fb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x108a440>, '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': '49ca1b5d70b54a29b055e1ff000001bd-1450358129.534349-1903973253', '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 05:25:01 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 05:25:01 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --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 05:25:01 INFO - Using env: {'DISPLAY': ':0', 05:25:01 INFO - 'HOME': '/home/cltbld', 05:25:01 INFO - 'LANG': 'en_US.UTF-8', 05:25:01 INFO - 'LANGUAGE': 'en_US:en', 05:25:01 INFO - 'LOGNAME': 'cltbld', 05:25:01 INFO - 'MAIL': '/var/mail/cltbld', 05:25:01 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:25:01 INFO - 'MOZ_NO_REMOTE': '1', 05:25:01 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:25:01 INFO - 'NO_EM_RESTART': '1', 05:25:01 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:25:01 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:25:01 INFO - 'PWD': '/builds/slave/test', 05:25:01 INFO - 'SHELL': '/bin/bash', 05:25:01 INFO - 'SHLVL': '1', 05:25:01 INFO - 'TERM': 'linux', 05:25:01 INFO - 'TMOUT': '86400', 05:25:01 INFO - 'USER': 'cltbld', 05:25:01 INFO - 'XDG_SESSION_COOKIE': '49ca1b5d70b54a29b055e1ff000001bd-1450358129.534349-1903973253', 05:25:01 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:25:01 INFO - '_': '/tools/buildbot/bin/python'} 05:25:01 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:25:01 INFO - Downloading/unpacking blobuploader==1.2.4 05:25: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 05:25: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 05:25: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 05:25: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 05:25: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 05:25: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 05:25:03 INFO - Downloading blobuploader-1.2.4.tar.gz 05:25:03 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblobuploader-1.2.4.tar.gz 05:25:03 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 05:25:03 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 05:25: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 05:25: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 05:25: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 05:25: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 05:25: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 05:25: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 05:25:03 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Frequests-1.2.3.tar.gz 05:25:03 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 05:25:03 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 05:25: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 05:25: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 05:25: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 05:25: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 05:25: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 05:25: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 05:25:04 INFO - Downloading docopt-0.6.1.tar.gz 05:25:04 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fdocopt-0.6.1.tar.gz 05:25:04 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 05:25:04 INFO - Installing collected packages: blobuploader, requests, docopt 05:25:04 INFO - Running setup.py install for blobuploader 05:25:04 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 05:25:04 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 05:25:04 INFO - Running setup.py install for requests 05:25:04 INFO - Running setup.py install for docopt 05:25:04 INFO - Successfully installed blobuploader requests docopt 05:25:04 INFO - Cleaning up... 05:25:04 INFO - Return code: 0 05:25:04 INFO - Installing None into virtualenv /builds/slave/test/build/venv 05:25:04 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:25:04 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:25:04 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:25:04 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:25:04 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:25:04 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:25:04 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 0x7ffa2db35f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf2c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xffa240>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10890b0>, '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 0x1089fb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x108a440>, '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': '49ca1b5d70b54a29b055e1ff000001bd-1450358129.534349-1903973253', '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 05:25:04 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 05:25:04 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --download-cache /builds/slave/test/build/venv/cache --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 05:25:04 INFO - Using env: {'DISPLAY': ':0', 05:25:04 INFO - 'HOME': '/home/cltbld', 05:25:04 INFO - 'LANG': 'en_US.UTF-8', 05:25:04 INFO - 'LANGUAGE': 'en_US:en', 05:25:04 INFO - 'LOGNAME': 'cltbld', 05:25:04 INFO - 'MAIL': '/var/mail/cltbld', 05:25:04 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:25:04 INFO - 'MOZ_NO_REMOTE': '1', 05:25:04 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:25:04 INFO - 'NO_EM_RESTART': '1', 05:25:04 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:25:04 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:25:04 INFO - 'PWD': '/builds/slave/test', 05:25:04 INFO - 'SHELL': '/bin/bash', 05:25:04 INFO - 'SHLVL': '1', 05:25:04 INFO - 'TERM': 'linux', 05:25:04 INFO - 'TMOUT': '86400', 05:25:04 INFO - 'USER': 'cltbld', 05:25:04 INFO - 'XDG_SESSION_COOKIE': '49ca1b5d70b54a29b055e1ff000001bd-1450358129.534349-1903973253', 05:25:04 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:25:04 INFO - '_': '/tools/buildbot/bin/python'} 05:25:05 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:25:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 05:25:05 INFO - Running setup.py (path:/tmp/pip-4EiSvm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 05:25:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 05:25:05 INFO - Running setup.py (path:/tmp/pip-WfgdKq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 05:25:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 05:25:05 INFO - Running setup.py (path:/tmp/pip-ZL0ktk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 05:25:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 05:25:05 INFO - Running setup.py (path:/tmp/pip-hsqPXn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 05:25:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 05:25:05 INFO - Running setup.py (path:/tmp/pip-jv9SfO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 05:25:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 05:25:05 INFO - Running setup.py (path:/tmp/pip-lib0xS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 05:25:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 05:25:05 INFO - Running setup.py (path:/tmp/pip-FtBjjx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 05:25:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 05:25:05 INFO - Running setup.py (path:/tmp/pip-S4_AWO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 05:25:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 05:25:05 INFO - Running setup.py (path:/tmp/pip-IXrsGT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 05:25:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 05:25:05 INFO - Running setup.py (path:/tmp/pip-7UuTtz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 05:25:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 05:25:05 INFO - Running setup.py (path:/tmp/pip-sQYvoV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 05:25:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 05:25:05 INFO - Running setup.py (path:/tmp/pip-c5fNoj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 05:25:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 05:25:05 INFO - Running setup.py (path:/tmp/pip-br_v0z-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 05:25:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 05:25:05 INFO - Running setup.py (path:/tmp/pip-QldYN5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 05:25:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 05:25:06 INFO - Running setup.py (path:/tmp/pip-hH2nN1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 05:25:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 05:25:06 INFO - Running setup.py (path:/tmp/pip-t8nYsL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 05:25:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 05:25:06 INFO - Running setup.py (path:/tmp/pip-6Fr2cX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 05:25:06 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 05:25:06 INFO - Running setup.py install for manifestparser 05:25:06 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 05:25:06 INFO - Running setup.py install for mozcrash 05:25:06 INFO - Running setup.py install for mozdebug 05:25:06 INFO - Running setup.py install for mozdevice 05:25:06 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 05:25:06 INFO - Installing dm script to /builds/slave/test/build/venv/bin 05:25:06 INFO - Running setup.py install for mozfile 05:25:06 INFO - Running setup.py install for mozhttpd 05:25:06 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 05:25:06 INFO - Running setup.py install for mozinfo 05:25:06 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 05:25:06 INFO - Running setup.py install for mozInstall 05:25:07 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 05:25:07 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 05:25:07 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 05:25:07 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 05:25:07 INFO - Running setup.py install for mozleak 05:25:07 INFO - Running setup.py install for mozlog 05:25:07 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 05:25:07 INFO - Running setup.py install for moznetwork 05:25:07 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 05:25:07 INFO - Running setup.py install for mozprocess 05:25:07 INFO - Running setup.py install for mozprofile 05:25:07 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 05:25:07 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 05:25:07 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 05:25:07 INFO - Running setup.py install for mozrunner 05:25:07 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 05:25:07 INFO - Running setup.py install for mozscreenshot 05:25:07 INFO - Running setup.py install for moztest 05:25:07 INFO - Running setup.py install for mozversion 05:25:08 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 05:25:08 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 05:25:08 INFO - Cleaning up... 05:25:08 INFO - Return code: 0 05:25:08 INFO - Installing None into virtualenv /builds/slave/test/build/venv 05:25: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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:25:08 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:25:08 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:25: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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:25:08 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:25:08 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:25:08 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 0x7ffa2db35f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf2c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xffa240>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10890b0>, '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 0x1089fb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x108a440>, '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': '49ca1b5d70b54a29b055e1ff000001bd-1450358129.534349-1903973253', '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 05:25:08 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 05:25:08 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --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 05:25:08 INFO - Using env: {'DISPLAY': ':0', 05:25:08 INFO - 'HOME': '/home/cltbld', 05:25:08 INFO - 'LANG': 'en_US.UTF-8', 05:25:08 INFO - 'LANGUAGE': 'en_US:en', 05:25:08 INFO - 'LOGNAME': 'cltbld', 05:25:08 INFO - 'MAIL': '/var/mail/cltbld', 05:25:08 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:25:08 INFO - 'MOZ_NO_REMOTE': '1', 05:25:08 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:25:08 INFO - 'NO_EM_RESTART': '1', 05:25:08 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:25:08 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:25:08 INFO - 'PWD': '/builds/slave/test', 05:25:08 INFO - 'SHELL': '/bin/bash', 05:25:08 INFO - 'SHLVL': '1', 05:25:08 INFO - 'TERM': 'linux', 05:25:08 INFO - 'TMOUT': '86400', 05:25:08 INFO - 'USER': 'cltbld', 05:25:08 INFO - 'XDG_SESSION_COOKIE': '49ca1b5d70b54a29b055e1ff000001bd-1450358129.534349-1903973253', 05:25:08 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:25:08 INFO - '_': '/tools/buildbot/bin/python'} 05:25:08 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:25:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 05:25:08 INFO - Running setup.py (path:/tmp/pip-eTZ9_o-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 05:25: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)) 05:25:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 05:25:08 INFO - Running setup.py (path:/tmp/pip-YSNXcv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 05:25:08 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.16 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)) 05:25:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 05:25:08 INFO - Running setup.py (path:/tmp/pip-RxtLwI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 05:25:08 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)) 05:25:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 05:25:08 INFO - Running setup.py (path:/tmp/pip-bfJb8M-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 05:25:08 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.47 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)) 05:25:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 05:25:08 INFO - Running setup.py (path:/tmp/pip-OeotEW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 05:25:08 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)) 05:25:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 05:25:08 INFO - Running setup.py (path:/tmp/pip-sCYptH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 05:25:08 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)) 05:25:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 05:25:08 INFO - Running setup.py (path:/tmp/pip-YymoW7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 05:25:08 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)) 05:25:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 05:25:08 INFO - Running setup.py (path:/tmp/pip-6JvujY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 05:25:08 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)) 05:25:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 05:25:08 INFO - Running setup.py (path:/tmp/pip-eGnt6_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 05:25:08 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)) 05:25:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 05:25:08 INFO - Running setup.py (path:/tmp/pip-6wdzoY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 05:25:08 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.1 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)) 05:25:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 05:25:08 INFO - Running setup.py (path:/tmp/pip-e1kPhA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 05:25: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)) 05:25:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 05:25:09 INFO - Running setup.py (path:/tmp/pip-TbAOKQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 05:25:09 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.22 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)) 05:25:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 05:25:09 INFO - Running setup.py (path:/tmp/pip-4zFsxL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 05:25:09 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.27 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)) 05:25:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 05:25:09 INFO - Running setup.py (path:/tmp/pip-ZfJbX1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 05:25:09 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.11 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)) 05:25:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 05:25:09 INFO - Running setup.py (path:/tmp/pip-Wi2ICo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 05:25: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)) 05:25:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 05:25:09 INFO - Running setup.py (path:/tmp/pip-0j0Tod-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 05:25:09 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.7 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)) 05:25:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 05:25:09 INFO - Running setup.py (path:/tmp/pip-cvNToe-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 05:25:09 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)) 05:25:09 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.16->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 05:25:09 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.16->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 05:25:09 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)) 05:25:09 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.47->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 05:25:09 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.47->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 05:25:09 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 05:25:09 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 05:25:09 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 05:25:09 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 05:25:09 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 05:25:09 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 05:25:09 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 05:25:11 INFO - Downloading blessings-1.5.1.tar.gz 05:25:11 INFO - Storing download in cache at /builds/slave/test/build/venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblessings-1.5.1.tar.gz 05:25:11 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 05:25:11 INFO - Installing collected packages: blessings 05:25:11 INFO - Running setup.py install for blessings 05:25:11 INFO - Successfully installed blessings 05:25:11 INFO - Cleaning up... 05:25:11 INFO - Return code: 0 05:25:11 INFO - Done creating virtualenv /builds/slave/test/build/venv. 05:25:11 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 05:25:11 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 05:25:11 INFO - Reading from file tmpfile_stdout 05:25:11 INFO - Current package versions: 05:25:11 INFO - argparse == 1.2.1 05:25:11 INFO - blessings == 1.5.1 05:25:11 INFO - blobuploader == 1.2.4 05:25:11 INFO - docopt == 0.6.1 05:25:11 INFO - manifestparser == 1.1 05:25:11 INFO - mozInstall == 1.12 05:25:11 INFO - mozcrash == 0.16 05:25:11 INFO - mozdebug == 0.1 05:25:11 INFO - mozdevice == 0.47 05:25:11 INFO - mozfile == 1.2 05:25:11 INFO - mozhttpd == 0.7 05:25:11 INFO - mozinfo == 0.9 05:25:11 INFO - mozleak == 0.1 05:25:11 INFO - mozlog == 3.1 05:25:11 INFO - moznetwork == 0.27 05:25:11 INFO - mozprocess == 0.22 05:25:11 INFO - mozprofile == 0.27 05:25:11 INFO - mozrunner == 6.11 05:25:11 INFO - mozscreenshot == 0.1 05:25:11 INFO - mozsystemmonitor == 0.0 05:25:11 INFO - moztest == 0.7 05:25:11 INFO - mozversion == 1.4 05:25:11 INFO - psutil == 3.1.1 05:25:11 INFO - requests == 1.2.3 05:25:11 INFO - wsgiref == 0.1.2 05:25:11 INFO - Installing None into virtualenv /builds/slave/test/build/venv 05:25:11 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:25:11 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:25:11 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:25:11 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:25:11 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:25:11 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:25:11 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 0x7ffa2db35f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf2c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xffa240>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10890b0>, '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 0x1089fb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x108a440>, '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': '49ca1b5d70b54a29b055e1ff000001bd-1450358129.534349-1903973253', '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 05:25:11 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 05:25:11 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --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 05:25:11 INFO - Using env: {'DISPLAY': ':0', 05:25:11 INFO - 'HOME': '/home/cltbld', 05:25:11 INFO - 'LANG': 'en_US.UTF-8', 05:25:11 INFO - 'LANGUAGE': 'en_US:en', 05:25:11 INFO - 'LOGNAME': 'cltbld', 05:25:11 INFO - 'MAIL': '/var/mail/cltbld', 05:25:11 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:25:11 INFO - 'MOZ_NO_REMOTE': '1', 05:25:11 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:25:11 INFO - 'NO_EM_RESTART': '1', 05:25:11 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:25:11 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:25:11 INFO - 'PWD': '/builds/slave/test', 05:25:11 INFO - 'SHELL': '/bin/bash', 05:25:11 INFO - 'SHLVL': '1', 05:25:11 INFO - 'TERM': 'linux', 05:25:11 INFO - 'TMOUT': '86400', 05:25:11 INFO - 'USER': 'cltbld', 05:25:11 INFO - 'XDG_SESSION_COOKIE': '49ca1b5d70b54a29b055e1ff000001bd-1450358129.534349-1903973253', 05:25:11 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:25:11 INFO - '_': '/tools/buildbot/bin/python'} 05:25:11 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:25:11 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 1)) 05:25:11 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 2)) 05:25:11 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 3)) 05:25:11 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 4)) 05:25:11 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 5)) 05:25:11 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 6)) 05:25:11 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 7)) 05:25:11 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 8)) 05:25:11 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash>=0.15->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 05:25:11 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 3)) 05:25:11 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.0->mozcrash>=0.15->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 05:25:11 INFO - Cleaning up... 05:25:11 INFO - Return code: 0 05:25:11 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 05:25:11 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:25:11 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:25:11 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:25:11 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:25:11 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:25:11 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:25:11 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 0x7ffa2db35f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf2c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xffa240>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10890b0>, '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 0x1089fb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x108a440>, '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': '49ca1b5d70b54a29b055e1ff000001bd-1450358129.534349-1903973253', '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 05:25:11 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 05:25:11 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --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 05:25:11 INFO - Using env: {'DISPLAY': ':0', 05:25:11 INFO - 'HOME': '/home/cltbld', 05:25:11 INFO - 'LANG': 'en_US.UTF-8', 05:25:11 INFO - 'LANGUAGE': 'en_US:en', 05:25:11 INFO - 'LOGNAME': 'cltbld', 05:25:11 INFO - 'MAIL': '/var/mail/cltbld', 05:25:11 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:25:11 INFO - 'MOZ_NO_REMOTE': '1', 05:25:11 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:25:11 INFO - 'NO_EM_RESTART': '1', 05:25:11 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:25:11 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:25:11 INFO - 'PWD': '/builds/slave/test', 05:25:11 INFO - 'SHELL': '/bin/bash', 05:25:11 INFO - 'SHLVL': '1', 05:25:11 INFO - 'TERM': 'linux', 05:25:11 INFO - 'TMOUT': '86400', 05:25:11 INFO - 'USER': 'cltbld', 05:25:11 INFO - 'XDG_SESSION_COOKIE': '49ca1b5d70b54a29b055e1ff000001bd-1450358129.534349-1903973253', 05:25:11 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:25:11 INFO - '_': '/tools/buildbot/bin/python'} 05:25:12 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:25:12 INFO - Downloading/unpacking jsonschema 05:25:12 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 05:25:12 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 05:25:12 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 05:25:12 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 05:25:12 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 05:25:12 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 05:25:13 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 05:25:13 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fjsonschema-2.5.1-py2.py3-none-any.whl 05:25:13 INFO - Downloading/unpacking functools32 (from jsonschema) 05:25:13 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 05:25:13 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 05:25:13 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 05:25:13 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 05:25:13 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 05:25:13 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 05:25:13 INFO - Downloading functools32-3.2.3-2.tar.gz 05:25:13 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Ffunctools32-3.2.3-2.tar.gz 05:25:13 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 05:25:14 INFO - warning: no files found matching '*.txt' 05:25:14 INFO - no previously-included directories found matching 'build' 05:25:14 INFO - no previously-included directories found matching 'dist' 05:25:14 INFO - no previously-included directories found matching '.git*' 05:25:14 INFO - Installing collected packages: jsonschema, functools32 05:25:14 INFO - Running setup.py install for functools32 05:25:14 INFO - warning: no files found matching '*.txt' 05:25:14 INFO - no previously-included directories found matching 'build' 05:25:14 INFO - no previously-included directories found matching 'dist' 05:25:14 INFO - no previously-included directories found matching '.git*' 05:25:14 INFO - Successfully installed jsonschema functools32 05:25:14 INFO - Cleaning up... 05:25:14 INFO - Return code: 0 05:25:14 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 05:25:14 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:25:14 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:25:14 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:25:14 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:25:14 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:25:14 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:25:14 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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', 'flake8']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ffa2db35f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf2c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xffa240>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10890b0>, '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 0x1089fb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x108a440>, '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': '49ca1b5d70b54a29b055e1ff000001bd-1450358129.534349-1903973253', '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 05:25:14 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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', 'flake8'] in /builds/slave/test/build 05:25:14 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --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 flake8 05:25:14 INFO - Using env: {'DISPLAY': ':0', 05:25:14 INFO - 'HOME': '/home/cltbld', 05:25:14 INFO - 'LANG': 'en_US.UTF-8', 05:25:14 INFO - 'LANGUAGE': 'en_US:en', 05:25:14 INFO - 'LOGNAME': 'cltbld', 05:25:14 INFO - 'MAIL': '/var/mail/cltbld', 05:25:14 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:25:14 INFO - 'MOZ_NO_REMOTE': '1', 05:25:14 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:25:14 INFO - 'NO_EM_RESTART': '1', 05:25:14 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:25:14 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:25:14 INFO - 'PWD': '/builds/slave/test', 05:25:14 INFO - 'SHELL': '/bin/bash', 05:25:14 INFO - 'SHLVL': '1', 05:25:14 INFO - 'TERM': 'linux', 05:25:14 INFO - 'TMOUT': '86400', 05:25:14 INFO - 'USER': 'cltbld', 05:25:14 INFO - 'XDG_SESSION_COOKIE': '49ca1b5d70b54a29b055e1ff000001bd-1450358129.534349-1903973253', 05:25:14 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:25:14 INFO - '_': '/tools/buildbot/bin/python'} 05:25:14 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:25:14 INFO - Downloading/unpacking flake8 05:25:14 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 05:25:14 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 05:25:14 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 05:25:14 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 05:25:14 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 05:25:14 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 05:25:16 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 05:25:16 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fflake8-2.5.0-py2.py3-none-any.whl 05:25:16 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 05:25:16 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 05:25:16 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 05:25:16 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 05:25:16 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 05:25:16 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 05:25:16 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 05:25:16 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 05:25:16 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fmccabe-0.3.1-py2.py3-none-any.whl 05:25:16 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 05:25:16 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 05:25:16 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 05:25:16 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 05:25:16 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 05:25:16 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 05:25:16 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 05:25:16 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpyflakes-1.0.0-py2.py3-none-any.whl 05:25:16 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 05:25:16 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 05:25:16 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 05:25:16 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 05:25:16 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 05:25:16 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 05:25:16 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 05:25:16 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpep8-1.5.7.tar.gz 05:25:16 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 05:25:16 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 05:25:16 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 05:25:16 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 05:25:16 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 05:25:16 INFO - no previously-included directories found matching 'docs/_build' 05:25:16 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 05:25:16 INFO - Running setup.py install for pep8 05:25:16 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 05:25:16 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 05:25:16 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 05:25:16 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 05:25:16 INFO - no previously-included directories found matching 'docs/_build' 05:25:16 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 05:25:16 INFO - Successfully installed flake8 mccabe pyflakes pep8 05:25:16 INFO - Cleaning up... 05:25:17 INFO - Return code: 0 05:25:17 INFO - Running post-action listener: _resource_record_post_action 05:25:17 INFO - Running post-action listener: _start_resource_monitoring 05:25:17 INFO - Starting resource monitoring. 05:25:17 INFO - ##### 05:25:17 INFO - ##### Running install step. 05:25:17 INFO - ##### 05:25:17 INFO - Running pre-action listener: _resource_record_pre_action 05:25:17 INFO - Running main action method: install 05:25:17 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 05:25:17 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 05:25:17 INFO - Reading from file tmpfile_stdout 05:25:17 INFO - Detecting whether we're running mozinstall >=1.0... 05:25:17 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 05:25:17 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 05:25:17 INFO - Reading from file tmpfile_stdout 05:25:17 INFO - Output received: 05:25:17 INFO - Usage: mozinstall [options] installer 05:25:17 INFO - Options: 05:25:17 INFO - -h, --help show this help message and exit 05:25:17 INFO - -d DEST, --destination=DEST 05:25:17 INFO - Directory to install application into. [default: 05:25:17 INFO - "/builds/slave/test"] 05:25:17 INFO - --app=APP Application being installed. [default: firefox] 05:25:17 INFO - mkdir: /builds/slave/test/build/application 05:25:17 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 05:25:17 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 05:25:32 INFO - Reading from file tmpfile_stdout 05:25:32 INFO - Output received: 05:25:32 INFO - /builds/slave/test/build/application/firefox/firefox 05:25:32 INFO - Running post-action listener: _resource_record_post_action 05:25:32 INFO - ##### 05:25:32 INFO - ##### Running run-tests step. 05:25:32 INFO - ##### 05:25:32 INFO - Running pre-action listener: _resource_record_pre_action 05:25:32 INFO - Running main action method: run_tests 05:25:32 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 05:25:32 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 05:25:32 INFO - Python 2.7.3 05:25:32 INFO - Return code: 0 05:25:32 INFO - grabbing minidump binary from tooltool 05:25:32 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:25:32 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: {'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10890b0>, '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 0x1089fb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x108a440>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 05:25:32 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 05:25:32 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 05:25:32 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 05:25:32 INFO - Return code: 0 05:25:32 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 05:25:32 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 05:25:32 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 05:25:32 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 05:25:32 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 05:25:32 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 05:25:32 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 05:25:33 INFO - Return code: 0 05:25:33 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--debug', '--branchName', 'Fx-Team-Non-PGO', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/GPMUu3YiSySyjdMvXjUPqQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-060', '--webServer', 'localhost'] in /builds/slave/test/build 05:25:33 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --debug --branchName Fx-Team-Non-PGO --suite dromaeojs --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/GPMUu3YiSySyjdMvXjUPqQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-060 --webServer localhost 05:25:33 INFO - Using env: {'DISPLAY': ':0', 05:25:33 INFO - 'HOME': '/home/cltbld', 05:25:33 INFO - 'LANG': 'en_US.UTF-8', 05:25:33 INFO - 'LANGUAGE': 'en_US:en', 05:25:33 INFO - 'LOGNAME': 'cltbld', 05:25:33 INFO - 'MAIL': '/var/mail/cltbld', 05:25:33 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 05:25:33 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 05:25:33 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:25:33 INFO - 'MOZ_NO_REMOTE': '1', 05:25:33 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 05:25:33 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:25:33 INFO - 'NO_EM_RESTART': '1', 05:25:33 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:25:33 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:25:33 INFO - 'PWD': '/builds/slave/test', 05:25:33 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 05:25:33 INFO - 'SHELL': '/bin/bash', 05:25:33 INFO - 'SHLVL': '1', 05:25:33 INFO - 'TERM': 'linux', 05:25:33 INFO - 'TMOUT': '86400', 05:25:33 INFO - 'USER': 'cltbld', 05:25:33 INFO - 'XDG_SESSION_COOKIE': '49ca1b5d70b54a29b055e1ff000001bd-1450358129.534349-1903973253', 05:25:33 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:25:33 INFO - '_': '/tools/buildbot/bin/python'} 05:25:33 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--debug', '--branchName', 'Fx-Team-Non-PGO', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/GPMUu3YiSySyjdMvXjUPqQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-060', '--webServer', 'localhost'] with output_timeout 3600 05:25:33 INFO - mozversion INFO | application_buildid: 20151217050435 05:25:34 INFO - mozversion INFO | application_changeset: a9eaed26451a0381ed8a599597aa1c8629a2f3d1 05:25:34 INFO - mozversion INFO | application_display_name: Nightly 05:25:34 INFO - mozversion INFO | application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 05:25:34 INFO - mozversion INFO | application_name: Firefox 05:25:34 INFO - mozversion INFO | application_remotingname: firefox 05:25:34 INFO - mozversion INFO | application_repository: https://hg.mozilla.org/integration/fx-team 05:25:34 INFO - mozversion INFO | application_vendor: Mozilla 05:25:34 INFO - mozversion INFO | application_version: 46.0a1 05:25:34 INFO - mozversion INFO | platform_buildid: 20151217050435 05:25:34 INFO - mozversion INFO | platform_changeset: a9eaed26451a0381ed8a599597aa1c8629a2f3d1 05:25:34 INFO - mozversion INFO | platform_repository: https://hg.mozilla.org/integration/fx-team 05:25:34 INFO - mozversion INFO | platform_version: 46.0a1 05:25:34 INFO - 2015-12-17 05:25:33,999 DEBUG : using testdate: 1450358733 05:25:34 INFO - 2015-12-17 05:25:34,000 DEBUG : actual date: 1450358734 05:25:34 INFO - 2015-12-17 05:25:34,093 INFO : starting webserver on 'localhost:39069' 05:25:34 INFO - 2015-12-17 05:25:34,094 INFO : Starting test suite talos-linux64-ix-060 05:25:34 INFO - 2015-12-17 05:25:34,094 INFO : Starting test dromaeo_css 05:25:34 INFO - 2015-12-17 05:25:34,095 DEBUG : operating with platform_type : linux_ 05:25:34 INFO - 2015-12-17 05:25:34,095 INFO : Initialising browser for dromaeo_css test... 05:25:34 INFO - 2015-12-17 05:25:34,109 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmptRcYGX/profile http://localhost:39069/getInfo.html 05:25:38 INFO - 2015-12-17 05:25:38,298 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 05:25:38 INFO - 2015-12-17 05:25:38,298 DEBUG : BROWSER_OUTPUT: colorDepth:24 05:25:38 INFO - 2015-12-17 05:25:38,298 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 05:25:38 INFO - 2015-12-17 05:25:38,299 DEBUG : BROWSER_OUTPUT: __metrics 05:25:38 INFO - 2015-12-17 05:25:38,361 DEBUG : BROWSER_OUTPUT: JavaScript error: resource://gre/modules/PerformanceStats.jsm, line 211: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIPerformanceStatsService.isMonitoringJank] 05:25:38 INFO - 2015-12-17 05:25:38,436 DEBUG : BROWSER_OUTPUT: JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 05:25:38 INFO - 2015-12-17 05:25:38,735 DEBUG : BROWSER_OUTPUT: JavaScript error: resource://gre/modules/IndexedDBHelper.jsm, line 138: UnknownError: The operation failed for reasons unrelated to the database itself and not covered by any other error code. 05:25:39 INFO - 2015-12-17 05:25:39,428 INFO : Browser initialized. 05:25:39 INFO - 2015-12-17 05:25:39,428 INFO : Running cycle 1/1 for dromaeo_css test... 05:25:39 INFO - 2015-12-17 05:25:39,429 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmptRcYGX/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 05:25:51 INFO - 2015-12-17 05:25:51,373 DEBUG : BROWSER_OUTPUT: RSS: Main: 147279872 05:25:51 INFO - 2015-12-17 05:25:51,373 DEBUG : BROWSER_OUTPUT: 05:26:42 INFO - 2015-12-17 05:26:42,821 DEBUG : BROWSER_OUTPUT: 1450358802819 addons.productaddons ERROR Request failed certificate checks: [Exception... "SSL is required and URI scheme is not https." nsresult: "0x8000ffff (NS_ERROR_UNEXPECTED)" location: "JS frame :: resource://gre/modules/CertUtils.jsm :: checkCert :: line 145" data: no] 05:28:54 INFO - 2015-12-17 05:28:54,846 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:39069/tests/dromaeo/cssquery-dojo.html (next: http://localhost:39069/tests/dromaeo/cssquery-ext.html) 05:28:56 INFO - 2015-12-17 05:28:56,024 DEBUG : BROWSER_OUTPUT: RSS: Main: 232042496 05:28:56 INFO - 2015-12-17 05:28:56,024 DEBUG : BROWSER_OUTPUT: 05:31:58 INFO - 2015-12-17 05:31:58,490 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:39069/tests/dromaeo/cssquery-ext.html (next: http://localhost:39069/tests/dromaeo/cssquery-jquery.html) 05:31:59 INFO - 2015-12-17 05:31:59,059 DEBUG : BROWSER_OUTPUT: RSS: Main: 227528704 05:31:59 INFO - 2015-12-17 05:31:59,059 DEBUG : BROWSER_OUTPUT: 05:35:01 INFO - 2015-12-17 05:35:01,101 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:39069/tests/dromaeo/cssquery-jquery.html (next: http://localhost:39069/tests/dromaeo/cssquery-mootools.html) 05:35:01 INFO - 2015-12-17 05:35:01,683 DEBUG : BROWSER_OUTPUT: RSS: Main: 222089216 05:35:01 INFO - 2015-12-17 05:35:01,683 DEBUG : BROWSER_OUTPUT: 05:38:03 INFO - 2015-12-17 05:38:03,697 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:39069/tests/dromaeo/cssquery-mootools.html (next: http://localhost:39069/tests/dromaeo/cssquery-prototype.html) 05:38:04 INFO - 2015-12-17 05:38:04,270 DEBUG : BROWSER_OUTPUT: RSS: Main: 212701184 05:38:04 INFO - 2015-12-17 05:38:04,271 DEBUG : BROWSER_OUTPUT: 05:41:06 INFO - 2015-12-17 05:41:06,955 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:39069/tests/dromaeo/cssquery-prototype.html (next: http://localhost:39069/tests/dromaeo/cssquery-yui.html) 05:41:07 INFO - 2015-12-17 05:41:07,543 DEBUG : BROWSER_OUTPUT: RSS: Main: 187641856 05:41:07 INFO - 2015-12-17 05:41:07,544 DEBUG : BROWSER_OUTPUT: 05:44:09 INFO - 2015-12-17 05:44:09,792 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:39069/tests/dromaeo/cssquery-yui.html (next: http://localhost:39069/tests/dromaeo/cssquery-dojo.html) 05:44:10 INFO - 2015-12-17 05:44:10,042 DEBUG : BROWSER_OUTPUT: RSS: Main: 251953152 05:44:10 INFO - 2015-12-17 05:44:10,042 DEBUG : BROWSER_OUTPUT: 05:44:10 INFO - 2015-12-17 05:44:10,043 DEBUG : BROWSER_OUTPUT: __start_tp_report 05:44:10 INFO - 2015-12-17 05:44:10,043 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 05:44:10 INFO - 2015-12-17 05:44:10,044 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 05:44:10 INFO - 2015-12-17 05:44:10,044 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 05:44:10 INFO - 2015-12-17 05:44:10,044 DEBUG : BROWSER_OUTPUT: |0;dojo.html;2612.438325759961;2708.2146177608493;2717.796165287604;2728.249731323887;2747.079728291023;4561.338605902142;4683.320918466825;4755.262934245189;4760.809567617295;4774.37933068701;4691.882702932428;4706.976465117669;4741.265103908891;4742.430908291001;4760.190767569513;4337.262665346899;4363.258246098171;4381.978090109561;4520.2767557190855;4525.502194758574;4264.189803937242;4432.3794668746405;4464.196444639963;4526.54734526548;4537.047220083787;4300.118475712503;4346.304591265398;4358.8910277243;4412.470503539564;4431.556844315575;4424.889377765549;4437.445319335083;4438.134563760068;4438.289873620205;4457.576530229623;4379.386885835986;4397.2304846651705;4400.955990440087;4423.867283981485;4436.578525040116;4526.864194074183;4643.233866412038;4658.767061646938;4663.60359369454;4738.067404054626;5031;5035.546800787946;5099.770510327045;5112.693238405707;5115.718635475047;5145.819896303611;5188.7146206958605;5197.064528384889;5203.089459344599;5251.921221181686;4551.180787458289;4785;4785.210440277385;4790.257510085942;4792.976035119802;5104.846854594294;5125.538701516882;5182.404023537266;5295.920561191585;5347.625666203407;4998.150314446553;5007.474215207423;5048.192289233705;5064.1897296433135;5064.265681476165;4763.69036012658;5088.643794934393;5090.211017292326;5101.336826212569;5114.590832733373;4895.510448955147;4923.655344125948;4926.679765815211;4933.605311575066;5124.205748109049;4909.2881532177635;4954.20732682769;4993.625478089158;5042.773075211624;5048.5203905628905;4153.771542565188;4159.480064991876;4160.625543701081;4195.643370313557;4203.957960420418;3557.982210088933;3661.139632186434;3684.6683798458266;3701.4632878232505;3711.7958512282084;4228.957710422918;4305.48334199898;4312.202242585132;4337.609615134653;4339.7613131278085;5122.410922743858;5163.302954101148;5168.715720635401;5170.870728231825;5196.53231209193;4129.442525259112;4231.851885184065;4232.217039847638;4403.361512580722;4431.268840641258;4421.270490369053;4484.798184081724;4496.820127194941;4505.234110201273;4519.209138400833;4822.156122678587;4826.517348265286;4831.057943701085;4864.385323112848;4865.294532292798;4894.339264199288;5094.694318340911;5096.949030509648;5137.357830271216;5140.974295128501;4721.598664113451;4790.0659371423635;4800.711957282574;4805.831795887128;4829.082474329866;5070.112730272114;5071.695698258116;5128.102582048052;5138.845834624967;5174.922376164436;4836.395450568679;5172.922406163986;5199.66202196856;5205;5208.661437006583;4799.448063472745;4841.878953026203;4860.781264843161;4886.731229782396;4898.755062246944;5009.824656137018;5013.323201367914;5015.147424937696;5020.121478741133;5059.747012649279;4639.884002899955;4921.803127874988;4923.778429970732;4931.16170251051;4975.776090075883;4829.106615276185;4859.781309840995;4870.95129048705;4903.26451032348;4942.678725882806;4885.5358740919555;4890.559849613552;4894.51054894522;4901.534354236342;4933.975330123327 05:44:10 INFO - 2015-12-17 05:44:10,045 DEBUG : BROWSER_OUTPUT: |1;ext.html;553.8860408932886;559.2087196616785;571.0948147186709;586.3960121075293;595.8927393069248;27129.32176695581;27847.582286265697;27864.303392415175;35357.82321088397;35502.46746298801;40811.59188408115;41233;41267.174656506926;41414.17171656565;41419.17161656765;7828.686852525906;8011.759647210564;8015.559144247064;8016.919830801705;8022.1576734442915;7082.114735658043;7294.161171465296;10156.949215253913;10503.894961050368;10510.842337364946;10114.9494252529;10208.540615672275;10234.795304093914;10237.539310730997;10250.128739057189;7196.352328290427;7402.11174659039;9956.601735930553;10093.545790439448;10109.898901011044;7115.25289844564;10069.446180460072;10409.115225205867;10424.166066714644;10432.530536125892;37017.444738328944;37626.24747505062;37640.24719505595;37672.24655506875;37674.17443691707;2709.1195361507393;2718.1573712149298;2771.514984877638;2773.457750129596;3549.7870127792416;26366.86816565924;26793.464130717275;26886.462270754477;26953.595696064378;27462.862685686443;3231.402190594724;3349.815760133192;3352.4636058230567;3384.3231353729107;3408.3353746019534;220043;220285;220827;221487;221652.8917355419;51806.48193518092;52484.737576311876;52665.47334526682;56395;57067;47063.5293647066;66018.66990665016;67248.66375668188;67270;67287.32712672811;12067.456964436622;12100.878991209975;12141.575044873387;12174.330411827434;12186.2078964867;8451.661933522713;8479.364047696448;8484.15158484159;8604.698835540727;8623.698170564126;19262.229510819692;19522.804771952382;19550.511237219183;19602.607947840963;19610.117544710523;7620.9618951905995;7877.172896845863;7952.1650226726515;7964.606193916042;8009.879851802228;845.6617353058825;854.6752234150982;864.6103317966999;886.7960369115011;902.5216635183364;26939.326516836845;27011.324716882234;27218.86390568074;27314.453710926067;27451.17646470609;927.2535608834953;941.7786820097272;942.9057094290654;946.9337146399823;1048.2976405808126;13180.538681146114;13313;13360.6659833503;15918.9204053979;16408.75386869198;332851;339570;340694;340720;341915;49577;49649.50350496449;49722.25416618754;49969.500304997215;50000.24999625009;1207.8550573931184;1212.9150959432754;1217.7503611759569;1221.0109811053076;1231.6612931443744;27329.453410932067;28044;28575.857120714263;30670.693293067678;31430.214244644067;36276.45585316169;36814.8159259202;42815.57184428241;44029;44301.77849110734;252416;255213;257966;258160;258525;31880.521792172673;37263.44104838376;37825;37904.62095379011;37993.050173745876;32845;34343.82828085843;38865.222695545366;39310.60689393069;39599.80200098981;32272.810840087343;32742.50886236661;33406.83296583501;33933.49099763555;34019;33542.32915341631;38282.42576361413;39501.604983949794;39594.60405396025;40545;33755.493667594514;34084.31831363408;36006.279874401844;36731;36771.08072298214;26934;29443.705562944095;29730;29752.404951901273;29784.404311914073;23562.882185588962;23789.405264868517;23866.28401147968;24056.518869622858;24069.75930240675 05:44:10 INFO - 2015-12-17 05:44:10,049 DEBUG : BROWSER_OUTPUT: |2;jquery.html;324.5580617550873;325.83708145927034;327.17714946908546;327.2652894252404;330.99338013239736;12542.623721288375;12971;14948.551543453686;15258.694826103485;15425.22873856307;12360.629181124581;14461.710765784677;14784.778228326557;15300.387984480636;15325.616859578517;5029.119904016791;5032.446430892599;5157.71632560209;5160.793568257265;5175.197844334115;3731.7387782855076;3845.3270677631444;5025.246213068032;5070.138076527;5747.712614369286;5821.602815324334;5853.85365365865;5874.060150375941;5879.500242479395;5889.2049573307695;5690.658560486363;5796.449337312949;5825.300963884319;5833.300003999505;5851.76592936282;5071.7210553419545;5085.669431486978;5092.28707980883;5093.694378337312;5094.4650811664615;18907.33824316156;19064.90467547667;19248.61502769937;19362.70955935662;19393;1818.5453636590853;1840.5674666453372;1849.1678744565;1875.5967466994662;1875.9437216883516;12452.439640216213;12478.563250286197;12641.87358126416;12652.746945061048;12787.040971927143;1670.2650833633163;1695.7795486586788;1745.9476215713548;1793.8564914806784;1811.7931261666909;53727.462725372636;53893.46106538924;54461.549230284734;55750;57002.14496782593;8767.912320876838;8953.418027828171;9248.398854074463;9251.306152038489;9327.580258888367;11863.70340741471;11900.76198476043;11908.88091119095;11920.821187682192;11926.165168438127;6655.567388119756;6702.09521714572;6748.527603067836;6828.634273145391;6852.725890964405;6164.321924588292;6253.030780229072;6277.932751432268;6296.527760417987;6307.716152773136;5566.304211973504;5620.887582248332;5623.268975033301;5658.660480371191;5665.716714164275;1494.745893198159;1504.7818066380314;1554.9611259718597;1564.6792407556425;1579.5419328394867;838.2246422059692;867.4231635962014;867.5878957495265;878.3587980774071;951.9524023798782;12005;15348;16326.918365408097;16678;16729.581760455843;816.7468084893702;820.4339006085781;839.9538025408539;861.9913800861912;883.7923088074298;9008.41445306053;9110.59002344896;9223.400478968846;9401.623935042522;9990.450525221182;445159;449933;450002;453732;475543;37330.44004339937;70660;73054;73303.63348183225;73557;1053.9789204215872;1055.9260851740305;1064.5422468338688;1091.6724982505216;1092.5684354680016;14433;14527.92736036313;14574.344154513285;14574.781378279122;14790.926045369704;33255.50116748202;33692.66307336895;34457.82771086128;34586;34945.65054349424;43495.565044349154;44183.33724994063;46027.53972460233;47733;49433.752831235615;8410.158984101785;8755.343349248958;8848.336374772047;8870.201681848665;8886.60010299551;10384.636537721446;10388.792224155324;10436.53035613384;10477.266591338534;10528.420936848546;12630.431630576462;13461.394237259152;13788.586342409744;14181.361838717075;14606.12363258208;13422.127561708458;13703.314834258048;14003.579892603238;14206.218657973497;14371.712565748836;10794.676159715222;13328.40022198984;13829.79255311151;14236.786448203493;14499.78250326267;8967.192952634294;9025.593848276712;9105.499197543933;9185.127412895765;9306;13267.40296686632;13763.174209547458;14063.085899416505;14127.505537306144;14495.855041449451 05:44:10 INFO - 2015-12-17 05:44:10,049 DEBUG : BROWSER_OUTPUT: |3;mootools.html;1257.5158563952875;1628.519586721917;1678.9412370567024;1707.1805533343995;1711.9058451785152;6172.722227499762;6785.728570857166;6917.827054323644;6939.514234003622;6951.443884489241;7045.084139061914;7065.2228254891925;7110.893336599956;7128.037714908486;7135.429165666747;2038.9082491287854;2062.3091264426434;2065.1429656692453;2065.8863762493056;2067.65883629201;2045.836333093349;2070.5858828234336;2080.583883223354;2104.189886893542;2104.4318034130774;2012.4968757810548;2053.6200802851445;2068.389825001628;2075.7094006839056;2077.3352527191305;2024.9291274805385;2034.064330408014;2045.2125931516398;2047.1606641277153;2057.0537552725764;1992.1732481020358;2017.2536161620294;2044.2436298569476;2045.6113338465643;2048.07836473586;7039.120109986252;7098.148222213367;7104.573725576482;7113.64431778409;7122.893156602655;3995.2808494470983;4050.8379664813374;4054.3715724062818;4074.409210664437;4077.6330130288416;2573.150860216143;2577.484503099369;2604.804639652015;2648.3643925457945;2661.3878807874103;864.2369566085241;870.9912900870974;887.5784002598779;888.2361169394316;892.6474042753141;9154.221891139261;9155.954220228923;9157.77105572366;9172.724818255463;9193.954030229806;3529.7352698547197;3563.8396272167815;3604.4953706480587;3605.94591081134;3611.1694310308776;7993.400494962901;7995.960525131695;7996.80007999793;8003.559804210708;8006.559639219899;3972.3644216925154;3980.383040628707;3993.682084911972;3994.380870965005;4005.1388951375593;3188.5536024956523;3276.639569647337;3627.6372362763514;3683.631636836295;3695.722820788452;3356.194513316835;3410.2838403935452;3436.295559410315;3440.569928758905;3462.8095454749728;1098.7198264442675;1106.9335839849634;1107.983380249297;1109.1237922041657;1126.3692332293942;800.8838718385801;802.3861745764494;802.3901834605741;852.2883392367443;862.1593945902695;6392.26488953767;6400;6416.871662566816;6428.100065990765;6472.449841763503;994.7065615643403;1004.8090862736057;1027.3579013116803;1029.9244192398123;1033.8397548380012;4990.476000020019;5072.51811077947;5074.340335756328;5078.5175408336145;5084.110280700863;8289.502629842229;8337.874931876027;8541.615627296787;8576.442531235574;8645.870311945326;8480.575971201539;8485.957570212233;8575.3997220194;8587.828243435097;8598.656053757779;6450.3549645036055;6563.048357988065;6572.86854262912;6586.506012049115;6594.439472644879;6268.655223962726;6494.447971922251;6560.3111673273615;6574.408303252731;6582.3746744059235;7462.253774622712;7705.884411733717;7714.807129821799;7731.342835859015;7852.960735196288;7657;7827.217278272127;7841.059072911287;7853.568053757098;7859.724909628136;5815.273090863642;5970.492508136857;5975.312839023568;5978.730957106854;5988.790392336247;6813.250542440427;6827.590344579341;6848.280930502226;6878.174619045746;6905.482088843256;6512.73949042033;6556.770513032021;6573.605583664996;6623.834404139935;6641.900371494335;5560.2493663356545;5890.263717035371;6258.249010118815;6402.6158430494315;6548.705308261045;6252.187215661935;6301.338359472373;6313.526485513697;6316.810495685137;6326.367363263821;5312.893742125213;5315.893682126259;5337.9466205339;5342.599305052059;5500.092484739973;5750.453706897838;5765.94234057654;5778.942210578009;5788.21859049023;5816.04035334182 05:44:10 INFO - 2015-12-17 05:44:10,049 DEBUG : BROWSER_OUTPUT: |4;prototype.html;288.87000849617664;297.04944178628386;301.72392261081114;307.95226739855326;310.45360166107645;5330.653507522014;5361.705106219157;5371.462853714626;5469.5624350052;5481.287432633762;5298.841034768953;5370.91943620845;5372.194170874371;5375.408705042442;5385.138377859544;3932.488776459056;4146.274401979656;4152.709310348277;4154.729942553724;4158.480189976253;4006.9599304007024;4008.1783234437016;4093.4678491796026;4101.282275601758;4135.152293779783;4067.877963661095;4073.124278280169;4073.8370465181356;4077.97961010196;4099.200655872106;3855.3253180693546;3949.3483575210057;3977.7215594908366;4067.857624983141;4074.633283004529;3552.0587044433246;3563.875264365761;3564.6791788739138;3572.178398968226;3576.678098971079;5129.6409251352425;5141.845744627667;5142.331496905378;5147.305113809625;5184.300119483859;4691.437027556681;4697.78859951303;4702.13010593038;4707.105649926537;4710.882227944295;5506.752196151143;5569.610127291091;5604.495595396434;5616.803411880605;5628.943710562883;3874.8837534874;3882.650561449455;3885.0870045539277;3887.941680874789;3889.0666240102455;5830.854228644318;5931.881362372728;5931.932252194603;5932.080527518242;5935.9406405935815;3968.4245784361106;3974.2250261198787;3976.224636195914;3978.76127432355;3978.960210397859;4019.2162528307285;4020.979895100506;4021.9597804021587;4024.678025757932;4059.7970101494807;4718.7168769873915;4757.619390448755;4759.405074365704;4764.666473346832;4765.118453086121;5645.096784514541;5649.915251271234;5656.236408084856;5656.490915817596;5663.858403539862;1454.7672372420573;1490.0389248934594;1490.4410845932775;1491.9104853708811;1493.0444515510083;1010.4846528270488;1011.049613363436;1012.8987101289812;1015.5937624949931;1038.7247379444452;4938;4949.307097006422;4955.752212389366;4955.950440495621;4958.305837182726;5854.443827836349;5862;5868.914250863604;5869.765209391662;5874.500667443315;4939.678920870132;4941.332920055746;4947.6536642434685;4953.281774142729;4960.578350840219;3091.679196517216;3122.2350524121734;3157.3527426877436;3157.7789554731407;3162.857671404792;5522.723863806874;5532.6680399176175;5535.557155427556;5538.390777014525;5542.8337149885565;6004.579679422399;6007.969960150172;6009.06859436788;6018.525461261931;6019.819405417845;5527.474889885454;5543.251661025791;5543.6396634218645;5543.667379957215;5549;5671.461211184931;5840.561957853263;5843.328017278068;5845.883082338414;5846;5696.174054762119;5705.971470142623;5711.543076553949;5715.457031581993;5719.027765279996;5530.474604912527;5533.031719449161;5533.280673512418;5537.889242215053;5540.750666219949;4039.1719697461363;4130.153318569746;4148.709590328648;4148.751074935513;4155.8753237402925;5807.128930660435;5829.475347218601;5830.096335068071;5839.211706419749;5839.678817665069;5604.243427137284;5605.103183490622;5615.3823079462045;5618.52242559387;5625.8593535161945;5607.327120745536;5613.214150018919;5613.859653508532;5617.831465056055;5618.943810562006;5333.173358129496;5550.944490555043;5561.277033985556;5561.6384934980715;5565.916511252415;5424.972875135599;5602.439756024365;5700.800471983461;5701.144828275792;5704.0588302929555;5405.945940540544;5532.336119665505;5542.7782888684005;5544.972275138599;5547.223388725501 05:44:10 INFO - 2015-12-17 05:44:10,050 DEBUG : BROWSER_OUTPUT: |5;yui.html;704.0495331302741;714.7641278378136;716.9354758071776;718.1382341190573;731.1190016030677;10304.22718296128;10771.5691372345;10772.353658780468;10781.892181078187;10787.838182427251;10389.792204155912;10438.06057454829;10452.581896724121;10460.843087353676;10476.68569942901;778.1440415542914;789.9131095579481;789.9328557072656;790.5888937752394;790.7113903425237;624.4972796898495;632.8734253149365;772.058089131259;786.0292538714683;787.0437418536477;827.5034979012604;828.9212524810133;834.9081601023883;836.5399030533213;837.2381133168817;639.9008153736179;643.9871202575969;828.0105274197336;828.9336853051772;829;483.2726746246911;484.3388774323059;485.19215506182167;597.560792817279;610.6183635227983;9883.901160988442;10128.594856205744;10175.389476631426;10256.897431025669;10266.897331026743;9390.060993900624;10090.747731306703;10388.844167337496;10479.633212837514;10668;8267.793305167359;8344.582770861492;8499.362547808878;8542.786430339229;8548.358873084544;3154.5268209768487;3205.5351973963643;3208.631007434152;3217.115293294339;3227.386796508656;37898.81050594757;40018.199636007404;40154.39768403476;40369.39445908314;40403.59596404028;8710.825783484295;8806.911930880737;8838.381313308135;8940.061293564213;9033.322500812465;15338.156401397808;15348.923255383876;15373.154476503676;15379.769303460456;15402.845971540366;6049.5462840287155;6339.746410143543;6340.397662222082;6365.035272487467;6371.9681401593625;3467.1158854492446;3530.858765649345;3537.699295559906;3551.0944709099012;3636.8727094551564;2558.5266725655815;2563.2950938492063;2583.1733845169365;2591.5076135534187;2592.3519120219944;438.31841486488815;442.1422440465487;448.7285192458581;451.90058187198764;453.77311344327836;430.7803020459588;444.9065696203833;462.7246788161039;497.29632569913167;562.9746661400247;6484.513661475408;6489.7404103835315;6540.084388185658;6790.7283708652085;6793.272488143163;410.97328673636116;443.8535283356549;515.5849541119435;536.8496820890157;539.9838004859861;2998.5692711231345;3084.4293805646025;3100.8449577521483;3107.704768047032;3168.6551951555684;50089.74955125201;50978.23532647013;51001;51018.74490627523;51077;45359.09281814411;45704.77147614241;45727.542724572326;45948.310775338396;46160.76919615381;40784.79607601943;41240.58759412428;41390.586094139275;41910;41931.7903410481;6343.429091381798;6467.547271690936;6488.383603557654;6607.5044371673275;6610.4711623071;30651;30682.232944176576;30919.690803091682;30941.69058309388;31121.8443907779;38559.80720096381;41323.793381034106;41511;41954.37068444037;43246.351304731084;8961.372703910925;8971.955140224258;9087.681931132378;9210.9539452305;9280.164785169367;9326.813463730823;9778.65774697882;9817;9971.551280192263;10057;8682.609282582172;9010.189082982562;9116.635334586543;9320.72037838866;9437.811243775224;8636.568171591269;8689.17452841979;8694.39139260271;8721.91278087211;8735.694250701195;8451.830963380575;8635.266002389615;8678.609462574326;8794.956025219833;8814.779630509032;7593;7822.843543129219;7830.4518683691595;7857.724979625686;8064.596770161351;7662.195469475625;7741;7758;7834.608269586384;7989.409594827591 05:44:10 INFO - 2015-12-17 05:44:10,050 DEBUG : BROWSER_OUTPUT: __end_tp_report 05:44:10 INFO - 2015-12-17 05:44:10,050 DEBUG : BROWSER_OUTPUT: __start_cc_report 05:44:10 INFO - 2015-12-17 05:44:10,050 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,980 05:44:10 INFO - 2015-12-17 05:44:10,050 DEBUG : BROWSER_OUTPUT: __end_cc_report 05:44:10 INFO - 2015-12-17 05:44:10,050 DEBUG : BROWSER_OUTPUT: __startTimestamp1450359850042__endTimestamp 05:44:10 INFO - 2015-12-17 05:44:10,050 DEBUG : BROWSER_OUTPUT: 05:44:10 INFO - 2015-12-17 05:44:10,051 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 05:44:10 INFO - 2015-12-17 05:44:10,051 DEBUG : BROWSER_OUTPUT: Number of tests: 6 05:44:10 INFO - 2015-12-17 05:44:10,051 DEBUG : BROWSER_OUTPUT: 05:44:10 INFO - 2015-12-17 05:44:10,051 DEBUG : BROWSER_OUTPUT: [#0] dojo.html Cycles:165 Average:4687.41 Median:4822.16 stddev:502.05 (10.4%) stddev-sans-first:476.48 05:44:10 INFO - 2015-12-17 05:44:10,052 DEBUG : BROWSER_OUTPUT: Values: 2612.4 2708.2 2717.8 2728.2 2747.1 4561.3 4683.3 4755.3 4760.8 4774.4 4691.9 4707.0 4741.3 4742.4 4760.2 4337.3 4363.3 4382.0 4520.3 4525.5 4264.2 4432.4 4464.2 4526.5 4537.0 4300.1 4346.3 4358.9 4412.5 4431.6 4424.9 4437.4 4438.1 4438.3 4457.6 4379.4 4397.2 4401.0 4423.9 4436.6 4526.9 4643.2 4658.8 4663.6 4738.1 5031.0 5035.5 5099.8 5112.7 5115.7 5145.8 5188.7 5197.1 5203.1 5251.9 4551.2 4785.0 4785.2 4790.3 4793.0 5104.8 5125.5 5182.4 5295.9 5347.6 4998.2 5007.5 5048.2 5064.2 5064.3 4763.7 5088.6 5090.2 5101.3 5114.6 4895.5 4923.7 4926.7 4933.6 5124.2 4909.3 4954.2 4993.6 5042.8 5048.5 4153.8 4159.5 4160.6 4195.6 4204.0 3558.0 3661.1 3684.7 3701.5 3711.8 4229.0 4305.5 4312.2 4337.6 4339.8 5122.4 5163.3 5168.7 5170.9 5196.5 4129.4 4231.9 4232.2 4403.4 4431.3 4421.3 4484.8 4496.8 4505.2 4519.2 4822.2 4826.5 4831.1 4864.4 4865.3 4894.3 5094.7 5096.9 5137.4 5141.0 4721.6 4790.1 4800.7 4805.8 4829.1 5070.1 5071.7 5128.1 5138.8 5174.9 4836.4 5172.9 5199.7 5205.0 5208.7 4799.4 4841.9 4860.8 4886.7 4898.8 5009.8 5013.3 5015.1 5020.1 5059.7 4639.9 4921.8 4923.8 4931.2 4975.8 4829.1 4859.8 4871.0 4903.3 4942.7 4885.5 4890.6 4894.5 4901.5 4934.0 05:44:10 INFO - 2015-12-17 05:44:10,052 DEBUG : BROWSER_OUTPUT: 05:44:10 INFO - 2015-12-17 05:44:10,052 DEBUG : BROWSER_OUTPUT: [#1] ext.html Cycles:180 Average:43579.21 Median:186794.50 stddev:72472.27 (38.8%) stddev-sans-first:72603.57 05:44:10 INFO - 2015-12-17 05:44:10,052 DEBUG : BROWSER_OUTPUT: Values: 553.9 559.2 571.1 586.4 595.9 27129.3 27847.6 27864.3 35357.8 35502.5 40811.6 41233.0 41267.2 41414.2 41419.2 7828.7 8011.8 8015.6 8016.9 8022.2 7082.1 7294.2 10156.9 10503.9 10510.8 10114.9 10208.5 10234.8 10237.5 10250.1 7196.4 7402.1 9956.6 10093.5 10109.9 7115.3 10069.4 10409.1 10424.2 10432.5 37017.4 37626.2 37640.2 37672.2 37674.2 2709.1 2718.2 2771.5 2773.5 3549.8 26366.9 26793.5 26886.5 26953.6 27462.9 3231.4 3349.8 3352.5 3384.3 3408.3 220043.0 220285.0 220827.0 221487.0 221652.9 51806.5 52484.7 52665.5 56395.0 57067.0 47063.5 66018.7 67248.7 67270.0 67287.3 12067.5 12100.9 12141.6 12174.3 12186.2 8451.7 8479.4 8484.2 8604.7 8623.7 19262.2 19522.8 19550.5 19602.6 19610.1 7621.0 7877.2 7952.2 7964.6 8009.9 845.7 854.7 864.6 886.8 902.5 26939.3 27011.3 27218.9 27314.5 27451.2 927.3 941.8 942.9 946.9 1048.3 13180.5 13313.0 13360.7 15918.9 16408.8 332851.0 339570.0 340694.0 340720.0 341915.0 49577.0 49649.5 49722.3 49969.5 50000.2 1207.9 1212.9 1217.8 1221.0 1231.7 27329.5 28044.0 28575.9 30670.7 31430.2 36276.5 36814.8 42815.6 44029.0 44301.8 252416.0 255213.0 257966.0 258160.0 258525.0 31880.5 37263.4 37825.0 37904.6 37993.1 32845.0 34343.8 38865.2 39310.6 39599.8 32272.8 32742.5 33406.8 33933.5 34019.0 33542.3 38282.4 39501.6 39594.6 40545.0 33755.5 34084.3 36006.3 36731.0 36771.1 26934.0 29443.7 29730.0 29752.4 29784.4 23562.9 23789.4 23866.3 24056.5 24069.8 05:44:10 INFO - 2015-12-17 05:44:10,052 DEBUG : BROWSER_OUTPUT: 05:44:10 INFO - 2015-12-17 05:44:10,052 DEBUG : BROWSER_OUTPUT: [#2] jquery.html Cycles:180 Average:25370.47 Median:20531.09 stddev:74310.11 (361.9%) stddev-sans-first:74494.77 05:44:10 INFO - 2015-12-17 05:44:10,052 DEBUG : BROWSER_OUTPUT: Values: 324.6 325.8 327.2 327.3 331.0 12542.6 12971.0 14948.6 15258.7 15425.2 12360.6 14461.7 14784.8 15300.4 15325.6 5029.1 5032.4 5157.7 5160.8 5175.2 3731.7 3845.3 5025.2 5070.1 5747.7 5821.6 5853.9 5874.1 5879.5 5889.2 5690.7 5796.4 5825.3 5833.3 5851.8 5071.7 5085.7 5092.3 5093.7 5094.5 18907.3 19064.9 19248.6 19362.7 19393.0 1818.5 1840.6 1849.2 1875.6 1875.9 12452.4 12478.6 12641.9 12652.7 12787.0 1670.3 1695.8 1745.9 1793.9 1811.8 53727.5 53893.5 54461.5 55750.0 57002.1 8767.9 8953.4 9248.4 9251.3 9327.6 11863.7 11900.8 11908.9 11920.8 11926.2 6655.6 6702.1 6748.5 6828.6 6852.7 6164.3 6253.0 6277.9 6296.5 6307.7 5566.3 5620.9 5623.3 5658.7 5665.7 1494.7 1504.8 1555.0 1564.7 1579.5 838.2 867.4 867.6 878.4 952.0 12005.0 15348.0 16326.9 16678.0 16729.6 816.7 820.4 840.0 862.0 883.8 9008.4 9110.6 9223.4 9401.6 9990.5 445159.0 449933.0 450002.0 453732.0 475543.0 37330.4 70660.0 73054.0 73303.6 73557.0 1054.0 1055.9 1064.5 1091.7 1092.6 14433.0 14527.9 14574.3 14574.8 14790.9 33255.5 33692.7 34457.8 34586.0 34945.7 43495.6 44183.3 46027.5 47733.0 49433.8 8410.2 8755.3 8848.3 8870.2 8886.6 10384.6 10388.8 10436.5 10477.3 10528.4 12630.4 13461.4 13788.6 14181.4 14606.1 13422.1 13703.3 14003.6 14206.2 14371.7 10794.7 13328.4 13829.8 14236.8 14499.8 8967.2 9025.6 9105.5 9185.1 9306.0 13267.4 13763.2 14063.1 14127.5 14495.9 05:44:10 INFO - 2015-12-17 05:44:10,052 DEBUG : BROWSER_OUTPUT: 05:44:10 INFO - 2015-12-17 05:44:10,053 DEBUG : BROWSER_OUTPUT: [#3] mootools.html Cycles:180 Average:4860.48 Median:6080.76 stddev:2533.03 (41.7%) stddev-sans-first:2525.66 05:44:10 INFO - 2015-12-17 05:44:10,054 DEBUG : BROWSER_OUTPUT: Values: 1257.5 1628.5 1678.9 1707.2 1711.9 6172.7 6785.7 6917.8 6939.5 6951.4 7045.1 7065.2 7110.9 7128.0 7135.4 2038.9 2062.3 2065.1 2065.9 2067.7 2045.8 2070.6 2080.6 2104.2 2104.4 2012.5 2053.6 2068.4 2075.7 2077.3 2024.9 2034.1 2045.2 2047.2 2057.1 1992.2 2017.3 2044.2 2045.6 2048.1 7039.1 7098.1 7104.6 7113.6 7122.9 3995.3 4050.8 4054.4 4074.4 4077.6 2573.2 2577.5 2604.8 2648.4 2661.4 864.2 871.0 887.6 888.2 892.6 9154.2 9156.0 9157.8 9172.7 9194.0 3529.7 3563.8 3604.5 3605.9 3611.2 7993.4 7996.0 7996.8 8003.6 8006.6 3972.4 3980.4 3993.7 3994.4 4005.1 3188.6 3276.6 3627.6 3683.6 3695.7 3356.2 3410.3 3436.3 3440.6 3462.8 1098.7 1106.9 1108.0 1109.1 1126.4 800.9 802.4 802.4 852.3 862.2 6392.3 6400.0 6416.9 6428.1 6472.4 994.7 1004.8 1027.4 1029.9 1033.8 4990.5 5072.5 5074.3 5078.5 5084.1 8289.5 8337.9 8541.6 8576.4 8645.9 8480.6 8486.0 8575.4 8587.8 8598.7 6450.4 6563.0 6572.9 6586.5 6594.4 6268.7 6494.4 6560.3 6574.4 6582.4 7462.3 7705.9 7714.8 7731.3 7853.0 7657.0 7827.2 7841.1 7853.6 7859.7 5815.3 5970.5 5975.3 5978.7 5988.8 6813.3 6827.6 6848.3 6878.2 6905.5 6512.7 6556.8 6573.6 6623.8 6641.9 5560.2 5890.3 6258.2 6402.6 6548.7 6252.2 6301.3 6313.5 6316.8 6326.4 5312.9 5315.9 5337.9 5342.6 5500.1 5750.5 5765.9 5778.9 5788.2 5816.0 05:44:10 INFO - 2015-12-17 05:44:10,054 DEBUG : BROWSER_OUTPUT: 05:44:10 INFO - 2015-12-17 05:44:10,054 DEBUG : BROWSER_OUTPUT: [#4] prototype.html Cycles:180 Average:4663.95 Median:5314.75 stddev:1374.07 (25.9%) stddev-sans-first:1338.11 05:44:10 INFO - 2015-12-17 05:44:10,054 DEBUG : BROWSER_OUTPUT: Values: 288.9 297.0 301.7 308.0 310.5 5330.7 5361.7 5371.5 5469.6 5481.3 5298.8 5370.9 5372.2 5375.4 5385.1 3932.5 4146.3 4152.7 4154.7 4158.5 4007.0 4008.2 4093.5 4101.3 4135.2 4067.9 4073.1 4073.8 4078.0 4099.2 3855.3 3949.3 3977.7 4067.9 4074.6 3552.1 3563.9 3564.7 3572.2 3576.7 5129.6 5141.8 5142.3 5147.3 5184.3 4691.4 4697.8 4702.1 4707.1 4710.9 5506.8 5569.6 5604.5 5616.8 5628.9 3874.9 3882.7 3885.1 3887.9 3889.1 5830.9 5931.9 5931.9 5932.1 5935.9 3968.4 3974.2 3976.2 3978.8 3979.0 4019.2 4021.0 4022.0 4024.7 4059.8 4718.7 4757.6 4759.4 4764.7 4765.1 5645.1 5649.9 5656.2 5656.5 5663.9 1454.8 1490.0 1490.4 1491.9 1493.0 1010.5 1011.0 1012.9 1015.6 1038.7 4938.0 4949.3 4955.8 4956.0 4958.3 5854.4 5862.0 5868.9 5869.8 5874.5 4939.7 4941.3 4947.7 4953.3 4960.6 3091.7 3122.2 3157.4 3157.8 3162.9 5522.7 5532.7 5535.6 5538.4 5542.8 6004.6 6008.0 6009.1 6018.5 6019.8 5527.5 5543.3 5543.6 5543.7 5549.0 5671.5 5840.6 5843.3 5845.9 5846.0 5696.2 5706.0 5711.5 5715.5 5719.0 5530.5 5533.0 5533.3 5537.9 5540.8 4039.2 4130.2 4148.7 4148.8 4155.9 5807.1 5829.5 5830.1 5839.2 5839.7 5604.2 5605.1 5615.4 5618.5 5625.9 5607.3 5613.2 5613.9 5617.8 5618.9 5333.2 5550.9 5561.3 5561.6 5565.9 5425.0 5602.4 5700.8 5701.1 5704.1 5405.9 5532.3 5542.8 5545.0 5547.2 05:44:10 INFO - 2015-12-17 05:44:10,054 DEBUG : BROWSER_OUTPUT: 05:44:10 INFO - 2015-12-17 05:44:10,054 DEBUG : BROWSER_OUTPUT: [#5] yui.html Cycles:180 Average:11743.50 Median:551.48 stddev:14180.14 (2571.3%) stddev-sans-first:14195.68 05:44:10 INFO - 2015-12-17 05:44:10,055 DEBUG : BROWSER_OUTPUT: Values: 704.0 714.8 716.9 718.1 731.1 10304.2 10771.6 10772.4 10781.9 10787.8 10389.8 10438.1 10452.6 10460.8 10476.7 778.1 789.9 789.9 790.6 790.7 624.5 632.9 772.1 786.0 787.0 827.5 828.9 834.9 836.5 837.2 639.9 644.0 828.0 828.9 829.0 483.3 484.3 485.2 597.6 610.6 9883.9 10128.6 10175.4 10256.9 10266.9 9390.1 10090.7 10388.8 10479.6 10668.0 8267.8 8344.6 8499.4 8542.8 8548.4 3154.5 3205.5 3208.6 3217.1 3227.4 37898.8 40018.2 40154.4 40369.4 40403.6 8710.8 8806.9 8838.4 8940.1 9033.3 15338.2 15348.9 15373.2 15379.8 15402.8 6049.5 6339.7 6340.4 6365.0 6372.0 3467.1 3530.9 3537.7 3551.1 3636.9 2558.5 2563.3 2583.2 2591.5 2592.4 438.3 442.1 448.7 451.9 453.8 430.8 444.9 462.7 497.3 563.0 6484.5 6489.7 6540.1 6790.7 6793.3 411.0 443.9 515.6 536.8 540.0 2998.6 3084.4 3100.8 3107.7 3168.7 50089.7 50978.2 51001.0 51018.7 51077.0 45359.1 45704.8 45727.5 45948.3 46160.8 40784.8 41240.6 41390.6 41910.0 41931.8 6343.4 6467.5 6488.4 6607.5 6610.5 30651.0 30682.2 30919.7 30941.7 31121.8 38559.8 41323.8 41511.0 41954.4 43246.4 8961.4 8972.0 9087.7 9211.0 9280.2 9326.8 9778.7 9817.0 9971.6 10057.0 8682.6 9010.2 9116.6 9320.7 9437.8 8636.6 8689.2 8694.4 8721.9 8735.7 8451.8 8635.3 8678.6 8795.0 8814.8 7593.0 7822.8 7830.5 7857.7 8064.6 7662.2 7741.0 7758.0 7834.6 7989.4 05:44:10 INFO - 2015-12-17 05:44:10,056 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 05:44:10 INFO - 2015-12-17 05:44:10,056 DEBUG : BROWSER_OUTPUT: 05:44:10 INFO - 2015-12-17 05:44:10,815 INFO : Browser exited with error code: 0 05:44:10 INFO - 2015-12-17 05:44:10,833 INFO : Completed test dromaeo_css (00:18:36) 05:44:10 INFO - 2015-12-17 05:44:10,833 INFO : Starting test kraken 05:44:10 INFO - 2015-12-17 05:44:10,833 DEBUG : operating with platform_type : linux_ 05:44:10 INFO - 2015-12-17 05:44:10,834 INFO : Initialising browser for kraken test... 05:44:10 INFO - 2015-12-17 05:44:10,840 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpb58gxA/profile http://localhost:39069/getInfo.html 05:44:15 INFO - 2015-12-17 05:44:15,021 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 05:44:15 INFO - 2015-12-17 05:44:15,021 DEBUG : BROWSER_OUTPUT: colorDepth:24 05:44:15 INFO - 2015-12-17 05:44:15,021 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 05:44:15 INFO - 2015-12-17 05:44:15,021 DEBUG : BROWSER_OUTPUT: __metrics 05:44:15 INFO - 2015-12-17 05:44:15,063 DEBUG : BROWSER_OUTPUT: JavaScript error: resource://gre/modules/PerformanceStats.jsm, line 211: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIPerformanceStatsService.isMonitoringJank] 05:44:15 INFO - 2015-12-17 05:44:15,118 DEBUG : BROWSER_OUTPUT: JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 05:44:15 ERROR - 2015-12-17 05:44:15,126 DEBUG : BROWSER_OUTPUT: JavaScript error: chrome://browser/content/tab-content.js, line 408: TypeError: content is null 05:44:16 INFO - 2015-12-17 05:44:16,008 INFO : Browser initialized. 05:44:16 INFO - 2015-12-17 05:44:16,009 INFO : Running cycle 1/1 for kraken test... 05:44:16 INFO - 2015-12-17 05:44:16,009 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpb58gxA/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 05:44:28 INFO - 2015-12-17 05:44:28,050 DEBUG : BROWSER_OUTPUT: RSS: Main: 150691840 05:44:28 INFO - 2015-12-17 05:44:28,051 DEBUG : BROWSER_OUTPUT: 05:44:30 INFO - 2015-12-17 05:44:30,668 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:39069/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:39069/tests/kraken/driver.html?testName=audio-beat-detection) 05:44:31 INFO - 2015-12-17 05:44:31,250 DEBUG : BROWSER_OUTPUT: RSS: Main: 185806848 05:44:31 INFO - 2015-12-17 05:44:31,251 DEBUG : BROWSER_OUTPUT: 05:44:33 INFO - 2015-12-17 05:44:33,993 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:39069/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:39069/tests/kraken/driver.html?testName=audio-dft) 05:44:34 INFO - 2015-12-17 05:44:34,567 DEBUG : BROWSER_OUTPUT: RSS: Main: 174088192 05:44:34 INFO - 2015-12-17 05:44:34,567 DEBUG : BROWSER_OUTPUT: 05:44:37 INFO - 2015-12-17 05:44:37,560 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:39069/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:39069/tests/kraken/driver.html?testName=audio-fft) 05:44:38 INFO - 2015-12-17 05:44:38,125 DEBUG : BROWSER_OUTPUT: RSS: Main: 160944128 05:44:38 INFO - 2015-12-17 05:44:38,125 DEBUG : BROWSER_OUTPUT: 05:44:40 INFO - 2015-12-17 05:44:40,191 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:39069/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:39069/tests/kraken/driver.html?testName=audio-oscillator) 05:44:40 INFO - 2015-12-17 05:44:40,764 DEBUG : BROWSER_OUTPUT: RSS: Main: 162615296 05:44:40 INFO - 2015-12-17 05:44:40,764 DEBUG : BROWSER_OUTPUT: 05:44:43 INFO - 2015-12-17 05:44:43,046 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:39069/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:39069/tests/kraken/driver.html?testName=imaging-gaussian-blur) 05:44:43 INFO - 2015-12-17 05:44:43,615 DEBUG : BROWSER_OUTPUT: RSS: Main: 165466112 05:44:43 INFO - 2015-12-17 05:44:43,615 DEBUG : BROWSER_OUTPUT: 05:44:46 INFO - 2015-12-17 05:44:46,644 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:39069/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:39069/tests/kraken/driver.html?testName=imaging-darkroom) 05:44:47 INFO - 2015-12-17 05:44:47,225 DEBUG : BROWSER_OUTPUT: RSS: Main: 166068224 05:44:47 INFO - 2015-12-17 05:44:47,225 DEBUG : BROWSER_OUTPUT: 05:44:50 INFO - 2015-12-17 05:44:50,607 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:39069/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:39069/tests/kraken/driver.html?testName=imaging-desaturate) 05:44:51 INFO - 2015-12-17 05:44:51,180 DEBUG : BROWSER_OUTPUT: RSS: Main: 166907904 05:44:51 INFO - 2015-12-17 05:44:51,180 DEBUG : BROWSER_OUTPUT: 05:44:54 INFO - 2015-12-17 05:44:54,022 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:39069/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:39069/tests/kraken/driver.html?testName=json-parse-financial) 05:44:54 INFO - 2015-12-17 05:44:54,603 DEBUG : BROWSER_OUTPUT: RSS: Main: 167079936 05:44:54 INFO - 2015-12-17 05:44:54,604 DEBUG : BROWSER_OUTPUT: 05:44:56 INFO - 2015-12-17 05:44:56,414 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:39069/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:39069/tests/kraken/driver.html?testName=json-stringify-tinderbox) 05:44:56 INFO - 2015-12-17 05:44:56,980 DEBUG : BROWSER_OUTPUT: RSS: Main: 174084096 05:44:56 INFO - 2015-12-17 05:44:56,980 DEBUG : BROWSER_OUTPUT: 05:44:58 INFO - 2015-12-17 05:44:58,855 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:39069/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:39069/tests/kraken/driver.html?testName=stanford-crypto-aes) 05:44:59 INFO - 2015-12-17 05:44:59,457 DEBUG : BROWSER_OUTPUT: RSS: Main: 172953600 05:44:59 INFO - 2015-12-17 05:44:59,457 DEBUG : BROWSER_OUTPUT: 05:45:01 INFO - 2015-12-17 05:45:01,610 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:39069/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:39069/tests/kraken/driver.html?testName=stanford-crypto-ccm) 05:45:02 INFO - 2015-12-17 05:45:02,183 DEBUG : BROWSER_OUTPUT: RSS: Main: 183222272 05:45:02 INFO - 2015-12-17 05:45:02,183 DEBUG : BROWSER_OUTPUT: 05:45:04 INFO - 2015-12-17 05:45:04,686 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:39069/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:39069/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 05:45:05 INFO - 2015-12-17 05:45:05,279 DEBUG : BROWSER_OUTPUT: RSS: Main: 190287872 05:45:05 INFO - 2015-12-17 05:45:05,279 DEBUG : BROWSER_OUTPUT: 05:45:07 INFO - 2015-12-17 05:45:07,895 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:39069/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:39069/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 05:45:08 INFO - 2015-12-17 05:45:08,476 DEBUG : BROWSER_OUTPUT: RSS: Main: 186306560 05:45:08 INFO - 2015-12-17 05:45:08,476 DEBUG : BROWSER_OUTPUT: 05:45:10 INFO - 2015-12-17 05:45:10,255 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:39069/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:39069/tests/kraken/driver.html?testName=ai-astar) 05:45:10 INFO - 2015-12-17 05:45:10,504 DEBUG : BROWSER_OUTPUT: RSS: Main: 245567488 05:45:10 INFO - 2015-12-17 05:45:10,505 DEBUG : BROWSER_OUTPUT: 05:45:10 INFO - 2015-12-17 05:45:10,508 DEBUG : BROWSER_OUTPUT: __start_tp_report 05:45:10 INFO - 2015-12-17 05:45:10,508 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 05:45:10 INFO - 2015-12-17 05:45:10,508 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 05:45:10 INFO - 2015-12-17 05:45:10,508 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 05:45:10 INFO - 2015-12-17 05:45:10,509 DEBUG : BROWSER_OUTPUT: |0;ai-astar;112;113;107;112;114;113;102;112;115;103 05:45:10 INFO - 2015-12-17 05:45:10,509 DEBUG : BROWSER_OUTPUT: |1;audio-beat-detection;152;130;155;164;136;156;151;140;170;133 05:45:10 INFO - 2015-12-17 05:45:10,509 DEBUG : BROWSER_OUTPUT: |2;audio-dft;161;159;161;162;161;163;162;163;162;161 05:45:10 INFO - 2015-12-17 05:45:10,509 DEBUG : BROWSER_OUTPUT: |3;audio-fft;72;71;86;100;72;74;76;105;90;72 05:45:10 INFO - 2015-12-17 05:45:10,510 DEBUG : BROWSER_OUTPUT: |4;audio-oscillator;95;95;130;95;94;96;143;95;95;133 05:45:10 INFO - 2015-12-17 05:45:10,510 DEBUG : BROWSER_OUTPUT: |5;imaging-gaussian-blur;110;109;110;110;109;109;111;110;109;109 05:45:10 INFO - 2015-12-17 05:45:10,510 DEBUG : BROWSER_OUTPUT: |6;imaging-darkroom;147;146;146;147;146;147;146;148;146;147 05:45:10 INFO - 2015-12-17 05:45:10,510 DEBUG : BROWSER_OUTPUT: |7;imaging-desaturate;96;95;96;96;96;96;96;96;96;96 05:45:10 INFO - 2015-12-17 05:45:10,510 DEBUG : BROWSER_OUTPUT: |8;json-parse-financial;71;71;71;71;72;71;71;82;79;68 05:45:10 INFO - 2015-12-17 05:45:10,510 DEBUG : BROWSER_OUTPUT: |9;json-stringify-tinderbox;67;67;67;68;69;69;69;68;69;73 05:45:10 INFO - 2015-12-17 05:45:10,511 DEBUG : BROWSER_OUTPUT: |10;stanford-crypto-aes;87;85;85;91;82;82;83;84;85;85 05:45:10 INFO - 2015-12-17 05:45:10,511 DEBUG : BROWSER_OUTPUT: |11;stanford-crypto-ccm;121;120;117;135;128;130;129;119;121;126 05:45:10 INFO - 2015-12-17 05:45:10,511 DEBUG : BROWSER_OUTPUT: |12;stanford-crypto-pbkdf2;142;146;149;156;146;136;146;149;150;142 05:45:10 INFO - 2015-12-17 05:45:10,511 DEBUG : BROWSER_OUTPUT: |13;stanford-crypto-sha256-iterative;70;71;73;70;70;70;69;70;69;70 05:45:10 INFO - 2015-12-17 05:45:10,511 DEBUG : BROWSER_OUTPUT: __end_tp_report 05:45:10 INFO - 2015-12-17 05:45:10,511 DEBUG : BROWSER_OUTPUT: __start_cc_report 05:45:10 INFO - 2015-12-17 05:45:10,511 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,982 05:45:10 INFO - 2015-12-17 05:45:10,511 DEBUG : BROWSER_OUTPUT: __end_cc_report 05:45:10 INFO - 2015-12-17 05:45:10,512 DEBUG : BROWSER_OUTPUT: __startTimestamp1450359910507__endTimestamp 05:45:10 INFO - 2015-12-17 05:45:10,512 DEBUG : BROWSER_OUTPUT: 05:45:10 INFO - 2015-12-17 05:45:10,515 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 05:45:10 INFO - 2015-12-17 05:45:10,515 DEBUG : BROWSER_OUTPUT: Number of tests: 14 05:45:10 INFO - 2015-12-17 05:45:10,515 DEBUG : BROWSER_OUTPUT: 05:45:10 INFO - 2015-12-17 05:45:10,515 DEBUG : BROWSER_OUTPUT: [#0] ai-astar Cycles:10 Average:110.30 Median:112.50 stddev:4.62 (4.1%) stddev-sans-first:4.86 05:45:10 INFO - 2015-12-17 05:45:10,515 DEBUG : BROWSER_OUTPUT: Values: 112.0 113.0 107.0 112.0 114.0 113.0 102.0 112.0 115.0 103.0 05:45:10 INFO - 2015-12-17 05:45:10,516 DEBUG : BROWSER_OUTPUT: 05:45:10 INFO - 2015-12-17 05:45:10,516 DEBUG : BROWSER_OUTPUT: [#1] audio-beat-detection Cycles:10 Average:148.70 Median:153.50 stddev:13.46 (8.8%) stddev-sans-first:14.22 05:45:10 INFO - 2015-12-17 05:45:10,516 DEBUG : BROWSER_OUTPUT: Values: 152.0 130.0 155.0 164.0 136.0 156.0 151.0 140.0 170.0 133.0 05:45:10 INFO - 2015-12-17 05:45:10,516 DEBUG : BROWSER_OUTPUT: 05:45:10 INFO - 2015-12-17 05:45:10,516 DEBUG : BROWSER_OUTPUT: [#2] audio-dft Cycles:10 Average:161.50 Median:162.00 stddev:1.18 (0.7%) stddev-sans-first:1.24 05:45:10 INFO - 2015-12-17 05:45:10,516 DEBUG : BROWSER_OUTPUT: Values: 161.0 159.0 161.0 162.0 161.0 163.0 162.0 163.0 162.0 161.0 05:45:10 INFO - 2015-12-17 05:45:10,516 DEBUG : BROWSER_OUTPUT: 05:45:10 INFO - 2015-12-17 05:45:10,516 DEBUG : BROWSER_OUTPUT: [#3] audio-fft Cycles:10 Average:81.80 Median:73.00 stddev:12.71 (17.4%) stddev-sans-first:12.98 05:45:10 INFO - 2015-12-17 05:45:10,516 DEBUG : BROWSER_OUTPUT: Values: 72.0 71.0 86.0 100.0 72.0 74.0 76.0 105.0 90.0 72.0 05:45:10 INFO - 2015-12-17 05:45:10,516 DEBUG : BROWSER_OUTPUT: 05:45:10 INFO - 2015-12-17 05:45:10,516 DEBUG : BROWSER_OUTPUT: [#4] audio-oscillator Cycles:10 Average:107.10 Median:95.00 stddev:19.75 (20.8%) stddev-sans-first:20.46 05:45:10 INFO - 2015-12-17 05:45:10,516 DEBUG : BROWSER_OUTPUT: Values: 95.0 95.0 130.0 95.0 94.0 96.0 143.0 95.0 95.0 133.0 05:45:10 INFO - 2015-12-17 05:45:10,517 DEBUG : BROWSER_OUTPUT: 05:45:10 INFO - 2015-12-17 05:45:10,517 DEBUG : BROWSER_OUTPUT: [#5] imaging-gaussian-blur Cycles:10 Average:109.60 Median:110.00 stddev:0.70 (0.6%) stddev-sans-first:0.73 05:45:10 INFO - 2015-12-17 05:45:10,517 DEBUG : BROWSER_OUTPUT: Values: 110.0 109.0 110.0 110.0 109.0 109.0 111.0 110.0 109.0 109.0 05:45:10 INFO - 2015-12-17 05:45:10,517 DEBUG : BROWSER_OUTPUT: 05:45:10 INFO - 2015-12-17 05:45:10,517 DEBUG : BROWSER_OUTPUT: [#6] imaging-darkroom Cycles:10 Average:146.60 Median:147.00 stddev:0.70 (0.5%) stddev-sans-first:0.73 05:45:10 INFO - 2015-12-17 05:45:10,517 DEBUG : BROWSER_OUTPUT: Values: 147.0 146.0 146.0 147.0 146.0 147.0 146.0 148.0 146.0 147.0 05:45:10 INFO - 2015-12-17 05:45:10,517 DEBUG : BROWSER_OUTPUT: 05:45:10 INFO - 2015-12-17 05:45:10,517 DEBUG : BROWSER_OUTPUT: [#7] imaging-desaturate Cycles:10 Average:95.90 Median:96.00 stddev:0.32 (0.3%) stddev-sans-first:0.33 05:45:10 INFO - 2015-12-17 05:45:10,517 DEBUG : BROWSER_OUTPUT: Values: 96.0 95.0 96.0 96.0 96.0 96.0 96.0 96.0 96.0 96.0 05:45:10 INFO - 2015-12-17 05:45:10,517 DEBUG : BROWSER_OUTPUT: 05:45:10 INFO - 2015-12-17 05:45:10,517 DEBUG : BROWSER_OUTPUT: [#8] json-parse-financial Cycles:10 Average:72.70 Median:71.00 stddev:4.30 (6.1%) stddev-sans-first:4.51 05:45:10 INFO - 2015-12-17 05:45:10,517 DEBUG : BROWSER_OUTPUT: Values: 71.0 71.0 71.0 71.0 72.0 71.0 71.0 82.0 79.0 68.0 05:45:10 INFO - 2015-12-17 05:45:10,518 DEBUG : BROWSER_OUTPUT: 05:45:10 INFO - 2015-12-17 05:45:10,518 DEBUG : BROWSER_OUTPUT: [#9] json-stringify-tinderbox Cycles:10 Average:68.60 Median:69.00 stddev:1.78 (2.6%) stddev-sans-first:1.79 05:45:10 INFO - 2015-12-17 05:45:10,518 DEBUG : BROWSER_OUTPUT: Values: 67.0 67.0 67.0 68.0 69.0 69.0 69.0 68.0 69.0 73.0 05:45:10 INFO - 2015-12-17 05:45:10,518 DEBUG : BROWSER_OUTPUT: 05:45:10 INFO - 2015-12-17 05:45:10,518 DEBUG : BROWSER_OUTPUT: [#10] stanford-crypto-aes Cycles:10 Average:84.90 Median:85.00 stddev:2.64 (3.1%) stddev-sans-first:2.69 05:45:10 INFO - 2015-12-17 05:45:10,518 DEBUG : BROWSER_OUTPUT: Values: 87.0 85.0 85.0 91.0 82.0 82.0 83.0 84.0 85.0 85.0 05:45:10 INFO - 2015-12-17 05:45:10,518 DEBUG : BROWSER_OUTPUT: 05:45:10 INFO - 2015-12-17 05:45:10,518 DEBUG : BROWSER_OUTPUT: [#11] stanford-crypto-ccm Cycles:10 Average:124.60 Median:127.00 stddev:5.83 (4.6%) stddev-sans-first:6.04 05:45:10 INFO - 2015-12-17 05:45:10,518 DEBUG : BROWSER_OUTPUT: Values: 121.0 120.0 117.0 135.0 128.0 130.0 129.0 119.0 121.0 126.0 05:45:10 INFO - 2015-12-17 05:45:10,518 DEBUG : BROWSER_OUTPUT: 05:45:10 INFO - 2015-12-17 05:45:10,518 DEBUG : BROWSER_OUTPUT: [#12] stanford-crypto-pbkdf2 Cycles:10 Average:146.20 Median:147.50 stddev:5.43 (3.7%) stddev-sans-first:5.55 05:45:10 INFO - 2015-12-17 05:45:10,518 DEBUG : BROWSER_OUTPUT: Values: 142.0 146.0 149.0 156.0 146.0 136.0 146.0 149.0 150.0 142.0 05:45:10 INFO - 2015-12-17 05:45:10,519 DEBUG : BROWSER_OUTPUT: 05:45:10 INFO - 2015-12-17 05:45:10,519 DEBUG : BROWSER_OUTPUT: [#13] stanford-crypto-sha256-iterative Cycles:10 Average:70.20 Median:70.00 stddev:1.14 (1.6%) stddev-sans-first:1.20 05:45:10 INFO - 2015-12-17 05:45:10,519 DEBUG : BROWSER_OUTPUT: Values: 70.0 71.0 73.0 70.0 70.0 70.0 69.0 70.0 69.0 70.0 05:45:10 INFO - 2015-12-17 05:45:10,519 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 05:45:10 INFO - 2015-12-17 05:45:10,519 DEBUG : BROWSER_OUTPUT: 05:45:11 INFO - 2015-12-17 05:45:11,335 INFO : Browser exited with error code: 0 05:45:11 INFO - 2015-12-17 05:45:11,390 INFO : Completed test kraken (00:01:00) 05:45:11 INFO - 2015-12-17 05:45:11,391 INFO : Starting test v8_7 05:45:11 INFO - 2015-12-17 05:45:11,391 DEBUG : operating with platform_type : linux_ 05:45:11 INFO - 2015-12-17 05:45:11,391 INFO : Initialising browser for v8_7 test... 05:45:11 INFO - 2015-12-17 05:45:11,397 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpdbnrvz/profile http://localhost:39069/getInfo.html 05:45:15 INFO - 2015-12-17 05:45:15,598 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 05:45:15 INFO - 2015-12-17 05:45:15,598 DEBUG : BROWSER_OUTPUT: colorDepth:24 05:45:15 INFO - 2015-12-17 05:45:15,598 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 05:45:15 INFO - 2015-12-17 05:45:15,598 DEBUG : BROWSER_OUTPUT: __metrics 05:45:15 INFO - 2015-12-17 05:45:15,666 DEBUG : BROWSER_OUTPUT: JavaScript error: resource://gre/modules/PerformanceStats.jsm, line 211: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIPerformanceStatsService.isMonitoringJank] 05:45:15 INFO - 2015-12-17 05:45:15,727 DEBUG : BROWSER_OUTPUT: JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 05:45:16 INFO - 2015-12-17 05:45:16,616 INFO : Browser initialized. 05:45:16 INFO - 2015-12-17 05:45:16,616 INFO : Running cycle 1/1 for v8_7 test... 05:45:16 INFO - 2015-12-17 05:45:16,617 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpdbnrvz/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/v8_7/v8.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 05:45:28 INFO - 2015-12-17 05:45:28,664 DEBUG : BROWSER_OUTPUT: RSS: Main: 150224896 05:45:28 INFO - 2015-12-17 05:45:28,664 DEBUG : BROWSER_OUTPUT: 05:45:50 INFO - 2015-12-17 05:45:50,054 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:39069/tests/v8_7/run.html (next: http://localhost:39069/tests/v8_7/run.html) 05:45:50 INFO - 2015-12-17 05:45:50,304 DEBUG : BROWSER_OUTPUT: RSS: Main: 450945024 05:45:50 INFO - 2015-12-17 05:45:50,305 DEBUG : BROWSER_OUTPUT: 05:45:50 INFO - 2015-12-17 05:45:50,306 DEBUG : BROWSER_OUTPUT: __start_tp_report 05:45:50 INFO - 2015-12-17 05:45:50,306 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 05:45:50 INFO - 2015-12-17 05:45:50,306 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 05:45:50 INFO - 2015-12-17 05:45:50,307 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 05:45:50 INFO - 2015-12-17 05:45:50,307 DEBUG : BROWSER_OUTPUT: |0;Richards;167.9261125104954 05:45:50 INFO - 2015-12-17 05:45:50,307 DEBUG : BROWSER_OUTPUT: |1;DeltaBlue;185.8045336306206 05:45:50 INFO - 2015-12-17 05:45:50,307 DEBUG : BROWSER_OUTPUT: |2;Encrypt;277.85495971103086 05:45:50 INFO - 2015-12-17 05:45:50,307 DEBUG : BROWSER_OUTPUT: |3;Decrypt;5128.205128205128 05:45:50 INFO - 2015-12-17 05:45:50,307 DEBUG : BROWSER_OUTPUT: |4;RayTrace;2070.3933747412007 05:45:50 INFO - 2015-12-17 05:45:50,307 DEBUG : BROWSER_OUTPUT: |5;Earley;793.0214115781126 05:45:50 INFO - 2015-12-17 05:45:50,308 DEBUG : BROWSER_OUTPUT: |6;Boyer;12432.098765432098 05:45:50 INFO - 2015-12-17 05:45:50,308 DEBUG : BROWSER_OUTPUT: |7;RegExp;26894.736842105263 05:45:50 INFO - 2015-12-17 05:45:50,308 DEBUG : BROWSER_OUTPUT: |8;Splay;610.5006105006105 05:45:50 INFO - 2015-12-17 05:45:50,308 DEBUG : BROWSER_OUTPUT: |9;NavierStokes;4835.748792270531 05:45:50 INFO - 2015-12-17 05:45:50,308 DEBUG : BROWSER_OUTPUT: __end_tp_report 05:45:50 INFO - 2015-12-17 05:45:50,308 DEBUG : BROWSER_OUTPUT: __startTimestamp1450359950305__endTimestamp 05:45:50 INFO - 2015-12-17 05:45:50,308 DEBUG : BROWSER_OUTPUT: 05:45:50 INFO - 2015-12-17 05:45:50,309 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 05:45:50 INFO - 2015-12-17 05:45:50,309 DEBUG : BROWSER_OUTPUT: Number of tests: 10 05:45:50 INFO - 2015-12-17 05:45:50,309 DEBUG : BROWSER_OUTPUT: 05:45:50 INFO - 2015-12-17 05:45:50,310 DEBUG : BROWSER_OUTPUT: [#0] Richards Cycles:1 Average:167.93 Median:167.93 stddev:0.00 (0.0%) 05:45:50 INFO - 2015-12-17 05:45:50,310 DEBUG : BROWSER_OUTPUT: Values: 167.9 05:45:50 INFO - 2015-12-17 05:45:50,310 DEBUG : BROWSER_OUTPUT: 05:45:50 INFO - 2015-12-17 05:45:50,310 DEBUG : BROWSER_OUTPUT: [#1] DeltaBlue Cycles:1 Average:185.80 Median:185.80 stddev:0.00 (0.0%) 05:45:50 INFO - 2015-12-17 05:45:50,310 DEBUG : BROWSER_OUTPUT: Values: 185.8 05:45:50 INFO - 2015-12-17 05:45:50,310 DEBUG : BROWSER_OUTPUT: 05:45:50 INFO - 2015-12-17 05:45:50,310 DEBUG : BROWSER_OUTPUT: [#2] Encrypt Cycles:1 Average:277.85 Median:277.85 stddev:0.00 (0.0%) 05:45:50 INFO - 2015-12-17 05:45:50,310 DEBUG : BROWSER_OUTPUT: Values: 277.9 05:45:50 INFO - 2015-12-17 05:45:50,310 DEBUG : BROWSER_OUTPUT: 05:45:50 INFO - 2015-12-17 05:45:50,310 DEBUG : BROWSER_OUTPUT: [#3] Decrypt Cycles:1 Average:5128.21 Median:5128.21 stddev:0.00 (0.0%) 05:45:50 INFO - 2015-12-17 05:45:50,310 DEBUG : BROWSER_OUTPUT: Values: 5128.2 05:45:50 INFO - 2015-12-17 05:45:50,311 DEBUG : BROWSER_OUTPUT: 05:45:50 INFO - 2015-12-17 05:45:50,311 DEBUG : BROWSER_OUTPUT: [#4] RayTrace Cycles:1 Average:2070.39 Median:2070.39 stddev:0.00 (0.0%) 05:45:50 INFO - 2015-12-17 05:45:50,311 DEBUG : BROWSER_OUTPUT: Values: 2070.4 05:45:50 INFO - 2015-12-17 05:45:50,311 DEBUG : BROWSER_OUTPUT: 05:45:50 INFO - 2015-12-17 05:45:50,311 DEBUG : BROWSER_OUTPUT: [#5] Earley Cycles:1 Average:793.02 Median:793.02 stddev:0.00 (0.0%) 05:45:50 INFO - 2015-12-17 05:45:50,311 DEBUG : BROWSER_OUTPUT: Values: 793.0 05:45:50 INFO - 2015-12-17 05:45:50,311 DEBUG : BROWSER_OUTPUT: 05:45:50 INFO - 2015-12-17 05:45:50,311 DEBUG : BROWSER_OUTPUT: [#6] Boyer Cycles:1 Average:12432.10 Median:12432.10 stddev:0.00 (0.0%) 05:45:50 INFO - 2015-12-17 05:45:50,311 DEBUG : BROWSER_OUTPUT: Values: 12432.1 05:45:50 INFO - 2015-12-17 05:45:50,311 DEBUG : BROWSER_OUTPUT: 05:45:50 INFO - 2015-12-17 05:45:50,311 DEBUG : BROWSER_OUTPUT: [#7] RegExp Cycles:1 Average:26894.74 Median:26894.74 stddev:0.00 (0.0%) 05:45:50 INFO - 2015-12-17 05:45:50,311 DEBUG : BROWSER_OUTPUT: Values: 26894.7 05:45:50 INFO - 2015-12-17 05:45:50,311 DEBUG : BROWSER_OUTPUT: 05:45:50 INFO - 2015-12-17 05:45:50,311 DEBUG : BROWSER_OUTPUT: [#8] Splay Cycles:1 Average:610.50 Median:610.50 stddev:0.00 (0.0%) 05:45:50 INFO - 2015-12-17 05:45:50,311 DEBUG : BROWSER_OUTPUT: Values: 610.5 05:45:50 INFO - 2015-12-17 05:45:50,311 DEBUG : BROWSER_OUTPUT: 05:45:50 INFO - 2015-12-17 05:45:50,312 DEBUG : BROWSER_OUTPUT: [#9] NavierStokes Cycles:1 Average:4835.75 Median:4835.75 stddev:0.00 (0.0%) 05:45:50 INFO - 2015-12-17 05:45:50,312 DEBUG : BROWSER_OUTPUT: Values: 4835.7 05:45:50 INFO - 2015-12-17 05:45:50,312 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 05:45:50 INFO - 2015-12-17 05:45:50,312 DEBUG : BROWSER_OUTPUT: 05:45:51 INFO - 2015-12-17 05:45:51,231 INFO : Browser exited with error code: 0 05:45:51 INFO - 2015-12-17 05:45:51,245 INFO : Completed test v8_7 (00:00:39) 05:45:51 INFO - 2015-12-17 05:45:51,359 INFO : Completed test suite (00:20:17) 05:45:51 INFO - 2015-12-17 05:45:51,359 DEBUG : Working with test: dromaeo_css 05:45:51 INFO - 2015-12-17 05:45:51,359 DEBUG : Generating results file: dromaeo_css 05:45:51 INFO - 2015-12-17 05:45:51,360 DEBUG : Working with test: kraken 05:45:51 INFO - 2015-12-17 05:45:51,360 DEBUG : Generating results file: kraken 05:45:51 INFO - 2015-12-17 05:45:51,361 INFO : javascript benchmark 05:45:51 INFO - 2015-12-17 05:45:51,361 DEBUG : Working with test: v8_7 05:45:51 INFO - 2015-12-17 05:45:51,361 DEBUG : Generating results file: v8_7 05:45:51 INFO - 2015-12-17 05:45:51,361 INFO : Posting result 0 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 05:45:51 INFO - 2015-12-17 05:45:51,427 DEBUG : process_Request line: dromaeo_css graph.html#tests=[[72,132,35]] 05:45:51 INFO - 2015-12-17 05:45:51,427 DEBUG : process_Request line: dromaeo_css 6247.40 graph.html#tests=[[72,132,35]] 05:45:51 INFO - 2015-12-17 05:45:51,427 INFO : Posting result 1 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 05:45:51 INFO - 2015-12-17 05:45:51,473 DEBUG : process_Request line: kraken 1528.70 graph.html#tests=[[232,132,35]] 05:45:51 INFO - 2015-12-17 05:45:51,473 INFO : Posting result 2 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 05:45:51 INFO - 2015-12-17 05:45:51,507 DEBUG : process_Request line: v8_7 19663.85 graph.html#tests=[[230,132,35]] 05:45:51 INFO - 2015-12-17 05:45:51,508 INFO : javascript benchmark 05:45:51 INFO - 2015-12-17 05:45:51,512 INFO : PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [2612.438325759961, 2708.2146177608493, 2717.796165287604, 2728.249731323887, 2747.079728291023, 4561.338605902142, 4683.320918466825, 4755.262934245189, 4760.809567617295, 4774.37933068701, 4691.882702932428, 4706.976465117669, 4741.265103908891, 4742.430908291001, 4760.190767569513, 4337.262665346899, 4363.258246098171, 4381.978090109561, 4520.2767557190855, 4525.502194758574, 4264.189803937242, 4432.3794668746405, 4464.196444639963, 4526.54734526548, 4537.047220083787, 4300.118475712503, 4346.304591265398, 4358.8910277243, 4412.470503539564, 4431.556844315575, 4424.889377765549, 4437.445319335083, 4438.134563760068, 4438.289873620205, 4457.576530229623, 4379.386885835986, 4397.2304846651705, 4400.955990440087, 4423.867283981485, 4436.578525040116, 4526.864194074183, 4643.233866412038, 4658.767061646938, 4663.60359369454, 4738.067404054626, 5031.0, 5035.546800787946, 5099.770510327045, 5112.693238405707, 5115.718635475047, 5145.819896303611, 5188.7146206958605, 5197.064528384889, 5203.089459344599, 5251.921221181686, 4551.180787458289, 4785.0, 4785.210440277385, 4790.257510085942, 4792.976035119802, 5104.846854594294, 5125.538701516882, 5182.404023537266, 5295.920561191585, 5347.625666203407, 4998.150314446553, 5007.474215207423, 5048.192289233705, 5064.1897296433135, 5064.265681476165, 4763.69036012658, 5088.643794934393, 5090.211017292326, 5101.336826212569, 5114.590832733373, 4895.510448955147, 4923.655344125948, 4926.679765815211, 4933.605311575066, 5124.205748109049, 4909.2881532177635, 4954.20732682769, 4993.625478089158, 5042.773075211624, 5048.5203905628905, 4153.771542565188, 4159.480064991876, 4160.625543701081, 4195.643370313557, 4203.957960420418, 3557.982210088933, 3661.139632186434, 3684.6683798458266, 3701.4632878232505, 3711.7958512282084, 4228.957710422918, 4305.48334199898, 4312.202242585132, 4337.609615134653, 4339.7613131278085, 5122.410922743858, 5163.302954101148, 5168.715720635401, 5170.870728231825, 5196.53231209193, 4129.442525259112, 4231.851885184065, 4232.217039847638, 4403.361512580722, 4431.268840641258, 4421.270490369053, 4484.798184081724, 4496.820127194941, 4505.234110201273, 4519.209138400833, 4822.156122678587, 4826.517348265286, 4831.057943701085, 4864.385323112848, 4865.294532292798, 4894.339264199288, 5094.694318340911, 5096.949030509648, 5137.357830271216, 5140.974295128501, 4721.598664113451, 4790.0659371423635, 4800.711957282574, 4805.831795887128, 4829.082474329866, 5070.112730272114, 5071.695698258116, 5128.102582048052, 5138.845834624967, 5174.922376164436, 4836.395450568679, 5172.922406163986, 5199.66202196856, 5205.0, 5208.661437006583, 4799.448063472745, 4841.878953026203, 4860.781264843161, 4886.731229782396, 4898.755062246944, 5009.824656137018, 5013.323201367914, 5015.147424937696, 5020.121478741133, 5059.747012649279, 4639.884002899955, 4921.803127874988, 4923.778429970732, 4931.16170251051, 4975.776090075883, 4829.106615276185, 4859.781309840995, 4870.95129048705, 4903.26451032348, 4942.678725882806, 4885.5358740919555, 4890.559849613552, 4894.51054894522, 4901.534354236342, 4933.975330123327], "unit": "score", "name": "dojo.html", "value": 4655.5622808387225}, {"lowerIsBetter": false, "replicates": [553.8860408932886, 559.2087196616785, 571.0948147186709, 586.3960121075293, 595.8927393069248, 27129.32176695581, 27847.582286265697, 27864.303392415175, 35357.82321088397, 35502.46746298801, 40811.59188408115, 41233.0, 41267.174656506926, 41414.17171656565, 41419.17161656765, 7828.686852525906, 8011.759647210564, 8015.559144247064, 8016.919830801705, 8022.1576734442915, 7082.114735658043, 7294.161171465296, 10156.949215253913, 10503.894961050368, 10510.842337364946, 10114.9494252529, 10208.540615672275, 10234.795304093914, 10237.539310730997, 10250.128739057189, 7196.352328290427, 7402.11174659039, 9956.601735930553, 10093.545790439448, 10109.898901011044, 7115.25289844564, 10069.446180460072, 10409.115225205867, 10424.166066714644, 10432.530536125892, 37017.444738328944, 37626.24747505062, 37640.24719505595, 37672.24655506875, 37674.17443691707, 2709.1195361507393, 2718.1573712149298, 2771.514984877638, 2773.457750129596, 3549.7870127792416, 26366.86816565924, 26793.464130717275, 26886.462270754477, 26953.595696064378, 27462.862685686443, 3231.402190594724, 3349.815760133192, 3352.4636058230567, 3384.3231353729107, 3408.3353746019534, 220043.0, 220285.0, 220827.0, 221487.0, 221652.8917355419, 51806.48193518092, 52484.737576311876, 52665.47334526682, 56395.0, 57067.0, 47063.5293647066, 66018.66990665016, 67248.66375668188, 67270.0, 67287.32712672811, 12067.456964436622, 12100.878991209975, 12141.575044873387, 12174.330411827434, 12186.2078964867, 8451.661933522713, 8479.364047696448, 8484.15158484159, 8604.698835540727, 8623.698170564126, 19262.229510819692, 19522.804771952382, 19550.511237219183, 19602.607947840963, 19610.117544710523, 7620.9618951905995, 7877.172896845863, 7952.1650226726515, 7964.606193916042, 8009.879851802228, 845.6617353058825, 854.6752234150982, 864.6103317966999, 886.7960369115011, 902.5216635183364, 26939.326516836845, 27011.324716882234, 27218.86390568074, 27314.453710926067, 27451.17646470609, 927.2535608834953, 941.7786820097272, 942.9057094290654, 946.9337146399823, 1048.2976405808126, 13180.538681146114, 13313.0, 13360.6659833503, 15918.9204053979, 16408.75386869198, 332851.0, 339570.0, 340694.0, 340720.0, 341915.0, 49577.0, 49649.50350496449, 49722.25416618754, 49969.500304997215, 50000.24999625009, 1207.8550573931184, 1212.9150959432754, 1217.7503611759569, 1221.0109811053076, 1231.6612931443744, 27329.453410932067, 28044.0, 28575.857120714263, 30670.693293067678, 31430.214244644067, 36276.45585316169, 36814.8159259202, 42815.57184428241, 44029.0, 44301.77849110734, 252416.0, 255213.0, 257966.0, 258160.0, 258525.0, 31880.521792172673, 37263.44104838376, 37825.0, 37904.62095379011, 37993.050173745876, 32845.0, 34343.82828085843, 38865.222695545366, 39310.60689393069, 39599.80200098981, 32272.810840087343, 32742.50886236661, 33406.83296583501, 33933.49099763555, 34019.0, 33542.32915341631, 38282.42576361413, 39501.604983949794, 39594.60405396025, 40545.0, 33755.493667594514, 34084.31831363408, 36006.279874401844, 36731.0, 36771.08072298214, 26934.0, 29443.705562944095, 29730.0, 29752.404951901273, 29784.404311914073, 23562.882185588962, 23789.405264868517, 23866.28401147968, 24056.518869622858, 24069.75930240675], "unit": "score", "name": "ext.html", "value": 17429.170713170464}, {"lowerIsBetter": false, "replicates": [324.5580617550873, 325.83708145927034, 327.17714946908546, 327.2652894252404, 330.99338013239736, 12542.623721288375, 12971.0, 14948.551543453686, 15258.694826103485, 15425.22873856307, 12360.629181124581, 14461.710765784677, 14784.778228326557, 15300.387984480636, 15325.616859578517, 5029.119904016791, 5032.446430892599, 5157.71632560209, 5160.793568257265, 5175.197844334115, 3731.7387782855076, 3845.3270677631444, 5025.246213068032, 5070.138076527, 5747.712614369286, 5821.602815324334, 5853.85365365865, 5874.060150375941, 5879.500242479395, 5889.2049573307695, 5690.658560486363, 5796.449337312949, 5825.300963884319, 5833.300003999505, 5851.76592936282, 5071.7210553419545, 5085.669431486978, 5092.28707980883, 5093.694378337312, 5094.4650811664615, 18907.33824316156, 19064.90467547667, 19248.61502769937, 19362.70955935662, 19393.0, 1818.5453636590853, 1840.5674666453372, 1849.1678744565, 1875.5967466994662, 1875.9437216883516, 12452.439640216213, 12478.563250286197, 12641.87358126416, 12652.746945061048, 12787.040971927143, 1670.2650833633163, 1695.7795486586788, 1745.9476215713548, 1793.8564914806784, 1811.7931261666909, 53727.462725372636, 53893.46106538924, 54461.549230284734, 55750.0, 57002.14496782593, 8767.912320876838, 8953.418027828171, 9248.398854074463, 9251.306152038489, 9327.580258888367, 11863.70340741471, 11900.76198476043, 11908.88091119095, 11920.821187682192, 11926.165168438127, 6655.567388119756, 6702.09521714572, 6748.527603067836, 6828.634273145391, 6852.725890964405, 6164.321924588292, 6253.030780229072, 6277.932751432268, 6296.527760417987, 6307.716152773136, 5566.304211973504, 5620.887582248332, 5623.268975033301, 5658.660480371191, 5665.716714164275, 1494.745893198159, 1504.7818066380314, 1554.9611259718597, 1564.6792407556425, 1579.5419328394867, 838.2246422059692, 867.4231635962014, 867.5878957495265, 878.3587980774071, 951.9524023798782, 12005.0, 15348.0, 16326.918365408097, 16678.0, 16729.581760455843, 816.7468084893702, 820.4339006085781, 839.9538025408539, 861.9913800861912, 883.7923088074298, 9008.41445306053, 9110.59002344896, 9223.400478968846, 9401.623935042522, 9990.450525221182, 445159.0, 449933.0, 450002.0, 453732.0, 475543.0, 37330.44004339937, 70660.0, 73054.0, 73303.63348183225, 73557.0, 1053.9789204215872, 1055.9260851740305, 1064.5422468338688, 1091.6724982505216, 1092.5684354680016, 14433.0, 14527.92736036313, 14574.344154513285, 14574.781378279122, 14790.926045369704, 33255.50116748202, 33692.66307336895, 34457.82771086128, 34586.0, 34945.65054349424, 43495.565044349154, 44183.33724994063, 46027.53972460233, 47733.0, 49433.752831235615, 8410.158984101785, 8755.343349248958, 8848.336374772047, 8870.201681848665, 8886.60010299551, 10384.636537721446, 10388.792224155324, 10436.53035613384, 10477.266591338534, 10528.420936848546, 12630.431630576462, 13461.394237259152, 13788.586342409744, 14181.361838717075, 14606.12363258208, 13422.127561708458, 13703.314834258048, 14003.579892603238, 14206.218657973497, 14371.712565748836, 10794.676159715222, 13328.40022198984, 13829.79255311151, 14236.786448203493, 14499.78250326267, 8967.192952634294, 9025.593848276712, 9105.499197543933, 9185.127412895765, 9306.0, 13267.40296686632, 13763.174209547458, 14063.085899416505, 14127.505537306144, 14495.855041449451], "unit": "score", "name": "jquery.html", "value": 8280.102815233013}, {"lowerIsBetter": false, "replicates": [1257.5158563952875, 1628.519586721917, 1678.9412370567024, 1707.1805533343995, 1711.9058451785152, 6172.722227499762, 6785.728570857166, 6917.827054323644, 6939.514234003622, 6951.443884489241, 7045.084139061914, 7065.2228254891925, 7110.893336599956, 7128.037714908486, 7135.429165666747, 2038.9082491287854, 2062.3091264426434, 2065.1429656692453, 2065.8863762493056, 2067.65883629201, 2045.836333093349, 2070.5858828234336, 2080.583883223354, 2104.189886893542, 2104.4318034130774, 2012.4968757810548, 2053.6200802851445, 2068.389825001628, 2075.7094006839056, 2077.3352527191305, 2024.9291274805385, 2034.064330408014, 2045.2125931516398, 2047.1606641277153, 2057.0537552725764, 1992.1732481020358, 2017.2536161620294, 2044.2436298569476, 2045.6113338465643, 2048.07836473586, 7039.120109986252, 7098.148222213367, 7104.573725576482, 7113.64431778409, 7122.893156602655, 3995.2808494470983, 4050.8379664813374, 4054.3715724062818, 4074.409210664437, 4077.6330130288416, 2573.150860216143, 2577.484503099369, 2604.804639652015, 2648.3643925457945, 2661.3878807874103, 864.2369566085241, 870.9912900870974, 887.5784002598779, 888.2361169394316, 892.6474042753141, 9154.221891139261, 9155.954220228923, 9157.77105572366, 9172.724818255463, 9193.954030229806, 3529.7352698547197, 3563.8396272167815, 3604.4953706480587, 3605.94591081134, 3611.1694310308776, 7993.400494962901, 7995.960525131695, 7996.80007999793, 8003.559804210708, 8006.559639219899, 3972.3644216925154, 3980.383040628707, 3993.682084911972, 3994.380870965005, 4005.1388951375593, 3188.5536024956523, 3276.639569647337, 3627.6372362763514, 3683.631636836295, 3695.722820788452, 3356.194513316835, 3410.2838403935452, 3436.295559410315, 3440.569928758905, 3462.8095454749728, 1098.7198264442675, 1106.9335839849634, 1107.983380249297, 1109.1237922041657, 1126.3692332293942, 800.8838718385801, 802.3861745764494, 802.3901834605741, 852.2883392367443, 862.1593945902695, 6392.26488953767, 6400.0, 6416.871662566816, 6428.100065990765, 6472.449841763503, 994.7065615643403, 1004.8090862736057, 1027.3579013116803, 1029.9244192398123, 1033.8397548380012, 4990.476000020019, 5072.51811077947, 5074.340335756328, 5078.5175408336145, 5084.110280700863, 8289.502629842229, 8337.874931876027, 8541.615627296787, 8576.442531235574, 8645.870311945326, 8480.575971201539, 8485.957570212233, 8575.3997220194, 8587.828243435097, 8598.656053757779, 6450.3549645036055, 6563.048357988065, 6572.86854262912, 6586.506012049115, 6594.439472644879, 6268.655223962726, 6494.447971922251, 6560.3111673273615, 6574.408303252731, 6582.3746744059235, 7462.253774622712, 7705.884411733717, 7714.807129821799, 7731.342835859015, 7852.960735196288, 7657.0, 7827.217278272127, 7841.059072911287, 7853.568053757098, 7859.724909628136, 5815.273090863642, 5970.492508136857, 5975.312839023568, 5978.730957106854, 5988.790392336247, 6813.250542440427, 6827.590344579341, 6848.280930502226, 6878.174619045746, 6905.482088843256, 6512.73949042033, 6556.770513032021, 6573.605583664996, 6623.834404139935, 6641.900371494335, 5560.2493663356545, 5890.263717035371, 6258.249010118815, 6402.6158430494315, 6548.705308261045, 6252.187215661935, 6301.338359472373, 6313.526485513697, 6316.810495685137, 6326.367363263821, 5312.893742125213, 5315.893682126259, 5337.9466205339, 5342.599305052059, 5500.092484739973, 5750.453706897838, 5765.94234057654, 5778.942210578009, 5788.21859049023, 5816.04035334182], "unit": "score", "name": "mootools.html", "value": 3986.6662150712696}, {"lowerIsBetter": false, "replicates": [288.87000849617664, 297.04944178628386, 301.72392261081114, 307.95226739855326, 310.45360166107645, 5330.653507522014, 5361.705106219157, 5371.462853714626, 5469.5624350052, 5481.287432633762, 5298.841034768953, 5370.91943620845, 5372.194170874371, 5375.408705042442, 5385.138377859544, 3932.488776459056, 4146.274401979656, 4152.709310348277, 4154.729942553724, 4158.480189976253, 4006.9599304007024, 4008.1783234437016, 4093.4678491796026, 4101.282275601758, 4135.152293779783, 4067.877963661095, 4073.124278280169, 4073.8370465181356, 4077.97961010196, 4099.200655872106, 3855.3253180693546, 3949.3483575210057, 3977.7215594908366, 4067.857624983141, 4074.633283004529, 3552.0587044433246, 3563.875264365761, 3564.6791788739138, 3572.178398968226, 3576.678098971079, 5129.6409251352425, 5141.845744627667, 5142.331496905378, 5147.305113809625, 5184.300119483859, 4691.437027556681, 4697.78859951303, 4702.13010593038, 4707.105649926537, 4710.882227944295, 5506.752196151143, 5569.610127291091, 5604.495595396434, 5616.803411880605, 5628.943710562883, 3874.8837534874, 3882.650561449455, 3885.0870045539277, 3887.941680874789, 3889.0666240102455, 5830.854228644318, 5931.881362372728, 5931.932252194603, 5932.080527518242, 5935.9406405935815, 3968.4245784361106, 3974.2250261198787, 3976.224636195914, 3978.76127432355, 3978.960210397859, 4019.2162528307285, 4020.979895100506, 4021.9597804021587, 4024.678025757932, 4059.7970101494807, 4718.7168769873915, 4757.619390448755, 4759.405074365704, 4764.666473346832, 4765.118453086121, 5645.096784514541, 5649.915251271234, 5656.236408084856, 5656.490915817596, 5663.858403539862, 1454.7672372420573, 1490.0389248934594, 1490.4410845932775, 1491.9104853708811, 1493.0444515510083, 1010.4846528270488, 1011.049613363436, 1012.8987101289812, 1015.5937624949931, 1038.7247379444452, 4938.0, 4949.307097006422, 4955.752212389366, 4955.950440495621, 4958.305837182726, 5854.443827836349, 5862.0, 5868.914250863604, 5869.765209391662, 5874.500667443315, 4939.678920870132, 4941.332920055746, 4947.6536642434685, 4953.281774142729, 4960.578350840219, 3091.679196517216, 3122.2350524121734, 3157.3527426877436, 3157.7789554731407, 3162.857671404792, 5522.723863806874, 5532.6680399176175, 5535.557155427556, 5538.390777014525, 5542.8337149885565, 6004.579679422399, 6007.969960150172, 6009.06859436788, 6018.525461261931, 6019.819405417845, 5527.474889885454, 5543.251661025791, 5543.6396634218645, 5543.667379957215, 5549.0, 5671.461211184931, 5840.561957853263, 5843.328017278068, 5845.883082338414, 5846.0, 5696.174054762119, 5705.971470142623, 5711.543076553949, 5715.457031581993, 5719.027765279996, 5530.474604912527, 5533.031719449161, 5533.280673512418, 5537.889242215053, 5540.750666219949, 4039.1719697461363, 4130.153318569746, 4148.709590328648, 4148.751074935513, 4155.8753237402925, 5807.128930660435, 5829.475347218601, 5830.096335068071, 5839.211706419749, 5839.678817665069, 5604.243427137284, 5605.103183490622, 5615.3823079462045, 5618.52242559387, 5625.8593535161945, 5607.327120745536, 5613.214150018919, 5613.859653508532, 5617.831465056055, 5618.943810562006, 5333.173358129496, 5550.944490555043, 5561.277033985556, 5561.6384934980715, 5565.916511252415, 5424.972875135599, 5602.439756024365, 5700.800471983461, 5701.144828275792, 5704.0588302929555, 5405.945940540544, 5532.336119665505, 5542.7782888684005, 5544.972275138599, 5547.223388725501], "unit": "score", "name": "prototype.html", "value": 4225.118058481295}, {"lowerIsBetter": false, "replicates": [704.0495331302741, 714.7641278378136, 716.9354758071776, 718.1382341190573, 731.1190016030677, 10304.22718296128, 10771.5691372345, 10772.353658780468, 10781.892181078187, 10787.838182427251, 10389.792204155912, 10438.06057454829, 10452.581896724121, 10460.843087353676, 10476.68569942901, 778.1440415542914, 789.9131095579481, 789.9328557072656, 790.5888937752394, 790.7113903425237, 624.4972796898495, 632.8734253149365, 772.058089131259, 786.0292538714683, 787.0437418536477, 827.5034979012604, 828.9212524810133, 834.9081601023883, 836.5399030533213, 837.2381133168817, 639.9008153736179, 643.9871202575969, 828.0105274197336, 828.9336853051772, 829.0, 483.2726746246911, 484.3388774323059, 485.19215506182167, 597.560792817279, 610.6183635227983, 9883.901160988442, 10128.594856205744, 10175.389476631426, 10256.897431025669, 10266.897331026743, 9390.060993900624, 10090.747731306703, 10388.844167337496, 10479.633212837514, 10668.0, 8267.793305167359, 8344.582770861492, 8499.362547808878, 8542.786430339229, 8548.358873084544, 3154.5268209768487, 3205.5351973963643, 3208.631007434152, 3217.115293294339, 3227.386796508656, 37898.81050594757, 40018.199636007404, 40154.39768403476, 40369.39445908314, 40403.59596404028, 8710.825783484295, 8806.911930880737, 8838.381313308135, 8940.061293564213, 9033.322500812465, 15338.156401397808, 15348.923255383876, 15373.154476503676, 15379.769303460456, 15402.845971540366, 6049.5462840287155, 6339.746410143543, 6340.397662222082, 6365.035272487467, 6371.9681401593625, 3467.1158854492446, 3530.858765649345, 3537.699295559906, 3551.0944709099012, 3636.8727094551564, 2558.5266725655815, 2563.2950938492063, 2583.1733845169365, 2591.5076135534187, 2592.3519120219944, 438.31841486488815, 442.1422440465487, 448.7285192458581, 451.90058187198764, 453.77311344327836, 430.7803020459588, 444.9065696203833, 462.7246788161039, 497.29632569913167, 562.9746661400247, 6484.513661475408, 6489.7404103835315, 6540.084388185658, 6790.7283708652085, 6793.272488143163, 410.97328673636116, 443.8535283356549, 515.5849541119435, 536.8496820890157, 539.9838004859861, 2998.5692711231345, 3084.4293805646025, 3100.8449577521483, 3107.704768047032, 3168.6551951555684, 50089.74955125201, 50978.23532647013, 51001.0, 51018.74490627523, 51077.0, 45359.09281814411, 45704.77147614241, 45727.542724572326, 45948.310775338396, 46160.76919615381, 40784.79607601943, 41240.58759412428, 41390.586094139275, 41910.0, 41931.7903410481, 6343.429091381798, 6467.547271690936, 6488.383603557654, 6607.5044371673275, 6610.4711623071, 30651.0, 30682.232944176576, 30919.690803091682, 30941.69058309388, 31121.8443907779, 38559.80720096381, 41323.793381034106, 41511.0, 41954.37068444037, 43246.351304731084, 8961.372703910925, 8971.955140224258, 9087.681931132378, 9210.9539452305, 9280.164785169367, 9326.813463730823, 9778.65774697882, 9817.0, 9971.551280192263, 10057.0, 8682.609282582172, 9010.189082982562, 9116.635334586543, 9320.72037838866, 9437.811243775224, 8636.568171591269, 8689.17452841979, 8694.39139260271, 8721.91278087211, 8735.694250701195, 8451.830963380575, 8635.266002389615, 8678.609462574326, 8794.956025219833, 8814.779630509032, 7593.0, 7822.843543129219, 7830.4518683691595, 7857.724979625686, 8064.596770161351, 7662.195469475625, 7741.0, 7758.0, 7834.608269586384, 7989.409594827591], "unit": "score", "name": "yui.html", "value": 5253.057866567759}], "name": "dromaeo_css", "value": 6247.394164894479}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [112.0, 113.0, 107.0, 112.0, 114.0, 113.0, 102.0, 112.0, 115.0, 103.0], "unit": "score", "name": "ai-astar", "value": 110.3}, {"lowerIsBetter": true, "replicates": [152.0, 130.0, 155.0, 164.0, 136.0, 156.0, 151.0, 140.0, 170.0, 133.0], "unit": "score", "name": "audio-beat-detection", "value": 148.7}, {"lowerIsBetter": true, "replicates": [161.0, 159.0, 161.0, 162.0, 161.0, 163.0, 162.0, 163.0, 162.0, 161.0], "unit": "score", "name": "audio-dft", "value": 161.5}, {"lowerIsBetter": true, "replicates": [72.0, 71.0, 86.0, 100.0, 72.0, 74.0, 76.0, 105.0, 90.0, 72.0], "unit": "score", "name": "audio-fft", "value": 81.8}, {"lowerIsBetter": true, "replicates": [95.0, 95.0, 130.0, 95.0, 94.0, 96.0, 143.0, 95.0, 95.0, 133.0], "unit": "score", "name": "audio-oscillator", "value": 107.1}, {"lowerIsBetter": true, "replicates": [110.0, 109.0, 110.0, 110.0, 109.0, 109.0, 111.0, 110.0, 109.0, 109.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 109.6}, {"lowerIsBetter": true, "replicates": [147.0, 146.0, 146.0, 147.0, 146.0, 147.0, 146.0, 148.0, 146.0, 147.0], "unit": "score", "name": "imaging-darkroom", "value": 146.6}, {"lowerIsBetter": true, "replicates": [96.0, 95.0, 96.0, 96.0, 96.0, 96.0, 96.0, 96.0, 96.0, 96.0], "unit": "score", "name": "imaging-desaturate", "value": 95.9}, {"lowerIsBetter": true, "replicates": [71.0, 71.0, 71.0, 71.0, 72.0, 71.0, 71.0, 82.0, 79.0, 68.0], "unit": "score", "name": "json-parse-financial", "value": 72.7}, {"lowerIsBetter": true, "replicates": [67.0, 67.0, 67.0, 68.0, 69.0, 69.0, 69.0, 68.0, 69.0, 73.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 68.6}, {"lowerIsBetter": true, "replicates": [87.0, 85.0, 85.0, 91.0, 82.0, 82.0, 83.0, 84.0, 85.0, 85.0], "unit": "score", "name": "stanford-crypto-aes", "value": 84.9}, {"lowerIsBetter": true, "replicates": [121.0, 120.0, 117.0, 135.0, 128.0, 130.0, 129.0, 119.0, 121.0, 126.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 124.6}, {"lowerIsBetter": true, "replicates": [142.0, 146.0, 149.0, 156.0, 146.0, 136.0, 146.0, 149.0, 150.0, 142.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 146.2}, {"lowerIsBetter": true, "replicates": [70.0, 71.0, 73.0, 70.0, 70.0, 70.0, 69.0, 70.0, 69.0, 70.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 70.2}], "name": "kraken", "value": 1528.7}, {"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [167.9261125104954], "unit": "score", "name": "Richards", "value": 210.22340999999997}, {"lowerIsBetter": false, "replicates": [185.8045336306206], "unit": "score", "name": "DeltaBlue", "value": 355.8470759999999}, {"lowerIsBetter": false, "replicates": [277.85495971103086], "unit": "score", "name": "Encrypt", "value": 957.9854189999998}, {"lowerIsBetter": false, "replicates": [5128.205128205128], "unit": "score", "name": "Decrypt", "value": 51.90529499999997}, {"lowerIsBetter": false, "replicates": [2070.3933747412007], "unit": "score", "name": "RayTrace", "value": 357.41468700000013}, {"lowerIsBetter": false, "replicates": [793.0214115781126], "unit": "score", "name": "Earley", "value": 840.4098429999997}, {"lowerIsBetter": false, "replicates": [12432.098765432098], "unit": "score", "name": "Boyer", "value": 53.608245283018846}, {"lowerIsBetter": false, "replicates": [26894.736842105263], "unit": "score", "name": "RegExp", "value": 33.87224070450098}, {"lowerIsBetter": false, "replicates": [610.5006105006105], "unit": "score", "name": "Splay", "value": 133.48225799999997}, {"lowerIsBetter": false, "replicates": [4835.748792270531], "unit": "score", "name": "NavierStokes", "value": 306.881118881119}], "name": "v8_7", "value": 19663.847066082762}]} 05:45:51 INFO - RETURN: dromaeo_css: 6247.40 05:45:51 INFO - RETURN: kraken: 1528.70 05:45:51 INFO - RETURN: v8_7: 19663.85 05:45:51 INFO - TinderboxPrint: TalosResult: {"graphserver": {"v8_7": {"url": "http://graphs.mozilla.org/graph.html#tests=[[230,132,35]]", "result": "19663.85"}, "kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,132,35]]", "result": "1528.70"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,132,35]]", "result": "6247.40"}}} 05:45:51 INFO - Return code: 0 05:45:51 INFO - Validating PERFHERDER_DATA against /builds/slave/test/build/tests/talos/treeherder-schemas/performance-artifact.json 05:45:51 ERROR - # TBPL SUCCESS # 05:45:51 INFO - Running post-action listener: _resource_record_post_action 05:45:51 INFO - Running post-run listener: _resource_record_post_run 05:45:52 INFO - Total resource usage - Wall time: 1234s; CPU: 13.0%; Read bytes: 4096; Write bytes: 546471936; Read time: 12; Write time: 388476 05:45:52 INFO - install - Wall time: 16s; CPU: 13.0%; Read bytes: 0; Write bytes: 227414016; Read time: 0; Write time: 170512 05:45:52 INFO - run-tests - Wall time: 1219s; CPU: 13.0%; Read bytes: 4096; Write bytes: 319057920; Read time: 12; Write time: 217964 05:45:52 INFO - Running post-run listener: _upload_blobber_files 05:45:52 INFO - Blob upload gear active. 05:45:52 INFO - There are no files to upload in the directory. Skipping the blob upload mechanism ... 05:45:52 INFO - Copying logs to upload dir... 05:45:52 INFO - mkdir: /builds/slave/test/build/upload/logs program finished with exit code 0 elapsedTime=1277.900821 ========= master_lag: 0.03 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 17 secs) (at 2015-12-17 05:45:52.157093) ========= ========= Started set props: build_url (results: 0, elapsed: 0 secs) (at 2015-12-17 05:45:52.161771) ========= 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=49ca1b5d70b54a29b055e1ff000001bd-1450358129.534349-1903973253 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False build_url:https://queue.taskcluster.net/v1/task/GPMUu3YiSySyjdMvXjUPqQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.009971 build_url: 'https://queue.taskcluster.net/v1/task/GPMUu3YiSySyjdMvXjUPqQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2' ========= master_lag: 0.04 ========= ========= Finished set props: build_url (results: 0, elapsed: 0 secs) (at 2015-12-17 05:45:52.213270) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-12-17 05:45:52.216618) ========= 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=49ca1b5d70b54a29b055e1ff000001bd-1450358129.534349-1903973253 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004563 ========= master_lag: 0.04 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-12-17 05:45:52.265987) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2015-12-17 05:45:52.266290) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2015-12-17 05:45:52.269622) ========= ========= Total master_lag: 0.28 =========