builder: mozilla-central_ubuntu64_hw_test-dromaeojs-e10s slave: talos-linux64-ix-032 starttime: 1449322533.88 results: success (0) buildid: 20151205040640 builduid: f34627474c0e45709c5b6cc80c158429 revision: cba488c0af7031be976c19e0bc589be6f078c4db ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2015-12-05 05:35:33.879003) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2015-12-05 05:35:33.879394) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2015-12-05 05:35:33.879695) ========= 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=2dd9ebcff44b3efbe7b51203000001d7-1449318906.825876-1633103823 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test program finished with exit code 0 elapsedTime=0.006441 basedir: '/builds/slave/test' ========= master_lag: 0.02 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2015-12-05 05:35:33.905226) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-12-05 05:35:33.905544) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-12-05 05:35:33.920232) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-12-05 05:35:33.920501) ========= 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=2dd9ebcff44b3efbe7b51203000001d7-1449318906.825876-1633103823 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004565 ========= master_lag: 0.05 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-12-05 05:35:33.971351) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-12-05 05:35:33.971616) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-12-05 05:35:33.971937) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-12-05 05:35:33.972210) ========= 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=2dd9ebcff44b3efbe7b51203000001d7-1449318906.825876-1633103823 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2015-12-05 05:35: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% 46.4M=0s 2015-12-05 05:35:34 (46.4 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.211515 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-12-05 05:35:34.196291) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-12-05 05:35:34.196596) ========= 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=2dd9ebcff44b3efbe7b51203000001d7-1449318906.825876-1633103823 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.015207 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-12-05 05:35:34.246018) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-12-05 05:35:34.246382) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev cba488c0af7031be976c19e0bc589be6f078c4db --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo mozilla-central --rev cba488c0af7031be976c19e0bc589be6f078c4db --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=2dd9ebcff44b3efbe7b51203000001d7-1449318906.825876-1633103823 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2015-12-05 05:35:34,446 truncating revision to first 12 chars 2015-12-05 05:35:34,446 Setting DEBUG logging. 2015-12-05 05:35:34,446 attempt 1/10 2015-12-05 05:35:34,447 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/cba488c0af70?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2015-12-05 05:35:34,707 unpacking tar archive at: mozilla-central-cba488c0af70/testing/mozharness/ program finished with exit code 0 elapsedTime=0.881892 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-12-05 05:35:35.140590) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-12-05 05:35:35.140865) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-12-05 05:35:35.149660) ========= ========= Started tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-12-05 05:35:35.149918) ========= TinderboxPrint: script_revlink: https://hg.mozilla.org/build/mozharness/rev/production ========= Finished tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-12-05 05:35:35.150318) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 15 secs) (at 2015-12-05 05:35:35.150617) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Firefox-Non-PGO --system-bits 64 --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox-Non-PGO in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Firefox-Non-PGO', '--system-bits', '64', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Firefox-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=2dd9ebcff44b3efbe7b51203000001d7-1449318906.825876-1633103823 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 05:35:35 INFO - MultiFileLogger online at 20151205 05:35:35 in /builds/slave/test 05:35:35 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Firefox-Non-PGO --system-bits 64 --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox-Non-PGO 05:35:35 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 05:35:35 INFO - {'append_to_log': False, 05:35:35 INFO - 'base_work_dir': '/builds/slave/test', 05:35:35 INFO - 'blob_upload_branch': 'Firefox-Non-PGO', 05:35:35 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 05:35:35 INFO - 'branch': 'Firefox-Non-PGO', 05:35:35 INFO - 'buildbot_json_path': 'buildprops.json', 05:35:35 INFO - 'config_files': ('talos/linux_config.py',), 05:35:35 INFO - 'default_actions': ('clobber', 05:35:35 INFO - 'read-buildbot-config', 05:35:35 INFO - 'download-and-extract', 05:35:35 INFO - 'populate-webroot', 05:35:35 INFO - 'create-virtualenv', 05:35:35 INFO - 'install', 05:35:35 INFO - 'run-tests'), 05:35:35 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 05:35:35 INFO - 'download_minidump_stackwalk': True, 05:35:35 INFO - 'download_symbols': 'ondemand', 05:35:35 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 05:35:35 INFO - 'tooltool.py': '/tools/tooltool.py', 05:35:35 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 05:35:35 INFO - '/tools/misc-python/virtualenv.py')}, 05:35:35 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 05:35:35 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 05:35:35 INFO - 'installer_path': 'installer.exe', 05:35:35 INFO - 'log_level': 'info', 05:35:35 INFO - 'log_name': 'talos', 05:35:35 INFO - 'log_to_console': True, 05:35:35 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 05:35:35 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 05:35:35 INFO - 'opt_config_files': (), 05:35:35 INFO - 'pip_index': False, 05:35:35 INFO - 'sps_profile': False, 05:35:35 INFO - 'sps_profile_interval': 0, 05:35:35 INFO - 'suite': 'dromaeojs-e10s', 05:35:35 INFO - 'system_bits': '64', 05:35:35 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 05:35:35 INFO - 'title': 'talos-linux64-ix-032', 05:35:35 INFO - 'tooltool_cache': '/builds/tooltool_cache', 05:35:35 INFO - 'use_talos_json': True, 05:35:35 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 05:35:35 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 05:35:35 INFO - 'work_dir': 'build'} 05:35:35 INFO - ##### 05:35:35 INFO - ##### Running clobber step. 05:35:35 INFO - ##### 05:35:35 INFO - Running pre-action listener: _resource_record_pre_action 05:35:35 INFO - Running main action method: clobber 05:35:35 INFO - rmtree: /builds/slave/test/build 05:35:35 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 05:35:35 INFO - Running post-action listener: _resource_record_post_action 05:35:35 INFO - ##### 05:35:35 INFO - ##### Running read-buildbot-config step. 05:35:35 INFO - ##### 05:35:35 INFO - Running pre-action listener: _resource_record_pre_action 05:35:35 INFO - Running main action method: read_buildbot_config 05:35:35 INFO - Using buildbot properties: 05:35:35 INFO - { 05:35:35 INFO - "properties": { 05:35:35 INFO - "buildnumber": 112, 05:35:35 INFO - "product": "firefox", 05:35:35 INFO - "script_repo_revision": "production", 05:35:35 INFO - "builddir": "mozilla-central_ubuntu64_hw_test-dromaeojs-e10s", 05:35:35 INFO - "repository": "", 05:35:35 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-central talos dromaeojs-e10s", 05:35:35 INFO - "buildid": "20151205040640", 05:35:35 INFO - "slavename": "talos-linux64-ix-032", 05:35:35 INFO - "pgo_build": "False", 05:35:35 INFO - "basedir": "/builds/slave/test", 05:35:35 INFO - "project": "", 05:35:35 INFO - "platform": "ubuntu64_hw", 05:35:35 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 05:35:35 INFO - "slavebuilddir": "test", 05:35:35 INFO - "scheduler": "tests-mozilla-central-linux64-talos", 05:35:35 INFO - "branch": "mozilla-central", 05:35:35 INFO - "repo_path": "mozilla-central", 05:35:35 INFO - "stage_platform": "linux64", 05:35:35 INFO - "builduid": "f34627474c0e45709c5b6cc80c158429", 05:35:35 INFO - "revision": "cba488c0af7031be976c19e0bc589be6f078c4db" 05:35:35 INFO - }, 05:35:35 INFO - "sourcestamp": { 05:35:35 INFO - "repository": "", 05:35:35 INFO - "hasPatch": false, 05:35:35 INFO - "project": "", 05:35:35 INFO - "branch": "mozilla-central-linux64-talos", 05:35:35 INFO - "changes": [ 05:35:35 INFO - { 05:35:35 INFO - "category": null, 05:35:35 INFO - "files": [ 05:35:35 INFO - { 05:35:35 INFO - "url": null, 05:35:35 INFO - "name": "https://queue.taskcluster.net/v1/task/4LAPVSYNS5m426DQYv3_pg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2" 05:35:35 INFO - } 05:35:35 INFO - ], 05:35:35 INFO - "repository": "", 05:35:35 INFO - "rev": "cba488c0af7031be976c19e0bc589be6f078c4db", 05:35:35 INFO - "who": "ffxbld", 05:35:35 INFO - "when": 1449322470, 05:35:35 INFO - "number": 6770135, 05:35:35 INFO - "comments": "No bug, Automated HPKP preload list update from host bld-linux64-spot-049 - a=hpkp-update", 05:35:35 INFO - "project": "", 05:35:35 INFO - "at": "Sat 05 Dec 2015 05:34:30", 05:35:35 INFO - "branch": "mozilla-central-linux64-talos", 05:35:35 INFO - "revlink": "", 05:35:35 INFO - "properties": [ 05:35:35 INFO - [ 05:35:35 INFO - "buildid", 05:35:35 INFO - "20151205040640", 05:35:35 INFO - "Change" 05:35:35 INFO - ], 05:35:35 INFO - [ 05:35:35 INFO - "builduid", 05:35:35 INFO - "f34627474c0e45709c5b6cc80c158429", 05:35:35 INFO - "Change" 05:35:35 INFO - ], 05:35:35 INFO - [ 05:35:35 INFO - "pgo_build", 05:35:35 INFO - "False", 05:35:35 INFO - "Change" 05:35:35 INFO - ] 05:35:35 INFO - ], 05:35:35 INFO - "revision": "cba488c0af7031be976c19e0bc589be6f078c4db" 05:35:35 INFO - } 05:35:35 INFO - ], 05:35:35 INFO - "revision": "cba488c0af7031be976c19e0bc589be6f078c4db" 05:35:35 INFO - } 05:35:35 INFO - } 05:35:35 INFO - Found installer url https://queue.taskcluster.net/v1/task/4LAPVSYNS5m426DQYv3_pg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2. 05:35:35 INFO - Running post-action listener: _resource_record_post_action 05:35:35 INFO - ##### 05:35:35 INFO - ##### Running download-and-extract step. 05:35:35 INFO - ##### 05:35:35 INFO - Running pre-action listener: _resource_record_pre_action 05:35:35 INFO - Running main action method: download_and_extract 05:35:35 INFO - mkdir: /builds/slave/test/build/tests 05:35: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:35:35 INFO - https://queue.taskcluster.net/v1/task/4LAPVSYNS5m426DQYv3_pg/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 05:35:35 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/4LAPVSYNS5m426DQYv3_pg/artifacts/public/build/test_packages.json 05:35:35 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/4LAPVSYNS5m426DQYv3_pg/artifacts/public/build/test_packages.json 05:35:35 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/4LAPVSYNS5m426DQYv3_pg/artifacts/public/build/test_packages.json to /builds/slave/test/build/test_packages.json 05:35:35 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/4LAPVSYNS5m426DQYv3_pg/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test/build/test_packages.json'}, attempt #1 05:35:38 INFO - Downloaded 1302 bytes. 05:35:38 INFO - Reading from file /builds/slave/test/build/test_packages.json 05:35:38 INFO - Using the following test package requirements: 05:35:38 INFO - {u'common': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'], 05:35:38 INFO - u'cppunittest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 05:35:38 INFO - u'firefox-45.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 05:35:38 INFO - u'jittest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 05:35:38 INFO - u'jsshell-linux-x86_64.zip'], 05:35:38 INFO - u'mochitest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 05:35:38 INFO - u'firefox-45.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 05:35:38 INFO - u'mozbase': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'], 05:35:38 INFO - u'reftest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 05:35:38 INFO - u'firefox-45.0a1.en-US.linux-x86_64.reftest.tests.zip'], 05:35:38 INFO - u'talos': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 05:35:38 INFO - u'firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip'], 05:35:38 INFO - u'web-platform': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 05:35:38 INFO - u'firefox-45.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 05:35:38 INFO - u'webapprt': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'], 05:35:38 INFO - u'xpcshell': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 05:35:38 INFO - u'firefox-45.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 05:35:38 INFO - Downloading packages: [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 05:35:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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:35:38 INFO - https://queue.taskcluster.net/v1/task/4LAPVSYNS5m426DQYv3_pg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 05:35:38 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/4LAPVSYNS5m426DQYv3_pg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 05:35:38 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/4LAPVSYNS5m426DQYv3_pg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 05:35:38 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/4LAPVSYNS5m426DQYv3_pg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 05:35:38 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/4LAPVSYNS5m426DQYv3_pg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 05:35:39 INFO - Downloaded 21848918 bytes. 05:35:39 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'] in /builds/slave/test/build/tests 05:35:39 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 05:35:39 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'] with output_timeout 1760 05:35:40 INFO - Return code: 0 05:35:40 INFO - Downloading packages: [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 05:35:40 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:35:40 INFO - https://queue.taskcluster.net/v1/task/4LAPVSYNS5m426DQYv3_pg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 05:35:40 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/4LAPVSYNS5m426DQYv3_pg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 05:35:40 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/4LAPVSYNS5m426DQYv3_pg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 05:35:40 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/4LAPVSYNS5m426DQYv3_pg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 05:35:40 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/4LAPVSYNS5m426DQYv3_pg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 05:35:43 INFO - Downloaded 21848918 bytes. 05:35:43 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'] in /builds/slave/test/build/tests 05:35:43 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 05:35:43 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'] with output_timeout 1760 05:35:45 INFO - Return code: 0 05:35: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:35:45 INFO - https://queue.taskcluster.net/v1/task/4LAPVSYNS5m426DQYv3_pg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 05:35:45 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/4LAPVSYNS5m426DQYv3_pg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip 05:35:45 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/4LAPVSYNS5m426DQYv3_pg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip 05:35:45 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/4LAPVSYNS5m426DQYv3_pg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip 05:35:45 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/4LAPVSYNS5m426DQYv3_pg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 05:35:46 INFO - Downloaded 11132001 bytes. 05:35:46 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip'] in /builds/slave/test/build/tests 05:35:46 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip 05:35:46 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip'] with output_timeout 1760 05:35:46 INFO - Return code: 0 05:35:46 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:35:46 INFO - https://queue.taskcluster.net/v1/task/4LAPVSYNS5m426DQYv3_pg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 05:35:46 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/4LAPVSYNS5m426DQYv3_pg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 05:35:46 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/4LAPVSYNS5m426DQYv3_pg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 05:35:46 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/4LAPVSYNS5m426DQYv3_pg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 05:35:46 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/4LAPVSYNS5m426DQYv3_pg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 05:35:47 INFO - Downloaded 57699886 bytes. 05:35:47 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/4LAPVSYNS5m426DQYv3_pg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 05:35:47 INFO - mkdir: /builds/slave/test/properties 05:35:47 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 05:35:47 INFO - Writing to file /builds/slave/test/properties/build_url 05:35:47 INFO - Contents: 05:35:47 INFO - build_url:https://queue.taskcluster.net/v1/task/4LAPVSYNS5m426DQYv3_pg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 05:35:47 INFO - Running post-action listener: _resource_record_post_action 05:35:47 INFO - Running post-action listener: set_extra_try_arguments 05:35:47 INFO - ##### 05:35:47 INFO - ##### Running populate-webroot step. 05:35:47 INFO - ##### 05:35:47 INFO - Running pre-action listener: _resource_record_pre_action 05:35:47 INFO - Running main action method: populate_webroot 05:35:47 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 05:35:47 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 05:35:47 INFO - 'remote-trobocheck2': {'talos_options': ['--fennecIDs', 05:35:47 INFO - '../fennec_ids.txt'], 05:35:47 INFO - 'tests': ['tcheck2']}, 05:35:47 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 05:35:47 INFO - '--tppagecycles', 05:35:47 INFO - '7'], 05:35:47 INFO - 'tests': ['tsvgm']}}, 05:35:47 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 05:35:47 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 05:35:47 INFO - 'tests': ['tresize', 'tcanvasmark']}, 05:35:47 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 05:35:47 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 05:35:47 INFO - 'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 05:35:47 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:35:47 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 05:35:47 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:35:47 INFO - 'talos_options': ['--e10s'], 05:35:47 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 05:35:47 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:35:47 INFO - 'tests': ['damp', 'tps']}, 05:35:47 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:35:47 INFO - 'talos_options': ['--e10s'], 05:35:47 INFO - 'tests': ['damp', 'tps']}, 05:35:47 INFO - 'g3': {'tests': ['dromaeo_dom']}, 05:35:47 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 05:35:47 INFO - 'other': {'tests': ['a11yr', 05:35:47 INFO - 'ts_paint', 05:35:47 INFO - 'tpaint', 05:35:47 INFO - 'sessionrestore', 05:35:47 INFO - 'sessionrestore_no_auto_restore']}, 05:35:47 INFO - 'other-e10s': {'talos_options': ['--e10s'], 05:35:47 INFO - 'tests': ['a11yr', 05:35:47 INFO - 'ts_paint', 05:35:47 INFO - 'tpaint', 05:35:47 INFO - 'sessionrestore', 05:35:47 INFO - 'sessionrestore_no_auto_restore']}, 05:35:47 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 05:35:47 INFO - 'tests': ['a11yr', 05:35:47 INFO - 'ts_paint', 05:35:47 INFO - 'tpaint', 05:35:47 INFO - 'sessionrestore', 05:35:47 INFO - 'sessionrestore_no_auto_restore']}, 05:35:47 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 05:35:47 INFO - 'tests': ['a11yr', 05:35:47 INFO - 'ts_paint', 05:35:47 INFO - 'tpaint', 05:35:47 INFO - 'sessionrestore', 05:35:47 INFO - 'sessionrestore_no_auto_restore']}, 05:35:47 INFO - 'other_l64': {'tests': ['a11yr', 05:35:47 INFO - 'ts_paint', 05:35:47 INFO - 'tpaint', 05:35:47 INFO - 'sessionrestore', 05:35:47 INFO - 'sessionrestore_no_auto_restore']}, 05:35:47 INFO - 'other_nol64': {'tests': ['a11yr', 05:35:47 INFO - 'ts_paint', 05:35:47 INFO - 'tpaint', 05:35:47 INFO - 'sessionrestore', 05:35:47 INFO - 'sessionrestore_no_auto_restore']}, 05:35:47 INFO - 'svgr': {'tests': ['tsvgx', 05:35:47 INFO - 'tsvgr_opacity', 05:35:47 INFO - 'tart', 05:35:47 INFO - 'tscrollx', 05:35:47 INFO - 'cart']}, 05:35:47 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 05:35:47 INFO - 'tests': ['tsvgx', 05:35:47 INFO - 'tsvgr_opacity', 05:35:47 INFO - 'tart', 05:35:47 INFO - 'tscrollx', 05:35:47 INFO - 'cart']}, 05:35:47 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:35:47 INFO - 'tests': ['tp5o']}, 05:35:47 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:35:47 INFO - 'talos_options': ['--e10s'], 05:35:47 INFO - 'tests': ['tp5o']}, 05:35:47 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:35:47 INFO - 'talos_options': ['--xperf_path', 05:35:47 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 05:35:47 INFO - 'tests': ['tp5n']}, 05:35:47 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:35:47 INFO - 'talos_options': ['--e10s', 05:35:47 INFO - '--xperf_path', 05:35:47 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 05:35:47 INFO - 'tests': ['tp5n']}}, 05:35:47 INFO - 'talos.zip': {'path': '', 05:35:47 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 05:35:47 INFO - Running post-action listener: _resource_record_post_action 05:35:47 INFO - ##### 05:35:47 INFO - ##### Running create-virtualenv step. 05:35:47 INFO - ##### 05:35:47 INFO - Running pre-action listener: _resource_record_pre_action 05:35:47 INFO - Running main action method: create_virtualenv 05:35:47 INFO - Creating virtualenv /builds/slave/test/build/venv 05:35:47 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:35:47 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 05:35:47 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 05:35:47 INFO - Using real prefix '/usr' 05:35:47 INFO - New python executable in /builds/slave/test/build/venv/bin/python 05:35:48 INFO - Installing distribute.............................................................................................................................................................................................done. 05:35:50 INFO - Installing pip.................done. 05:35:50 INFO - Return code: 0 05:35:50 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 05:35: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:35:50 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:35:50 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:35: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:35:50 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:35:50 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:35:50 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 0x7f8960058f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x154d8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x161b240>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16aa0b0>, '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 0x16aafb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x16ab440>, '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': '2dd9ebcff44b3efbe7b51203000001d7-1449318906.825876-1633103823', '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:35:50 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:35:50 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:35:50 INFO - Using env: {'DISPLAY': ':0', 05:35:50 INFO - 'HOME': '/home/cltbld', 05:35:50 INFO - 'LANG': 'en_US.UTF-8', 05:35:50 INFO - 'LANGUAGE': 'en_US:en', 05:35:50 INFO - 'LOGNAME': 'cltbld', 05:35:50 INFO - 'MAIL': '/var/mail/cltbld', 05:35:50 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:35:50 INFO - 'MOZ_NO_REMOTE': '1', 05:35:50 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:35:50 INFO - 'NO_EM_RESTART': '1', 05:35:50 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:35:50 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:35:50 INFO - 'PWD': '/builds/slave/test', 05:35:50 INFO - 'SHELL': '/bin/bash', 05:35:50 INFO - 'SHLVL': '1', 05:35:50 INFO - 'TERM': 'linux', 05:35:50 INFO - 'TMOUT': '86400', 05:35:50 INFO - 'USER': 'cltbld', 05:35:50 INFO - 'XDG_SESSION_COOKIE': '2dd9ebcff44b3efbe7b51203000001d7-1449318906.825876-1633103823', 05:35:50 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:35:50 INFO - '_': '/tools/buildbot/bin/python'} 05:35:50 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:35:50 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:35:50 INFO - Cleaning up... 05:35:50 INFO - Return code: 0 05:35:50 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 05:35: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:35:50 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:35:50 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:35: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:35:50 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:35:50 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:35:50 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 0x7f8960058f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x154d8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x161b240>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16aa0b0>, '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 0x16aafb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x16ab440>, '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': '2dd9ebcff44b3efbe7b51203000001d7-1449318906.825876-1633103823', '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:35:50 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:35:50 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:35:50 INFO - Using env: {'DISPLAY': ':0', 05:35:50 INFO - 'HOME': '/home/cltbld', 05:35:50 INFO - 'LANG': 'en_US.UTF-8', 05:35:50 INFO - 'LANGUAGE': 'en_US:en', 05:35:50 INFO - 'LOGNAME': 'cltbld', 05:35:50 INFO - 'MAIL': '/var/mail/cltbld', 05:35:50 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:35:50 INFO - 'MOZ_NO_REMOTE': '1', 05:35:50 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:35:50 INFO - 'NO_EM_RESTART': '1', 05:35:50 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:35:50 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:35:50 INFO - 'PWD': '/builds/slave/test', 05:35:50 INFO - 'SHELL': '/bin/bash', 05:35:50 INFO - 'SHLVL': '1', 05:35:50 INFO - 'TERM': 'linux', 05:35:50 INFO - 'TMOUT': '86400', 05:35:50 INFO - 'USER': 'cltbld', 05:35:50 INFO - 'XDG_SESSION_COOKIE': '2dd9ebcff44b3efbe7b51203000001d7-1449318906.825876-1633103823', 05:35:50 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:35:50 INFO - '_': '/tools/buildbot/bin/python'} 05:35:50 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:35:50 INFO - Downloading/unpacking psutil>=0.7.1 05:35:50 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:35:50 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:35:50 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:35:50 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:35:50 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:35:50 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:35:52 INFO - Creating supposed download cache at /builds/slave/test/build/venv/cache 05:35:52 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpsutil-3.1.1.tar.gz 05:35:52 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 05:35:52 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 05:35:52 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 05:35:52 INFO - Installing collected packages: psutil 05:35:52 INFO - Running setup.py install for psutil 05:35:52 INFO - building 'psutil._psutil_linux' extension 05:35:52 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:35:52 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:35:52 INFO - building 'psutil._psutil_posix' extension 05:35:52 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:35:53 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:35:53 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 05:35:53 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 05:35:53 INFO - Successfully installed psutil 05:35:53 INFO - Cleaning up... 05:35:53 INFO - Return code: 0 05:35:53 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 05:35:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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:35:53 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:35:53 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:35:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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:35:53 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:35:53 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:35:53 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 0x7f8960058f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x154d8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x161b240>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16aa0b0>, '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 0x16aafb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x16ab440>, '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': '2dd9ebcff44b3efbe7b51203000001d7-1449318906.825876-1633103823', '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:35:53 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:35:53 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:35:53 INFO - Using env: {'DISPLAY': ':0', 05:35:53 INFO - 'HOME': '/home/cltbld', 05:35:53 INFO - 'LANG': 'en_US.UTF-8', 05:35:53 INFO - 'LANGUAGE': 'en_US:en', 05:35:53 INFO - 'LOGNAME': 'cltbld', 05:35:53 INFO - 'MAIL': '/var/mail/cltbld', 05:35:53 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:35:53 INFO - 'MOZ_NO_REMOTE': '1', 05:35:53 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:35:53 INFO - 'NO_EM_RESTART': '1', 05:35:53 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:35:53 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:35:53 INFO - 'PWD': '/builds/slave/test', 05:35:53 INFO - 'SHELL': '/bin/bash', 05:35:53 INFO - 'SHLVL': '1', 05:35:53 INFO - 'TERM': 'linux', 05:35:53 INFO - 'TMOUT': '86400', 05:35:53 INFO - 'USER': 'cltbld', 05:35:53 INFO - 'XDG_SESSION_COOKIE': '2dd9ebcff44b3efbe7b51203000001d7-1449318906.825876-1633103823', 05:35:53 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:35:53 INFO - '_': '/tools/buildbot/bin/python'} 05:35:53 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:35:53 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 05:35:53 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:35:53 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:35:53 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:35:53 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:35:53 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:35:53 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:35:55 INFO - Downloading mozsystemmonitor-0.0.tar.gz 05:35:55 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fmozsystemmonitor-0.0.tar.gz 05:35:55 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 05:35:55 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:35:55 INFO - Installing collected packages: mozsystemmonitor 05:35:55 INFO - Running setup.py install for mozsystemmonitor 05:35:55 INFO - Successfully installed mozsystemmonitor 05:35:55 INFO - Cleaning up... 05:35:55 INFO - Return code: 0 05:35:55 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 05:35:55 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:35:55 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:35:55 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:35:55 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:35:55 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:35:55 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:35:55 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 0x7f8960058f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x154d8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x161b240>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16aa0b0>, '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 0x16aafb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x16ab440>, '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': '2dd9ebcff44b3efbe7b51203000001d7-1449318906.825876-1633103823', '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:35:55 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:35:55 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:35:55 INFO - Using env: {'DISPLAY': ':0', 05:35:55 INFO - 'HOME': '/home/cltbld', 05:35:55 INFO - 'LANG': 'en_US.UTF-8', 05:35:55 INFO - 'LANGUAGE': 'en_US:en', 05:35:55 INFO - 'LOGNAME': 'cltbld', 05:35:55 INFO - 'MAIL': '/var/mail/cltbld', 05:35:55 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:35:55 INFO - 'MOZ_NO_REMOTE': '1', 05:35:55 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:35:55 INFO - 'NO_EM_RESTART': '1', 05:35:55 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:35:55 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:35:55 INFO - 'PWD': '/builds/slave/test', 05:35:55 INFO - 'SHELL': '/bin/bash', 05:35:55 INFO - 'SHLVL': '1', 05:35:55 INFO - 'TERM': 'linux', 05:35:55 INFO - 'TMOUT': '86400', 05:35:55 INFO - 'USER': 'cltbld', 05:35:55 INFO - 'XDG_SESSION_COOKIE': '2dd9ebcff44b3efbe7b51203000001d7-1449318906.825876-1633103823', 05:35:55 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:35:55 INFO - '_': '/tools/buildbot/bin/python'} 05:35:55 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:35:55 INFO - Downloading/unpacking blobuploader==1.2.4 05:35:55 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:35:55 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:35:55 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:35:55 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:35:55 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:35:55 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:35:57 INFO - Downloading blobuploader-1.2.4.tar.gz 05:35:57 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblobuploader-1.2.4.tar.gz 05:35:57 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 05:35:57 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 05:35: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:35: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:35: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:35: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:35: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:35: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:35:57 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Frequests-1.2.3.tar.gz 05:35:57 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 05:35:57 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 05:35: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:35: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:35: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:35: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:35: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:35: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:35:57 INFO - Downloading docopt-0.6.1.tar.gz 05:35:57 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fdocopt-0.6.1.tar.gz 05:35:57 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 05:35:57 INFO - Installing collected packages: blobuploader, requests, docopt 05:35:57 INFO - Running setup.py install for blobuploader 05:35:58 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 05:35:58 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 05:35:58 INFO - Running setup.py install for requests 05:35:58 INFO - Running setup.py install for docopt 05:35:58 INFO - Successfully installed blobuploader requests docopt 05:35:58 INFO - Cleaning up... 05:35:58 INFO - Return code: 0 05:35:58 INFO - Installing None into virtualenv /builds/slave/test/build/venv 05:35:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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:35:58 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:35:58 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:35:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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:35:58 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:35:58 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:35:58 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 0x7f8960058f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x154d8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x161b240>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16aa0b0>, '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 0x16aafb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x16ab440>, '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': '2dd9ebcff44b3efbe7b51203000001d7-1449318906.825876-1633103823', '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:35:58 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:35:58 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:35:58 INFO - Using env: {'DISPLAY': ':0', 05:35:58 INFO - 'HOME': '/home/cltbld', 05:35:58 INFO - 'LANG': 'en_US.UTF-8', 05:35:58 INFO - 'LANGUAGE': 'en_US:en', 05:35:58 INFO - 'LOGNAME': 'cltbld', 05:35:58 INFO - 'MAIL': '/var/mail/cltbld', 05:35:58 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:35:58 INFO - 'MOZ_NO_REMOTE': '1', 05:35:58 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:35:58 INFO - 'NO_EM_RESTART': '1', 05:35:58 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:35:58 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:35:58 INFO - 'PWD': '/builds/slave/test', 05:35:58 INFO - 'SHELL': '/bin/bash', 05:35:58 INFO - 'SHLVL': '1', 05:35:58 INFO - 'TERM': 'linux', 05:35:58 INFO - 'TMOUT': '86400', 05:35:58 INFO - 'USER': 'cltbld', 05:35:58 INFO - 'XDG_SESSION_COOKIE': '2dd9ebcff44b3efbe7b51203000001d7-1449318906.825876-1633103823', 05:35:58 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:35:58 INFO - '_': '/tools/buildbot/bin/python'} 05:35:58 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:35:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 05:35:58 INFO - Running setup.py (path:/tmp/pip-yuFalw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 05:35:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 05:35:58 INFO - Running setup.py (path:/tmp/pip-fqImI1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 05:35:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 05:35:58 INFO - Running setup.py (path:/tmp/pip-4boDfw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 05:35:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 05:35:58 INFO - Running setup.py (path:/tmp/pip-kta9iw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 05:35:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 05:35:59 INFO - Running setup.py (path:/tmp/pip-V1kXoj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 05:35:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 05:35:59 INFO - Running setup.py (path:/tmp/pip-KOO1jH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 05:35:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 05:35:59 INFO - Running setup.py (path:/tmp/pip-p6BZuc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 05:35:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 05:35:59 INFO - Running setup.py (path:/tmp/pip-I_PIC_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 05:35:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 05:35:59 INFO - Running setup.py (path:/tmp/pip-vobYq8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 05:35:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 05:35:59 INFO - Running setup.py (path:/tmp/pip-9rLSv0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 05:35:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 05:35:59 INFO - Running setup.py (path:/tmp/pip-bPG4id-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 05:35:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 05:35:59 INFO - Running setup.py (path:/tmp/pip-3u511w-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 05:35:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 05:35:59 INFO - Running setup.py (path:/tmp/pip-KYtrpY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 05:35:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 05:35:59 INFO - Running setup.py (path:/tmp/pip-vkGsqE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 05:35:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 05:35:59 INFO - Running setup.py (path:/tmp/pip-rKhvZJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 05:35:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 05:35:59 INFO - Running setup.py (path:/tmp/pip-8pxXED-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 05:35:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 05:35:59 INFO - Running setup.py (path:/tmp/pip-nPYGtR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 05:35:59 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 05:35:59 INFO - Running setup.py install for manifestparser 05:36:00 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 05:36:00 INFO - Running setup.py install for mozcrash 05:36:00 INFO - Running setup.py install for mozdebug 05:36:00 INFO - Running setup.py install for mozdevice 05:36:00 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 05:36:00 INFO - Installing dm script to /builds/slave/test/build/venv/bin 05:36:00 INFO - Running setup.py install for mozfile 05:36:00 INFO - Running setup.py install for mozhttpd 05:36:00 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 05:36:00 INFO - Running setup.py install for mozinfo 05:36:00 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 05:36:00 INFO - Running setup.py install for mozInstall 05:36:00 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 05:36:00 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 05:36:00 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 05:36:00 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 05:36:00 INFO - Running setup.py install for mozleak 05:36:00 INFO - Running setup.py install for mozlog 05:36:01 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 05:36:01 INFO - Running setup.py install for moznetwork 05:36:01 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 05:36:01 INFO - Running setup.py install for mozprocess 05:36:01 INFO - Running setup.py install for mozprofile 05:36:01 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 05:36:01 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 05:36:01 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 05:36:01 INFO - Running setup.py install for mozrunner 05:36:01 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 05:36:01 INFO - Running setup.py install for mozscreenshot 05:36:01 INFO - Running setup.py install for moztest 05:36:01 INFO - Running setup.py install for mozversion 05:36:01 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 05:36:01 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 05:36:01 INFO - Cleaning up... 05:36:01 INFO - Return code: 0 05:36:01 INFO - Installing None into virtualenv /builds/slave/test/build/venv 05:36: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:36:01 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:36:01 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:36: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:36:01 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:36:01 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:36: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', '-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 0x7f8960058f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x154d8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x161b240>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16aa0b0>, '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 0x16aafb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x16ab440>, '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': '2dd9ebcff44b3efbe7b51203000001d7-1449318906.825876-1633103823', '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:36:01 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:36:01 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:36:01 INFO - Using env: {'DISPLAY': ':0', 05:36:01 INFO - 'HOME': '/home/cltbld', 05:36:01 INFO - 'LANG': 'en_US.UTF-8', 05:36:01 INFO - 'LANGUAGE': 'en_US:en', 05:36:01 INFO - 'LOGNAME': 'cltbld', 05:36:01 INFO - 'MAIL': '/var/mail/cltbld', 05:36:01 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:36:01 INFO - 'MOZ_NO_REMOTE': '1', 05:36:01 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:36:01 INFO - 'NO_EM_RESTART': '1', 05:36:01 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:36:01 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:36:01 INFO - 'PWD': '/builds/slave/test', 05:36:01 INFO - 'SHELL': '/bin/bash', 05:36:01 INFO - 'SHLVL': '1', 05:36:01 INFO - 'TERM': 'linux', 05:36:01 INFO - 'TMOUT': '86400', 05:36:01 INFO - 'USER': 'cltbld', 05:36:01 INFO - 'XDG_SESSION_COOKIE': '2dd9ebcff44b3efbe7b51203000001d7-1449318906.825876-1633103823', 05:36:01 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:36:01 INFO - '_': '/tools/buildbot/bin/python'} 05:36:01 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:36:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 05:36:01 INFO - Running setup.py (path:/tmp/pip-8TXBKN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 05:36:02 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:36:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 05:36:02 INFO - Running setup.py (path:/tmp/pip-ET9dIz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 05:36:02 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:36:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 05:36:02 INFO - Running setup.py (path:/tmp/pip-0hNNPQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 05:36:02 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:36:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 05:36:02 INFO - Running setup.py (path:/tmp/pip-81ZqCF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 05:36:02 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:36:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 05:36:02 INFO - Running setup.py (path:/tmp/pip-e77FDH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 05:36:02 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:36:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 05:36:02 INFO - Running setup.py (path:/tmp/pip-Px746c-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 05:36:02 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:36:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 05:36:02 INFO - Running setup.py (path:/tmp/pip-9w8vjn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 05:36:02 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:36:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 05:36:02 INFO - Running setup.py (path:/tmp/pip-8bmXe0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 05:36:02 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:36:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 05:36:02 INFO - Running setup.py (path:/tmp/pip-Ylur3b-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 05:36:02 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:36:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 05:36:02 INFO - Running setup.py (path:/tmp/pip-WBwibW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 05:36:02 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:36:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 05:36:02 INFO - Running setup.py (path:/tmp/pip-_YocYn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 05:36:02 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:36:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 05:36:02 INFO - Running setup.py (path:/tmp/pip-R9exqd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 05:36:02 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:36:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 05:36:02 INFO - Running setup.py (path:/tmp/pip-TFMzhm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 05:36:02 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:36:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 05:36:02 INFO - Running setup.py (path:/tmp/pip-HxOjkN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 05:36:03 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:36:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 05:36:03 INFO - Running setup.py (path:/tmp/pip-CblkYw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 05:36:03 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:36:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 05:36:03 INFO - Running setup.py (path:/tmp/pip-KFVVlE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 05:36:03 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:36:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 05:36:03 INFO - Running setup.py (path:/tmp/pip-Z1sjCm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 05:36:03 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:36:03 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:36:03 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:36:03 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:36:03 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:36:03 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:36:03 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 05:36: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:36: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:36: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:36: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:36: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:36: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:36:04 INFO - Downloading blessings-1.5.1.tar.gz 05:36:04 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:36:04 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 05:36:04 INFO - Installing collected packages: blessings 05:36:04 INFO - Running setup.py install for blessings 05:36:05 INFO - Successfully installed blessings 05:36:05 INFO - Cleaning up... 05:36:05 INFO - Return code: 0 05:36:05 INFO - Done creating virtualenv /builds/slave/test/build/venv. 05:36:05 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 05:36:05 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 05:36:05 INFO - Reading from file tmpfile_stdout 05:36:05 INFO - Current package versions: 05:36:05 INFO - argparse == 1.2.1 05:36:05 INFO - blessings == 1.5.1 05:36:05 INFO - blobuploader == 1.2.4 05:36:05 INFO - docopt == 0.6.1 05:36:05 INFO - manifestparser == 1.1 05:36:05 INFO - mozInstall == 1.12 05:36:05 INFO - mozcrash == 0.16 05:36:05 INFO - mozdebug == 0.1 05:36:05 INFO - mozdevice == 0.47 05:36:05 INFO - mozfile == 1.2 05:36:05 INFO - mozhttpd == 0.7 05:36:05 INFO - mozinfo == 0.9 05:36:05 INFO - mozleak == 0.1 05:36:05 INFO - mozlog == 3.1 05:36:05 INFO - moznetwork == 0.27 05:36:05 INFO - mozprocess == 0.22 05:36:05 INFO - mozprofile == 0.27 05:36:05 INFO - mozrunner == 6.11 05:36:05 INFO - mozscreenshot == 0.1 05:36:05 INFO - mozsystemmonitor == 0.0 05:36:05 INFO - moztest == 0.7 05:36:05 INFO - mozversion == 1.4 05:36:05 INFO - psutil == 3.1.1 05:36:05 INFO - requests == 1.2.3 05:36:05 INFO - wsgiref == 0.1.2 05:36:05 INFO - Installing None into virtualenv /builds/slave/test/build/venv 05:36:05 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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:36:05 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:36:05 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:36:05 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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:36:05 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:36:05 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:36:05 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 0x7f8960058f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x154d8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x161b240>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16aa0b0>, '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 0x16aafb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x16ab440>, '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': '2dd9ebcff44b3efbe7b51203000001d7-1449318906.825876-1633103823', '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:36:05 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:36:05 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:36:05 INFO - Using env: {'DISPLAY': ':0', 05:36:05 INFO - 'HOME': '/home/cltbld', 05:36:05 INFO - 'LANG': 'en_US.UTF-8', 05:36:05 INFO - 'LANGUAGE': 'en_US:en', 05:36:05 INFO - 'LOGNAME': 'cltbld', 05:36:05 INFO - 'MAIL': '/var/mail/cltbld', 05:36:05 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:36:05 INFO - 'MOZ_NO_REMOTE': '1', 05:36:05 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:36:05 INFO - 'NO_EM_RESTART': '1', 05:36:05 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:36:05 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:36:05 INFO - 'PWD': '/builds/slave/test', 05:36:05 INFO - 'SHELL': '/bin/bash', 05:36:05 INFO - 'SHLVL': '1', 05:36:05 INFO - 'TERM': 'linux', 05:36:05 INFO - 'TMOUT': '86400', 05:36:05 INFO - 'USER': 'cltbld', 05:36:05 INFO - 'XDG_SESSION_COOKIE': '2dd9ebcff44b3efbe7b51203000001d7-1449318906.825876-1633103823', 05:36:05 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:36:05 INFO - '_': '/tools/buildbot/bin/python'} 05:36:05 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:36:05 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:36:05 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:36:05 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:36:05 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:36:05 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:36:05 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:36:05 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:36:05 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:36:05 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:36:05 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:36:05 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:36:05 INFO - Cleaning up... 05:36:05 INFO - Return code: 0 05:36:05 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 05:36:05 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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:36:05 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:36:05 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:36:05 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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:36:05 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:36:05 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:36:05 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 0x7f8960058f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x154d8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x161b240>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16aa0b0>, '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 0x16aafb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x16ab440>, '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': '2dd9ebcff44b3efbe7b51203000001d7-1449318906.825876-1633103823', '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:36:05 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:36:05 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:36:05 INFO - Using env: {'DISPLAY': ':0', 05:36:05 INFO - 'HOME': '/home/cltbld', 05:36:05 INFO - 'LANG': 'en_US.UTF-8', 05:36:05 INFO - 'LANGUAGE': 'en_US:en', 05:36:05 INFO - 'LOGNAME': 'cltbld', 05:36:05 INFO - 'MAIL': '/var/mail/cltbld', 05:36:05 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:36:05 INFO - 'MOZ_NO_REMOTE': '1', 05:36:05 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:36:05 INFO - 'NO_EM_RESTART': '1', 05:36:05 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:36:05 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:36:05 INFO - 'PWD': '/builds/slave/test', 05:36:05 INFO - 'SHELL': '/bin/bash', 05:36:05 INFO - 'SHLVL': '1', 05:36:05 INFO - 'TERM': 'linux', 05:36:05 INFO - 'TMOUT': '86400', 05:36:05 INFO - 'USER': 'cltbld', 05:36:05 INFO - 'XDG_SESSION_COOKIE': '2dd9ebcff44b3efbe7b51203000001d7-1449318906.825876-1633103823', 05:36:05 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:36:05 INFO - '_': '/tools/buildbot/bin/python'} 05:36:05 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:36:05 INFO - Downloading/unpacking jsonschema 05:36:05 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:36:05 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:36:05 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:36:05 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:36:05 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:36:05 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:36:07 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 05:36:07 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:36:07 INFO - Downloading/unpacking functools32 (from jsonschema) 05:36:07 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:36:07 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:36:07 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:36:07 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:36:07 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:36:07 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:36:07 INFO - Downloading functools32-3.2.3-2.tar.gz 05:36:07 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:36:07 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 05:36:07 INFO - warning: no files found matching '*.txt' 05:36:07 INFO - no previously-included directories found matching 'build' 05:36:07 INFO - no previously-included directories found matching 'dist' 05:36:07 INFO - no previously-included directories found matching '.git*' 05:36:07 INFO - Installing collected packages: jsonschema, functools32 05:36:07 INFO - Running setup.py install for functools32 05:36:07 INFO - warning: no files found matching '*.txt' 05:36:07 INFO - no previously-included directories found matching 'build' 05:36:07 INFO - no previously-included directories found matching 'dist' 05:36:07 INFO - no previously-included directories found matching '.git*' 05:36:07 INFO - Successfully installed jsonschema functools32 05:36:07 INFO - Cleaning up... 05:36:07 INFO - Return code: 0 05:36:07 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 05:36:07 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:36:07 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:36:07 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:36:07 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:36:07 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:36:07 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:36:07 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 0x7f8960058f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x154d8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x161b240>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16aa0b0>, '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 0x16aafb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x16ab440>, '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': '2dd9ebcff44b3efbe7b51203000001d7-1449318906.825876-1633103823', '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:36:07 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:36:07 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:36:07 INFO - Using env: {'DISPLAY': ':0', 05:36:07 INFO - 'HOME': '/home/cltbld', 05:36:07 INFO - 'LANG': 'en_US.UTF-8', 05:36:07 INFO - 'LANGUAGE': 'en_US:en', 05:36:07 INFO - 'LOGNAME': 'cltbld', 05:36:07 INFO - 'MAIL': '/var/mail/cltbld', 05:36:07 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:36:07 INFO - 'MOZ_NO_REMOTE': '1', 05:36:07 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:36:07 INFO - 'NO_EM_RESTART': '1', 05:36:07 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:36:07 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:36:07 INFO - 'PWD': '/builds/slave/test', 05:36:07 INFO - 'SHELL': '/bin/bash', 05:36:07 INFO - 'SHLVL': '1', 05:36:07 INFO - 'TERM': 'linux', 05:36:07 INFO - 'TMOUT': '86400', 05:36:07 INFO - 'USER': 'cltbld', 05:36:07 INFO - 'XDG_SESSION_COOKIE': '2dd9ebcff44b3efbe7b51203000001d7-1449318906.825876-1633103823', 05:36:07 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:36:07 INFO - '_': '/tools/buildbot/bin/python'} 05:36:08 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:36:08 INFO - Downloading/unpacking flake8 05:36:08 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:36:08 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:36:08 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:36:08 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:36:08 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:36:08 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:36:10 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 05:36:10 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:36:10 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 05:36:10 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:36:10 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:36:10 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:36:10 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:36:10 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:36:10 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:36:10 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 05:36:10 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:36:10 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 05:36:10 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:36:10 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:36:10 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:36:10 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:36:10 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:36:10 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:36:10 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:36:10 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 05:36:10 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:36:10 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:36:10 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:36:10 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:36:10 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:36:10 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:36:10 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpep8-1.5.7.tar.gz 05:36:10 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 05:36:10 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 05:36:10 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 05:36:10 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 05:36:10 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 05:36:10 INFO - no previously-included directories found matching 'docs/_build' 05:36:10 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 05:36:10 INFO - Running setup.py install for pep8 05:36:10 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 05:36:10 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 05:36:10 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 05:36:10 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 05:36:10 INFO - no previously-included directories found matching 'docs/_build' 05:36:10 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 05:36:10 INFO - Successfully installed flake8 mccabe pyflakes pep8 05:36:10 INFO - Cleaning up... 05:36:10 INFO - Return code: 0 05:36:10 INFO - Running post-action listener: _resource_record_post_action 05:36:10 INFO - Running post-action listener: _start_resource_monitoring 05:36:10 INFO - Starting resource monitoring. 05:36:10 INFO - ##### 05:36:10 INFO - ##### Running install step. 05:36:10 INFO - ##### 05:36:10 INFO - Running pre-action listener: _resource_record_pre_action 05:36:10 INFO - Running main action method: install 05:36:10 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 05:36:10 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 05:36:11 INFO - Reading from file tmpfile_stdout 05:36:11 INFO - Detecting whether we're running mozinstall >=1.0... 05:36:11 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 05:36:11 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 05:36:11 INFO - Reading from file tmpfile_stdout 05:36:11 INFO - Output received: 05:36:11 INFO - Usage: mozinstall [options] installer 05:36:11 INFO - Options: 05:36:11 INFO - -h, --help show this help message and exit 05:36:11 INFO - -d DEST, --destination=DEST 05:36:11 INFO - Directory to install application into. [default: 05:36:11 INFO - "/builds/slave/test"] 05:36:11 INFO - --app=APP Application being installed. [default: firefox] 05:36:11 INFO - mkdir: /builds/slave/test/build/application 05:36:11 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 05:36:11 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 05:36:26 INFO - Reading from file tmpfile_stdout 05:36:26 INFO - Output received: 05:36:26 INFO - /builds/slave/test/build/application/firefox/firefox 05:36:26 INFO - Running post-action listener: _resource_record_post_action 05:36:26 INFO - ##### 05:36:26 INFO - ##### Running run-tests step. 05:36:26 INFO - ##### 05:36:26 INFO - Running pre-action listener: _resource_record_pre_action 05:36:26 INFO - Running main action method: run_tests 05:36:26 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 05:36:26 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 05:36:26 INFO - Python 2.7.3 05:36:26 INFO - Return code: 0 05:36:26 INFO - grabbing minidump binary from tooltool 05:36:26 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:36:26 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 0x16aa0b0>, '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 0x16aafb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x16ab440>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 05:36:26 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:36:26 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:36:26 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 05:36:26 INFO - Return code: 0 05:36:26 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 05:36:26 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 05:36:26 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 05:36:26 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 05:36:26 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 05:36:26 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 05:36:26 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 05:36:27 INFO - Return code: 0 05:36:27 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--debug', '--branchName', 'Firefox-Non-PGO', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/4LAPVSYNS5m426DQYv3_pg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-032', '--webServer', 'localhost'] in /builds/slave/test/build 05:36:27 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --debug --branchName Firefox-Non-PGO --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/4LAPVSYNS5m426DQYv3_pg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-032 --webServer localhost 05:36:27 INFO - Using env: {'DISPLAY': ':0', 05:36:27 INFO - 'HOME': '/home/cltbld', 05:36:27 INFO - 'LANG': 'en_US.UTF-8', 05:36:27 INFO - 'LANGUAGE': 'en_US:en', 05:36:27 INFO - 'LOGNAME': 'cltbld', 05:36:27 INFO - 'MAIL': '/var/mail/cltbld', 05:36:27 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 05:36:27 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 05:36:27 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:36:27 INFO - 'MOZ_NO_REMOTE': '1', 05:36:27 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 05:36:27 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:36:27 INFO - 'NO_EM_RESTART': '1', 05:36:27 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:36:27 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:36:27 INFO - 'PWD': '/builds/slave/test', 05:36:27 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 05:36:27 INFO - 'SHELL': '/bin/bash', 05:36:27 INFO - 'SHLVL': '1', 05:36:27 INFO - 'TERM': 'linux', 05:36:27 INFO - 'TMOUT': '86400', 05:36:27 INFO - 'USER': 'cltbld', 05:36:27 INFO - 'XDG_SESSION_COOKIE': '2dd9ebcff44b3efbe7b51203000001d7-1449318906.825876-1633103823', 05:36:27 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:36:27 INFO - '_': '/tools/buildbot/bin/python'} 05:36:27 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--debug', '--branchName', 'Firefox-Non-PGO', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/4LAPVSYNS5m426DQYv3_pg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-032', '--webServer', 'localhost'] with output_timeout 3600 05:36:27 INFO - mozversion INFO | application_buildid: 20151205040640 05:36:27 INFO - mozversion INFO | application_changeset: cba488c0af7031be976c19e0bc589be6f078c4db 05:36:27 INFO - mozversion INFO | application_display_name: Nightly 05:36:27 INFO - mozversion INFO | application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 05:36:27 INFO - mozversion INFO | application_name: Firefox 05:36:27 INFO - mozversion INFO | application_remotingname: firefox 05:36:27 INFO - mozversion INFO | application_repository: https://hg.mozilla.org/mozilla-central 05:36:27 INFO - mozversion INFO | application_vendor: Mozilla 05:36:27 INFO - mozversion INFO | application_version: 45.0a1 05:36:27 INFO - mozversion INFO | platform_buildid: 20151205040640 05:36:27 INFO - mozversion INFO | platform_changeset: cba488c0af7031be976c19e0bc589be6f078c4db 05:36:27 INFO - mozversion INFO | platform_repository: https://hg.mozilla.org/mozilla-central 05:36:27 INFO - mozversion INFO | platform_version: 45.0a1 05:36:27 INFO - 2015-12-05 05:36:27,491 DEBUG : using testdate: 1449322587 05:36:27 INFO - 2015-12-05 05:36:27,491 DEBUG : actual date: 1449322587 05:36:27 INFO - 2015-12-05 05:36:27,606 INFO : starting webserver on 'localhost:51441' 05:36:27 INFO - 2015-12-05 05:36:27,607 INFO : Starting test suite talos-linux64-ix-032.e 05:36:27 INFO - 2015-12-05 05:36:27,607 INFO : Starting test dromaeo_css 05:36:27 INFO - 2015-12-05 05:36:27,607 DEBUG : operating with platform_type : linux_ 05:36:27 INFO - 2015-12-05 05:36:27,608 INFO : Initialising browser for dromaeo_css test... 05:36:27 INFO - 2015-12-05 05:36:27,618 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpvuSkyZ/profile http://localhost:51441/getInfo.html 05:36:33 INFO - 2015-12-05 05:36:33,671 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 05:36:33 INFO - 2015-12-05 05:36:33,671 DEBUG : BROWSER_OUTPUT: colorDepth:24 05:36:33 INFO - 2015-12-05 05:36:33,671 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 05:36:33 INFO - 2015-12-05 05:36:33,671 DEBUG : BROWSER_OUTPUT: __metrics 05:36:33 INFO - 2015-12-05 05:36:33,787 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:36:33 INFO - 2015-12-05 05:36:33,904 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:36:34 INFO - 2015-12-05 05:36:34,825 INFO : Browser initialized. 05:36:34 INFO - 2015-12-05 05:36:34,826 INFO : Running cycle 1/1 for dromaeo_css test... 05:36:34 INFO - 2015-12-05 05:36:34,826 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpvuSkyZ/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 05:36:46 INFO - 2015-12-05 05:36:46,849 DEBUG : BROWSER_OUTPUT: RSS: Main: 143171584 05:36:46 INFO - 2015-12-05 05:36:46,849 DEBUG : BROWSER_OUTPUT: 05:37:36 INFO - 2015-12-05 05:37:36,498 DEBUG : BROWSER_OUTPUT: 1449322656492 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:39:48 INFO - 2015-12-05 05:39:48,879 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51441/tests/dromaeo/cssquery-dojo.html (next: http://localhost:51441/tests/dromaeo/cssquery-ext.html) 05:39:49 INFO - 2015-12-05 05:39:49,985 DEBUG : BROWSER_OUTPUT: RSS: Main: 147509248 05:39:49 INFO - 2015-12-05 05:39:49,986 DEBUG : BROWSER_OUTPUT: 05:42:51 INFO - 2015-12-05 05:42:51,920 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51441/tests/dromaeo/cssquery-ext.html (next: http://localhost:51441/tests/dromaeo/cssquery-jquery.html) 05:42:52 INFO - 2015-12-05 05:42:52,515 DEBUG : BROWSER_OUTPUT: RSS: Main: 144838656 05:42:52 INFO - 2015-12-05 05:42:52,515 DEBUG : BROWSER_OUTPUT: 05:45:54 INFO - 2015-12-05 05:45:54,312 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51441/tests/dromaeo/cssquery-jquery.html (next: http://localhost:51441/tests/dromaeo/cssquery-mootools.html) 05:45:54 INFO - 2015-12-05 05:45:54,899 DEBUG : BROWSER_OUTPUT: RSS: Main: 146219008 05:45:54 INFO - 2015-12-05 05:45:54,899 DEBUG : BROWSER_OUTPUT: 05:48:56 INFO - 2015-12-05 05:48:56,704 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51441/tests/dromaeo/cssquery-mootools.html (next: http://localhost:51441/tests/dromaeo/cssquery-prototype.html) 05:48:57 INFO - 2015-12-05 05:48:57,310 DEBUG : BROWSER_OUTPUT: RSS: Main: 143785984 05:48:57 INFO - 2015-12-05 05:48:57,310 DEBUG : BROWSER_OUTPUT: 05:51:59 INFO - 2015-12-05 05:51:59,888 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51441/tests/dromaeo/cssquery-prototype.html (next: http://localhost:51441/tests/dromaeo/cssquery-yui.html) 05:52:00 INFO - 2015-12-05 05:52:00,522 DEBUG : BROWSER_OUTPUT: RSS: Main: 145711104 05:52:00 INFO - 2015-12-05 05:52:00,522 DEBUG : BROWSER_OUTPUT: 05:55:02 INFO - 2015-12-05 05:55:02,882 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51441/tests/dromaeo/cssquery-yui.html (next: http://localhost:51441/tests/dromaeo/cssquery-dojo.html) 05:55:03 INFO - 2015-12-05 05:55:03,132 DEBUG : BROWSER_OUTPUT: RSS: Main: 148168704 05:55:03 INFO - 2015-12-05 05:55:03,132 DEBUG : BROWSER_OUTPUT: 05:55:03 INFO - 2015-12-05 05:55:03,134 DEBUG : BROWSER_OUTPUT: __start_tp_report 05:55:03 INFO - 2015-12-05 05:55:03,134 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 05:55:03 INFO - 2015-12-05 05:55:03,134 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 05:55:03 INFO - 2015-12-05 05:55:03,134 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 05:55:03 INFO - 2015-12-05 05:55:03,138 DEBUG : BROWSER_OUTPUT: |0;dojo.html;2667.9333016674586;2686.5029969455663;2699.3386620278034;2733.139061195723;2747.2994386431455;4471.485779135401;4721.339012538243;4737.407824021997;4747.501512341202;4766.856994290169;4564.931526027104;4635.629149668027;4635.930461043079;4648.279516674921;4652.813887444507;4144.109016561439;4265.402843601898;4375.824967001332;4427.00392411708;4510.571495707903;4152.397902304149;4418.845340413086;4421.226285400058;4462.286034234523;4476.395686582318;4184.727992680497;4217.62041416274;4231.090315582134;4261.978690106561;4267.445232119804;4319.222539942809;4332.935005974913;4337.71804832688;4346.500152482474;4392.143532011259;4114.0948991221885;4222.324428091521;4310.094880075188;4310.568943105695;4370.169667763146;4496.392986946753;4548.56788605082;4570.862874113782;4583.427071616048;4603.654725895572;4892.9510704892855;4918.311436398907;4954.975225123887;4955.033768415161;4986.775595098229;4959.20652695567;4966.453690094087;4976.5023497649945;4994.825181118644;5001.799928002875;4415.271480205763;4520.367148599199;4533.2746760518485;4616.676832621752;4657.301404789241;5119.513646203604;5198.81804136861;5201.453847345974;5211.1922651989;5225.216217567396;4732.763361831963;4956.083124621957;4978;4980.900381992412;5022.995400919831;4903.239997800275;4962.9007419851405;4978.103941290602;4987.800487980513;5030.647854650139;4987.226979818134;5034.949650503521;5039.899202015939;5042.470540593258;5077.974610126999;4656.115338085753;4771.594414474739;4994.675346102492;5000.074986127578;5065.265536497187;4048.0487085534874;4110.383442483651;4112.938305925413;4123.546409894909;4142.026623743418;3636.2000359920776;3645.325614761278;3666.3034023535442;3700.4449332600325;3714.925701485955;4102.097538541576;4208.263553878059;4220.91558168841;4302.7848607569495;4370.082282720664;4875.219964805614;4938.209886418228;4958.479359667255;4969.478204788517;4995.125852975715;4316.6546676265825;4381.890452738643;4386.342048692722;4414.4702635683925;4429.645628349725;4301.591348821857;4435.6895017349125;4453.354263631755;4486.349479325545;4487.88780280489;4703.082898834763;4752.2158843790385;4775.808967641325;4783.210770222874;4807.543283388072;5059.291699162047;5078.162103253069;5078.162103253069;5098.439171691037;5114.846554603368;4597.448306203143;4720.291956206596;4813.278008298783;4818.397700287464;4854;4982.451930287738;5034;5055.494450554915;5057.31726216956;5102.515261050195;5069.594432445322;5073.416557095981;5077.263796749525;5088.974555127201;5118.488151185001;4663.696859704109;4694.460137084143;4791.377120974251;4917.262410638433;4922.556969872729;4827.662063655511;4833.854984350475;4859.805607775649;4864.197407427735;4907.533784290486;4728.3380326753595;4759.524047595212;4772.331873537777;4772.594329482033;4788.880277993078;4667.813287468463;4716.339712440193;4726.692764970266;4827.468978412302;4880.682755620874;4708.576228139484;4743.312219728189;4750.12122757291;4753.83361582343;4766.308885211555 05:55:03 INFO - 2015-12-05 05:55:03,138 DEBUG : BROWSER_OUTPUT: |1;ext.html;542.7476223556046;547.4087984976226;549.6839317392499;557.1308758336994;558.0763835851667;37526;38018.42972355413;38269.425958610605;38371.61628383715;38438.423423648666;40457.19085618293;40848.79575602125;40892.18215635685;41115.17769644605;41173.11788174829;7841.686332546691;8026.357891368676;8044.758657240292;8054.597270136499;8079.313258373046;7703.730369437043;7729.34300584451;7754;7757.922420775804;7765.8058548536455;7935.404844636647;8046.5976701165;8052.154523775007;8054.43618946674;8054.919450805505;7948.801279967989;7994.840103197904;8022.27799498048;8024.117347091816;8042.798930026737;7758.146603873626;7868.567228802413;7884.32983196429;7888.56612886291;7921.683132674686;37840.62159378399;38269.61730382716;38285.0428739281;38290.80854595737;38303.23393532142;2641.1077731134183;2644.867756612181;2657.109868194157;2686.7850571954195;2688.9327766805986;26899.193024209304;27017.32456688579;27074.323141921413;27348;27506.312342191606;3429.2969941162;3448.603410607762;3474.6525347465304;3562.2341196642847;3574.7855128692363;212878;212895;213923.93038034867;213983;215500;51301;53362.73318633382;53874;53954.19068713972;53989.73005134949;48941.51058489441;66226.33773662298;67699.32300677028;67868.6606566964;68228;14444.494442694666;14854.257287135817;14878.628034299012;14917.328720207617;14950.252487375588;10618.575256989789;10695.465226738632;10701.89298107009;10718.35689858611;10727.731806704895;19087.522811929535;19421.90289048574;19493.8050619492;19520.535959802786;19530.511737206685;7499.925000750031;7601.7719468416035;7684.231576842271;7689.461737678421;7822.726204582812;826.8428998490267;858.8539948208819;860.720265913568;920.9125133112343;940.041158018817;22913.770862291498;22915.312540623807;23136.65295020576;23177.53644927092;23340.41648958756;912.8539433690578;928.2620316848122;949.0367277213634;993.7465946183677;1042.3120740311358;12396.938015309866;12435.316057616737;12443.875561244453;12525.812112818316;12531.122821402414;255286;262396;262565;262615;264121;45944.3108353375;46420.76789616098;46472.3029154563;46483.30275045877;46691.53308466872;1190.7678002789546;1201.549418967887;1206.258151236983;1219.432963671897;1230.7292395672937;24917.626235606844;25278.620820688073;25301.493970120864;25360.365990849637;25740.485190296462;39195.80402097971;39365;39812.20375592414;39931.80034099811;39996.80001599973;244980;245983;246435;247211;247388;28768.856155719925;29029.564556532092;29140.70859291465;29224.561631575118;29260;34846.47730283997;35153.47269791007;35244.64755352413;35366.82316588401;35411.468827968114;29516.262093447836;30688.232794180323;32485.633330672612;33150.668493314755;33364;32507.512387314684;32601.34797304088;32708.672913270562;32771.18072048218;32959.340813184084;32974.34051319008;33128.50307245441;33241.33517329591;33248.66751332456;33392.66607333896;26783;37913.62086379101;40697.79651101726;41041.58958410378;41869;28797.280067997628;28917;29052.128436146948;29203.561946570393;29631.555526667547 05:55:03 INFO - 2015-12-05 05:55:03,142 DEBUG : BROWSER_OUTPUT: |2;jquery.html;329.30188001436926;331.99170020749494;332.3950410253339;334.4932427372531;334.9748768842336;14997.850021499782;15435.691286174284;16090.919545402287;16239.756403653955;16798.076105814176;15040.623984400368;15315.923420382882;15619.672327852146;15875.761863572026;15908.84091159088;4573.268277075668;4728.739919304437;4745.90508189836;4749.928751068736;4755;4947.208446648537;4948.628852836052;4959.305697202394;4974.179260422026;4997.500249974992;4770.761461926907;4937.407511098673;4949.480304568023;4951.03454826309;4954.504549545053;4806.303086052538;4908.116539022974;4916.852494425155;4937.1606826839525;4956.430010548797;5196.92204616931;5211.062008838446;5216.8695782605355;5217.426083130853;5230.34620672416;11208.495617697223;11461.197716159872;13876.791848122186;18762.62474750511;18810.811891881043;1572.481081243187;1636.0674415583123;1664.459050808492;1708.069102339228;1768.717005279162;8173.346132309401;8560.571971401405;8577.656893724243;8865.290776737846;8891.199792018684;1609.3884323956822;1659.842314980075;1666.7416550434702;1677.9916100419541;1735.9584249450354;55602.16596751052;57384.42615573874;58331.70834145802;60265.6986715068;61632.075518866804;12298.20061695987;14808.11693826378;15434.228288585526;16088.839111608968;16190.614180151957;22807.771922280564;23089.653655195187;23132.074717011466;23159;23276.65085023726;8813.515256660818;8820.073892241222;9048.366614336934;9073.727788166365;9125.269978401711;7540.095188577406;7554.4334174936;7579.355754760797;7586.848263034708;7591.278828511283;4037.0916543777416;4095.4061661059577;4132.132252227066;7664;7675.002249707614;1730.4722059771639;1758.6834369813557;1791.8208179182238;1800.0639667373155;1823.3709370267236;839.9244068033784;862.7411776467035;870.6909047288248;878.2666473494703;921.4563407589554;15698.76451853223;15769.369225231092;15895.682086358209;16101.27544260511;16488;845.8139209373928;891.9920489846432;900.2662829793697;905.330055758747;928.7863791328033;9092.454452732858;9121.133492318218;9139.543022848964;9285.924184543099;9418.34071614994;448099;450690;456735;459893;471791;71809;73015.63492182505;74324;74465.25534744692;74856.62571687107;1031.9896801032044;1044.3785947361307;1068.161493227828;1077.2513103393223;1081.9621313254;14248.430062797372;14424.495142669955;14446.349914254093;14458;14491.49279775245;33046.17384565309;34212;34332.82833585816;34792.304153917285;35666.10834729049;40342.79828600838;42353.57646423496;42952.78523607362;43051;43106.56893431026;7597.354224890946;8326.666933322842;8390.202930721573;8538.359623028422;8585.399022068395;9816.214702823614;9909.95045024799;11539.653810385702;15467.767983480031;15729.44946926852;13259.469621215043;13377.732445350845;13440.395182216627;13444.932775336061;13658.248796316298;12449.875501244871;12519.687007824878;12714.936425317814;13153.868461315647;13487.258200798658;13147.671308217372;13211.867881321064;13542.187468751512;13807.79288310656;14036.929815350857;8522.786930326543;8542;8556.358273129665;8565;8965.417247878868;13025.413856376295;13765;13856;14300.427982880568;14400.711985760436 05:55:03 INFO - 2015-12-05 05:55:03,142 DEBUG : BROWSER_OUTPUT: |3;mootools.html;1394.5943247897371;1417.1426287096306;1509.486774496671;1677.0859881364656;1747.1177055586932;6067.089936509526;6291.11924330593;6957.443404527638;7221.627890700764;7228.602426866521;7096.325849044332;7285.271472852712;7310.34206921377;7320;7334.229905859888;2086.895655217241;2108.9050992705365;2109.198504568262;2115.820155286795;2124.0654112190664;2076.9926585605967;2088.4152437317575;2117.8093971542557;2128.8935553222277;2129.9680504792364;2060.6805945078463;2066.101245958013;2070.9275175368866;2074.0770357191054;2092.131765317399;2032.634125857345;2053.969190462144;2054.6609809381434;2061.680439531875;2065.7004734313514;2050.3131450963947;2067.5451400691823;2091.278508914422;2093.2987449204534;2101.2645574049116;7351.669174887143;7430.145533263636;7440.330370266702;7441.330280274748;7449.664765085584;4265.0616864289805;4275.444192255018;4297.8495752648505;4309.612134907873;4358.302671572565;2579.2649095007832;2626.75045870642;2671.2520494261444;2743.067357098596;2752.353196998724;839.6431516605479;846.7459762071354;847.855864503036;851.3231980575457;882.5851849630664;9829.361091529028;9867.90132098677;9872.1608663263;9876.753081172956;9940.304178707493;3956.5054368203973;3999.480067591253;4005.319095753729;4019.336809426412;4039.535453422894;8564.3148548116;8600.913990860012;8618.569071546523;8627.352948528885;8657.523836188944;4352.368906508538;4360.912781744348;4389.714668546598;4389.868303950887;4391.033972526039;3244.561984132112;3343.481760327153;3882.3011857865854;3893.669038131734;3897.4738410314812;3552.342816578941;3572.6070132285427;3583.6774690278;3594.9101272467874;3598.7660802047785;1083.7019819549687;1084.9783004340027;1089.5696200000955;1092.579356947565;1097.7091070866227;882.8190221004679;894.3918135667678;1166.608452672019;1185.2651356159236;1202.482932339085;6935.202451718016;6944.51388402807;6945.374916257561;6961.686724097428;7013.824654383681;414.04562483475877;423.82199476220063;425.05001322045206;426.05203422384943;427.74549143259713;5370.087085195526;5461.344638643309;5523.226748255248;5526.281583394213;5540.335159780771;8576;8619.267362274151;8743.519106449206;8795.120487951153;8934.553272336487;8823.985241697286;8848.867266991001;8849.070847561043;8872.600732967032;8892.3330750194;6933.133358330309;6933.341332573397;6934.202566704894;6980.7905762827195;7029.578225306498;6719.664016799043;6723.394894459327;6728.226253980855;6730.831729206613;6744.22441419243;7780.455368124403;7866.449348545547;7901.130875603564;7969.681212751425;7970.242826931432;7718.15100338951;7877.684892604231;7948.8807667886185;8107.797305067421;8112.351011918914;5401.567874570103;5502.202180683858;6132.202813634378;6440.13058237132;6513.381228783258;6554.918438457792;6557.803265902031;6574.04676321921;6580.473562115115;6581.638009909501;6428.967855160694;6541.771038013647;6544.411003009752;6584.868302633825;6653.201615806134;6300.653464059521;6368.968155159195;6569.9014514783275;6598.934010659832;6620.768273110418;6347.746090156342;6404.263509696445;6404.935950640434;6439.935600643934;6464.4828413725845;5834.124881267844;5853.531717462678;5918.526517878646;5948.256467941507;5974.790882319272;6013.699315034319;6035.969820150871;6060.000099983629;6060.606060606046;6078.787242446493 05:55:03 INFO - 2015-12-05 05:55:03,143 DEBUG : BROWSER_OUTPUT: |4;prototype.html;277.2320671739282;281.6620055932881;286.61450349280216;287.5514197851352;289.78845442826724;5328.067588172074;5516.69658168801;5525.419830917756;5565.6660600364;5606.187102870082;5421.864453388667;5483.341998960131;5488.835334939959;5495.642783219088;5526.866992266586;4132.380142978563;4133.8553150639655;4136.048708796979;4141.8964525886795;4145.585441455861;4142.627163555279;4143.979280103596;4159.916801663965;4163.354680024601;4169.187008533338;4026.3557830747086;4106.671466282705;4113.56807535209;4122.938155927648;4123.381492776078;4049.838006479752;4101.630853223224;4105.32262176739;4108.979455102735;4113.938290925638;3510.8420121094355;3511.2450823073164;3511.473279008144;3514.4025515662397;3515.8417871195857;5046.142155833517;5170.689758614495;5184.766685499161;5286.5770738341225;5295.602829787743;4750.121227572876;4768.403949506312;4770.713757174581;4785.928211076836;4813.205821039524;5764.654120752726;5773.220615216934;5773.913391299134;5774.82675519735;5782.537397008229;3931.4495970564144;3934.665553427962;3938.8818335449982;3942.6451619354107;3944.980275098606;5865.706714664249;5966.463018328328;6096.993995990701;6097.69511524422;6104.908426373608;3931.3906344516645;3945.5659877413464;3959.4060890866026;3960.0099975006246;3960.108975480494;4015.2371049500503;4019.0354314964197;4024.557298697141;4025.75845449274;4028.4964379452567;4699.624030077585;4701.059788042405;4704.788284527136;4711.104890070944;4711.646626503026;5520.199571062173;5579.13523403873;5750.3099628044065;5752.827415177551;5785.65286082828;1418.0640777087074;1452.6368407898026;1454.2946670864621;1455.6870272891379;1455.7015811758565;953.6233187890745;955.1785464500524;961.9134277915022;973.634886917406;977.6040703515088;4964.453910069889;4989.376327959005;4989.401271847401;4991.0766508195375;4993.076280888047;5902.793402230901;5940.70296485174;5961.731722072517;5965.164876917235;5971.223740913741;4924.285978533093;4935.679180853233;4970.2793095001025;4977.552020318189;4987.301777751118;3155.709615545849;3179.4277030134335;3185.9327125413247;3206.8075915445147;3221.500667396557;5595.8601034973635;5612.438756124437;5620.213170156181;5620.522255608319;5622.240997465372;6082.75668973245;6095.603785753912;6099.085137229451;6105.236845394325;6143;5612.635178713371;5617.354004289477;5623.2408624835125;5626.2967129108865;5627.43725627434;5787.421257874347;6027.547933905063;6033.939660603338;6043.54673399488;6046.697665116639;5908.438698323653;5908.793192238251;5908.940910590839;5909.261342332208;5913.319968203712;5671.971640141773;5678.432156784454;5681.119426488901;5689.829305120853;5695.2311437957005;3822.7897465639658;3893.9026524335986;3914.4911161548816;3948.0919388540224;3952.78259695708;5832.387599302012;5942.465178133989;5942.910856337245;5955.702214889325;5976.163337132718;5783.219265399117;5813.709314534341;5814.098814683731;5819.301683797971;5829.504492118217;5798.971005144947;5802.82591522255;5813.79651712188;5818.505427038749;5823.068309070529;5513.2005859151;5654.604177707521;5673.74468148926;5694.857628559153;5697;5816.272965879265;5825;5828.184054232495;5828.970855145697;5838.94161058401;5624.212610234488;5625.578081643811;5647.830565083054;5666.858328541819;5671.291088613923 05:55:03 INFO - 2015-12-05 05:55:03,144 DEBUG : BROWSER_OUTPUT: |5;yui.html;746.4289818289006;751.2975368030895;755.9470837041407;770.3644493293033;777.308195705822;11302.491387887545;11475.540978360876;11478.598249061284;11494.36780977046;11515.654530364092;10795.352278863274;13272.668183295422;13472.25902575358;13491.595252142451;13548.18710877348;806.5725165662179;807.6325272001241;816.7876352148425;820.3929092471558;822.411975437562;816.6447595296036;825.1377310710292;831.9542425166613;832.8875601793771;834.2075028722708;846.3060290561742;853.6628031927385;854.3293514591047;855.0466230153365;856.8286342731448;839.236294971579;842.1999100854182;843.9704610338639;845.5856630251194;845.8308338332358;621.0808004153878;622.947049500793;624.0171729526014;625.6058683029662;628.3873223606993;11687.240329378563;11712.648620541397;11715.824262635982;11742.178047536676;11754.647360579196;10555.313904596176;10831.079358254558;11056;11433.656990290305;11761.58834440799;9067.682631107946;9333.626654933794;9378.343515953886;9424.481653509054;9430.90569094314;3123.0630810756684;3124.812511249332;3163.6994485523837;3176.6029246344206;3198.104530731399;40984.180316393504;41566;41719.374209386886;41719.53981610629;41752.1649567007;8617.69838055665;8774.210321071134;9115.954420227989;9180.21968132703;9249.028851970446;16348.509544713677;16426.917865410836;16439.178041097897;16512;16547.669046619;5994.400559943971;6017.488513476316;6221.502279817604;6313.053042043638;6363.809085727436;3296.159479332755;3306.5866766654167;3380.695737383647;3384.340053689556;3549.5030695702108;2596.4287856671504;2633.4601406711577;2640.3003204150914;2641.5245255853747;2642.7753640940737;452.30119465426;454.470541818784;462.2303864066359;471.63919601504875;482.73449602718364;573.7160105747598;578.2858170159849;599.8860216558927;610.6458254212546;619.8202521268872;7212.675429605575;7362.411007119417;7450.590217538087;7506;7580.810479738051;474.30751103388747;479.71217269637935;528.1496790167827;565.5419110520492;573.6586730895111;3594.2092739597247;3597.9280414391565;3708.165662725919;3757.1170774867883;3777.792221427848;50419.24371134436;50544.747276263384;50652;50852.49147508552;50900.490995089574;44737.77631111889;44982;45208.54791452109;45409;46187.07625847464;41889;41897.162056759305;42219.788901055916;42280;42371.57628423676;7382.224866388952;7383.114026316876;7496.362809161283;7558.3953283738265;7728.961355193188;29460.263493412836;30106.397872042875;30189.698103018687;30577.54133688041;30925;37700.05749856275;38471;39041.609583903795;39047.41428878626;39322.2135557293;10151.441670708182;10273.640422585173;10431.478426078818;10614;10647.30792498485;11228.157888158257;11354.432278385882;11371;11490.08079353633;11493.540258389905;10668;10842.457877106272;10928;10977.95179467327;11030.06244469197;10236.18110551169;10243.94878025605;10250.128739056965;10250.179985601284;10469.31949423285;10209.540570674486;10443.68668939933;10516.737081572715;10634.30876992993;10689;9391.436513809193;9445.433274003582;9530.571124299284;9549.61801527959;9605.663801766905;8461.450005749606;8811.611433100714;8867.512286824287;8896.86654700193;8922.375433719577 05:55:03 INFO - 2015-12-05 05:55:03,144 DEBUG : BROWSER_OUTPUT: __end_tp_report 05:55:03 INFO - 2015-12-05 05:55:03,144 DEBUG : BROWSER_OUTPUT: __start_cc_report 05:55:03 INFO - 2015-12-05 05:55:03,144 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,339 05:55:03 INFO - 2015-12-05 05:55:03,144 DEBUG : BROWSER_OUTPUT: __end_cc_report 05:55:03 INFO - 2015-12-05 05:55:03,144 DEBUG : BROWSER_OUTPUT: __startTimestamp1449323703132__endTimestamp 05:55:03 INFO - 2015-12-05 05:55:03,145 DEBUG : BROWSER_OUTPUT: 05:55:03 INFO - 2015-12-05 05:55:03,145 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 05:55:03 INFO - 2015-12-05 05:55:03,145 DEBUG : BROWSER_OUTPUT: Number of tests: 6 05:55:03 INFO - 2015-12-05 05:55:03,145 DEBUG : BROWSER_OUTPUT: 05:55:03 INFO - 2015-12-05 05:55:03,145 DEBUG : BROWSER_OUTPUT: [#0] dojo.html Cycles:165 Average:4609.67 Median:4728.34 stddev:482.60 (10.2%) stddev-sans-first:459.41 05:55:03 INFO - 2015-12-05 05:55:03,145 DEBUG : BROWSER_OUTPUT: Values: 2667.9 2686.5 2699.3 2733.1 2747.3 4471.5 4721.3 4737.4 4747.5 4766.9 4564.9 4635.6 4635.9 4648.3 4652.8 4144.1 4265.4 4375.8 4427.0 4510.6 4152.4 4418.8 4421.2 4462.3 4476.4 4184.7 4217.6 4231.1 4262.0 4267.4 4319.2 4332.9 4337.7 4346.5 4392.1 4114.1 4222.3 4310.1 4310.6 4370.2 4496.4 4548.6 4570.9 4583.4 4603.7 4893.0 4918.3 4955.0 4955.0 4986.8 4959.2 4966.5 4976.5 4994.8 5001.8 4415.3 4520.4 4533.3 4616.7 4657.3 5119.5 5198.8 5201.5 5211.2 5225.2 4732.8 4956.1 4978.0 4980.9 5023.0 4903.2 4962.9 4978.1 4987.8 5030.6 4987.2 5034.9 5039.9 5042.5 5078.0 4656.1 4771.6 4994.7 5000.1 5065.3 4048.0 4110.4 4112.9 4123.5 4142.0 3636.2 3645.3 3666.3 3700.4 3714.9 4102.1 4208.3 4220.9 4302.8 4370.1 4875.2 4938.2 4958.5 4969.5 4995.1 4316.7 4381.9 4386.3 4414.5 4429.6 4301.6 4435.7 4453.4 4486.3 4487.9 4703.1 4752.2 4775.8 4783.2 4807.5 5059.3 5078.2 5078.2 5098.4 5114.8 4597.4 4720.3 4813.3 4818.4 4854.0 4982.5 5034.0 5055.5 5057.3 5102.5 5069.6 5073.4 5077.3 5089.0 5118.5 4663.7 4694.5 4791.4 4917.3 4922.6 4827.7 4833.9 4859.8 4864.2 4907.5 4728.3 4759.5 4772.3 4772.6 4788.9 4667.8 4716.3 4726.7 4827.5 4880.7 4708.6 4743.3 4750.1 4753.8 4766.3 05:55:03 INFO - 2015-12-05 05:55:03,145 DEBUG : BROWSER_OUTPUT: 05:55:03 INFO - 2015-12-05 05:55:03,145 DEBUG : BROWSER_OUTPUT: [#1] ext.html Cycles:180 Average:40579.62 Median:34999.98 stddev:62873.69 (179.6%) stddev-sans-first:62978.20 05:55:03 INFO - 2015-12-05 05:55:03,145 DEBUG : BROWSER_OUTPUT: Values: 542.7 547.4 549.7 557.1 558.1 37526.0 38018.4 38269.4 38371.6 38438.4 40457.2 40848.8 40892.2 41115.2 41173.1 7841.7 8026.4 8044.8 8054.6 8079.3 7703.7 7729.3 7754.0 7757.9 7765.8 7935.4 8046.6 8052.2 8054.4 8054.9 7948.8 7994.8 8022.3 8024.1 8042.8 7758.1 7868.6 7884.3 7888.6 7921.7 37840.6 38269.6 38285.0 38290.8 38303.2 2641.1 2644.9 2657.1 2686.8 2688.9 26899.2 27017.3 27074.3 27348.0 27506.3 3429.3 3448.6 3474.7 3562.2 3574.8 212878.0 212895.0 213923.9 213983.0 215500.0 51301.0 53362.7 53874.0 53954.2 53989.7 48941.5 66226.3 67699.3 67868.7 68228.0 14444.5 14854.3 14878.6 14917.3 14950.3 10618.6 10695.5 10701.9 10718.4 10727.7 19087.5 19421.9 19493.8 19520.5 19530.5 7499.9 7601.8 7684.2 7689.5 7822.7 826.8 858.9 860.7 920.9 940.0 22913.8 22915.3 23136.7 23177.5 23340.4 912.9 928.3 949.0 993.7 1042.3 12396.9 12435.3 12443.9 12525.8 12531.1 255286.0 262396.0 262565.0 262615.0 264121.0 45944.3 46420.8 46472.3 46483.3 46691.5 1190.8 1201.5 1206.3 1219.4 1230.7 24917.6 25278.6 25301.5 25360.4 25740.5 39195.8 39365.0 39812.2 39931.8 39996.8 244980.0 245983.0 246435.0 247211.0 247388.0 28768.9 29029.6 29140.7 29224.6 29260.0 34846.5 35153.5 35244.6 35366.8 35411.5 29516.3 30688.2 32485.6 33150.7 33364.0 32507.5 32601.3 32708.7 32771.2 32959.3 32974.3 33128.5 33241.3 33248.7 33392.7 26783.0 37913.6 40697.8 41041.6 41869.0 28797.3 28917.0 29052.1 29203.6 29631.6 05:55:03 INFO - 2015-12-05 05:55:03,145 DEBUG : BROWSER_OUTPUT: 05:55:03 INFO - 2015-12-05 05:55:03,145 DEBUG : BROWSER_OUTPUT: [#2] jquery.html Cycles:180 Average:26036.51 Median:4113.77 stddev:74783.86 (1817.9%) stddev-sans-first:74968.74 05:55:03 INFO - 2015-12-05 05:55:03,147 DEBUG : BROWSER_OUTPUT: Values: 329.3 332.0 332.4 334.5 335.0 14997.9 15435.7 16090.9 16239.8 16798.1 15040.6 15315.9 15619.7 15875.8 15908.8 4573.3 4728.7 4745.9 4749.9 4755.0 4947.2 4948.6 4959.3 4974.2 4997.5 4770.8 4937.4 4949.5 4951.0 4954.5 4806.3 4908.1 4916.9 4937.2 4956.4 5196.9 5211.1 5216.9 5217.4 5230.3 11208.5 11461.2 13876.8 18762.6 18810.8 1572.5 1636.1 1664.5 1708.1 1768.7 8173.3 8560.6 8577.7 8865.3 8891.2 1609.4 1659.8 1666.7 1678.0 1736.0 55602.2 57384.4 58331.7 60265.7 61632.1 12298.2 14808.1 15434.2 16088.8 16190.6 22807.8 23089.7 23132.1 23159.0 23276.7 8813.5 8820.1 9048.4 9073.7 9125.3 7540.1 7554.4 7579.4 7586.8 7591.3 4037.1 4095.4 4132.1 7664.0 7675.0 1730.5 1758.7 1791.8 1800.1 1823.4 839.9 862.7 870.7 878.3 921.5 15698.8 15769.4 15895.7 16101.3 16488.0 845.8 892.0 900.3 905.3 928.8 9092.5 9121.1 9139.5 9285.9 9418.3 448099.0 450690.0 456735.0 459893.0 471791.0 71809.0 73015.6 74324.0 74465.3 74856.6 1032.0 1044.4 1068.2 1077.3 1082.0 14248.4 14424.5 14446.3 14458.0 14491.5 33046.2 34212.0 34332.8 34792.3 35666.1 40342.8 42353.6 42952.8 43051.0 43106.6 7597.4 8326.7 8390.2 8538.4 8585.4 9816.2 9910.0 11539.7 15467.8 15729.4 13259.5 13377.7 13440.4 13444.9 13658.2 12449.9 12519.7 12714.9 13153.9 13487.3 13147.7 13211.9 13542.2 13807.8 14036.9 8522.8 8542.0 8556.4 8565.0 8965.4 13025.4 13765.0 13856.0 14300.4 14400.7 05:55:03 INFO - 2015-12-05 05:55:03,147 DEBUG : BROWSER_OUTPUT: 05:55:03 INFO - 2015-12-05 05:55:03,147 DEBUG : BROWSER_OUTPUT: [#3] mootools.html Cycles:180 Average:5041.33 Median:6105.50 stddev:2667.95 (43.7%) stddev-sans-first:2661.36 05:55:03 INFO - 2015-12-05 05:55:03,147 DEBUG : BROWSER_OUTPUT: Values: 1394.6 1417.1 1509.5 1677.1 1747.1 6067.1 6291.1 6957.4 7221.6 7228.6 7096.3 7285.3 7310.3 7320.0 7334.2 2086.9 2108.9 2109.2 2115.8 2124.1 2077.0 2088.4 2117.8 2128.9 2130.0 2060.7 2066.1 2070.9 2074.1 2092.1 2032.6 2054.0 2054.7 2061.7 2065.7 2050.3 2067.5 2091.3 2093.3 2101.3 7351.7 7430.1 7440.3 7441.3 7449.7 4265.1 4275.4 4297.8 4309.6 4358.3 2579.3 2626.8 2671.3 2743.1 2752.4 839.6 846.7 847.9 851.3 882.6 9829.4 9867.9 9872.2 9876.8 9940.3 3956.5 3999.5 4005.3 4019.3 4039.5 8564.3 8600.9 8618.6 8627.4 8657.5 4352.4 4360.9 4389.7 4389.9 4391.0 3244.6 3343.5 3882.3 3893.7 3897.5 3552.3 3572.6 3583.7 3594.9 3598.8 1083.7 1085.0 1089.6 1092.6 1097.7 882.8 894.4 1166.6 1185.3 1202.5 6935.2 6944.5 6945.4 6961.7 7013.8 414.0 423.8 425.1 426.1 427.7 5370.1 5461.3 5523.2 5526.3 5540.3 8576.0 8619.3 8743.5 8795.1 8934.6 8824.0 8848.9 8849.1 8872.6 8892.3 6933.1 6933.3 6934.2 6980.8 7029.6 6719.7 6723.4 6728.2 6730.8 6744.2 7780.5 7866.4 7901.1 7969.7 7970.2 7718.2 7877.7 7948.9 8107.8 8112.4 5401.6 5502.2 6132.2 6440.1 6513.4 6554.9 6557.8 6574.0 6580.5 6581.6 6429.0 6541.8 6544.4 6584.9 6653.2 6300.7 6369.0 6569.9 6598.9 6620.8 6347.7 6404.3 6404.9 6439.9 6464.5 5834.1 5853.5 5918.5 5948.3 5974.8 6013.7 6036.0 6060.0 6060.6 6078.8 05:55:03 INFO - 2015-12-05 05:55:03,147 DEBUG : BROWSER_OUTPUT: 05:55:03 INFO - 2015-12-05 05:55:03,147 DEBUG : BROWSER_OUTPUT: [#4] prototype.html Cycles:180 Average:4731.80 Median:5514.95 stddev:1430.02 (25.9%) stddev-sans-first:1394.40 05:55:03 INFO - 2015-12-05 05:55:03,147 DEBUG : BROWSER_OUTPUT: Values: 277.2 281.7 286.6 287.6 289.8 5328.1 5516.7 5525.4 5565.7 5606.2 5421.9 5483.3 5488.8 5495.6 5526.9 4132.4 4133.9 4136.0 4141.9 4145.6 4142.6 4144.0 4159.9 4163.4 4169.2 4026.4 4106.7 4113.6 4122.9 4123.4 4049.8 4101.6 4105.3 4109.0 4113.9 3510.8 3511.2 3511.5 3514.4 3515.8 5046.1 5170.7 5184.8 5286.6 5295.6 4750.1 4768.4 4770.7 4785.9 4813.2 5764.7 5773.2 5773.9 5774.8 5782.5 3931.4 3934.7 3938.9 3942.6 3945.0 5865.7 5966.5 6097.0 6097.7 6104.9 3931.4 3945.6 3959.4 3960.0 3960.1 4015.2 4019.0 4024.6 4025.8 4028.5 4699.6 4701.1 4704.8 4711.1 4711.6 5520.2 5579.1 5750.3 5752.8 5785.7 1418.1 1452.6 1454.3 1455.7 1455.7 953.6 955.2 961.9 973.6 977.6 4964.5 4989.4 4989.4 4991.1 4993.1 5902.8 5940.7 5961.7 5965.2 5971.2 4924.3 4935.7 4970.3 4977.6 4987.3 3155.7 3179.4 3185.9 3206.8 3221.5 5595.9 5612.4 5620.2 5620.5 5622.2 6082.8 6095.6 6099.1 6105.2 6143.0 5612.6 5617.4 5623.2 5626.3 5627.4 5787.4 6027.5 6033.9 6043.5 6046.7 5908.4 5908.8 5908.9 5909.3 5913.3 5672.0 5678.4 5681.1 5689.8 5695.2 3822.8 3893.9 3914.5 3948.1 3952.8 5832.4 5942.5 5942.9 5955.7 5976.2 5783.2 5813.7 5814.1 5819.3 5829.5 5799.0 5802.8 5813.8 5818.5 5823.1 5513.2 5654.6 5673.7 5694.9 5697.0 5816.3 5825.0 5828.2 5829.0 5838.9 5624.2 5625.6 5647.8 5666.9 5671.3 05:55:03 INFO - 2015-12-05 05:55:03,147 DEBUG : BROWSER_OUTPUT: 05:55:03 INFO - 2015-12-05 05:55:03,147 DEBUG : BROWSER_OUTPUT: [#5] yui.html Cycles:180 Average:12296.76 Median:44859.89 stddev:14012.66 (31.2%) stddev-sans-first:14025.12 05:55:03 INFO - 2015-12-05 05:55:03,148 DEBUG : BROWSER_OUTPUT: Values: 746.4 751.3 755.9 770.4 777.3 11302.5 11475.5 11478.6 11494.4 11515.7 10795.4 13272.7 13472.3 13491.6 13548.2 806.6 807.6 816.8 820.4 822.4 816.6 825.1 832.0 832.9 834.2 846.3 853.7 854.3 855.0 856.8 839.2 842.2 844.0 845.6 845.8 621.1 622.9 624.0 625.6 628.4 11687.2 11712.6 11715.8 11742.2 11754.6 10555.3 10831.1 11056.0 11433.7 11761.6 9067.7 9333.6 9378.3 9424.5 9430.9 3123.1 3124.8 3163.7 3176.6 3198.1 40984.2 41566.0 41719.4 41719.5 41752.2 8617.7 8774.2 9116.0 9180.2 9249.0 16348.5 16426.9 16439.2 16512.0 16547.7 5994.4 6017.5 6221.5 6313.1 6363.8 3296.2 3306.6 3380.7 3384.3 3549.5 2596.4 2633.5 2640.3 2641.5 2642.8 452.3 454.5 462.2 471.6 482.7 573.7 578.3 599.9 610.6 619.8 7212.7 7362.4 7450.6 7506.0 7580.8 474.3 479.7 528.1 565.5 573.7 3594.2 3597.9 3708.2 3757.1 3777.8 50419.2 50544.7 50652.0 50852.5 50900.5 44737.8 44982.0 45208.5 45409.0 46187.1 41889.0 41897.2 42219.8 42280.0 42371.6 7382.2 7383.1 7496.4 7558.4 7729.0 29460.3 30106.4 30189.7 30577.5 30925.0 37700.1 38471.0 39041.6 39047.4 39322.2 10151.4 10273.6 10431.5 10614.0 10647.3 11228.2 11354.4 11371.0 11490.1 11493.5 10668.0 10842.5 10928.0 10978.0 11030.1 10236.2 10243.9 10250.1 10250.2 10469.3 10209.5 10443.7 10516.7 10634.3 10689.0 9391.4 9445.4 9530.6 9549.6 9605.7 8461.5 8811.6 8867.5 8896.9 8922.4 05:55:03 INFO - 2015-12-05 05:55:03,149 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 05:55:03 INFO - 2015-12-05 05:55:03,149 DEBUG : BROWSER_OUTPUT: 05:55:03 INFO - 2015-12-05 05:55:03,946 INFO : Browser exited with error code: 0 05:55:03 INFO - 2015-12-05 05:55:03,964 INFO : Completed test dromaeo_css (00:18:36) 05:55:03 INFO - 2015-12-05 05:55:03,964 INFO : Starting test kraken 05:55:03 INFO - 2015-12-05 05:55:03,964 DEBUG : operating with platform_type : linux_ 05:55:03 INFO - 2015-12-05 05:55:03,965 INFO : Initialising browser for kraken test... 05:55:03 INFO - 2015-12-05 05:55:03,971 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpUmUT52/profile http://localhost:51441/getInfo.html 05:55:09 INFO - 2015-12-05 05:55:09,712 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 05:55:09 INFO - 2015-12-05 05:55:09,712 DEBUG : BROWSER_OUTPUT: colorDepth:24 05:55:09 INFO - 2015-12-05 05:55:09,712 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 05:55:09 INFO - 2015-12-05 05:55:09,712 DEBUG : BROWSER_OUTPUT: __metrics 05:55:09 INFO - 2015-12-05 05:55:09,869 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:55:10 INFO - 2015-12-05 05:55:10,813 INFO : Browser initialized. 05:55:10 INFO - 2015-12-05 05:55:10,814 INFO : Running cycle 1/1 for kraken test... 05:55:10 INFO - 2015-12-05 05:55:10,814 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpUmUT52/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 05:55:22 INFO - 2015-12-05 05:55:22,946 DEBUG : BROWSER_OUTPUT: RSS: Main: 143437824 05:55:22 INFO - 2015-12-05 05:55:22,947 DEBUG : BROWSER_OUTPUT: 05:55:25 INFO - 2015-12-05 05:55:25,507 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51441/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:51441/tests/kraken/driver.html?testName=audio-beat-detection) 05:55:26 INFO - 2015-12-05 05:55:26,134 DEBUG : BROWSER_OUTPUT: RSS: Main: 142983168 05:55:26 INFO - 2015-12-05 05:55:26,134 DEBUG : BROWSER_OUTPUT: 05:55:28 INFO - 2015-12-05 05:55:28,880 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51441/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:51441/tests/kraken/driver.html?testName=audio-dft) 05:55:29 INFO - 2015-12-05 05:55:29,482 DEBUG : BROWSER_OUTPUT: RSS: Main: 141963264 05:55:29 INFO - 2015-12-05 05:55:29,482 DEBUG : BROWSER_OUTPUT: 05:55:32 INFO - 2015-12-05 05:55:32,387 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51441/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:51441/tests/kraken/driver.html?testName=audio-fft) 05:55:32 INFO - 2015-12-05 05:55:32,968 DEBUG : BROWSER_OUTPUT: RSS: Main: 138498048 05:55:32 INFO - 2015-12-05 05:55:32,968 DEBUG : BROWSER_OUTPUT: 05:55:35 INFO - 2015-12-05 05:55:35,022 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51441/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:51441/tests/kraken/driver.html?testName=audio-oscillator) 05:55:35 INFO - 2015-12-05 05:55:35,611 DEBUG : BROWSER_OUTPUT: RSS: Main: 139284480 05:55:35 INFO - 2015-12-05 05:55:35,611 DEBUG : BROWSER_OUTPUT: 05:55:37 INFO - 2015-12-05 05:55:37,867 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51441/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:51441/tests/kraken/driver.html?testName=imaging-gaussian-blur) 05:55:38 INFO - 2015-12-05 05:55:38,453 DEBUG : BROWSER_OUTPUT: RSS: Main: 140853248 05:55:38 INFO - 2015-12-05 05:55:38,453 DEBUG : BROWSER_OUTPUT: 05:55:41 INFO - 2015-12-05 05:55:41,513 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51441/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:51441/tests/kraken/driver.html?testName=imaging-darkroom) 05:55:42 INFO - 2015-12-05 05:55:42,106 DEBUG : BROWSER_OUTPUT: RSS: Main: 140935168 05:55:42 INFO - 2015-12-05 05:55:42,107 DEBUG : BROWSER_OUTPUT: 05:55:45 INFO - 2015-12-05 05:55:45,589 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51441/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:51441/tests/kraken/driver.html?testName=imaging-desaturate) 05:55:46 INFO - 2015-12-05 05:55:46,191 DEBUG : BROWSER_OUTPUT: RSS: Main: 138620928 05:55:46 INFO - 2015-12-05 05:55:46,191 DEBUG : BROWSER_OUTPUT: 05:55:49 INFO - 2015-12-05 05:55:49,094 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51441/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:51441/tests/kraken/driver.html?testName=json-parse-financial) 05:55:49 INFO - 2015-12-05 05:55:49,695 DEBUG : BROWSER_OUTPUT: RSS: Main: 139997184 05:55:49 INFO - 2015-12-05 05:55:49,695 DEBUG : BROWSER_OUTPUT: 05:55:51 INFO - 2015-12-05 05:55:51,452 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51441/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:51441/tests/kraken/driver.html?testName=json-stringify-tinderbox) 05:55:52 INFO - 2015-12-05 05:55:52,034 DEBUG : BROWSER_OUTPUT: RSS: Main: 140980224 05:55:52 INFO - 2015-12-05 05:55:52,034 DEBUG : BROWSER_OUTPUT: 05:55:53 INFO - 2015-12-05 05:55:53,937 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51441/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:51441/tests/kraken/driver.html?testName=stanford-crypto-aes) 05:55:54 INFO - 2015-12-05 05:55:54,559 DEBUG : BROWSER_OUTPUT: RSS: Main: 141131776 05:55:54 INFO - 2015-12-05 05:55:54,560 DEBUG : BROWSER_OUTPUT: 05:55:56 INFO - 2015-12-05 05:55:56,759 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51441/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:51441/tests/kraken/driver.html?testName=stanford-crypto-ccm) 05:55:57 INFO - 2015-12-05 05:55:57,348 DEBUG : BROWSER_OUTPUT: RSS: Main: 141131776 05:55:57 INFO - 2015-12-05 05:55:57,349 DEBUG : BROWSER_OUTPUT: 05:55:59 INFO - 2015-12-05 05:55:59,949 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51441/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:51441/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 05:56:00 INFO - 2015-12-05 05:56:00,563 DEBUG : BROWSER_OUTPUT: RSS: Main: 141467648 05:56:00 INFO - 2015-12-05 05:56:00,563 DEBUG : BROWSER_OUTPUT: 05:56:03 INFO - 2015-12-05 05:56:03,160 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51441/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:51441/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 05:56:03 INFO - 2015-12-05 05:56:03,754 DEBUG : BROWSER_OUTPUT: RSS: Main: 140541952 05:56:03 INFO - 2015-12-05 05:56:03,754 DEBUG : BROWSER_OUTPUT: 05:56:05 INFO - 2015-12-05 05:56:05,523 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51441/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:51441/tests/kraken/driver.html?testName=ai-astar) 05:56:05 INFO - 2015-12-05 05:56:05,773 DEBUG : BROWSER_OUTPUT: RSS: Main: 141197312 05:56:05 INFO - 2015-12-05 05:56:05,774 DEBUG : BROWSER_OUTPUT: 05:56:05 INFO - 2015-12-05 05:56:05,774 DEBUG : BROWSER_OUTPUT: __start_tp_report 05:56:05 INFO - 2015-12-05 05:56:05,774 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 05:56:05 INFO - 2015-12-05 05:56:05,774 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 05:56:05 INFO - 2015-12-05 05:56:05,774 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 05:56:05 INFO - 2015-12-05 05:56:05,774 DEBUG : BROWSER_OUTPUT: |0;ai-astar;114;108;111;112;113;125;113;112;112;112 05:56:05 INFO - 2015-12-05 05:56:05,774 DEBUG : BROWSER_OUTPUT: |1;audio-beat-detection;153;132;149;161;137;157;168;132;169;138 05:56:05 INFO - 2015-12-05 05:56:05,774 DEBUG : BROWSER_OUTPUT: |2;audio-dft;164;163;165;163;164;170;164;162;164;163 05:56:05 INFO - 2015-12-05 05:56:05,774 DEBUG : BROWSER_OUTPUT: |3;audio-fft;73;72;72;73;74;128;78;79;71;79 05:56:05 INFO - 2015-12-05 05:56:05,775 DEBUG : BROWSER_OUTPUT: |4;audio-oscillator;94;94;140;94;94;94;127;93;94;126 05:56:05 INFO - 2015-12-05 05:56:05,775 DEBUG : BROWSER_OUTPUT: |5;imaging-gaussian-blur;111;109;111;110;110;114;109;110;111;110 05:56:05 INFO - 2015-12-05 05:56:05,775 DEBUG : BROWSER_OUTPUT: |6;imaging-darkroom;148;148;147;149;148;148;148;149;148;147 05:56:05 INFO - 2015-12-05 05:56:05,775 DEBUG : BROWSER_OUTPUT: |7;imaging-desaturate;96;97;98;96;96;96;96;97;96;95 05:56:05 INFO - 2015-12-05 05:56:05,775 DEBUG : BROWSER_OUTPUT: |8;json-parse-financial;73;73;73;72;73;74;73;73;74;75 05:56:05 INFO - 2015-12-05 05:56:05,775 DEBUG : BROWSER_OUTPUT: |9;json-stringify-tinderbox;68;69;69;69;69;68;70;68;69;68 05:56:05 INFO - 2015-12-05 05:56:05,775 DEBUG : BROWSER_OUTPUT: |10;stanford-crypto-aes;85;85;84;86;85;94;86;87;86;97 05:56:05 INFO - 2015-12-05 05:56:05,775 DEBUG : BROWSER_OUTPUT: |11;stanford-crypto-ccm;131;133;123;127;129;135;130;123;122;123 05:56:05 INFO - 2015-12-05 05:56:05,775 DEBUG : BROWSER_OUTPUT: |12;stanford-crypto-pbkdf2;156;148;144;145;148;135;147;145;148;147 05:56:05 INFO - 2015-12-05 05:56:05,776 DEBUG : BROWSER_OUTPUT: |13;stanford-crypto-sha256-iterative;69;71;70;68;69;70;68;69;70;71 05:56:05 INFO - 2015-12-05 05:56:05,776 DEBUG : BROWSER_OUTPUT: __end_tp_report 05:56:05 INFO - 2015-12-05 05:56:05,776 DEBUG : BROWSER_OUTPUT: __start_cc_report 05:56:05 INFO - 2015-12-05 05:56:05,776 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,785 05:56:05 INFO - 2015-12-05 05:56:05,776 DEBUG : BROWSER_OUTPUT: __end_cc_report 05:56:05 INFO - 2015-12-05 05:56:05,776 DEBUG : BROWSER_OUTPUT: __startTimestamp1449323765772__endTimestamp 05:56:05 INFO - 2015-12-05 05:56:05,776 DEBUG : BROWSER_OUTPUT: 05:56:05 INFO - 2015-12-05 05:56:05,784 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 05:56:05 INFO - 2015-12-05 05:56:05,784 DEBUG : BROWSER_OUTPUT: Number of tests: 14 05:56:05 INFO - 2015-12-05 05:56:05,784 DEBUG : BROWSER_OUTPUT: 05:56:05 INFO - 2015-12-05 05:56:05,784 DEBUG : BROWSER_OUTPUT: [#0] ai-astar Cycles:10 Average:113.20 Median:112.50 stddev:4.44 (3.9%) stddev-sans-first:4.70 05:56:05 INFO - 2015-12-05 05:56:05,784 DEBUG : BROWSER_OUTPUT: Values: 114.0 108.0 111.0 112.0 113.0 125.0 113.0 112.0 112.0 112.0 05:56:05 INFO - 2015-12-05 05:56:05,784 DEBUG : BROWSER_OUTPUT: 05:56:05 INFO - 2015-12-05 05:56:05,784 DEBUG : BROWSER_OUTPUT: [#1] audio-beat-detection Cycles:10 Average:149.60 Median:155.00 stddev:14.24 (9.2%) stddev-sans-first:15.05 05:56:05 INFO - 2015-12-05 05:56:05,784 DEBUG : BROWSER_OUTPUT: Values: 153.0 132.0 149.0 161.0 137.0 157.0 168.0 132.0 169.0 138.0 05:56:05 INFO - 2015-12-05 05:56:05,784 DEBUG : BROWSER_OUTPUT: 05:56:05 INFO - 2015-12-05 05:56:05,784 DEBUG : BROWSER_OUTPUT: [#2] audio-dft Cycles:10 Average:164.20 Median:164.00 stddev:2.20 (1.3%) stddev-sans-first:2.33 05:56:05 INFO - 2015-12-05 05:56:05,784 DEBUG : BROWSER_OUTPUT: Values: 164.0 163.0 165.0 163.0 164.0 170.0 164.0 162.0 164.0 163.0 05:56:05 INFO - 2015-12-05 05:56:05,784 DEBUG : BROWSER_OUTPUT: 05:56:05 INFO - 2015-12-05 05:56:05,785 DEBUG : BROWSER_OUTPUT: [#3] audio-fft Cycles:10 Average:79.90 Median:73.50 stddev:17.17 (23.4%) stddev-sans-first:18.03 05:56:05 INFO - 2015-12-05 05:56:05,785 DEBUG : BROWSER_OUTPUT: Values: 73.0 72.0 72.0 73.0 74.0 128.0 78.0 79.0 71.0 79.0 05:56:05 INFO - 2015-12-05 05:56:05,785 DEBUG : BROWSER_OUTPUT: 05:56:05 INFO - 2015-12-05 05:56:05,785 DEBUG : BROWSER_OUTPUT: [#4] audio-oscillator Cycles:10 Average:105.00 Median:94.00 stddev:18.32 (19.5%) stddev-sans-first:18.99 05:56:05 INFO - 2015-12-05 05:56:05,785 DEBUG : BROWSER_OUTPUT: Values: 94.0 94.0 140.0 94.0 94.0 94.0 127.0 93.0 94.0 126.0 05:56:05 INFO - 2015-12-05 05:56:05,785 DEBUG : BROWSER_OUTPUT: 05:56:05 INFO - 2015-12-05 05:56:05,785 DEBUG : BROWSER_OUTPUT: [#5] imaging-gaussian-blur Cycles:10 Average:110.50 Median:110.50 stddev:1.43 (1.3%) stddev-sans-first:1.51 05:56:05 INFO - 2015-12-05 05:56:05,785 DEBUG : BROWSER_OUTPUT: Values: 111.0 109.0 111.0 110.0 110.0 114.0 109.0 110.0 111.0 110.0 05:56:05 INFO - 2015-12-05 05:56:05,785 DEBUG : BROWSER_OUTPUT: 05:56:05 INFO - 2015-12-05 05:56:05,785 DEBUG : BROWSER_OUTPUT: [#6] imaging-darkroom Cycles:10 Average:148.00 Median:148.00 stddev:0.67 (0.5%) stddev-sans-first:0.71 05:56:05 INFO - 2015-12-05 05:56:05,785 DEBUG : BROWSER_OUTPUT: Values: 148.0 148.0 147.0 149.0 148.0 148.0 148.0 149.0 148.0 147.0 05:56:05 INFO - 2015-12-05 05:56:05,785 DEBUG : BROWSER_OUTPUT: 05:56:05 INFO - 2015-12-05 05:56:05,785 DEBUG : BROWSER_OUTPUT: [#7] imaging-desaturate Cycles:10 Average:96.30 Median:96.00 stddev:0.82 (0.9%) stddev-sans-first:0.87 05:56:05 INFO - 2015-12-05 05:56:05,785 DEBUG : BROWSER_OUTPUT: Values: 96.0 97.0 98.0 96.0 96.0 96.0 96.0 97.0 96.0 95.0 05:56:05 INFO - 2015-12-05 05:56:05,785 DEBUG : BROWSER_OUTPUT: 05:56:05 INFO - 2015-12-05 05:56:05,785 DEBUG : BROWSER_OUTPUT: [#8] json-parse-financial Cycles:10 Average:73.30 Median:73.00 stddev:0.82 (1.1%) stddev-sans-first:0.87 05:56:05 INFO - 2015-12-05 05:56:05,786 DEBUG : BROWSER_OUTPUT: Values: 73.0 73.0 73.0 72.0 73.0 74.0 73.0 73.0 74.0 75.0 05:56:05 INFO - 2015-12-05 05:56:05,786 DEBUG : BROWSER_OUTPUT: 05:56:05 INFO - 2015-12-05 05:56:05,786 DEBUG : BROWSER_OUTPUT: [#9] json-stringify-tinderbox Cycles:10 Average:68.70 Median:69.00 stddev:0.67 (1.0%) stddev-sans-first:0.67 05:56:05 INFO - 2015-12-05 05:56:05,786 DEBUG : BROWSER_OUTPUT: Values: 68.0 69.0 69.0 69.0 69.0 68.0 70.0 68.0 69.0 68.0 05:56:05 INFO - 2015-12-05 05:56:05,786 DEBUG : BROWSER_OUTPUT: 05:56:05 INFO - 2015-12-05 05:56:05,786 DEBUG : BROWSER_OUTPUT: [#10] stanford-crypto-aes Cycles:10 Average:87.50 Median:86.00 stddev:4.35 (5.1%) stddev-sans-first:4.52 05:56:05 INFO - 2015-12-05 05:56:05,786 DEBUG : BROWSER_OUTPUT: Values: 85.0 85.0 84.0 86.0 85.0 94.0 86.0 87.0 86.0 97.0 05:56:05 INFO - 2015-12-05 05:56:05,786 DEBUG : BROWSER_OUTPUT: 05:56:05 INFO - 2015-12-05 05:56:05,786 DEBUG : BROWSER_OUTPUT: [#11] stanford-crypto-ccm Cycles:10 Average:127.60 Median:129.50 stddev:4.70 (3.6%) stddev-sans-first:4.82 05:56:05 INFO - 2015-12-05 05:56:05,786 DEBUG : BROWSER_OUTPUT: Values: 131.0 133.0 123.0 127.0 129.0 135.0 130.0 123.0 122.0 123.0 05:56:05 INFO - 2015-12-05 05:56:05,786 DEBUG : BROWSER_OUTPUT: 05:56:05 INFO - 2015-12-05 05:56:05,786 DEBUG : BROWSER_OUTPUT: [#12] stanford-crypto-pbkdf2 Cycles:10 Average:146.30 Median:147.50 stddev:5.17 (3.5%) stddev-sans-first:4.12 05:56:05 INFO - 2015-12-05 05:56:05,786 DEBUG : BROWSER_OUTPUT: Values: 156.0 148.0 144.0 145.0 148.0 135.0 147.0 145.0 148.0 147.0 05:56:05 INFO - 2015-12-05 05:56:05,786 DEBUG : BROWSER_OUTPUT: 05:56:05 INFO - 2015-12-05 05:56:05,786 DEBUG : BROWSER_OUTPUT: [#13] stanford-crypto-sha256-iterative Cycles:10 Average:69.50 Median:70.00 stddev:1.08 (1.5%) stddev-sans-first:1.13 05:56:05 INFO - 2015-12-05 05:56:05,786 DEBUG : BROWSER_OUTPUT: Values: 69.0 71.0 70.0 68.0 69.0 70.0 68.0 69.0 70.0 71.0 05:56:05 INFO - 2015-12-05 05:56:05,786 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 05:56:05 INFO - 2015-12-05 05:56:05,787 DEBUG : BROWSER_OUTPUT: 05:56:06 INFO - 2015-12-05 05:56:06,785 INFO : Browser exited with error code: 0 05:56:06 INFO - 2015-12-05 05:56:06,839 INFO : Completed test kraken (00:01:02) 05:56:06 INFO - 2015-12-05 05:56:06,839 INFO : Starting test v8_7 05:56:06 INFO - 2015-12-05 05:56:06,839 DEBUG : operating with platform_type : linux_ 05:56:06 INFO - 2015-12-05 05:56:06,839 INFO : Initialising browser for v8_7 test... 05:56:06 INFO - 2015-12-05 05:56:06,845 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp24Po6y/profile http://localhost:51441/getInfo.html 05:56:12 INFO - 2015-12-05 05:56:12,608 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 05:56:12 INFO - 2015-12-05 05:56:12,608 DEBUG : BROWSER_OUTPUT: colorDepth:24 05:56:12 INFO - 2015-12-05 05:56:12,608 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 05:56:12 INFO - 2015-12-05 05:56:12,609 DEBUG : BROWSER_OUTPUT: __metrics 05:56:12 INFO - 2015-12-05 05:56:12,771 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:56:14 INFO - 2015-12-05 05:56:14,129 INFO : Browser initialized. 05:56:14 INFO - 2015-12-05 05:56:14,130 INFO : Running cycle 1/1 for v8_7 test... 05:56:14 INFO - 2015-12-05 05:56:14,130 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp24Po6y/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/v8_7/v8.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 05:56:26 INFO - 2015-12-05 05:56:26,127 DEBUG : BROWSER_OUTPUT: RSS: Main: 143200256 05:56:26 INFO - 2015-12-05 05:56:26,128 DEBUG : BROWSER_OUTPUT: 05:56:47 INFO - 2015-12-05 05:56:47,607 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51441/tests/v8_7/run.html (next: http://localhost:51441/tests/v8_7/run.html) 05:56:47 INFO - 2015-12-05 05:56:47,857 DEBUG : BROWSER_OUTPUT: RSS: Main: 138342400 05:56:47 INFO - 2015-12-05 05:56:47,858 DEBUG : BROWSER_OUTPUT: 05:56:47 INFO - 2015-12-05 05:56:47,859 DEBUG : BROWSER_OUTPUT: __start_tp_report 05:56:47 INFO - 2015-12-05 05:56:47,859 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 05:56:47 INFO - 2015-12-05 05:56:47,859 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 05:56:47 INFO - 2015-12-05 05:56:47,859 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 05:56:47 INFO - 2015-12-05 05:56:47,859 DEBUG : BROWSER_OUTPUT: |0;Richards;165.18004625041294 05:56:47 INFO - 2015-12-05 05:56:47,860 DEBUG : BROWSER_OUTPUT: |1;DeltaBlue;191.27773527161438 05:56:47 INFO - 2015-12-05 05:56:47,860 DEBUG : BROWSER_OUTPUT: |2;Encrypt;277.4694783573807 05:56:47 INFO - 2015-12-05 05:56:47,860 DEBUG : BROWSER_OUTPUT: |3;Decrypt;5170.103092783505 05:56:47 INFO - 2015-12-05 05:56:47,860 DEBUG : BROWSER_OUTPUT: |4;RayTrace;1052.6315789473683 05:56:47 INFO - 2015-12-05 05:56:47,860 DEBUG : BROWSER_OUTPUT: |5;Earley;717.3601147776184 05:56:47 INFO - 2015-12-05 05:56:47,860 DEBUG : BROWSER_OUTPUT: |6;Boyer;12195.121951219513 05:56:47 INFO - 2015-12-05 05:56:47,860 DEBUG : BROWSER_OUTPUT: |7;RegExp;26076.923076923078 05:56:47 INFO - 2015-12-05 05:56:47,861 DEBUG : BROWSER_OUTPUT: |8;Splay;591.016548463357 05:56:47 INFO - 2015-12-05 05:56:47,861 DEBUG : BROWSER_OUTPUT: |9;NavierStokes;4840.579710144928 05:56:47 INFO - 2015-12-05 05:56:47,861 DEBUG : BROWSER_OUTPUT: __end_tp_report 05:56:47 INFO - 2015-12-05 05:56:47,862 DEBUG : BROWSER_OUTPUT: __startTimestamp1449323807858__endTimestamp 05:56:47 INFO - 2015-12-05 05:56:47,862 DEBUG : BROWSER_OUTPUT: 05:56:47 INFO - 2015-12-05 05:56:47,862 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 05:56:47 INFO - 2015-12-05 05:56:47,862 DEBUG : BROWSER_OUTPUT: Number of tests: 10 05:56:47 INFO - 2015-12-05 05:56:47,863 DEBUG : BROWSER_OUTPUT: 05:56:47 INFO - 2015-12-05 05:56:47,863 DEBUG : BROWSER_OUTPUT: [#0] Richards Cycles:1 Average:165.18 Median:165.18 stddev:0.00 (0.0%) 05:56:47 INFO - 2015-12-05 05:56:47,863 DEBUG : BROWSER_OUTPUT: Values: 165.2 05:56:47 INFO - 2015-12-05 05:56:47,863 DEBUG : BROWSER_OUTPUT: 05:56:47 INFO - 2015-12-05 05:56:47,863 DEBUG : BROWSER_OUTPUT: [#1] DeltaBlue Cycles:1 Average:191.28 Median:191.28 stddev:0.00 (0.0%) 05:56:47 INFO - 2015-12-05 05:56:47,863 DEBUG : BROWSER_OUTPUT: Values: 191.3 05:56:47 INFO - 2015-12-05 05:56:47,863 DEBUG : BROWSER_OUTPUT: 05:56:47 INFO - 2015-12-05 05:56:47,863 DEBUG : BROWSER_OUTPUT: [#2] Encrypt Cycles:1 Average:277.47 Median:277.47 stddev:0.00 (0.0%) 05:56:47 INFO - 2015-12-05 05:56:47,864 DEBUG : BROWSER_OUTPUT: Values: 277.5 05:56:47 INFO - 2015-12-05 05:56:47,864 DEBUG : BROWSER_OUTPUT: 05:56:47 INFO - 2015-12-05 05:56:47,864 DEBUG : BROWSER_OUTPUT: [#3] Decrypt Cycles:1 Average:5170.10 Median:5170.10 stddev:0.00 (0.0%) 05:56:47 INFO - 2015-12-05 05:56:47,864 DEBUG : BROWSER_OUTPUT: Values: 5170.1 05:56:47 INFO - 2015-12-05 05:56:47,864 DEBUG : BROWSER_OUTPUT: 05:56:47 INFO - 2015-12-05 05:56:47,864 DEBUG : BROWSER_OUTPUT: [#4] RayTrace Cycles:1 Average:1052.63 Median:1052.63 stddev:0.00 (0.0%) 05:56:47 INFO - 2015-12-05 05:56:47,864 DEBUG : BROWSER_OUTPUT: Values: 1052.6 05:56:47 INFO - 2015-12-05 05:56:47,864 DEBUG : BROWSER_OUTPUT: 05:56:47 INFO - 2015-12-05 05:56:47,865 DEBUG : BROWSER_OUTPUT: [#5] Earley Cycles:1 Average:717.36 Median:717.36 stddev:0.00 (0.0%) 05:56:47 INFO - 2015-12-05 05:56:47,865 DEBUG : BROWSER_OUTPUT: Values: 717.4 05:56:47 INFO - 2015-12-05 05:56:47,865 DEBUG : BROWSER_OUTPUT: 05:56:47 INFO - 2015-12-05 05:56:47,865 DEBUG : BROWSER_OUTPUT: [#6] Boyer Cycles:1 Average:12195.12 Median:12195.12 stddev:0.00 (0.0%) 05:56:47 INFO - 2015-12-05 05:56:47,865 DEBUG : BROWSER_OUTPUT: Values: 12195.1 05:56:47 INFO - 2015-12-05 05:56:47,865 DEBUG : BROWSER_OUTPUT: 05:56:47 INFO - 2015-12-05 05:56:47,865 DEBUG : BROWSER_OUTPUT: [#7] RegExp Cycles:1 Average:26076.92 Median:26076.92 stddev:0.00 (0.0%) 05:56:47 INFO - 2015-12-05 05:56:47,865 DEBUG : BROWSER_OUTPUT: Values: 26076.9 05:56:47 INFO - 2015-12-05 05:56:47,865 DEBUG : BROWSER_OUTPUT: 05:56:47 INFO - 2015-12-05 05:56:47,865 DEBUG : BROWSER_OUTPUT: [#8] Splay Cycles:1 Average:591.02 Median:591.02 stddev:0.00 (0.0%) 05:56:47 INFO - 2015-12-05 05:56:47,865 DEBUG : BROWSER_OUTPUT: Values: 591.0 05:56:47 INFO - 2015-12-05 05:56:47,866 DEBUG : BROWSER_OUTPUT: 05:56:47 INFO - 2015-12-05 05:56:47,866 DEBUG : BROWSER_OUTPUT: [#9] NavierStokes Cycles:1 Average:4840.58 Median:4840.58 stddev:0.00 (0.0%) 05:56:47 INFO - 2015-12-05 05:56:47,866 DEBUG : BROWSER_OUTPUT: Values: 4840.6 05:56:47 INFO - 2015-12-05 05:56:47,866 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 05:56:47 INFO - 2015-12-05 05:56:47,866 DEBUG : BROWSER_OUTPUT: 05:56:48 INFO - 2015-12-05 05:56:48,913 INFO : Browser exited with error code: 0 05:56:48 INFO - 2015-12-05 05:56:48,932 INFO : Completed test v8_7 (00:00:42) 05:56:49 INFO - 2015-12-05 05:56:49,392 INFO : Completed test suite (00:20:21) 05:56:49 INFO - 2015-12-05 05:56:49,392 DEBUG : Working with test: dromaeo_css 05:56:49 INFO - 2015-12-05 05:56:49,393 DEBUG : Generating results file: dromaeo_css 05:56:49 INFO - 2015-12-05 05:56:49,394 DEBUG : Working with test: kraken 05:56:49 INFO - 2015-12-05 05:56:49,394 DEBUG : Generating results file: kraken 05:56:49 INFO - 2015-12-05 05:56:49,394 INFO : javascript benchmark 05:56:49 INFO - 2015-12-05 05:56:49,395 DEBUG : Working with test: v8_7 05:56:49 INFO - 2015-12-05 05:56:49,395 DEBUG : Generating results file: v8_7 05:56:49 INFO - 2015-12-05 05:56:49,395 INFO : Posting result 0 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 05:56:49 INFO - 2015-12-05 05:56:49,532 DEBUG : process_Request line: dromaeo_css graph.html#tests=[[72,94,43]] 05:56:49 INFO - 2015-12-05 05:56:49,532 DEBUG : process_Request line: dromaeo_css 6337.48 graph.html#tests=[[72,94,43]] 05:56:49 INFO - 2015-12-05 05:56:49,532 INFO : Posting result 1 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 05:56:49 INFO - 2015-12-05 05:56:49,566 DEBUG : process_Request line: kraken 1539.60 graph.html#tests=[[232,94,43]] 05:56:49 INFO - 2015-12-05 05:56:49,567 INFO : Posting result 2 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 05:56:49 INFO - 2015-12-05 05:56:49,595 DEBUG : process_Request line: v8_7 21387.57 graph.html#tests=[[230,94,43]] 05:56:49 INFO - 2015-12-05 05:56:49,596 INFO : javascript benchmark 05:56:49 INFO - 2015-12-05 05:56:49,600 INFO : PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [2667.9333016674586, 2686.5029969455663, 2699.3386620278034, 2733.139061195723, 2747.2994386431455, 4471.485779135401, 4721.339012538243, 4737.407824021997, 4747.501512341202, 4766.856994290169, 4564.931526027104, 4635.629149668027, 4635.930461043079, 4648.279516674921, 4652.813887444507, 4144.109016561439, 4265.402843601898, 4375.824967001332, 4427.00392411708, 4510.571495707903, 4152.397902304149, 4418.845340413086, 4421.226285400058, 4462.286034234523, 4476.395686582318, 4184.727992680497, 4217.62041416274, 4231.090315582134, 4261.978690106561, 4267.445232119804, 4319.222539942809, 4332.935005974913, 4337.71804832688, 4346.500152482474, 4392.143532011259, 4114.0948991221885, 4222.324428091521, 4310.094880075188, 4310.568943105695, 4370.169667763146, 4496.392986946753, 4548.56788605082, 4570.862874113782, 4583.427071616048, 4603.654725895572, 4892.9510704892855, 4918.311436398907, 4954.975225123887, 4955.033768415161, 4986.775595098229, 4959.20652695567, 4966.453690094087, 4976.5023497649945, 4994.825181118644, 5001.799928002875, 4415.271480205763, 4520.367148599199, 4533.2746760518485, 4616.676832621752, 4657.301404789241, 5119.513646203604, 5198.81804136861, 5201.453847345974, 5211.1922651989, 5225.216217567396, 4732.763361831963, 4956.083124621957, 4978.0, 4980.900381992412, 5022.995400919831, 4903.239997800275, 4962.9007419851405, 4978.103941290602, 4987.800487980513, 5030.647854650139, 4987.226979818134, 5034.949650503521, 5039.899202015939, 5042.470540593258, 5077.974610126999, 4656.115338085753, 4771.594414474739, 4994.675346102492, 5000.074986127578, 5065.265536497187, 4048.0487085534874, 4110.383442483651, 4112.938305925413, 4123.546409894909, 4142.026623743418, 3636.2000359920776, 3645.325614761278, 3666.3034023535442, 3700.4449332600325, 3714.925701485955, 4102.097538541576, 4208.263553878059, 4220.91558168841, 4302.7848607569495, 4370.082282720664, 4875.219964805614, 4938.209886418228, 4958.479359667255, 4969.478204788517, 4995.125852975715, 4316.6546676265825, 4381.890452738643, 4386.342048692722, 4414.4702635683925, 4429.645628349725, 4301.591348821857, 4435.6895017349125, 4453.354263631755, 4486.349479325545, 4487.88780280489, 4703.082898834763, 4752.2158843790385, 4775.808967641325, 4783.210770222874, 4807.543283388072, 5059.291699162047, 5078.162103253069, 5078.162103253069, 5098.439171691037, 5114.846554603368, 4597.448306203143, 4720.291956206596, 4813.278008298783, 4818.397700287464, 4854.0, 4982.451930287738, 5034.0, 5055.494450554915, 5057.31726216956, 5102.515261050195, 5069.594432445322, 5073.416557095981, 5077.263796749525, 5088.974555127201, 5118.488151185001, 4663.696859704109, 4694.460137084143, 4791.377120974251, 4917.262410638433, 4922.556969872729, 4827.662063655511, 4833.854984350475, 4859.805607775649, 4864.197407427735, 4907.533784290486, 4728.3380326753595, 4759.524047595212, 4772.331873537777, 4772.594329482033, 4788.880277993078, 4667.813287468463, 4716.339712440193, 4726.692764970266, 4827.468978412302, 4880.682755620874, 4708.576228139484, 4743.312219728189, 4750.12122757291, 4753.83361582343, 4766.308885211555], "unit": "ms", "name": "dojo.html", "value": 4580.100462725814}, {"lowerIsBetter": false, "replicates": [542.7476223556046, 547.4087984976226, 549.6839317392499, 557.1308758336994, 558.0763835851667, 37526.0, 38018.42972355413, 38269.425958610605, 38371.61628383715, 38438.423423648666, 40457.19085618293, 40848.79575602125, 40892.18215635685, 41115.17769644605, 41173.11788174829, 7841.686332546691, 8026.357891368676, 8044.758657240292, 8054.597270136499, 8079.313258373046, 7703.730369437043, 7729.34300584451, 7754.0, 7757.922420775804, 7765.8058548536455, 7935.404844636647, 8046.5976701165, 8052.154523775007, 8054.43618946674, 8054.919450805505, 7948.801279967989, 7994.840103197904, 8022.27799498048, 8024.117347091816, 8042.798930026737, 7758.146603873626, 7868.567228802413, 7884.32983196429, 7888.56612886291, 7921.683132674686, 37840.62159378399, 38269.61730382716, 38285.0428739281, 38290.80854595737, 38303.23393532142, 2641.1077731134183, 2644.867756612181, 2657.109868194157, 2686.7850571954195, 2688.9327766805986, 26899.193024209304, 27017.32456688579, 27074.323141921413, 27348.0, 27506.312342191606, 3429.2969941162, 3448.603410607762, 3474.6525347465304, 3562.2341196642847, 3574.7855128692363, 212878.0, 212895.0, 213923.93038034867, 213983.0, 215500.0, 51301.0, 53362.73318633382, 53874.0, 53954.19068713972, 53989.73005134949, 48941.51058489441, 66226.33773662298, 67699.32300677028, 67868.6606566964, 68228.0, 14444.494442694666, 14854.257287135817, 14878.628034299012, 14917.328720207617, 14950.252487375588, 10618.575256989789, 10695.465226738632, 10701.89298107009, 10718.35689858611, 10727.731806704895, 19087.522811929535, 19421.90289048574, 19493.8050619492, 19520.535959802786, 19530.511737206685, 7499.925000750031, 7601.7719468416035, 7684.231576842271, 7689.461737678421, 7822.726204582812, 826.8428998490267, 858.8539948208819, 860.720265913568, 920.9125133112343, 940.041158018817, 22913.770862291498, 22915.312540623807, 23136.65295020576, 23177.53644927092, 23340.41648958756, 912.8539433690578, 928.2620316848122, 949.0367277213634, 993.7465946183677, 1042.3120740311358, 12396.938015309866, 12435.316057616737, 12443.875561244453, 12525.812112818316, 12531.122821402414, 255286.0, 262396.0, 262565.0, 262615.0, 264121.0, 45944.3108353375, 46420.76789616098, 46472.3029154563, 46483.30275045877, 46691.53308466872, 1190.7678002789546, 1201.549418967887, 1206.258151236983, 1219.432963671897, 1230.7292395672937, 24917.626235606844, 25278.620820688073, 25301.493970120864, 25360.365990849637, 25740.485190296462, 39195.80402097971, 39365.0, 39812.20375592414, 39931.80034099811, 39996.80001599973, 244980.0, 245983.0, 246435.0, 247211.0, 247388.0, 28768.856155719925, 29029.564556532092, 29140.70859291465, 29224.561631575118, 29260.0, 34846.47730283997, 35153.47269791007, 35244.64755352413, 35366.82316588401, 35411.468827968114, 29516.262093447836, 30688.232794180323, 32485.633330672612, 33150.668493314755, 33364.0, 32507.512387314684, 32601.34797304088, 32708.672913270562, 32771.18072048218, 32959.340813184084, 32974.34051319008, 33128.50307245441, 33241.33517329591, 33248.66751332456, 33392.66607333896, 26783.0, 37913.62086379101, 40697.79651101726, 41041.58958410378, 41869.0, 28797.280067997628, 28917.0, 29052.128436146948, 29203.561946570393, 29631.555526667547], "unit": "ms", "name": "ext.html", "value": 16884.381742915386}, {"lowerIsBetter": false, "replicates": [329.30188001436926, 331.99170020749494, 332.3950410253339, 334.4932427372531, 334.9748768842336, 14997.850021499782, 15435.691286174284, 16090.919545402287, 16239.756403653955, 16798.076105814176, 15040.623984400368, 15315.923420382882, 15619.672327852146, 15875.761863572026, 15908.84091159088, 4573.268277075668, 4728.739919304437, 4745.90508189836, 4749.928751068736, 4755.0, 4947.208446648537, 4948.628852836052, 4959.305697202394, 4974.179260422026, 4997.500249974992, 4770.761461926907, 4937.407511098673, 4949.480304568023, 4951.03454826309, 4954.504549545053, 4806.303086052538, 4908.116539022974, 4916.852494425155, 4937.1606826839525, 4956.430010548797, 5196.92204616931, 5211.062008838446, 5216.8695782605355, 5217.426083130853, 5230.34620672416, 11208.495617697223, 11461.197716159872, 13876.791848122186, 18762.62474750511, 18810.811891881043, 1572.481081243187, 1636.0674415583123, 1664.459050808492, 1708.069102339228, 1768.717005279162, 8173.346132309401, 8560.571971401405, 8577.656893724243, 8865.290776737846, 8891.199792018684, 1609.3884323956822, 1659.842314980075, 1666.7416550434702, 1677.9916100419541, 1735.9584249450354, 55602.16596751052, 57384.42615573874, 58331.70834145802, 60265.6986715068, 61632.075518866804, 12298.20061695987, 14808.11693826378, 15434.228288585526, 16088.839111608968, 16190.614180151957, 22807.771922280564, 23089.653655195187, 23132.074717011466, 23159.0, 23276.65085023726, 8813.515256660818, 8820.073892241222, 9048.366614336934, 9073.727788166365, 9125.269978401711, 7540.095188577406, 7554.4334174936, 7579.355754760797, 7586.848263034708, 7591.278828511283, 4037.0916543777416, 4095.4061661059577, 4132.132252227066, 7664.0, 7675.002249707614, 1730.4722059771639, 1758.6834369813557, 1791.8208179182238, 1800.0639667373155, 1823.3709370267236, 839.9244068033784, 862.7411776467035, 870.6909047288248, 878.2666473494703, 921.4563407589554, 15698.76451853223, 15769.369225231092, 15895.682086358209, 16101.27544260511, 16488.0, 845.8139209373928, 891.9920489846432, 900.2662829793697, 905.330055758747, 928.7863791328033, 9092.454452732858, 9121.133492318218, 9139.543022848964, 9285.924184543099, 9418.34071614994, 448099.0, 450690.0, 456735.0, 459893.0, 471791.0, 71809.0, 73015.63492182505, 74324.0, 74465.25534744692, 74856.62571687107, 1031.9896801032044, 1044.3785947361307, 1068.161493227828, 1077.2513103393223, 1081.9621313254, 14248.430062797372, 14424.495142669955, 14446.349914254093, 14458.0, 14491.49279775245, 33046.17384565309, 34212.0, 34332.82833585816, 34792.304153917285, 35666.10834729049, 40342.79828600838, 42353.57646423496, 42952.78523607362, 43051.0, 43106.56893431026, 7597.354224890946, 8326.666933322842, 8390.202930721573, 8538.359623028422, 8585.399022068395, 9816.214702823614, 9909.95045024799, 11539.653810385702, 15467.767983480031, 15729.44946926852, 13259.469621215043, 13377.732445350845, 13440.395182216627, 13444.932775336061, 13658.248796316298, 12449.875501244871, 12519.687007824878, 12714.936425317814, 13153.868461315647, 13487.258200798658, 13147.671308217372, 13211.867881321064, 13542.187468751512, 13807.79288310656, 14036.929815350857, 8522.786930326543, 8542.0, 8556.358273129665, 8565.0, 8965.417247878868, 13025.413856376295, 13765.0, 13856.0, 14300.427982880568, 14400.711985760436], "unit": "ms", "name": "jquery.html", "value": 8505.841807801024}, {"lowerIsBetter": false, "replicates": [1394.5943247897371, 1417.1426287096306, 1509.486774496671, 1677.0859881364656, 1747.1177055586932, 6067.089936509526, 6291.11924330593, 6957.443404527638, 7221.627890700764, 7228.602426866521, 7096.325849044332, 7285.271472852712, 7310.34206921377, 7320.0, 7334.229905859888, 2086.895655217241, 2108.9050992705365, 2109.198504568262, 2115.820155286795, 2124.0654112190664, 2076.9926585605967, 2088.4152437317575, 2117.8093971542557, 2128.8935553222277, 2129.9680504792364, 2060.6805945078463, 2066.101245958013, 2070.9275175368866, 2074.0770357191054, 2092.131765317399, 2032.634125857345, 2053.969190462144, 2054.6609809381434, 2061.680439531875, 2065.7004734313514, 2050.3131450963947, 2067.5451400691823, 2091.278508914422, 2093.2987449204534, 2101.2645574049116, 7351.669174887143, 7430.145533263636, 7440.330370266702, 7441.330280274748, 7449.664765085584, 4265.0616864289805, 4275.444192255018, 4297.8495752648505, 4309.612134907873, 4358.302671572565, 2579.2649095007832, 2626.75045870642, 2671.2520494261444, 2743.067357098596, 2752.353196998724, 839.6431516605479, 846.7459762071354, 847.855864503036, 851.3231980575457, 882.5851849630664, 9829.361091529028, 9867.90132098677, 9872.1608663263, 9876.753081172956, 9940.304178707493, 3956.5054368203973, 3999.480067591253, 4005.319095753729, 4019.336809426412, 4039.535453422894, 8564.3148548116, 8600.913990860012, 8618.569071546523, 8627.352948528885, 8657.523836188944, 4352.368906508538, 4360.912781744348, 4389.714668546598, 4389.868303950887, 4391.033972526039, 3244.561984132112, 3343.481760327153, 3882.3011857865854, 3893.669038131734, 3897.4738410314812, 3552.342816578941, 3572.6070132285427, 3583.6774690278, 3594.9101272467874, 3598.7660802047785, 1083.7019819549687, 1084.9783004340027, 1089.5696200000955, 1092.579356947565, 1097.7091070866227, 882.8190221004679, 894.3918135667678, 1166.608452672019, 1185.2651356159236, 1202.482932339085, 6935.202451718016, 6944.51388402807, 6945.374916257561, 6961.686724097428, 7013.824654383681, 414.04562483475877, 423.82199476220063, 425.05001322045206, 426.05203422384943, 427.74549143259713, 5370.087085195526, 5461.344638643309, 5523.226748255248, 5526.281583394213, 5540.335159780771, 8576.0, 8619.267362274151, 8743.519106449206, 8795.120487951153, 8934.553272336487, 8823.985241697286, 8848.867266991001, 8849.070847561043, 8872.600732967032, 8892.3330750194, 6933.133358330309, 6933.341332573397, 6934.202566704894, 6980.7905762827195, 7029.578225306498, 6719.664016799043, 6723.394894459327, 6728.226253980855, 6730.831729206613, 6744.22441419243, 7780.455368124403, 7866.449348545547, 7901.130875603564, 7969.681212751425, 7970.242826931432, 7718.15100338951, 7877.684892604231, 7948.8807667886185, 8107.797305067421, 8112.351011918914, 5401.567874570103, 5502.202180683858, 6132.202813634378, 6440.13058237132, 6513.381228783258, 6554.918438457792, 6557.803265902031, 6574.04676321921, 6580.473562115115, 6581.638009909501, 6428.967855160694, 6541.771038013647, 6544.411003009752, 6584.868302633825, 6653.201615806134, 6300.653464059521, 6368.968155159195, 6569.9014514783275, 6598.934010659832, 6620.768273110418, 6347.746090156342, 6404.263509696445, 6404.935950640434, 6439.935600643934, 6464.4828413725845, 5834.124881267844, 5853.531717462678, 5918.526517878646, 5948.256467941507, 5974.790882319272, 6013.699315034319, 6035.969820150871, 6060.000099983629, 6060.606060606046, 6078.787242446493], "unit": "ms", "name": "mootools.html", "value": 4044.185795624035}, {"lowerIsBetter": false, "replicates": [277.2320671739282, 281.6620055932881, 286.61450349280216, 287.5514197851352, 289.78845442826724, 5328.067588172074, 5516.69658168801, 5525.419830917756, 5565.6660600364, 5606.187102870082, 5421.864453388667, 5483.341998960131, 5488.835334939959, 5495.642783219088, 5526.866992266586, 4132.380142978563, 4133.8553150639655, 4136.048708796979, 4141.8964525886795, 4145.585441455861, 4142.627163555279, 4143.979280103596, 4159.916801663965, 4163.354680024601, 4169.187008533338, 4026.3557830747086, 4106.671466282705, 4113.56807535209, 4122.938155927648, 4123.381492776078, 4049.838006479752, 4101.630853223224, 4105.32262176739, 4108.979455102735, 4113.938290925638, 3510.8420121094355, 3511.2450823073164, 3511.473279008144, 3514.4025515662397, 3515.8417871195857, 5046.142155833517, 5170.689758614495, 5184.766685499161, 5286.5770738341225, 5295.602829787743, 4750.121227572876, 4768.403949506312, 4770.713757174581, 4785.928211076836, 4813.205821039524, 5764.654120752726, 5773.220615216934, 5773.913391299134, 5774.82675519735, 5782.537397008229, 3931.4495970564144, 3934.665553427962, 3938.8818335449982, 3942.6451619354107, 3944.980275098606, 5865.706714664249, 5966.463018328328, 6096.993995990701, 6097.69511524422, 6104.908426373608, 3931.3906344516645, 3945.5659877413464, 3959.4060890866026, 3960.0099975006246, 3960.108975480494, 4015.2371049500503, 4019.0354314964197, 4024.557298697141, 4025.75845449274, 4028.4964379452567, 4699.624030077585, 4701.059788042405, 4704.788284527136, 4711.104890070944, 4711.646626503026, 5520.199571062173, 5579.13523403873, 5750.3099628044065, 5752.827415177551, 5785.65286082828, 1418.0640777087074, 1452.6368407898026, 1454.2946670864621, 1455.6870272891379, 1455.7015811758565, 953.6233187890745, 955.1785464500524, 961.9134277915022, 973.634886917406, 977.6040703515088, 4964.453910069889, 4989.376327959005, 4989.401271847401, 4991.0766508195375, 4993.076280888047, 5902.793402230901, 5940.70296485174, 5961.731722072517, 5965.164876917235, 5971.223740913741, 4924.285978533093, 4935.679180853233, 4970.2793095001025, 4977.552020318189, 4987.301777751118, 3155.709615545849, 3179.4277030134335, 3185.9327125413247, 3206.8075915445147, 3221.500667396557, 5595.8601034973635, 5612.438756124437, 5620.213170156181, 5620.522255608319, 5622.240997465372, 6082.75668973245, 6095.603785753912, 6099.085137229451, 6105.236845394325, 6143.0, 5612.635178713371, 5617.354004289477, 5623.2408624835125, 5626.2967129108865, 5627.43725627434, 5787.421257874347, 6027.547933905063, 6033.939660603338, 6043.54673399488, 6046.697665116639, 5908.438698323653, 5908.793192238251, 5908.940910590839, 5909.261342332208, 5913.319968203712, 5671.971640141773, 5678.432156784454, 5681.119426488901, 5689.829305120853, 5695.2311437957005, 3822.7897465639658, 3893.9026524335986, 3914.4911161548816, 3948.0919388540224, 3952.78259695708, 5832.387599302012, 5942.465178133989, 5942.910856337245, 5955.702214889325, 5976.163337132718, 5783.219265399117, 5813.709314534341, 5814.098814683731, 5819.301683797971, 5829.504492118217, 5798.971005144947, 5802.82591522255, 5813.79651712188, 5818.505427038749, 5823.068309070529, 5513.2005859151, 5654.604177707521, 5673.74468148926, 5694.857628559153, 5697.0, 5816.272965879265, 5825.0, 5828.184054232495, 5828.970855145697, 5838.94161058401, 5624.212610234488, 5625.578081643811, 5647.830565083054, 5666.858328541819, 5671.291088613923], "unit": "ms", "name": "prototype.html", "value": 4262.679569549753}, {"lowerIsBetter": false, "replicates": [746.4289818289006, 751.2975368030895, 755.9470837041407, 770.3644493293033, 777.308195705822, 11302.491387887545, 11475.540978360876, 11478.598249061284, 11494.36780977046, 11515.654530364092, 10795.352278863274, 13272.668183295422, 13472.25902575358, 13491.595252142451, 13548.18710877348, 806.5725165662179, 807.6325272001241, 816.7876352148425, 820.3929092471558, 822.411975437562, 816.6447595296036, 825.1377310710292, 831.9542425166613, 832.8875601793771, 834.2075028722708, 846.3060290561742, 853.6628031927385, 854.3293514591047, 855.0466230153365, 856.8286342731448, 839.236294971579, 842.1999100854182, 843.9704610338639, 845.5856630251194, 845.8308338332358, 621.0808004153878, 622.947049500793, 624.0171729526014, 625.6058683029662, 628.3873223606993, 11687.240329378563, 11712.648620541397, 11715.824262635982, 11742.178047536676, 11754.647360579196, 10555.313904596176, 10831.079358254558, 11056.0, 11433.656990290305, 11761.58834440799, 9067.682631107946, 9333.626654933794, 9378.343515953886, 9424.481653509054, 9430.90569094314, 3123.0630810756684, 3124.812511249332, 3163.6994485523837, 3176.6029246344206, 3198.104530731399, 40984.180316393504, 41566.0, 41719.374209386886, 41719.53981610629, 41752.1649567007, 8617.69838055665, 8774.210321071134, 9115.954420227989, 9180.21968132703, 9249.028851970446, 16348.509544713677, 16426.917865410836, 16439.178041097897, 16512.0, 16547.669046619, 5994.400559943971, 6017.488513476316, 6221.502279817604, 6313.053042043638, 6363.809085727436, 3296.159479332755, 3306.5866766654167, 3380.695737383647, 3384.340053689556, 3549.5030695702108, 2596.4287856671504, 2633.4601406711577, 2640.3003204150914, 2641.5245255853747, 2642.7753640940737, 452.30119465426, 454.470541818784, 462.2303864066359, 471.63919601504875, 482.73449602718364, 573.7160105747598, 578.2858170159849, 599.8860216558927, 610.6458254212546, 619.8202521268872, 7212.675429605575, 7362.411007119417, 7450.590217538087, 7506.0, 7580.810479738051, 474.30751103388747, 479.71217269637935, 528.1496790167827, 565.5419110520492, 573.6586730895111, 3594.2092739597247, 3597.9280414391565, 3708.165662725919, 3757.1170774867883, 3777.792221427848, 50419.24371134436, 50544.747276263384, 50652.0, 50852.49147508552, 50900.490995089574, 44737.77631111889, 44982.0, 45208.54791452109, 45409.0, 46187.07625847464, 41889.0, 41897.162056759305, 42219.788901055916, 42280.0, 42371.57628423676, 7382.224866388952, 7383.114026316876, 7496.362809161283, 7558.3953283738265, 7728.961355193188, 29460.263493412836, 30106.397872042875, 30189.698103018687, 30577.54133688041, 30925.0, 37700.05749856275, 38471.0, 39041.609583903795, 39047.41428878626, 39322.2135557293, 10151.441670708182, 10273.640422585173, 10431.478426078818, 10614.0, 10647.30792498485, 11228.157888158257, 11354.432278385882, 11371.0, 11490.08079353633, 11493.540258389905, 10668.0, 10842.457877106272, 10928.0, 10977.95179467327, 11030.06244469197, 10236.18110551169, 10243.94878025605, 10250.128739056965, 10250.179985601284, 10469.31949423285, 10209.540570674486, 10443.68668939933, 10516.737081572715, 10634.30876992993, 10689.0, 9391.436513809193, 9445.433274003582, 9530.571124299284, 9549.61801527959, 9605.663801766905, 8461.450005749606, 8811.611433100714, 8867.512286824287, 8896.86654700193, 8922.375433719577], "unit": "ms", "name": "yui.html", "value": 5712.990284214154}], "name": "dromaeo_css", "value": 6337.4820431960325}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [114.0, 108.0, 111.0, 112.0, 113.0, 125.0, 113.0, 112.0, 112.0, 112.0], "unit": "ms", "name": "ai-astar", "value": 113.2}, {"lowerIsBetter": true, "replicates": [153.0, 132.0, 149.0, 161.0, 137.0, 157.0, 168.0, 132.0, 169.0, 138.0], "unit": "ms", "name": "audio-beat-detection", "value": 149.6}, {"lowerIsBetter": true, "replicates": [164.0, 163.0, 165.0, 163.0, 164.0, 170.0, 164.0, 162.0, 164.0, 163.0], "unit": "ms", "name": "audio-dft", "value": 164.2}, {"lowerIsBetter": true, "replicates": [73.0, 72.0, 72.0, 73.0, 74.0, 128.0, 78.0, 79.0, 71.0, 79.0], "unit": "ms", "name": "audio-fft", "value": 79.9}, {"lowerIsBetter": true, "replicates": [94.0, 94.0, 140.0, 94.0, 94.0, 94.0, 127.0, 93.0, 94.0, 126.0], "unit": "ms", "name": "audio-oscillator", "value": 105.0}, {"lowerIsBetter": true, "replicates": [111.0, 109.0, 111.0, 110.0, 110.0, 114.0, 109.0, 110.0, 111.0, 110.0], "unit": "ms", "name": "imaging-gaussian-blur", "value": 110.5}, {"lowerIsBetter": true, "replicates": [148.0, 148.0, 147.0, 149.0, 148.0, 148.0, 148.0, 149.0, 148.0, 147.0], "unit": "ms", "name": "imaging-darkroom", "value": 148.0}, {"lowerIsBetter": true, "replicates": [96.0, 97.0, 98.0, 96.0, 96.0, 96.0, 96.0, 97.0, 96.0, 95.0], "unit": "ms", "name": "imaging-desaturate", "value": 96.3}, {"lowerIsBetter": true, "replicates": [73.0, 73.0, 73.0, 72.0, 73.0, 74.0, 73.0, 73.0, 74.0, 75.0], "unit": "ms", "name": "json-parse-financial", "value": 73.3}, {"lowerIsBetter": true, "replicates": [68.0, 69.0, 69.0, 69.0, 69.0, 68.0, 70.0, 68.0, 69.0, 68.0], "unit": "ms", "name": "json-stringify-tinderbox", "value": 68.7}, {"lowerIsBetter": true, "replicates": [85.0, 85.0, 84.0, 86.0, 85.0, 94.0, 86.0, 87.0, 86.0, 97.0], "unit": "ms", "name": "stanford-crypto-aes", "value": 87.5}, {"lowerIsBetter": true, "replicates": [131.0, 133.0, 123.0, 127.0, 129.0, 135.0, 130.0, 123.0, 122.0, 123.0], "unit": "ms", "name": "stanford-crypto-ccm", "value": 127.6}, {"lowerIsBetter": true, "replicates": [156.0, 148.0, 144.0, 145.0, 148.0, 135.0, 147.0, 145.0, 148.0, 147.0], "unit": "ms", "name": "stanford-crypto-pbkdf2", "value": 146.3}, {"lowerIsBetter": true, "replicates": [69.0, 71.0, 70.0, 68.0, 69.0, 70.0, 68.0, 69.0, 70.0, 71.0], "unit": "ms", "name": "stanford-crypto-sha256-iterative", "value": 69.5}], "name": "kraken", "value": 1539.6}, {"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [165.18004625041294], "unit": "score", "name": "Richards", "value": 213.71830799999998}, {"lowerIsBetter": false, "replicates": [191.27773527161438], "unit": "score", "name": "DeltaBlue", "value": 345.66490400000004}, {"lowerIsBetter": false, "replicates": [277.4694783573807], "unit": "score", "name": "Encrypt", "value": 959.316324}, {"lowerIsBetter": false, "replicates": [5170.103092783505], "unit": "score", "name": "Decrypt", "value": 51.48466001994015}, {"lowerIsBetter": false, "replicates": [1052.6315789473683], "unit": "score", "name": "RayTrace", "value": 702.9895499999999}, {"lowerIsBetter": false, "replicates": [717.3601147776184], "unit": "score", "name": "Earley", "value": 929.0494220000003}, {"lowerIsBetter": false, "replicates": [12195.121951219513], "unit": "score", "name": "Boyer", "value": 54.64996600000001}, {"lowerIsBetter": false, "replicates": [26076.923076923078], "unit": "score", "name": "RegExp", "value": 34.934528023598794}, {"lowerIsBetter": false, "replicates": [591.016548463357], "unit": "score", "name": "Splay", "value": 137.882772}, {"lowerIsBetter": false, "replicates": [4840.579710144928], "unit": "score", "name": "NavierStokes", "value": 306.5748502994012}], "name": "v8_7", "value": 21387.574417158678}]} 05:56:49 INFO - RETURN: dromaeo_css: 6337.48 05:56:49 INFO - RETURN: kraken: 1539.60 05:56:49 INFO - RETURN: v8_7: 21387.57 05:56:49 INFO - TinderboxPrint: TalosResult: {"graphserver": {"v8_7": {"url": "http://graphs.mozilla.org/graph.html#tests=[[230,94,43]]", "result": "21387.57"}, "kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,94,43]]", "result": "1539.60"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,94,43]]", "result": "6337.48"}}} 05:56:49 INFO - Return code: 0 05:56:49 INFO - Validating PERFHERDER_DATA against /builds/slave/test/build/tests/talos/treeherder-schemas/performance-artifact.json 05:56:49 INFO - # TBPL SUCCESS # 05:56:49 INFO - Running post-action listener: _resource_record_post_action 05:56:49 INFO - Running post-run listener: _resource_record_post_run 05:56:50 INFO - Total resource usage - Wall time: 1238s; CPU: 13.0%; Read bytes: 0; Write bytes: 514478080; Read time: 0; Write time: 1252248 05:56:50 INFO - install - Wall time: 15s; CPU: 21.0%; Read bytes: 0; Write bytes: 242417664; Read time: 0; Write time: 979936 05:56:50 INFO - run-tests - Wall time: 1223s; CPU: 13.0%; Read bytes: 0; Write bytes: 272060416; Read time: 0; Write time: 272312 05:56:50 INFO - Running post-run listener: _upload_blobber_files 05:56:50 INFO - Blob upload gear active. 05:56:50 INFO - There are no files to upload in the directory. Skipping the blob upload mechanism ... 05:56:50 INFO - Copying logs to upload dir... 05:56:50 INFO - mkdir: /builds/slave/test/build/upload/logs program finished with exit code 0 elapsedTime=1275.548198 ========= master_lag: 0.02 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 15 secs) (at 2015-12-05 05:56:50.717348) ========= ========= Started set props: build_url (results: 0, elapsed: 0 secs) (at 2015-12-05 05:56:50.720813) ========= 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=2dd9ebcff44b3efbe7b51203000001d7-1449318906.825876-1633103823 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False build_url:https://queue.taskcluster.net/v1/task/4LAPVSYNS5m426DQYv3_pg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.009885 build_url: 'https://queue.taskcluster.net/v1/task/4LAPVSYNS5m426DQYv3_pg/artifacts/public/build/firefox-45.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-05 05:56:50.775156) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-12-05 05:56:50.775548) ========= 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=2dd9ebcff44b3efbe7b51203000001d7-1449318906.825876-1633103823 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004657 ========= master_lag: 0.05 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-12-05 05:56:50.826731) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2015-12-05 05:56:50.827113) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2015-12-05 05:56:50.827455) ========= ========= Total master_lag: 0.23 =========