builder: fx-team_ubuntu64_hw_test-dromaeojs-pgo slave: talos-linux64-ix-037 starttime: 1468260677.86 results: success (0) buildid: 20160711083053 builduid: 24a15c3ccce84b07bf5a1ebd261dd506 revision: 2578ab43cad698e854118f526000862c6cfe283b ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-07-11 11:11:17.857827) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-07-11 11:11:17.858413) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-07-11 11:11:17.858751) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-07-11 11:11:17.882194) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-11 11:11:17.882770) ========= 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=56c518bb7cbc29fb3c9463e2000001c4-1468260325.186396-193553409 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-07-11 11:11:18-- 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% 221M=0s 2016-07-11 11:11:18 (221 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.119117 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-11 11:11:18.020288) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-07-11 11:11:18.021012) ========= rm -rf scripts properties in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'scripts', 'properties'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=56c518bb7cbc29fb3c9463e2000001c4-1468260325.186396-193553409 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.020173 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-07-11 11:11:18.072205) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-11 11:11:18.072591) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev 2578ab43cad698e854118f526000862c6cfe283b --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo integration/fx-team --rev 2578ab43cad698e854118f526000862c6cfe283b --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=56c518bb7cbc29fb3c9463e2000001c4-1468260325.186396-193553409 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-07-11 11:11:18,278 truncating revision to first 12 chars 2016-07-11 11:11:18,278 Setting DEBUG logging. 2016-07-11 11:11:18,278 attempt 1/10 2016-07-11 11:11:18,278 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/2578ab43cad6?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-07-11 11:11:18,593 unpacking tar archive at: fx-team-2578ab43cad6/testing/mozharness/ program finished with exit code 0 elapsedTime=0.655937 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-11 11:11:18.747300) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-07-11 11:11:18.748019) ========= script_repo_revision: 2578ab43cad698e854118f526000862c6cfe283b ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-07-11 11:11:18.749051) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-07-11 11:11:18.749790) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-07-11 11:11:18.764632) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 34 secs) (at 2016-07-11 11:11:18.764948) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs', '--add-option', '--webServer,localhost', '--branch-name', 'Fx-Team', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Fx-Team'] 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=56c518bb7cbc29fb3c9463e2000001c4-1468260325.186396-193553409 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 11:11:19 INFO - MultiFileLogger online at 20160711 11:11:19 in /builds/slave/test 11:11:19 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team 11:11:19 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 11:11:19 INFO - {'append_to_log': False, 11:11:19 INFO - 'base_work_dir': '/builds/slave/test', 11:11:19 INFO - 'blob_upload_branch': 'Fx-Team', 11:11:19 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 11:11:19 INFO - 'branch': 'Fx-Team', 11:11:19 INFO - 'buildbot_json_path': 'buildprops.json', 11:11:19 INFO - 'config_files': ('talos/linux_config.py',), 11:11:19 INFO - 'default_actions': ('clobber', 11:11:19 INFO - 'read-buildbot-config', 11:11:19 INFO - 'download-and-extract', 11:11:19 INFO - 'populate-webroot', 11:11:19 INFO - 'create-virtualenv', 11:11:19 INFO - 'install', 11:11:19 INFO - 'run-tests'), 11:11:19 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 11:11:19 INFO - 'download_minidump_stackwalk': True, 11:11:19 INFO - 'download_symbols': 'ondemand', 11:11:19 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 11:11:19 INFO - 'tooltool.py': '/tools/tooltool.py', 11:11:19 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 11:11:19 INFO - '/tools/misc-python/virtualenv.py')}, 11:11:19 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 11:11:19 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 11:11:19 INFO - 'installer_path': 'installer.exe', 11:11:19 INFO - 'log_level': 'info', 11:11:19 INFO - 'log_name': 'talos', 11:11:19 INFO - 'log_to_console': True, 11:11:19 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 11:11:19 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 11:11:19 INFO - 'opt_config_files': (), 11:11:19 INFO - 'pip_index': False, 11:11:19 INFO - 'sps_profile': False, 11:11:19 INFO - 'sps_profile_interval': 0, 11:11:19 INFO - 'suite': 'dromaeojs', 11:11:19 INFO - 'system_bits': '32', 11:11:19 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 11:11:19 INFO - 'title': 'talos-linux64-ix-037', 11:11:19 INFO - 'tooltool_cache': '/builds/tooltool_cache', 11:11:19 INFO - 'use_talos_json': True, 11:11:19 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 11:11:19 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 11:11:19 INFO - 'work_dir': 'build'} 11:11:19 INFO - ##### 11:11:19 INFO - ##### Running clobber step. 11:11:19 INFO - ##### 11:11:19 INFO - Running pre-action listener: _resource_record_pre_action 11:11:19 INFO - Running main action method: clobber 11:11:19 INFO - rmtree: /builds/slave/test/build 11:11:19 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 11:11:19 INFO - Running post-action listener: _resource_record_post_action 11:11:19 INFO - ##### 11:11:19 INFO - ##### Finished clobber step (success) 11:11:19 INFO - ##### 11:11:19 INFO - ##### 11:11:19 INFO - ##### Running read-buildbot-config step. 11:11:19 INFO - ##### 11:11:19 INFO - Running pre-action listener: _resource_record_pre_action 11:11:19 INFO - Running main action method: read_buildbot_config 11:11:19 INFO - Using buildbot properties: 11:11:19 INFO - { 11:11:19 INFO - "project": "", 11:11:19 INFO - "product": "firefox", 11:11:19 INFO - "script_repo_revision": "production", 11:11:19 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs", 11:11:19 INFO - "repository": "", 11:11:19 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team pgo talos dromaeojs", 11:11:19 INFO - "buildid": "20160711083053", 11:11:19 INFO - "pgo_build": "True", 11:11:19 INFO - "basedir": "/builds/slave/test", 11:11:19 INFO - "buildnumber": 887, 11:11:19 INFO - "slavename": "talos-linux64-ix-037", 11:11:19 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 11:11:19 INFO - "platform": "ubuntu64_hw", 11:11:19 INFO - "scheduler": "tests-fx-team-linux64-pgo-talos", 11:11:19 INFO - "branch": "fx-team", 11:11:19 INFO - "repo_path": "integration/fx-team", 11:11:19 INFO - "revision": "2578ab43cad698e854118f526000862c6cfe283b", 11:11:19 INFO - "stage_platform": "linux64-pgo", 11:11:19 INFO - "builduid": "24a15c3ccce84b07bf5a1ebd261dd506", 11:11:19 INFO - "slavebuilddir": "test" 11:11:19 INFO - } 11:11:19 INFO - Found installer url https://queue.taskcluster.net/v1/task/Lr0LHSGWSIezF2PiqBKcXQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2. 11:11:19 INFO - Running post-action listener: _resource_record_post_action 11:11:19 INFO - ##### 11:11:19 INFO - ##### Finished read-buildbot-config step (success) 11:11:19 INFO - ##### 11:11:19 INFO - ##### 11:11:19 INFO - ##### Running download-and-extract step. 11:11:19 INFO - ##### 11:11:19 INFO - Running pre-action listener: _resource_record_pre_action 11:11:19 INFO - Running main action method: download_and_extract 11:11:19 INFO - mkdir: /builds/slave/test/build/tests 11:11:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 11:11:19 INFO - https://queue.taskcluster.net/v1/task/Lr0LHSGWSIezF2PiqBKcXQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 11:11:19 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Lr0LHSGWSIezF2PiqBKcXQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 11:11:19 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Lr0LHSGWSIezF2PiqBKcXQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 11:11:19 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Lr0LHSGWSIezF2PiqBKcXQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 11:11:19 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Lr0LHSGWSIezF2PiqBKcXQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json'}, attempt #1 11:11:21 INFO - Downloaded 1361 bytes. 11:11:21 INFO - Reading from file /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 11:11:21 INFO - Using the following test package requirements: 11:11:21 INFO - {u'common': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'], 11:11:21 INFO - u'cppunittest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 11:11:21 INFO - u'firefox-50.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 11:11:21 INFO - u'gtest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 11:11:21 INFO - u'firefox-50.0a1.en-US.linux-x86_64.gtest.tests.zip'], 11:11:21 INFO - u'jittest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 11:11:21 INFO - u'jsshell-linux-x86_64.zip'], 11:11:21 INFO - u'mochitest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 11:11:21 INFO - u'firefox-50.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 11:11:21 INFO - u'mozbase': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'], 11:11:21 INFO - u'reftest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 11:11:21 INFO - u'firefox-50.0a1.en-US.linux-x86_64.reftest.tests.zip'], 11:11:21 INFO - u'talos': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 11:11:21 INFO - u'firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip'], 11:11:21 INFO - u'web-platform': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 11:11:21 INFO - u'firefox-50.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 11:11:21 INFO - u'xpcshell': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 11:11:21 INFO - u'firefox-50.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 11:11:21 INFO - Downloading packages: [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 11:11:21 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')]} 11:11:21 INFO - https://queue.taskcluster.net/v1/task/Lr0LHSGWSIezF2PiqBKcXQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 11:11:21 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Lr0LHSGWSIezF2PiqBKcXQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 11:11:21 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Lr0LHSGWSIezF2PiqBKcXQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 11:11:21 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Lr0LHSGWSIezF2PiqBKcXQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 11:11:21 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Lr0LHSGWSIezF2PiqBKcXQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 11:11:25 INFO - Downloaded 24269892 bytes. 11:11:25 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 11:11:25 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 11:11:26 INFO - Return code: 0 11:11:26 INFO - Downloading packages: [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 11:11: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')]} 11:11:26 INFO - https://queue.taskcluster.net/v1/task/Lr0LHSGWSIezF2PiqBKcXQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 11:11:26 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Lr0LHSGWSIezF2PiqBKcXQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 11:11:26 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Lr0LHSGWSIezF2PiqBKcXQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 11:11:26 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Lr0LHSGWSIezF2PiqBKcXQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 11:11:26 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Lr0LHSGWSIezF2PiqBKcXQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 11:11:27 INFO - Downloaded 24269892 bytes. 11:11:27 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 11:11:27 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 11:11:29 INFO - Return code: 0 11:11:29 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 11:11:29 INFO - https://queue.taskcluster.net/v1/task/Lr0LHSGWSIezF2PiqBKcXQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 11:11:29 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Lr0LHSGWSIezF2PiqBKcXQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 11:11:29 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Lr0LHSGWSIezF2PiqBKcXQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 11:11:29 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Lr0LHSGWSIezF2PiqBKcXQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 11:11:29 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Lr0LHSGWSIezF2PiqBKcXQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 11:11:30 INFO - Downloaded 14403333 bytes. 11:11:30 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test/build/tests'] 11:11:30 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test/build/tests 11:11:30 INFO - Return code: 0 11:11:30 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')]} 11:11:30 INFO - https://queue.taskcluster.net/v1/task/Lr0LHSGWSIezF2PiqBKcXQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 11:11:30 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Lr0LHSGWSIezF2PiqBKcXQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 11:11:30 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Lr0LHSGWSIezF2PiqBKcXQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 11:11:30 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Lr0LHSGWSIezF2PiqBKcXQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 11:11:30 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Lr0LHSGWSIezF2PiqBKcXQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 11:11:32 INFO - Downloaded 60493312 bytes. 11:11:32 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/Lr0LHSGWSIezF2PiqBKcXQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 11:11:32 INFO - mkdir: /builds/slave/test/properties 11:11:32 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 11:11:32 INFO - Writing to file /builds/slave/test/properties/build_url 11:11:32 INFO - Contents: 11:11:32 INFO - build_url:https://queue.taskcluster.net/v1/task/Lr0LHSGWSIezF2PiqBKcXQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 11:11:33 INFO - Running post-action listener: _resource_record_post_action 11:11:33 INFO - Running post-action listener: set_extra_try_arguments 11:11:33 INFO - ##### 11:11:33 INFO - ##### Finished download-and-extract step (success) 11:11:33 INFO - ##### 11:11:33 INFO - ##### 11:11:33 INFO - ##### Running populate-webroot step. 11:11:33 INFO - ##### 11:11:33 INFO - Running pre-action listener: _resource_record_pre_action 11:11:33 INFO - Running main action method: populate_webroot 11:11:33 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 11:11:33 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 11:11:33 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 11:11:33 INFO - '--tppagecycles', 11:11:33 INFO - '7'], 11:11:33 INFO - 'tests': ['tsvgm']}}, 11:11:33 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 11:11:33 INFO - 'tests': ['tresize', 'tcanvasmark']}, 11:11:33 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 11:11:33 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 11:11:33 INFO - 'tests': ['dromaeo_css', 'kraken']}, 11:11:33 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 11:11:33 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:11:33 INFO - 'talos_options': ['--disable-e10s'], 11:11:33 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 11:11:33 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:11:33 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 11:11:33 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:11:33 INFO - 'talos_options': ['--disable-e10s'], 11:11:33 INFO - 'tests': ['damp', 'tps']}, 11:11:33 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:11:33 INFO - 'tests': ['damp', 'tps']}, 11:11:33 INFO - 'g3': {'talos_options': ['--disable-e10s'], 11:11:33 INFO - 'tests': ['dromaeo_dom']}, 11:11:33 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 11:11:33 INFO - 'g4': {'talos_options': ['--disable-e10s'], 11:11:33 INFO - 'tests': ['basic_compositor_video']}, 11:11:33 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 11:11:33 INFO - 'other': {'talos_options': ['--disable-e10s'], 11:11:33 INFO - 'tests': ['a11yr', 11:11:33 INFO - 'ts_paint', 11:11:33 INFO - 'tpaint', 11:11:33 INFO - 'sessionrestore', 11:11:33 INFO - 'sessionrestore_no_auto_restore', 11:11:33 INFO - 'tabpaint']}, 11:11:33 INFO - 'other-e10s': {'tests': ['a11yr', 11:11:33 INFO - 'ts_paint', 11:11:33 INFO - 'tpaint', 11:11:33 INFO - 'sessionrestore', 11:11:33 INFO - 'sessionrestore_no_auto_restore', 11:11:33 INFO - 'tabpaint']}, 11:11:33 INFO - 'other-e10s_l64': {'tests': ['a11yr', 11:11:33 INFO - 'ts_paint', 11:11:33 INFO - 'tpaint', 11:11:33 INFO - 'sessionrestore', 11:11:33 INFO - 'sessionrestore_no_auto_restore', 11:11:33 INFO - 'tabpaint']}, 11:11:33 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 11:11:33 INFO - 'ts_paint', 11:11:33 INFO - 'tpaint', 11:11:33 INFO - 'sessionrestore', 11:11:33 INFO - 'sessionrestore_no_auto_restore', 11:11:33 INFO - 'tabpaint']}, 11:11:33 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 11:11:33 INFO - 'tests': ['a11yr', 11:11:33 INFO - 'ts_paint', 11:11:33 INFO - 'tpaint', 11:11:33 INFO - 'sessionrestore', 11:11:33 INFO - 'sessionrestore_no_auto_restore', 11:11:33 INFO - 'tabpaint']}, 11:11:33 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 11:11:33 INFO - 'tests': ['a11yr', 11:11:33 INFO - 'ts_paint', 11:11:33 INFO - 'tpaint', 11:11:33 INFO - 'sessionrestore', 11:11:33 INFO - 'sessionrestore_no_auto_restore', 11:11:33 INFO - 'tabpaint']}, 11:11:33 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 11:11:33 INFO - 'tests': ['tsvgx', 11:11:33 INFO - 'tsvgr_opacity', 11:11:33 INFO - 'tart', 11:11:33 INFO - 'tscrollx', 11:11:33 INFO - 'cart']}, 11:11:33 INFO - 'svgr-e10s': {'tests': ['tsvgx', 11:11:33 INFO - 'tsvgr_opacity', 11:11:33 INFO - 'tart', 11:11:33 INFO - 'tscrollx', 11:11:33 INFO - 'cart']}, 11:11:33 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:11:33 INFO - 'talos_options': ['--disable-e10s'], 11:11:33 INFO - 'tests': ['tp5o']}, 11:11:33 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:11:33 INFO - 'tests': ['tp5o']}, 11:11:33 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:11:33 INFO - 'talos_options': ['--disable-e10s', 11:11:33 INFO - '--xperf_path', 11:11:33 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 11:11:33 INFO - 'tests': ['tp5n']}, 11:11:33 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:11:33 INFO - 'talos_options': ['--xperf_path', 11:11:33 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 11:11:33 INFO - 'tests': ['tp5n']}}, 11:11:33 INFO - 'talos.zip': {'path': '', 11:11:33 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 11:11:33 INFO - Running post-action listener: _resource_record_post_action 11:11:33 INFO - ##### 11:11:33 INFO - ##### Finished populate-webroot step (success) 11:11:33 INFO - ##### 11:11:33 INFO - ##### 11:11:33 INFO - ##### Running create-virtualenv step. 11:11:33 INFO - ##### 11:11:33 INFO - Running pre-action listener: _resource_record_pre_action 11:11:33 INFO - Running main action method: create_virtualenv 11:11:33 INFO - Creating virtualenv /builds/slave/test/build/venv 11:11:33 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 11:11:33 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 11:11:33 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 11:11:33 INFO - Using real prefix '/usr' 11:11:33 INFO - New python executable in /builds/slave/test/build/venv/bin/python 11:11:33 INFO - Installing distribute.............................................................................................................................................................................................done. 11:11:35 INFO - Installing pip.................done. 11:11:35 INFO - Return code: 0 11:11:35 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 11:11: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')]} 11:11:35 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:11:35 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:11: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')]} 11:11:35 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:11:35 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:11:35 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x17e5030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19488a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1aa6180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1aa43b0>, '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 0x1aa52b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1aa5740>, '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': '56c518bb7cbc29fb3c9463e2000001c4-1468260325.186396-193553409', '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 11:11:35 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 11:11:35 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 11:11:35 INFO - Using env: {'DISPLAY': ':0', 11:11:35 INFO - 'HOME': '/home/cltbld', 11:11:35 INFO - 'LANG': 'en_US.UTF-8', 11:11:35 INFO - 'LANGUAGE': 'en_US:en', 11:11:35 INFO - 'LOGNAME': 'cltbld', 11:11:35 INFO - 'MAIL': '/var/mail/cltbld', 11:11:35 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:11:35 INFO - 'MOZ_NO_REMOTE': '1', 11:11:35 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:11:35 INFO - 'NO_EM_RESTART': '1', 11:11:35 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:11:35 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:11:35 INFO - 'PWD': '/builds/slave/test', 11:11:35 INFO - 'SHELL': '/bin/bash', 11:11:35 INFO - 'SHLVL': '1', 11:11:35 INFO - 'TERM': 'linux', 11:11:35 INFO - 'TMOUT': '86400', 11:11:35 INFO - 'USER': 'cltbld', 11:11:35 INFO - 'XDG_SESSION_COOKIE': '56c518bb7cbc29fb3c9463e2000001c4-1468260325.186396-193553409', 11:11:35 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:11:35 INFO - '_': '/tools/buildbot/bin/python'} 11:11:35 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:11:35 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 11:11:35 INFO - Cleaning up... 11:11:35 INFO - Return code: 0 11:11:35 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 11:11: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')]} 11:11:35 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:11:35 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:11: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')]} 11:11:35 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:11:35 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:11:35 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x17e5030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19488a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1aa6180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1aa43b0>, '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 0x1aa52b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1aa5740>, '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': '56c518bb7cbc29fb3c9463e2000001c4-1468260325.186396-193553409', '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 11:11:35 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1'] in /builds/slave/test/build 11:11:35 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 11:11:35 INFO - Using env: {'DISPLAY': ':0', 11:11:35 INFO - 'HOME': '/home/cltbld', 11:11:35 INFO - 'LANG': 'en_US.UTF-8', 11:11:35 INFO - 'LANGUAGE': 'en_US:en', 11:11:35 INFO - 'LOGNAME': 'cltbld', 11:11:35 INFO - 'MAIL': '/var/mail/cltbld', 11:11:35 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:11:35 INFO - 'MOZ_NO_REMOTE': '1', 11:11:35 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:11:35 INFO - 'NO_EM_RESTART': '1', 11:11:35 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:11:35 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:11:35 INFO - 'PWD': '/builds/slave/test', 11:11:35 INFO - 'SHELL': '/bin/bash', 11:11:35 INFO - 'SHLVL': '1', 11:11:35 INFO - 'TERM': 'linux', 11:11:35 INFO - 'TMOUT': '86400', 11:11:35 INFO - 'USER': 'cltbld', 11:11:35 INFO - 'XDG_SESSION_COOKIE': '56c518bb7cbc29fb3c9463e2000001c4-1468260325.186396-193553409', 11:11:35 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:11:35 INFO - '_': '/tools/buildbot/bin/python'} 11:11:36 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:11:36 INFO - Downloading/unpacking psutil>=3.1.1 11:11:36 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:11:36 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:11:36 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 11:11:36 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 11:11:36 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:11:36 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:11:38 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 11:11:38 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 11:11:38 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 11:11:38 INFO - Installing collected packages: psutil 11:11:38 INFO - Running setup.py install for psutil 11:11:38 INFO - building 'psutil._psutil_linux' extension 11:11:38 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 11:11:38 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 11:11:38 INFO - building 'psutil._psutil_posix' extension 11:11:38 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 11:11:38 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 11:11:38 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 11:11:38 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 11:11:38 INFO - Successfully installed psutil 11:11:38 INFO - Cleaning up... 11:11:38 INFO - Return code: 0 11:11:38 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 11:11: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')]} 11:11:38 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:11:38 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:11: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')]} 11:11:38 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:11:38 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:11:38 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x17e5030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19488a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1aa6180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1aa43b0>, '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 0x1aa52b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1aa5740>, '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': '56c518bb7cbc29fb3c9463e2000001c4-1468260325.186396-193553409', '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 11:11:38 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3'] in /builds/slave/test/build 11:11:38 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.3 11:11:38 INFO - Using env: {'DISPLAY': ':0', 11:11:38 INFO - 'HOME': '/home/cltbld', 11:11:38 INFO - 'LANG': 'en_US.UTF-8', 11:11:38 INFO - 'LANGUAGE': 'en_US:en', 11:11:38 INFO - 'LOGNAME': 'cltbld', 11:11:38 INFO - 'MAIL': '/var/mail/cltbld', 11:11:38 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:11:38 INFO - 'MOZ_NO_REMOTE': '1', 11:11:38 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:11:38 INFO - 'NO_EM_RESTART': '1', 11:11:38 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:11:38 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:11:38 INFO - 'PWD': '/builds/slave/test', 11:11:38 INFO - 'SHELL': '/bin/bash', 11:11:38 INFO - 'SHLVL': '1', 11:11:38 INFO - 'TERM': 'linux', 11:11:38 INFO - 'TMOUT': '86400', 11:11:38 INFO - 'USER': 'cltbld', 11:11:38 INFO - 'XDG_SESSION_COOKIE': '56c518bb7cbc29fb3c9463e2000001c4-1468260325.186396-193553409', 11:11:38 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:11:38 INFO - '_': '/tools/buildbot/bin/python'} 11:11:38 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:11:38 INFO - Downloading/unpacking mozsystemmonitor==0.3 11:11:38 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:11:38 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:11:38 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 11:11:38 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 11:11:38 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:11:38 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:11:40 INFO - Downloading mozsystemmonitor-0.3.tar.gz 11:11:40 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 11:11:40 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 11:11:40 INFO - Installing collected packages: mozsystemmonitor 11:11:40 INFO - Running setup.py install for mozsystemmonitor 11:11:40 INFO - Successfully installed mozsystemmonitor 11:11:40 INFO - Cleaning up... 11:11:40 INFO - Return code: 0 11:11:40 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 11:11: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')]} 11:11:40 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:11:40 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:11: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')]} 11:11:40 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:11:40 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:11:40 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x17e5030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19488a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1aa6180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1aa43b0>, '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 0x1aa52b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1aa5740>, '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': '56c518bb7cbc29fb3c9463e2000001c4-1468260325.186396-193553409', '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 11:11:40 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1'] in /builds/slave/test/build 11:11:40 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema==2.5.1 11:11:40 INFO - Using env: {'DISPLAY': ':0', 11:11:40 INFO - 'HOME': '/home/cltbld', 11:11:40 INFO - 'LANG': 'en_US.UTF-8', 11:11:40 INFO - 'LANGUAGE': 'en_US:en', 11:11:40 INFO - 'LOGNAME': 'cltbld', 11:11:40 INFO - 'MAIL': '/var/mail/cltbld', 11:11:40 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:11:40 INFO - 'MOZ_NO_REMOTE': '1', 11:11:40 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:11:40 INFO - 'NO_EM_RESTART': '1', 11:11:40 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:11:40 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:11:40 INFO - 'PWD': '/builds/slave/test', 11:11:40 INFO - 'SHELL': '/bin/bash', 11:11:40 INFO - 'SHLVL': '1', 11:11:40 INFO - 'TERM': 'linux', 11:11:40 INFO - 'TMOUT': '86400', 11:11:40 INFO - 'USER': 'cltbld', 11:11:40 INFO - 'XDG_SESSION_COOKIE': '56c518bb7cbc29fb3c9463e2000001c4-1468260325.186396-193553409', 11:11:40 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:11:40 INFO - '_': '/tools/buildbot/bin/python'} 11:11:41 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:11:41 INFO - Downloading/unpacking jsonschema==2.5.1 11:11:41 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 11:11:41 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 11:11:41 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 11:11:41 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 11:11:41 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 11:11:41 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 11:11:43 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 11:11:43 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 11:11:43 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:11:43 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:11:43 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:11:43 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:11:43 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:11:43 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:11:43 INFO - Downloading functools32-3.2.3-2.tar.gz 11:11:43 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 11:11:43 INFO - warning: no files found matching '*.txt' 11:11:43 INFO - no previously-included directories found matching 'build' 11:11:43 INFO - no previously-included directories found matching 'dist' 11:11:43 INFO - no previously-included directories found matching '.git*' 11:11:43 INFO - Installing collected packages: jsonschema, functools32 11:11:43 INFO - Running setup.py install for functools32 11:11:43 INFO - warning: no files found matching '*.txt' 11:11:43 INFO - no previously-included directories found matching 'build' 11:11:43 INFO - no previously-included directories found matching 'dist' 11:11:43 INFO - no previously-included directories found matching '.git*' 11:11:43 INFO - Successfully installed jsonschema functools32 11:11:43 INFO - Cleaning up... 11:11:43 INFO - Return code: 0 11:11:43 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 11:11:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:11:43 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:11:43 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:11:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:11:43 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:11:43 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:11:43 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x17e5030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19488a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1aa6180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1aa43b0>, '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 0x1aa52b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1aa5740>, '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': '56c518bb7cbc29fb3c9463e2000001c4-1468260325.186396-193553409', '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 11:11:43 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 11:11:43 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 11:11:43 INFO - Using env: {'DISPLAY': ':0', 11:11:43 INFO - 'HOME': '/home/cltbld', 11:11:43 INFO - 'LANG': 'en_US.UTF-8', 11:11:43 INFO - 'LANGUAGE': 'en_US:en', 11:11:43 INFO - 'LOGNAME': 'cltbld', 11:11:43 INFO - 'MAIL': '/var/mail/cltbld', 11:11:43 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:11:43 INFO - 'MOZ_NO_REMOTE': '1', 11:11:43 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:11:43 INFO - 'NO_EM_RESTART': '1', 11:11:43 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:11:43 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:11:43 INFO - 'PWD': '/builds/slave/test', 11:11:43 INFO - 'SHELL': '/bin/bash', 11:11:43 INFO - 'SHLVL': '1', 11:11:43 INFO - 'TERM': 'linux', 11:11:43 INFO - 'TMOUT': '86400', 11:11:43 INFO - 'USER': 'cltbld', 11:11:43 INFO - 'XDG_SESSION_COOKIE': '56c518bb7cbc29fb3c9463e2000001c4-1468260325.186396-193553409', 11:11:43 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:11:43 INFO - '_': '/tools/buildbot/bin/python'} 11:11:43 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:11:43 INFO - Downloading/unpacking blobuploader==1.2.4 11:11:43 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:11:43 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:11:43 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:11:43 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:11:43 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:11:43 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:11:45 INFO - Downloading blobuploader-1.2.4.tar.gz 11:11:45 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 11:11:45 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 11:11:45 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:11:45 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:11:45 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 11:11:45 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 11:11:45 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:11:45 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:11:45 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 11:11:46 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 11:11:46 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:11:46 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:11:46 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:11:46 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:11:46 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:11:46 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:11:46 INFO - Downloading docopt-0.6.1.tar.gz 11:11:46 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 11:11:46 INFO - Installing collected packages: blobuploader, requests, docopt 11:11:46 INFO - Running setup.py install for blobuploader 11:11:46 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 11:11:46 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 11:11:46 INFO - Running setup.py install for requests 11:11:46 INFO - Running setup.py install for docopt 11:11:46 INFO - Successfully installed blobuploader requests docopt 11:11:46 INFO - Cleaning up... 11:11:46 INFO - Return code: 0 11:11:46 INFO - Installing None into virtualenv /builds/slave/test/build/venv 11:11: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')]} 11:11:46 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:11:46 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:11: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')]} 11:11:46 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:11:46 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:11:46 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x17e5030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19488a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1aa6180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1aa43b0>, '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 0x1aa52b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1aa5740>, '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': '56c518bb7cbc29fb3c9463e2000001c4-1468260325.186396-193553409', '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 11:11:46 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 11:11:46 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 11:11:46 INFO - Using env: {'DISPLAY': ':0', 11:11:46 INFO - 'HOME': '/home/cltbld', 11:11:46 INFO - 'LANG': 'en_US.UTF-8', 11:11:46 INFO - 'LANGUAGE': 'en_US:en', 11:11:46 INFO - 'LOGNAME': 'cltbld', 11:11:46 INFO - 'MAIL': '/var/mail/cltbld', 11:11:46 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:11:46 INFO - 'MOZ_NO_REMOTE': '1', 11:11:46 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:11:46 INFO - 'NO_EM_RESTART': '1', 11:11:46 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:11:46 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:11:46 INFO - 'PWD': '/builds/slave/test', 11:11:46 INFO - 'SHELL': '/bin/bash', 11:11:46 INFO - 'SHLVL': '1', 11:11:46 INFO - 'TERM': 'linux', 11:11:46 INFO - 'TMOUT': '86400', 11:11:46 INFO - 'USER': 'cltbld', 11:11:46 INFO - 'XDG_SESSION_COOKIE': '56c518bb7cbc29fb3c9463e2000001c4-1468260325.186396-193553409', 11:11:46 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:11:46 INFO - '_': '/tools/buildbot/bin/python'} 11:11:47 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:11:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 11:11:47 INFO - Running setup.py (path:/tmp/pip-UdM3he-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 11:11:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 11:11:47 INFO - Running setup.py (path:/tmp/pip-cQ83H5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 11:11:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 11:11:47 INFO - Running setup.py (path:/tmp/pip-uVyozo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 11:11:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 11:11:47 INFO - Running setup.py (path:/tmp/pip-eUH6fs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 11:11:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 11:11:47 INFO - Running setup.py (path:/tmp/pip-L6Th0I-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 11:11:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 11:11:47 INFO - Running setup.py (path:/tmp/pip-KwgoFX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 11:11:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 11:11:47 INFO - Running setup.py (path:/tmp/pip-DV7ySA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 11:11:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 11:11:47 INFO - Running setup.py (path:/tmp/pip-ydNMvZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 11:11:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 11:11:47 INFO - Running setup.py (path:/tmp/pip-SQlpFb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 11:11:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 11:11:47 INFO - Running setup.py (path:/tmp/pip-57y7VB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 11:11:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 11:11:47 INFO - Running setup.py (path:/tmp/pip-ogkUr7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 11:11:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 11:11:48 INFO - Running setup.py (path:/tmp/pip-mGV598-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 11:11:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 11:11:48 INFO - Running setup.py (path:/tmp/pip-2KkF72-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 11:11:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 11:11:48 INFO - Running setup.py (path:/tmp/pip-nGgYwl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 11:11:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 11:11:48 INFO - Running setup.py (path:/tmp/pip-mlnAN4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 11:11:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 11:11:48 INFO - Running setup.py (path:/tmp/pip-fZOLVV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 11:11:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 11:11:48 INFO - Running setup.py (path:/tmp/pip-2TITn4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 11:11:48 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 11:11:48 INFO - Running setup.py install for manifestparser 11:11:48 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 11:11:48 INFO - Running setup.py install for mozcrash 11:11:48 INFO - Running setup.py install for mozdebug 11:11:48 INFO - Running setup.py install for mozdevice 11:11:48 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 11:11:48 INFO - Installing dm script to /builds/slave/test/build/venv/bin 11:11:48 INFO - Running setup.py install for mozfile 11:11:48 INFO - Running setup.py install for mozhttpd 11:11:49 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 11:11:49 INFO - Running setup.py install for mozinfo 11:11:49 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 11:11:49 INFO - Running setup.py install for mozInstall 11:11:49 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 11:11:49 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 11:11:49 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 11:11:49 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 11:11:49 INFO - Running setup.py install for mozleak 11:11:49 INFO - Running setup.py install for mozlog 11:11:49 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 11:11:49 INFO - Running setup.py install for moznetwork 11:11:49 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 11:11:49 INFO - Running setup.py install for mozprocess 11:11:49 INFO - Running setup.py install for mozprofile 11:11:49 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 11:11:49 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 11:11:49 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 11:11:49 INFO - Running setup.py install for mozrunner 11:11:49 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 11:11:49 INFO - Running setup.py install for mozscreenshot 11:11:49 INFO - Running setup.py install for moztest 11:11:50 INFO - Running setup.py install for mozversion 11:11:50 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 11:11:50 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 11:11:50 INFO - Cleaning up... 11:11:50 INFO - Return code: 0 11:11:50 INFO - Installing None into virtualenv /builds/slave/test/build/venv 11:11: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')]} 11:11:50 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:11:50 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:11: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')]} 11:11:50 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:11:50 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:11:50 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x17e5030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19488a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1aa6180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1aa43b0>, '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 0x1aa52b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1aa5740>, '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': '56c518bb7cbc29fb3c9463e2000001c4-1468260325.186396-193553409', '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 11:11:50 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 11:11:50 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 11:11:50 INFO - Using env: {'DISPLAY': ':0', 11:11:50 INFO - 'HOME': '/home/cltbld', 11:11:50 INFO - 'LANG': 'en_US.UTF-8', 11:11:50 INFO - 'LANGUAGE': 'en_US:en', 11:11:50 INFO - 'LOGNAME': 'cltbld', 11:11:50 INFO - 'MAIL': '/var/mail/cltbld', 11:11:50 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:11:50 INFO - 'MOZ_NO_REMOTE': '1', 11:11:50 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:11:50 INFO - 'NO_EM_RESTART': '1', 11:11:50 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:11:50 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:11:50 INFO - 'PWD': '/builds/slave/test', 11:11:50 INFO - 'SHELL': '/bin/bash', 11:11:50 INFO - 'SHLVL': '1', 11:11:50 INFO - 'TERM': 'linux', 11:11:50 INFO - 'TMOUT': '86400', 11:11:50 INFO - 'USER': 'cltbld', 11:11:50 INFO - 'XDG_SESSION_COOKIE': '56c518bb7cbc29fb3c9463e2000001c4-1468260325.186396-193553409', 11:11:50 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:11:50 INFO - '_': '/tools/buildbot/bin/python'} 11:11:50 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:11:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 11:11:50 INFO - Running setup.py (path:/tmp/pip-LMIz8d-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 11:11:50 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)) 11:11:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 11:11:50 INFO - Running setup.py (path:/tmp/pip-gIemU1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 11:11:50 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.17 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)) 11:11:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 11:11:50 INFO - Running setup.py (path:/tmp/pip-8sEQfv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 11:11:50 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)) 11:11:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 11:11:50 INFO - Running setup.py (path:/tmp/pip-Lmvgsj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 11:11:50 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.48 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)) 11:11:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 11:11:50 INFO - Running setup.py (path:/tmp/pip-6kAXFz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 11:11:50 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)) 11:11:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 11:11:50 INFO - Running setup.py (path:/tmp/pip-Uuc41G-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 11:11:50 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)) 11:11:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 11:11:50 INFO - Running setup.py (path:/tmp/pip-nolKec-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 11:11:50 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)) 11:11:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 11:11:50 INFO - Running setup.py (path:/tmp/pip-d2x0rR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 11:11:51 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)) 11:11:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 11:11:51 INFO - Running setup.py (path:/tmp/pip-faUnLx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 11:11:51 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)) 11:11:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 11:11:51 INFO - Running setup.py (path:/tmp/pip-1EWPJ5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 11:11:51 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.2 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)) 11:11:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 11:11:51 INFO - Running setup.py (path:/tmp/pip-4VnPys-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 11:11:51 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)) 11:11:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 11:11:51 INFO - Running setup.py (path:/tmp/pip-b8qyD1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 11:11:51 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.23 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)) 11:11:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 11:11:51 INFO - Running setup.py (path:/tmp/pip-sJA2z6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 11:11:51 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 from file:///builds/slave/test/build/tests/mozbase/mozprofile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 13)) 11:11:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 11:11:51 INFO - Running setup.py (path:/tmp/pip-IGVFYH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 11:11:51 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.12 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)) 11:11:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 11:11:51 INFO - Running setup.py (path:/tmp/pip-DkoHCZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 11:11:51 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)) 11:11:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 11:11:51 INFO - Running setup.py (path:/tmp/pip-hjnKCc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 11:11:51 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)) 11:11:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 11:11:51 INFO - Running setup.py (path:/tmp/pip-8qDeot-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 11:11:51 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)) 11:11:51 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.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 11:11:51 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.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 11:11:51 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)) 11:11:51 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.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 11:11:51 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.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 11:11:51 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.2->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 11:11:51 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:11:51 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:11:51 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:11:51 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:11:51 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:11:51 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:11:53 INFO - Downloading blessings-1.6.tar.gz 11:11:53 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 11:11:53 INFO - Installing collected packages: blessings 11:11:53 INFO - Running setup.py install for blessings 11:11:53 INFO - Successfully installed blessings 11:11:53 INFO - Cleaning up... 11:11:53 INFO - Return code: 0 11:11:53 INFO - Done creating virtualenv /builds/slave/test/build/venv. 11:11:53 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 11:11:53 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 11:11:54 INFO - Reading from file tmpfile_stdout 11:11:54 INFO - Current package versions: 11:11:54 INFO - argparse == 1.2.1 11:11:54 INFO - blessings == 1.6 11:11:54 INFO - blobuploader == 1.2.4 11:11:54 INFO - docopt == 0.6.1 11:11:54 INFO - functools32 == 3.2.3-2 11:11:54 INFO - jsonschema == 2.5.1 11:11:54 INFO - manifestparser == 1.1 11:11:54 INFO - mozInstall == 1.12 11:11:54 INFO - mozcrash == 0.17 11:11:54 INFO - mozdebug == 0.1 11:11:54 INFO - mozdevice == 0.48 11:11:54 INFO - mozfile == 1.2 11:11:54 INFO - mozhttpd == 0.7 11:11:54 INFO - mozinfo == 0.9 11:11:54 INFO - mozleak == 0.1 11:11:54 INFO - mozlog == 3.2 11:11:54 INFO - moznetwork == 0.27 11:11:54 INFO - mozprocess == 0.23 11:11:54 INFO - mozprofile == 0.28 11:11:54 INFO - mozrunner == 6.12 11:11:54 INFO - mozscreenshot == 0.1 11:11:54 INFO - mozsystemmonitor == 0.3 11:11:54 INFO - moztest == 0.7 11:11:54 INFO - mozversion == 1.4 11:11:54 INFO - psutil == 3.1.1 11:11:54 INFO - requests == 1.2.3 11:11:54 INFO - wsgiref == 0.1.2 11:11:54 INFO - Installing None into virtualenv /builds/slave/test/build/venv 11:11:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 11:11:54 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:11:54 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:11:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 11:11:54 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:11:54 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:11:54 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x17e5030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19488a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1aa6180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1aa43b0>, '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 0x1aa52b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1aa5740>, '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': '56c518bb7cbc29fb3c9463e2000001c4-1468260325.186396-193553409', '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 11:11:54 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/talos 11:11:54 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 11:11:54 INFO - Using env: {'DISPLAY': ':0', 11:11:54 INFO - 'HOME': '/home/cltbld', 11:11:54 INFO - 'LANG': 'en_US.UTF-8', 11:11:54 INFO - 'LANGUAGE': 'en_US:en', 11:11:54 INFO - 'LOGNAME': 'cltbld', 11:11:54 INFO - 'MAIL': '/var/mail/cltbld', 11:11:54 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:11:54 INFO - 'MOZ_NO_REMOTE': '1', 11:11:54 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:11:54 INFO - 'NO_EM_RESTART': '1', 11:11:54 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:11:54 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:11:54 INFO - 'PWD': '/builds/slave/test', 11:11:54 INFO - 'SHELL': '/bin/bash', 11:11:54 INFO - 'SHLVL': '1', 11:11:54 INFO - 'TERM': 'linux', 11:11:54 INFO - 'TMOUT': '86400', 11:11:54 INFO - 'USER': 'cltbld', 11:11:54 INFO - 'XDG_SESSION_COOKIE': '56c518bb7cbc29fb3c9463e2000001c4-1468260325.186396-193553409', 11:11:54 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:11:54 INFO - '_': '/tools/buildbot/bin/python'} 11:11:54 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:11:54 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 11:11:54 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 2)) 11:11:54 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 11:11:54 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 11:11:54 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 5)) 11:11:54 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 6)) 11:11:54 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 7)) 11:11:54 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 8)) 11:11:54 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 9)) 11:11:54 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozlog>=3.1->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 11:11:54 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 11:11:54 INFO - Cleaning up... 11:11:54 INFO - Return code: 0 11:11:54 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 11:11:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 11:11:54 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:11:54 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:11:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 11:11:54 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:11:54 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:11:54 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x17e5030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19488a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1aa6180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1aa43b0>, '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 0x1aa52b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1aa5740>, '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': '56c518bb7cbc29fb3c9463e2000001c4-1468260325.186396-193553409', '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 11:11:54 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 11:11:54 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 11:11:54 INFO - Using env: {'DISPLAY': ':0', 11:11:54 INFO - 'HOME': '/home/cltbld', 11:11:54 INFO - 'LANG': 'en_US.UTF-8', 11:11:54 INFO - 'LANGUAGE': 'en_US:en', 11:11:54 INFO - 'LOGNAME': 'cltbld', 11:11:54 INFO - 'MAIL': '/var/mail/cltbld', 11:11:54 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:11:54 INFO - 'MOZ_NO_REMOTE': '1', 11:11:54 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:11:54 INFO - 'NO_EM_RESTART': '1', 11:11:54 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:11:54 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:11:54 INFO - 'PWD': '/builds/slave/test', 11:11:54 INFO - 'SHELL': '/bin/bash', 11:11:54 INFO - 'SHLVL': '1', 11:11:54 INFO - 'TERM': 'linux', 11:11:54 INFO - 'TMOUT': '86400', 11:11:54 INFO - 'USER': 'cltbld', 11:11:54 INFO - 'XDG_SESSION_COOKIE': '56c518bb7cbc29fb3c9463e2000001c4-1468260325.186396-193553409', 11:11:54 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:11:54 INFO - '_': '/tools/buildbot/bin/python'} 11:11:54 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:11:54 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 11:11:54 INFO - Cleaning up... 11:11:54 INFO - Return code: 0 11:11:54 INFO - Running post-action listener: _resource_record_post_action 11:11:54 INFO - Running post-action listener: _start_resource_monitoring 11:11:54 INFO - Starting resource monitoring. 11:11:54 INFO - ##### 11:11:54 INFO - ##### Finished create-virtualenv step (success) 11:11:54 INFO - ##### 11:11:54 INFO - ##### 11:11:54 INFO - ##### Running install step. 11:11:54 INFO - ##### 11:11:54 INFO - Running pre-action listener: _resource_record_pre_action 11:11:54 INFO - Running main action method: install 11:11:54 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 11:11:54 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 11:11:54 INFO - Reading from file tmpfile_stdout 11:11:54 INFO - Detecting whether we're running mozinstall >=1.0... 11:11:54 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 11:11:54 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 11:11:54 INFO - Reading from file tmpfile_stdout 11:11:54 INFO - Output received: 11:11:54 INFO - Usage: mozinstall [options] installer 11:11:54 INFO - Options: 11:11:54 INFO - -h, --help show this help message and exit 11:11:54 INFO - -d DEST, --destination=DEST 11:11:54 INFO - Directory to install application into. [default: 11:11:54 INFO - "/builds/slave/test"] 11:11:54 INFO - --app=APP Application being installed. [default: firefox] 11:11:54 INFO - mkdir: /builds/slave/test/build/application 11:11:54 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 11:11:54 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 11:12:11 INFO - Reading from file tmpfile_stdout 11:12:11 INFO - Output received: 11:12:11 INFO - /builds/slave/test/build/application/firefox/firefox 11:12:11 INFO - Running post-action listener: _resource_record_post_action 11:12:11 INFO - ##### 11:12:11 INFO - ##### Finished install step (success) 11:12:11 INFO - ##### 11:12:11 INFO - ##### 11:12:11 INFO - ##### Running run-tests step. 11:12:11 INFO - ##### 11:12:11 INFO - Running pre-action listener: _resource_record_pre_action 11:12:11 INFO - Running main action method: run_tests 11:12:11 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 11:12:11 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 11:12:11 INFO - Python 2.7.3 11:12:11 INFO - Return code: 0 11:12:11 INFO - grabbing minidump binary from tooltool 11:12:11 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:12:11 INFO - retry: Calling run_command with args: (['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'],), kwargs: {'output_timeout': 600, 'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1aa43b0>, '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 0x1aa52b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1aa5740>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 11:12:11 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 11:12:11 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 11:12:11 INFO - Calling ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] with output_timeout 600 11:12:11 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 11:12:11 INFO - Return code: 0 11:12:11 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 11:12:11 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 11:12:11 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 11:12:11 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 11:12:11 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 11:12:11 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/Lr0LHSGWSIezF2PiqBKcXQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-037', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] in /builds/slave/test/build 11:12:11 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Fx-Team --suite dromaeojs --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/Lr0LHSGWSIezF2PiqBKcXQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-037 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log 11:12:11 INFO - Using env: {'DISPLAY': ':0', 11:12:11 INFO - 'HOME': '/home/cltbld', 11:12:11 INFO - 'LANG': 'en_US.UTF-8', 11:12:11 INFO - 'LANGUAGE': 'en_US:en', 11:12:11 INFO - 'LOGNAME': 'cltbld', 11:12:11 INFO - 'MAIL': '/var/mail/cltbld', 11:12:11 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 11:12:11 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 11:12:11 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:12:11 INFO - 'MOZ_NO_REMOTE': '1', 11:12:11 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 11:12:11 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:12:11 INFO - 'NO_EM_RESTART': '1', 11:12:11 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:12:11 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:12:11 INFO - 'PWD': '/builds/slave/test', 11:12:11 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 11:12:11 INFO - 'SHELL': '/bin/bash', 11:12:11 INFO - 'SHLVL': '1', 11:12:11 INFO - 'TERM': 'linux', 11:12:11 INFO - 'TMOUT': '86400', 11:12:11 INFO - 'USER': 'cltbld', 11:12:11 INFO - 'XDG_SESSION_COOKIE': '56c518bb7cbc29fb3c9463e2000001c4-1468260325.186396-193553409', 11:12:11 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:12:11 INFO - '_': '/tools/buildbot/bin/python'} 11:12:11 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/Lr0LHSGWSIezF2PiqBKcXQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-037', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] with output_timeout 3600 11:12:12 INFO - mozversion application_buildid: 20160711083053 11:12:12 INFO - mozversion application_changeset: 2578ab43cad698e854118f526000862c6cfe283b 11:12:12 INFO - mozversion application_display_name: Nightly 11:12:12 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 11:12:12 INFO - mozversion application_name: Firefox 11:12:12 INFO - mozversion application_remotingname: firefox 11:12:12 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 11:12:12 INFO - mozversion application_vendor: Mozilla 11:12:12 INFO - mozversion application_version: 50.0a1 11:12:12 INFO - mozversion platform_buildid: 20160711083053 11:12:12 INFO - mozversion platform_changeset: 2578ab43cad698e854118f526000862c6cfe283b 11:12:12 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 11:12:12 INFO - mozversion platform_version: 50.0a1 11:12:12 INFO - using testdate: 1468260732 11:12:12 INFO - actual date: 1468260732 11:12:12 INFO - starting webserver on 'localhost:36310' 11:12:12 INFO - SUITE-START | Running 2 tests 11:12:12 INFO - TEST-START | dromaeo_css 11:12:12 INFO - operating with platform_type : linux_ 11:12:12 INFO - Initialising browser for dromaeo_css test... 11:12:12 INFO - TEST-INFO | started process 29272 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp0O8Vil/profile http://localhost:36310/getInfo.html) 11:12:16 INFO - PROCESS | 29272 | __metrics Screen width/height:1600/1200 11:12:16 INFO - PROCESS | 29272 | colorDepth:24 11:12:16 INFO - PROCESS | 29272 | Browser inner width/height: 1024/697 11:12:16 INFO - PROCESS | 29272 | __metrics 11:12:16 INFO - PROCESS | 29272 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 693: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 11:12:16 INFO - PROCESS | 29272 | JavaScript error: resource://app/modules/CaptivePortalWatcher.jsm, line 60: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 11:12:17 INFO - PROCESS | 29272 | console.error: PushService: 11:12:17 INFO - PROCESS | 29272 | stateChangeProcessEnqueue: Error transitioning state 11:12:17 INFO - PROCESS | 29272 | UnknownError 11:12:17 INFO - TEST-INFO | 29272: exit 0 11:12:17 INFO - Browser initialized. 11:12:17 INFO - Running cycle 1/1 for dromaeo_css test... 11:12:17 INFO - TEST-INFO | started process 29353 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp0O8Vil/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 11:12:29 INFO - PROCESS | 29353 | RSS: Main: 157302784 11:12:29 INFO - PROCESS | 29353 | 11:13:21 INFO - PROCESS | 29353 | 1468260801356 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] 11:15:29 INFO - PROCESS | 29353 | Cycle 1(1): loaded http://localhost:36310/tests/dromaeo/cssquery-dojo.html (next: http://localhost:36310/tests/dromaeo/cssquery-ext.html) 11:15:30 INFO - PROCESS | 29353 | RSS: Main: 282505216 11:15:30 INFO - PROCESS | 29353 | 11:18:33 INFO - PROCESS | 29353 | Cycle 1(1): loaded http://localhost:36310/tests/dromaeo/cssquery-ext.html (next: http://localhost:36310/tests/dromaeo/cssquery-jquery.html) 11:18:33 INFO - PROCESS | 29353 | RSS: Main: 247750656 11:18:33 INFO - PROCESS | 29353 | 11:21:35 INFO - PROCESS | 29353 | Cycle 1(1): loaded http://localhost:36310/tests/dromaeo/cssquery-jquery.html (next: http://localhost:36310/tests/dromaeo/cssquery-mootools.html) 11:21:36 INFO - PROCESS | 29353 | RSS: Main: 248709120 11:21:36 INFO - PROCESS | 29353 | 11:24:38 INFO - PROCESS | 29353 | Cycle 1(1): loaded http://localhost:36310/tests/dromaeo/cssquery-mootools.html (next: http://localhost:36310/tests/dromaeo/cssquery-prototype.html) 11:24:38 INFO - PROCESS | 29353 | RSS: Main: 232509440 11:24:38 INFO - PROCESS | 29353 | 11:27:41 INFO - PROCESS | 29353 | Cycle 1(1): loaded http://localhost:36310/tests/dromaeo/cssquery-prototype.html (next: http://localhost:36310/tests/dromaeo/cssquery-yui.html) 11:27:42 INFO - PROCESS | 29353 | RSS: Main: 229122048 11:27:42 INFO - PROCESS | 29353 | 11:30:45 INFO - PROCESS | 29353 | Cycle 1(1): loaded http://localhost:36310/tests/dromaeo/cssquery-yui.html (next: http://localhost:36310/tests/dromaeo/cssquery-dojo.html) 11:30:45 INFO - PROCESS | 29353 | RSS: Main: 274923520 11:30:45 INFO - PROCESS | 29353 | 11:30:45 INFO - PROCESS | 29353 | __start_tp_report 11:30:45 INFO - PROCESS | 29353 | _x_x_mozilla_page_load 11:30:45 INFO - PROCESS | 29353 | _x_x_mozilla_page_load_details 11:30:45 INFO - PROCESS | 29353 | |i|pagename|runs| 11:30:45 INFO - PROCESS | 29353 | |0;dojo.html;3071.355015446756;3085.7994230375025;3101.3487167694784;3127.562141300217;3154.0064879562938;5383.515483606475;5459.535939445147;5465.617406781527;5550.084236101044;5561.304836895383;5396.676199428027;5422.9728851355685;5449.128139497681;5480.287562616864;5553.194786755928;4831.855044348676;4897.583705385046;4925.581325587329;4925.802967881281;5102.744862756866;5015.949840501585;5051.494850514938;5058.367704036996;5067.417247016603;5069.2142717878605;4821.9035619287415;4851.320815085891;4864.902701945959;4905.362302900636;5018.121828679985;4783.378160839104;4790.616750659939;4800.807967681289;4858.587020103296;4981.476944920767;4798.304245884327;4818.132736107499;4839.44346400165;4854.660173787836;4856.05306965142;5272.973635131838;5297.629165958385;5337.412884582693;5385.7576409061685;5405.027095122877;5791.971040144772;5792.304923409176;5798.9130163047585;5810.535157187415;5846.9707651461895;5805.4194580542035;5860.677662728548;5875.6474611523445;5877.588568800185;5881.323647780518;5314.9468505314835;5365.678059316453;5374.489423504721;5376.516113549799;5447.618666693333;5913.349531551526;5974.372690867396;5974.40255974399;5974.731137098841;5979.850503737354;5690.516306113944;5695.373508914016;5737.971310143423;5745.798897038583;5750.367459579443;5601.971990140023;5728.1694154348215;5790.88418231633;5797.623154494944;5824.708764561755;5815.476607105381;5828.912566311508;5830.737616807254;5832.533397328203;5870.471657550841;5671.829845104653;5806.738696758572;5849.473547380671;5856.150858125633;5865.618734782225;4342.739435633872;4416.955830441719;4445.044315472189;4452.109578084396;4508.030773383738;3952.0515076382035;3962.405639154092;3964.444977703124;3998.620131087542;4000.2599519089063;5566.777328906879;5583.637063590935;5584.860378490489;5587.189857470726;5598.776048957996;5744.655320680772;5781.82654520365;5788.27646544182;5792.478676919098;5869.178315035899;5547.8890422192135;5550.250716153349;5553.083741182741;5553.222548843165;5557.027520183951;4983.103041452501;5040.949590504121;5050.974745126325;5055.34280543527;5104.923426148611;5963.761449542057;6014.127951447016;6060.272767267956;6093.715917428541;6144.600600960924;5907.350191478848;5912.349641539513;5915.40845915405;5915.970420147872;5952.196453478725;6044.576879618385;6053.697315134314;6074.726637301421;6088.4215999479975;6090.756369745338;5559.833205003856;5574.554035677055;5617.859553511032;5656.236408084856;5731.19763233156;5820.738066787089;5859.44335288147;5859.560532959959;5860.853478662897;5861.296644402699;5664.0087984601705;5669.489745922887;5675.574331925205;5687.971560142173;5697.515711164598;5516.227728117987;5541.695206763667;5601.019821531298;5611.971940140274;5649.943500564942;5550.0564903965615;5550.167474878801;5554.166874968787;5578.9163162553405;5585.525230355465;5607.691576963306;5658.321001479849;5688.658680479184;5737.74180161902;5751.597388182787;5574.637648552831;5647.0964645656495;5655.321361436654;5657.151427285776;5695.629784064023 11:30:45 INFO - PROCESS | 29353 | |1;ext.html;579.8461062485654;617.4874853871287;617.8578926846825;630.4515071887458;631.5263552335748;30595.84702076492;42121.578784212186;42368;43065.7846710766;43180.136397272036;40150.397744033864;44101;44270.77864610672;44292.55707442925;44302.33546496805;8039.839203215932;8875.245604123642;9031.503267320295;9042.23141033013;10404.843927341097;10440.477976101203;10813.783724325509;10816.567337306498;10827.83758243627;10838;10997.34015959045;11026.338419694845;11036.668899933014;11046;11055.668329950075;10949.671509854677;10956.945215273912;10973.945130274378;10982.176336774774;10989.06592939601;10456.163506919429;10509.789804203872;10516.631917882914;10528.578856845717;10529.526171322308;42149.789251053546;42421.151576968594;42431.36352954708;42541.787291063345;42556.148877022286;3635.800030998294;3692.464592634053;3946.6842652587725;4007.338789099795;4235.597618226264;32545.837270813496;33523.83238083818;33603.15992100193;33649.49525757116;33804.154896127795;4364.825406983717;4454.265046267362;4499.505054444008;4503.324501324795;4511.977440112812;356427;360132;361062;361921;362356;57229;57490;57534.7123264381;57590;57595;60209.39790602038;60984.085238721455;61087.69456152691;61225;61249;16664.83335166633;17315.65368692619;17331.740023899652;17344.306227751;17347.392841250497;13318.667033324244;13600.863991360158;13628.591142265748;13635.045546811629;13642.317884105954;16286.674266514603;16543.586410339838;16676;16731.83268167327;16734.414295499842;6136.754529818757;6212.9068063979075;6240.910749179186;6335.809925702236;6370.681465926685;982.7641366072091;1070.6466865934224;1078.6207995537984;1082.0477979378097;1131.1968502363413;32328.67671323304;32386.514202286984;32402;32564.83717581397;32664.762171124938;1058.1799105692996;1091.5470079916904;1139.4929256480953;1160.5357856857324;1177.8881006304387;16684.66630667404;17286.654266914593;17444.040577768345;17466.563335916704;17629;521990;524939;527023;527213.3639331856;529130;57784;57915;57924;57926;58017.70991145102;1219.5731493977214;1244.794608889523;1325.807757875122;1344.6974430753198;1354.9187048777105;32479.837600811843;33805.15487112842;33922;34306.65693343035;34409.82795086109;50026.49973500364;50116.24825627545;50443;50473.747631261605;50524;408216;408524;410659;410965;411041;34985.82507087448;41578.58421415747;43426.56573434225;44778.3283250745;44901.77549112234;47942;48372.274415884494;48490.70995209219;48557.75721121372;49419.50580494149;39729;41791.7910410446;42632.147357053305;42924.57075429331;43400.56599433965;41285;41400.79299603483;41787.1642567153;42104;42575;40936;41526.79236603918;41601.791991041064;41854.16291674088;42010.579894200666;35348.670415436725;37014.62985370112;37622.435663465614;37754.62245377511;37864.62135378611;27857.72142278551;28088.71911280861;28149.859250703616;28346.574801377585;28409.715902840708 11:30:45 INFO - PROCESS | 29353 | |2;jquery.html;388.169317660207;391.33277761416787;392.6505410184936;402.1113339519661;416.62295622461664;12780.552680656156;19914.800851991477;20585.279515216953;20654.277100301493;21728.456788580294;15881.761773573406;18630.161642726074;19428.417147485598;19497.22011119557;20016.799832001674;5802.12968054792;5955.047192449188;5971.611845230068;5977.671228082454;5980.671063091529;5820.283016510119;5888;5937.317208521033;5977.491913187384;5979.46184843364;5738.167965644979;5834.766609335621;5884.2056322396575;5897.734601942923;5900.616459930112;5804.680742559158;5871.765129394819;5885.352611212763;5906.911396329058;5917.053271476586;5184.300119483859;5283.63014588979;5309.707966061865;5310.230016647564;5344.22508736235;23444.179453719207;24006.519869602686;24872.626910596355;24886;25008.374790630198;2695.2857492764433;2745.052956729925;2838.0918106206022;2844.573314002916;3208;15087.849121508754;15178.468753593681;15393.769093463607;15422.074675519505;15559.455419060392;1836.669399508088;1939.4096194319097;2010.1758279105643;2022.1709099269376;2180.509385388291;82161;84895.15104848934;85191.57404213001;87799.12200877973;88314.55842720809;11333.603323883624;11441.14191435629;11473.196876218584;11528.423578821026;11658.941705291589;15727.191372992023;15807.446739364066;15826.28781704826;15944.920275398548;15957.680846383008;8135.430519863553;8244.587770611566;8306;8514.531700756394;8528.488290702579;6747.763828265987;7831.451798374059;7846.372290216769;7857.214278572097;8101.473404228706;7862.70265406213;8759.386842921062;8904.243139333099;9190.172884440433;9249.445033298023;3292.8024318540965;3356.5300857879915;3459.3427248822645;3465.757396982187;3771.5851256362325;925.9120383563685;963.1957315641517;986.0533887468112;1083.2904447586843;1100.2243418390017;19572.902135489516;20478.283260085824;20478.385648430572;20525.589488210153;20862.582748344947;988.9752756181153;997.6857289953641;1030.2427715629008;1031.242037102729;1092.8907109289007;10792.622258220925;11376.203665743318;11428.142889283337;11447;11496.367699776425;457083;463210;464063;468497;469050;95716.52141739246;95831.52084239674;96609;96763;96876;969.14230905649;978.951052447389;990.1484723138095;991.6578780320777;1000.2498126405196;17518.824811751718;17820.376286829898;18189.636207275515;18191.909040454713;18393.448196554124;36287.455688165224;41644.58355416407;44995.77502112599;45490.31764523469;45972.770136150444;61332;61739.691301545005;62162.37837621566;62760;63539.36460635519;8784.209421152127;8799.34004949644;8960.775980600538;8984.550772461482;9225.630974760934;11455.828162577402;14098.577042688736;14348.713025739635;14375.856241437452;14472.421103155755;12103.75792484163;12152.392380381123;12194.390280486117;12225.877741222474;12464.940480059297;12060.879391205975;12069;12221;12405.193662411913;12413.565525206574;12494.500219991462;12501.06242031833;12539.87460125387;12574.497020119094;12604.936975315064;8870.64517419296;8970.865437018581;9059.954700226457;9105.453672779655;9167;9475.336726429085;12087.456064476944;12210.877891220975;12393.62819115428;12593.811092833432 11:30:45 INFO - PROCESS | 29353 | |3;mootools.html;1300.1678925487695;1468.3098943496555;1470.2501724120698;1599.3522623337553;1766.5230387795305;8331.583420828956;8654.783630409243;8665.393422460422;8944.64221431142;8954.37319387643;8785.780355491115;8969.372143949926;8984.730458086251;8985.505797181153;8990.37067405282;2089.7283353164066;2152.6770984352393;2156.7411910570754;2353.964690529639;2389.199618127929;2127.4681329667583;2138.0592539282743;2211.071350032982;2281.6919715838317;2294.0594356313914;2347.1784875293683;2399.592069348206;2417.9395515112087;2422.588160012793;2423.418379588895;2008.5279959209574;2257.8532395394245;2259.53679495703;2263.0268984336644;2265.784750448713;2275.988620056906;2344.542814151241;2345.4605440748724;2348.941276468085;2351.8588884666974;8953.059928707522;8957.596908139149;8959;8963.596638151299;8968.50673212973;5115.335006449175;5271.103912334912;5276.762545685453;5278.868028299285;5279.128943724281;3136.623605167372;3229.1281354034513;3253.056613582058;3260.10347154532;3302.3725492156414;1020.4897551224387;1050.175612144463;1060.459165825427;1070.9732256693567;1074.9355038697704;12771.425285862066;12784;12785.041121915894;12791.48834046637;12793.360331983456;4530.478994915561;4557.361969324297;4696.342512048316;4705.670603057822;4742.834000809955;10506.632267870587;10599.258051936291;10606.628767993083;10607.840882386616;10611;5239.607029472805;5270.183121616155;5271.4464981176425;5281.498257665516;5288.127458969227;4709;4849;4853.12643724126;4893.510648935149;4923.236898280772;3987.063040185554;4022.6982976276313;4038.959610403917;4098.749881286236;4138.79306034697;1276.2789024201297;1281.3849352310942;1297.6366617347157;1297.9870201298056;1301.1087405127519;906.8821053263166;949.4588084791602;956.9712908612753;977.4080255062759;978.2076518020426;5681.119426488901;5790.305163380422;5792.623479473821;5929.644221346733;6064.332923378425;437.7920487768348;462.95601917817754;469.07592043673907;470.45662260089654;472.30806867938634;4009.4186342980106;4079.122988557415;4152.6055024772595;4155.937660935088;4172.311568591209;10914.23600347968;11028;11441.027512661518;11448.427578621036;11459.598914037968;11121.72195695098;11158.609448669258;11172.21794474379;11185.272957257752;11215.887841121648;8245;8339.916600834036;8448.07071222165;8469.534175620276;8486.74539763808;5668.971655141698;5797.797077102281;5837.562182836219;6011.969940150271;6132.5707200495535;10023.799524009624;10272.589096436059;10386;10396;10426.218033647658;9154.771130721785;10200.795984080425;10432;10465.372077675363;10511.632092876713;6905.413039891666;7731.690732370867;7746.845063098819;7926.445148839756;7935.166807485131;8844.601992910462;8863.246624037029;8879.600417981335;8902.287816974756;8938.1508756668;7897.091834439113;8016.318612917968;8077.151899050515;8134.145914678874;8148.3073938713505;7447.590382529013;7594.734184303523;7705.768826935201;7805.570693611906;7902.051753789582;6721.596704197764;6936.514443989075;6949.096617439701;7034.261402552658;7105.18290396611;4895.290182923527;5024.447310795883;5034.823781167788;5095.719735414587;5235.764390602356;5003.049420610072;5026.296318515484;5126.102931986962;5137.383513978347;5305.204219367126 11:30:45 INFO - PROCESS | 29353 | |4;prototype.html;325.9152620318718;336.2786822266239;337.00919297266034;346.61698822800787;349.62066158218335;5414.619272085618;5471.425500322469;5491.560675145989;5493.780248790049;5503.6147469677135;5416.702081385532;5441.29263195784;5452.91820622691;5496.1755736639525;5518.6688798672;3858.6913046956174;3989.6808255339574;4070.9185816283657;4110.260153172428;4270.4234928284595;4227.767472788995;4249.405083288342;4272.2056736170725;4272.572742725718;4282.357646353056;4168.645665118469;4214.2414365414215;4218.388333691613;4249.575042495741;4256.4679415073115;4021.6581590564692;4117.5882411758585;4201.159768046387;4226.957730422687;4230.598093181143;3755.9436608450897;3766.7174961877968;3772.792496412696;3773.3208022555928;3776.395776675746;5259.526642602184;5275.235090911835;5315;5322.33470816148;5326.360836699582;4786.2581299898575;4865.586425153866;4885.975570122162;4890.193118135503;4907.435644900811;5645.350784659776;5655.858603534944;5659.886802263973;5663.320401551799;5682.664573825148;4166.625003749647;4178.1643671265865;4179.958200417987;4189.036521600018;4191.11986482839;5624.3813180550105;5647.971760141173;5683.516901063374;5899.528037756969;5954.285485741695;4250.53244143144;4272.124214536013;4272.60733988961;4287.6998610097;4291.806868690854;4243;4288.726974703412;4303.612674859278;4304.677149213759;4332.956670433318;4660.930086048712;4917.459079501252;4917.729524876167;4919.237518184687;4941.555260026615;5645.463680950304;5664.631798933056;5713.200151978726;5737.3975732548315;5751.539876809845;1435.9282035898163;1446.7829825526044;1449.9057561258485;1451.1148199598238;1453.4694836384645;879.3273146043282;916.2166347772692;923.2844545477309;928.661038720862;934.5047125023748;4910.435299940481;4912.59990902591;4936.679115857458;4941.802327906844;4947.183714687037;5135.3053492347435;5145.478715429413;5200.153945349422;5207.244949482304;5210.557102646318;4761.738104404221;4833.371661684029;4899.951000489949;4916.311716359713;4962.751862406937;2779.277387879166;2785.749282564579;2788.484130435876;2792.2740087577376;2799.7060308667296;5284.987557092497;5310.309659744285;5312.814051508179;5335.279737235501;5350.2242174885205;5245.318108645928;5247.7113758743635;5572.269587901899;6016.42843929826;6051.878962420727;6075.149479072933;6107.786227482017;6113.510919126459;6119.479844213202;6120.50047738307;5613.691246981455;5856.882862342814;5888.705564721661;5954.970225148846;5973.790917317873;5742.253507044057;5756.3380211276235;5781.8554536136935;5801.970990145022;5817.76728930838;5741.5406767459335;5845.18167456565;6041.365656605993;6071.939280607137;6118.816435506942;4150.252954468225;4154.1068670236045;4157.646600038909;4187.874363769091;4193.7903104845245;5735.4551317624755;5847.7368518417625;5882.7058647066615;5924.407559244041;5958.285005799332;5692.886142277214;5738.167965644875;5741.827745167651;5744.454276843693;5749.712514374348;5694.886102277848;5705.771769129188;5721.828345149652;5723.713814309184;5780.132980053026;5424.403315635356;5596.664200147841;5622.240997465454;5631.239782629456;5653.660780353028;5714.885702286014;5732.226149469769;5733.426657334233;5740.770369185353;5742.712864356849;5395.325584301962;5619.241402410622;5621.7189140542;5670.432956704297;5683.261176047087 11:30:45 INFO - PROCESS | 29353 | |5;yui.html;763.7250589787675;765.5253742679542;775.4494309040581;819.7663665855232;867.0462491259615;15499.767503487443;16639.584010399747;16643.084630345325;16706.749398759013;16753.832461675378;14620.780688289684;15305.387784488606;15363.23183840809;15371.154586497738;15371.385144594204;674.4840197249108;813.5240884082818;814.2061490047216;832.5504227717056;839.0434904209206;828.2876726015652;830.7632324787437;831.2560258568577;832.6919039955225;832.9208725171129;872.3544577013029;872.6116877989298;873.6767396063434;873.8077622922947;874.3442418186361;698.0680791143803;837.3385025829588;862.0861886400436;862.4092496639822;863.8013256950874;632.34552238433;632.4845251120322;632.9651869147195;633.0093403823048;633.1705465839765;14048.719025619532;14066.718665626733;14089.2955352233;14138.717225655531;14146.151230926178;14079.50721724745;14365.640858978504;14793.70412591753;14893.404263829434;15013.549593512213;13291;13314.667133321647;13528.458861645522;13545.59363219105;13565;4458.219811532968;4513.232750432434;4568.383268258809;4633.675642705012;4746.715197088186;82445.17554824495;82792.17207827965;83322;83954.58022709847;84046.57976710139;10863.45682715861;11202.607908723156;11258.493367798304;11410.600628977945;11852.703682407837;21566;21777;21887.78112218889;21898.562028759334;21901.123955041938;8401.453905496122;8432.241098301183;8538.231559159705;8586.672789071477;8853.822923541493;4805.519448055166;4824.758762061883;4840.419149702058;4932.136876046749;5007.992533682809;3125.890593829205;3226.8063916165106;3232.046546268856;3246.935061298761;3249.431349513826;534.6791924845139;597.2593983460478;617;657.2540166910495;668.3717305732596;584.8567101060268;647.5531883000715;686.2569074550586;698.6576577477;718.9604571748499;10198.011387779312;10468.714958510785;10499.632512862014;10621.150307975498;11041.613543525938;740.5834810385862;742.1391186223955;768.1435199752236;772.6864330637937;793.4445887878508;4895.534924182197;5110.693358398508;5134.178531434953;5198.2722418861385;5256.159014557652;118848.40575797239;121646;124943.37528312301;127420.36289818492;129396;61689.691551542855;99905.66506131743;100117.70690979408;101365;101986.98013019923;84626.15373846306;88175;89282.55358723165;89668.5516572413;90646;10129.037741414553;10135.949320253352;10282.948585257025;10456.26806123564;10609.787804243717;48466;52581.4273215848;54495.45504544904;54510.7274463641;55205.44794552003;67567;68498.65750671214;70785.29214707787;71173.64413177902;77192.61403692946;14406.135631862122;14519.709605808035;14566.271686415424;14764.261786910396;14907.403703851724;14869.776953345925;15013.249337533298;15018;15215.923920380328;15633.530994070195;13831.515896943558;13857.72284554283;14347.713045739236;14803.851961480248;15112.471063512725;13355.17784135365;13358.198508089547;13817.585472435441;13860.54295461183;14220.431182752987;14410.279486025447;14773;15115.924420377827;15167.848321516643;15310;10779;10866.945665271624;11163.162762792661;11278.661640150809;11600.331096107842;11845.776697094332;11872.46573904159;11918.986886114777;12195.51217951272;12298.754024919273 11:30:45 INFO - PROCESS | 29353 | __end_tp_report 11:30:45 INFO - PROCESS | 29353 | __start_cc_report 11:30:45 INFO - PROCESS | 29353 | _x_x_mozilla_cycle_collect,997 11:30:45 INFO - PROCESS | 29353 | __end_cc_report 11:30:45 INFO - PROCESS | 29353 | __startTimestamp1468261845515__endTimestamp 11:30:45 INFO - PROCESS | 29353 | 11:30:45 INFO - PROCESS | 29353 | ------- Summary: start ------- 11:30:45 INFO - PROCESS | 29353 | Number of tests: 6 11:30:45 INFO - PROCESS | 29353 | 11:30:45 INFO - PROCESS | 29353 | [#0] dojo.html Cycles:165 Average:5398.53 Median:5585.53 stddev:625.47 (11.2%) stddev-sans-first:600.16 11:30:45 INFO - PROCESS | 29353 | Values: 3071.4 3085.8 3101.3 3127.6 3154.0 5383.5 5459.5 5465.6 5550.1 5561.3 5396.7 5423.0 5449.1 5480.3 5553.2 4831.9 4897.6 4925.6 4925.8 5102.7 5015.9 5051.5 5058.4 5067.4 5069.2 4821.9 4851.3 4864.9 4905.4 5018.1 4783.4 4790.6 4800.8 4858.6 4981.5 4798.3 4818.1 4839.4 4854.7 4856.1 5273.0 5297.6 5337.4 5385.8 5405.0 5792.0 5792.3 5798.9 5810.5 5847.0 5805.4 5860.7 5875.6 5877.6 5881.3 5314.9 5365.7 5374.5 5376.5 5447.6 5913.3 5974.4 5974.4 5974.7 5979.9 5690.5 5695.4 5738.0 5745.8 5750.4 5602.0 5728.2 5790.9 5797.6 5824.7 5815.5 5828.9 5830.7 5832.5 5870.5 5671.8 5806.7 5849.5 5856.2 5865.6 4342.7 4417.0 4445.0 4452.1 4508.0 3952.1 3962.4 3964.4 3998.6 4000.3 5566.8 5583.6 5584.9 5587.2 5598.8 5744.7 5781.8 5788.3 5792.5 5869.2 5547.9 5550.3 5553.1 5553.2 5557.0 4983.1 5040.9 5051.0 5055.3 5104.9 5963.8 6014.1 6060.3 6093.7 6144.6 5907.4 5912.3 5915.4 5916.0 5952.2 6044.6 6053.7 6074.7 6088.4 6090.8 5559.8 5574.6 5617.9 5656.2 5731.2 5820.7 5859.4 5859.6 5860.9 5861.3 5664.0 5669.5 5675.6 5688.0 5697.5 5516.2 5541.7 5601.0 5612.0 5649.9 5550.1 5550.2 5554.2 5578.9 5585.5 5607.7 5658.3 5688.7 5737.7 5751.6 5574.6 5647.1 5655.3 5657.2 5695.6 11:30:45 INFO - PROCESS | 29353 | 11:30:45 INFO - PROCESS | 29353 | [#1] ext.html Cycles:180 Average:60161.36 Median:21868.17 stddev:115686.01 (529.0%) stddev-sans-first:115924.05 11:30:45 INFO - PROCESS | 29353 | Values: 579.8 617.5 617.9 630.5 631.5 30595.8 42121.6 42368.0 43065.8 43180.1 40150.4 44101.0 44270.8 44292.6 44302.3 8039.8 8875.2 9031.5 9042.2 10404.8 10440.5 10813.8 10816.6 10827.8 10838.0 10997.3 11026.3 11036.7 11046.0 11055.7 10949.7 10956.9 10973.9 10982.2 10989.1 10456.2 10509.8 10516.6 10528.6 10529.5 42149.8 42421.2 42431.4 42541.8 42556.1 3635.8 3692.5 3946.7 4007.3 4235.6 32545.8 33523.8 33603.2 33649.5 33804.2 4364.8 4454.3 4499.5 4503.3 4512.0 356427.0 360132.0 361062.0 361921.0 362356.0 57229.0 57490.0 57534.7 57590.0 57595.0 60209.4 60984.1 61087.7 61225.0 61249.0 16664.8 17315.7 17331.7 17344.3 17347.4 13318.7 13600.9 13628.6 13635.0 13642.3 16286.7 16543.6 16676.0 16731.8 16734.4 6136.8 6212.9 6240.9 6335.8 6370.7 982.8 1070.6 1078.6 1082.0 1131.2 32328.7 32386.5 32402.0 32564.8 32664.8 1058.2 1091.5 1139.5 1160.5 1177.9 16684.7 17286.7 17444.0 17466.6 17629.0 521990.0 524939.0 527023.0 527213.4 529130.0 57784.0 57915.0 57924.0 57926.0 58017.7 1219.6 1244.8 1325.8 1344.7 1354.9 32479.8 33805.2 33922.0 34306.7 34409.8 50026.5 50116.2 50443.0 50473.7 50524.0 408216.0 408524.0 410659.0 410965.0 411041.0 34985.8 41578.6 43426.6 44778.3 44901.8 47942.0 48372.3 48490.7 48557.8 49419.5 39729.0 41791.8 42632.1 42924.6 43400.6 41285.0 41400.8 41787.2 42104.0 42575.0 40936.0 41526.8 41601.8 41854.2 42010.6 35348.7 37014.6 37622.4 37754.6 37864.6 27857.7 28088.7 28149.9 28346.6 28409.7 11:30:45 INFO - PROCESS | 29353 | 11:30:45 INFO - PROCESS | 29353 | [#2] jquery.html Cycles:180 Average:29227.38 Median:2079.88 stddev:76851.76 (3695.0%) stddev-sans-first:77036.84 11:30:45 INFO - PROCESS | 29353 | Values: 388.2 391.3 392.7 402.1 416.6 12780.6 19914.8 20585.3 20654.3 21728.5 15881.8 18630.2 19428.4 19497.2 20016.8 5802.1 5955.0 5971.6 5977.7 5980.7 5820.3 5888.0 5937.3 5977.5 5979.5 5738.2 5834.8 5884.2 5897.7 5900.6 5804.7 5871.8 5885.4 5906.9 5917.1 5184.3 5283.6 5309.7 5310.2 5344.2 23444.2 24006.5 24872.6 24886.0 25008.4 2695.3 2745.1 2838.1 2844.6 3208.0 15087.8 15178.5 15393.8 15422.1 15559.5 1836.7 1939.4 2010.2 2022.2 2180.5 82161.0 84895.2 85191.6 87799.1 88314.6 11333.6 11441.1 11473.2 11528.4 11658.9 15727.2 15807.4 15826.3 15944.9 15957.7 8135.4 8244.6 8306.0 8514.5 8528.5 6747.8 7831.5 7846.4 7857.2 8101.5 7862.7 8759.4 8904.2 9190.2 9249.4 3292.8 3356.5 3459.3 3465.8 3771.6 925.9 963.2 986.1 1083.3 1100.2 19572.9 20478.3 20478.4 20525.6 20862.6 989.0 997.7 1030.2 1031.2 1092.9 10792.6 11376.2 11428.1 11447.0 11496.4 457083.0 463210.0 464063.0 468497.0 469050.0 95716.5 95831.5 96609.0 96763.0 96876.0 969.1 979.0 990.1 991.7 1000.2 17518.8 17820.4 18189.6 18191.9 18393.4 36287.5 41644.6 44995.8 45490.3 45972.8 61332.0 61739.7 62162.4 62760.0 63539.4 8784.2 8799.3 8960.8 8984.6 9225.6 11455.8 14098.6 14348.7 14375.9 14472.4 12103.8 12152.4 12194.4 12225.9 12464.9 12060.9 12069.0 12221.0 12405.2 12413.6 12494.5 12501.1 12539.9 12574.5 12604.9 8870.6 8970.9 9060.0 9105.5 9167.0 9475.3 12087.5 12210.9 12393.6 12593.8 11:30:45 INFO - PROCESS | 29353 | 11:30:45 INFO - PROCESS | 29353 | [#3] mootools.html Cycles:180 Average:5847.12 Median:2588.06 stddev:3424.15 (132.3%) stddev-sans-first:3416.71 11:30:45 INFO - PROCESS | 29353 | Values: 1300.2 1468.3 1470.3 1599.4 1766.5 8331.6 8654.8 8665.4 8944.6 8954.4 8785.8 8969.4 8984.7 8985.5 8990.4 2089.7 2152.7 2156.7 2354.0 2389.2 2127.5 2138.1 2211.1 2281.7 2294.1 2347.2 2399.6 2417.9 2422.6 2423.4 2008.5 2257.9 2259.5 2263.0 2265.8 2276.0 2344.5 2345.5 2348.9 2351.9 8953.1 8957.6 8959.0 8963.6 8968.5 5115.3 5271.1 5276.8 5278.9 5279.1 3136.6 3229.1 3253.1 3260.1 3302.4 1020.5 1050.2 1060.5 1071.0 1074.9 12771.4 12784.0 12785.0 12791.5 12793.4 4530.5 4557.4 4696.3 4705.7 4742.8 10506.6 10599.3 10606.6 10607.8 10611.0 5239.6 5270.2 5271.4 5281.5 5288.1 4709.0 4849.0 4853.1 4893.5 4923.2 3987.1 4022.7 4039.0 4098.7 4138.8 1276.3 1281.4 1297.6 1298.0 1301.1 906.9 949.5 957.0 977.4 978.2 5681.1 5790.3 5792.6 5929.6 6064.3 437.8 463.0 469.1 470.5 472.3 4009.4 4079.1 4152.6 4155.9 4172.3 10914.2 11028.0 11441.0 11448.4 11459.6 11121.7 11158.6 11172.2 11185.3 11215.9 8245.0 8339.9 8448.1 8469.5 8486.7 5669.0 5797.8 5837.6 6012.0 6132.6 10023.8 10272.6 10386.0 10396.0 10426.2 9154.8 10200.8 10432.0 10465.4 10511.6 6905.4 7731.7 7746.8 7926.4 7935.2 8844.6 8863.2 8879.6 8902.3 8938.2 7897.1 8016.3 8077.2 8134.1 8148.3 7447.6 7594.7 7705.8 7805.6 7902.1 6721.6 6936.5 6949.1 7034.3 7105.2 4895.3 5024.4 5034.8 5095.7 5235.8 5003.0 5026.3 5126.1 5137.4 5305.2 11:30:45 INFO - PROCESS | 29353 | 11:30:45 INFO - PROCESS | 29353 | [#4] prototype.html Cycles:180 Average:4718.60 Median:5311.56 stddev:1389.73 (26.2%) stddev-sans-first:1353.96 11:30:45 INFO - PROCESS | 29353 | Values: 325.9 336.3 337.0 346.6 349.6 5414.6 5471.4 5491.6 5493.8 5503.6 5416.7 5441.3 5452.9 5496.2 5518.7 3858.7 3989.7 4070.9 4110.3 4270.4 4227.8 4249.4 4272.2 4272.6 4282.4 4168.6 4214.2 4218.4 4249.6 4256.5 4021.7 4117.6 4201.2 4227.0 4230.6 3755.9 3766.7 3772.8 3773.3 3776.4 5259.5 5275.2 5315.0 5322.3 5326.4 4786.3 4865.6 4886.0 4890.2 4907.4 5645.4 5655.9 5659.9 5663.3 5682.7 4166.6 4178.2 4180.0 4189.0 4191.1 5624.4 5648.0 5683.5 5899.5 5954.3 4250.5 4272.1 4272.6 4287.7 4291.8 4243.0 4288.7 4303.6 4304.7 4333.0 4660.9 4917.5 4917.7 4919.2 4941.6 5645.5 5664.6 5713.2 5737.4 5751.5 1435.9 1446.8 1449.9 1451.1 1453.5 879.3 916.2 923.3 928.7 934.5 4910.4 4912.6 4936.7 4941.8 4947.2 5135.3 5145.5 5200.2 5207.2 5210.6 4761.7 4833.4 4900.0 4916.3 4962.8 2779.3 2785.7 2788.5 2792.3 2799.7 5285.0 5310.3 5312.8 5335.3 5350.2 5245.3 5247.7 5572.3 6016.4 6051.9 6075.1 6107.8 6113.5 6119.5 6120.5 5613.7 5856.9 5888.7 5955.0 5973.8 5742.3 5756.3 5781.9 5802.0 5817.8 5741.5 5845.2 6041.4 6071.9 6118.8 4150.3 4154.1 4157.6 4187.9 4193.8 5735.5 5847.7 5882.7 5924.4 5958.3 5692.9 5738.2 5741.8 5744.5 5749.7 5694.9 5705.8 5721.8 5723.7 5780.1 5424.4 5596.7 5622.2 5631.2 5653.7 5714.9 5732.2 5733.4 5740.8 5742.7 5395.3 5619.2 5621.7 5670.4 5683.3 11:30:45 INFO - PROCESS | 29353 | 11:30:45 INFO - PROCESS | 29353 | [#5] yui.html Cycles:180 Average:21399.28 Median:3239.49 stddev:30807.41 (951.0%) stddev-sans-first:30854.87 11:30:45 INFO - PROCESS | 29353 | Values: 763.7 765.5 775.4 819.8 867.0 15499.8 16639.6 16643.1 16706.7 16753.8 14620.8 15305.4 15363.2 15371.2 15371.4 674.5 813.5 814.2 832.6 839.0 828.3 830.8 831.3 832.7 832.9 872.4 872.6 873.7 873.8 874.3 698.1 837.3 862.1 862.4 863.8 632.3 632.5 633.0 633.0 633.2 14048.7 14066.7 14089.3 14138.7 14146.2 14079.5 14365.6 14793.7 14893.4 15013.5 13291.0 13314.7 13528.5 13545.6 13565.0 4458.2 4513.2 4568.4 4633.7 4746.7 82445.2 82792.2 83322.0 83954.6 84046.6 10863.5 11202.6 11258.5 11410.6 11852.7 21566.0 21777.0 21887.8 21898.6 21901.1 8401.5 8432.2 8538.2 8586.7 8853.8 4805.5 4824.8 4840.4 4932.1 5008.0 3125.9 3226.8 3232.0 3246.9 3249.4 534.7 597.3 617.0 657.3 668.4 584.9 647.6 686.3 698.7 719.0 10198.0 10468.7 10499.6 10621.2 11041.6 740.6 742.1 768.1 772.7 793.4 4895.5 5110.7 5134.2 5198.3 5256.2 118848.4 121646.0 124943.4 127420.4 129396.0 61689.7 99905.7 100117.7 101365.0 101987.0 84626.2 88175.0 89282.6 89668.6 90646.0 10129.0 10135.9 10282.9 10456.3 10609.8 48466.0 52581.4 54495.5 54510.7 55205.4 67567.0 68498.7 70785.3 71173.6 77192.6 14406.1 14519.7 14566.3 14764.3 14907.4 14869.8 15013.2 15018.0 15215.9 15633.5 13831.5 13857.7 14347.7 14803.9 15112.5 13355.2 13358.2 13817.6 13860.5 14220.4 14410.3 14773.0 15115.9 15167.8 15310.0 10779.0 10866.9 11163.2 11278.7 11600.3 11845.8 11872.5 11919.0 12195.5 12298.8 11:30:45 INFO - PROCESS | 29353 | -------- Summary: end -------- 11:30:45 INFO - PROCESS | 29353 | 11:30:46 INFO - TEST-INFO | 29353: exit 0 11:30:46 INFO - TEST-OK | dromaeo_css | took 1114072ms 11:30:46 INFO - TEST-START | kraken 11:30:46 INFO - operating with platform_type : linux_ 11:30:46 INFO - Initialising browser for kraken test... 11:30:46 INFO - TEST-INFO | started process 29547 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp3M564H/profile http://localhost:36310/getInfo.html) 11:30:50 INFO - PROCESS | 29547 | __metrics Screen width/height:1600/1200 11:30:50 INFO - PROCESS | 29547 | colorDepth:24 11:30:50 INFO - PROCESS | 29547 | Browser inner width/height: 1024/697 11:30:50 INFO - PROCESS | 29547 | __metrics 11:30:50 INFO - PROCESS | 29547 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 693: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 11:30:50 INFO - PROCESS | 29547 | JavaScript error: resource://app/modules/CaptivePortalWatcher.jsm, line 60: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 11:30:51 INFO - TEST-INFO | 29547: exit 0 11:30:51 INFO - Browser initialized. 11:30:51 INFO - Running cycle 1/1 for kraken test... 11:30:51 INFO - TEST-INFO | started process 29630 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp3M564H/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 11:31:03 INFO - PROCESS | 29630 | RSS: Main: 157016064 11:31:03 INFO - PROCESS | 29630 | 11:31:06 INFO - PROCESS | 29630 | Cycle 1(1): loaded http://localhost:36310/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:36310/tests/kraken/driver.html?testName=audio-beat-detection) 11:31:06 INFO - PROCESS | 29630 | RSS: Main: 215252992 11:31:06 INFO - PROCESS | 29630 | 11:31:09 INFO - PROCESS | 29630 | Cycle 1(1): loaded http://localhost:36310/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:36310/tests/kraken/driver.html?testName=audio-dft) 11:31:10 INFO - PROCESS | 29630 | RSS: Main: 203071488 11:31:10 INFO - PROCESS | 29630 | 11:31:13 INFO - PROCESS | 29630 | Cycle 1(1): loaded http://localhost:36310/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:36310/tests/kraken/driver.html?testName=audio-fft) 11:31:13 INFO - PROCESS | 29630 | RSS: Main: 269430784 11:31:13 INFO - PROCESS | 29630 | 11:31:15 INFO - PROCESS | 29630 | Cycle 1(1): loaded http://localhost:36310/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:36310/tests/kraken/driver.html?testName=audio-oscillator) 11:31:16 INFO - PROCESS | 29630 | RSS: Main: 180314112 11:31:16 INFO - PROCESS | 29630 | 11:31:18 INFO - PROCESS | 29630 | Cycle 1(1): loaded http://localhost:36310/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:36310/tests/kraken/driver.html?testName=imaging-gaussian-blur) 11:31:19 INFO - PROCESS | 29630 | RSS: Main: 184569856 11:31:19 INFO - PROCESS | 29630 | 11:31:22 INFO - PROCESS | 29630 | Cycle 1(1): loaded http://localhost:36310/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:36310/tests/kraken/driver.html?testName=imaging-darkroom) 11:31:22 INFO - PROCESS | 29630 | RSS: Main: 218976256 11:31:22 INFO - PROCESS | 29630 | 11:31:26 INFO - PROCESS | 29630 | Cycle 1(1): loaded http://localhost:36310/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:36310/tests/kraken/driver.html?testName=imaging-desaturate) 11:31:26 INFO - PROCESS | 29630 | RSS: Main: 220459008 11:31:26 INFO - PROCESS | 29630 | 11:31:29 INFO - PROCESS | 29630 | Cycle 1(1): loaded http://localhost:36310/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:36310/tests/kraken/driver.html?testName=json-parse-financial) 11:31:30 INFO - PROCESS | 29630 | RSS: Main: 220925952 11:31:30 INFO - PROCESS | 29630 | 11:31:31 INFO - PROCESS | 29630 | Cycle 1(1): loaded http://localhost:36310/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:36310/tests/kraken/driver.html?testName=json-stringify-tinderbox) 11:31:32 INFO - PROCESS | 29630 | RSS: Main: 207675392 11:31:32 INFO - PROCESS | 29630 | 11:31:34 INFO - PROCESS | 29630 | Cycle 1(1): loaded http://localhost:36310/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:36310/tests/kraken/driver.html?testName=stanford-crypto-aes) 11:31:34 INFO - PROCESS | 29630 | RSS: Main: 210726912 11:31:34 INFO - PROCESS | 29630 | 11:31:36 INFO - PROCESS | 29630 | Cycle 1(1): loaded http://localhost:36310/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:36310/tests/kraken/driver.html?testName=stanford-crypto-ccm) 11:31:37 INFO - PROCESS | 29630 | RSS: Main: 210075648 11:31:37 INFO - PROCESS | 29630 | 11:31:40 INFO - PROCESS | 29630 | Cycle 1(1): loaded http://localhost:36310/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:36310/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 11:31:40 INFO - PROCESS | 29630 | RSS: Main: 225107968 11:31:40 INFO - PROCESS | 29630 | 11:31:43 INFO - PROCESS | 29630 | Cycle 1(1): loaded http://localhost:36310/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:36310/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 11:31:43 INFO - PROCESS | 29630 | RSS: Main: 226037760 11:31:43 INFO - PROCESS | 29630 | 11:31:45 INFO - PROCESS | 29630 | Cycle 1(1): loaded http://localhost:36310/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:36310/tests/kraken/driver.html?testName=ai-astar) 11:31:45 INFO - PROCESS | 29630 | RSS: Main: 268046336 11:31:45 INFO - PROCESS | 29630 | 11:31:45 INFO - PROCESS | 29630 | __start_tp_report 11:31:45 INFO - PROCESS | 29630 | _x_x_mozilla_page_load 11:31:45 INFO - PROCESS | 29630 | _x_x_mozilla_page_load_details 11:31:45 INFO - PROCESS | 29630 | |i|pagename|runs| 11:31:45 INFO - PROCESS | 29630 | |0;ai-astar;103;112;110;110;111;110;111;110;110;110 11:31:45 INFO - PROCESS | 29630 | |1;audio-beat-detection;142;116;120;181;118;117;148;118;145;116 11:31:45 INFO - PROCESS | 29630 | |2;audio-dft;160;161;159;159;162;160;160;161;161;160 11:31:45 INFO - PROCESS | 29630 | |3;audio-fft;74;74;75;127;76;75;75;75;101;74 11:31:45 INFO - PROCESS | 29630 | |4;audio-oscillator;84;86;114;84;84;85;113;84;85;131 11:31:45 INFO - PROCESS | 29630 | |5;imaging-gaussian-blur;118;117;117;116;117;117;117;116;116;117 11:31:45 INFO - PROCESS | 29630 | |6;imaging-darkroom;146;146;146;145;146;145;146;146;146;145 11:31:45 INFO - PROCESS | 29630 | |7;imaging-desaturate;94;94;95;94;95;95;94;94;95;94 11:31:45 INFO - PROCESS | 29630 | |8;json-parse-financial;53;53;53;52;52;52;54;53;51;51 11:31:45 INFO - PROCESS | 29630 | |9;json-stringify-tinderbox;66;66;66;67;68;66;67;66;70;66 11:31:45 INFO - PROCESS | 29630 | |10;stanford-crypto-aes;75;78;80;77;79;75;78;76;75;78 11:31:45 INFO - PROCESS | 29630 | |11;stanford-crypto-ccm;128;119;118;119;120;124;124;122;196;131 11:31:45 INFO - PROCESS | 29630 | |12;stanford-crypto-pbkdf2;157;155;156;154;157;161;156;157;155;155 11:31:45 INFO - PROCESS | 29630 | |13;stanford-crypto-sha256-iterative;63;62;64;63;63;65;67;62;61;61 11:31:45 INFO - PROCESS | 29630 | __end_tp_report 11:31:45 INFO - PROCESS | 29630 | __start_cc_report 11:31:45 INFO - PROCESS | 29630 | _x_x_mozilla_cycle_collect,1673 11:31:45 INFO - PROCESS | 29630 | __end_cc_report 11:31:45 INFO - PROCESS | 29630 | __startTimestamp1468261905807__endTimestamp 11:31:45 INFO - PROCESS | 29630 | 11:31:45 INFO - PROCESS | 29630 | ------- Summary: start ------- 11:31:45 INFO - PROCESS | 29630 | Number of tests: 14 11:31:45 INFO - PROCESS | 29630 | 11:31:45 INFO - PROCESS | 29630 | [#0] ai-astar Cycles:10 Average:109.70 Median:110.00 stddev:2.45 (2.2%) stddev-sans-first:0.73 11:31:45 INFO - PROCESS | 29630 | Values: 103.0 112.0 110.0 110.0 111.0 110.0 111.0 110.0 110.0 110.0 11:31:45 INFO - PROCESS | 29630 | 11:31:45 INFO - PROCESS | 29630 | [#1] audio-beat-detection Cycles:10 Average:132.10 Median:131.00 stddev:21.60 (16.5%) stddev-sans-first:22.61 11:31:45 INFO - PROCESS | 29630 | Values: 142.0 116.0 120.0 181.0 118.0 117.0 148.0 118.0 145.0 116.0 11:31:45 INFO - PROCESS | 29630 | 11:31:45 INFO - PROCESS | 29630 | [#2] audio-dft Cycles:10 Average:160.30 Median:160.50 stddev:0.95 (0.6%) stddev-sans-first:1.00 11:31:45 INFO - PROCESS | 29630 | Values: 160.0 161.0 159.0 159.0 162.0 160.0 160.0 161.0 161.0 160.0 11:31:45 INFO - PROCESS | 29630 | 11:31:45 INFO - PROCESS | 29630 | [#3] audio-fft Cycles:10 Average:82.60 Median:75.00 stddev:17.66 (23.5%) stddev-sans-first:18.45 11:31:45 INFO - PROCESS | 29630 | Values: 74.0 74.0 75.0 127.0 76.0 75.0 75.0 75.0 101.0 74.0 11:31:45 INFO - PROCESS | 29630 | 11:31:45 INFO - PROCESS | 29630 | [#4] audio-oscillator Cycles:10 Average:95.00 Median:84.00 stddev:17.47 (20.8%) stddev-sans-first:18.07 11:31:45 INFO - PROCESS | 29630 | Values: 84.0 86.0 114.0 84.0 84.0 85.0 113.0 84.0 85.0 131.0 11:31:45 INFO - PROCESS | 29630 | 11:31:45 INFO - PROCESS | 29630 | [#5] imaging-gaussian-blur Cycles:10 Average:116.80 Median:117.00 stddev:0.63 (0.5%) stddev-sans-first:0.50 11:31:45 INFO - PROCESS | 29630 | Values: 118.0 117.0 117.0 116.0 117.0 117.0 117.0 116.0 116.0 117.0 11:31:45 INFO - PROCESS | 29630 | 11:31:45 INFO - PROCESS | 29630 | [#6] imaging-darkroom Cycles:10 Average:145.70 Median:146.00 stddev:0.48 (0.3%) stddev-sans-first:0.50 11:31:45 INFO - PROCESS | 29630 | Values: 146.0 146.0 146.0 145.0 146.0 145.0 146.0 146.0 146.0 145.0 11:31:45 INFO - PROCESS | 29630 | 11:31:45 INFO - PROCESS | 29630 | [#7] imaging-desaturate Cycles:10 Average:94.40 Median:94.50 stddev:0.52 (0.5%) stddev-sans-first:0.53 11:31:45 INFO - PROCESS | 29630 | Values: 94.0 94.0 95.0 94.0 95.0 95.0 94.0 94.0 95.0 94.0 11:31:45 INFO - PROCESS | 29630 | 11:31:45 INFO - PROCESS | 29630 | [#8] json-parse-financial Cycles:10 Average:52.40 Median:53.00 stddev:0.97 (1.8%) stddev-sans-first:1.00 11:31:45 INFO - PROCESS | 29630 | Values: 53.0 53.0 53.0 52.0 52.0 52.0 54.0 53.0 51.0 51.0 11:31:45 INFO - PROCESS | 29630 | 11:31:45 INFO - PROCESS | 29630 | [#9] json-stringify-tinderbox Cycles:10 Average:66.80 Median:66.50 stddev:1.32 (2.0%) stddev-sans-first:1.36 11:31:45 INFO - PROCESS | 29630 | Values: 66.0 66.0 66.0 67.0 68.0 66.0 67.0 66.0 70.0 66.0 11:31:45 INFO - PROCESS | 29630 | 11:31:45 INFO - PROCESS | 29630 | [#10] stanford-crypto-aes Cycles:10 Average:77.10 Median:78.00 stddev:1.79 (2.3%) stddev-sans-first:1.73 11:31:45 INFO - PROCESS | 29630 | Values: 75.0 78.0 80.0 77.0 79.0 75.0 78.0 76.0 75.0 78.0 11:31:45 INFO - PROCESS | 29630 | 11:31:45 INFO - PROCESS | 29630 | [#11] stanford-crypto-ccm Cycles:10 Average:130.10 Median:124.00 stddev:23.53 (19.0%) stddev-sans-first:24.94 11:31:45 INFO - PROCESS | 29630 | Values: 128.0 119.0 118.0 119.0 120.0 124.0 124.0 122.0 196.0 131.0 11:31:45 INFO - PROCESS | 29630 | 11:31:45 INFO - PROCESS | 29630 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:156.30 Median:156.50 stddev:1.95 (1.2%) stddev-sans-first:2.05 11:31:45 INFO - PROCESS | 29630 | Values: 157.0 155.0 156.0 154.0 157.0 161.0 156.0 157.0 155.0 155.0 11:31:45 INFO - PROCESS | 29630 | 11:31:45 INFO - PROCESS | 29630 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:63.10 Median:63.00 stddev:1.85 (2.9%) stddev-sans-first:1.96 11:31:45 INFO - PROCESS | 29630 | Values: 63.0 62.0 64.0 63.0 63.0 65.0 67.0 62.0 61.0 61.0 11:31:45 INFO - PROCESS | 29630 | -------- Summary: end -------- 11:31:45 INFO - PROCESS | 29630 | 11:31:46 INFO - TEST-INFO | 29630: exit 0 11:31:46 INFO - TEST-OK | kraken | took 60548ms 11:31:46 INFO - SUITE-END | took 1174s 11:31:46 INFO - Completed test suite (00:19:34) 11:31:46 INFO - javascript benchmark 11:31:47 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3071.355015446756, 3085.7994230375025, 3101.3487167694784, 3127.562141300217, 3154.0064879562938, 5383.515483606475, 5459.535939445147, 5465.617406781527, 5550.084236101044, 5561.304836895383, 5396.676199428027, 5422.9728851355685, 5449.128139497681, 5480.287562616864, 5553.194786755928, 4831.855044348676, 4897.583705385046, 4925.581325587329, 4925.802967881281, 5102.744862756866, 5015.949840501585, 5051.494850514938, 5058.367704036996, 5067.417247016603, 5069.2142717878605, 4821.9035619287415, 4851.320815085891, 4864.902701945959, 4905.362302900636, 5018.121828679985, 4783.378160839104, 4790.616750659939, 4800.807967681289, 4858.587020103296, 4981.476944920767, 4798.304245884327, 4818.132736107499, 4839.44346400165, 4854.660173787836, 4856.05306965142, 5272.973635131838, 5297.629165958385, 5337.412884582693, 5385.7576409061685, 5405.027095122877, 5791.971040144772, 5792.304923409176, 5798.9130163047585, 5810.535157187415, 5846.9707651461895, 5805.4194580542035, 5860.677662728548, 5875.6474611523445, 5877.588568800185, 5881.323647780518, 5314.9468505314835, 5365.678059316453, 5374.489423504721, 5376.516113549799, 5447.618666693333, 5913.349531551526, 5974.372690867396, 5974.40255974399, 5974.731137098841, 5979.850503737354, 5690.516306113944, 5695.373508914016, 5737.971310143423, 5745.798897038583, 5750.367459579443, 5601.971990140023, 5728.1694154348215, 5790.88418231633, 5797.623154494944, 5824.708764561755, 5815.476607105381, 5828.912566311508, 5830.737616807254, 5832.533397328203, 5870.471657550841, 5671.829845104653, 5806.738696758572, 5849.473547380671, 5856.150858125633, 5865.618734782225, 4342.739435633872, 4416.955830441719, 4445.044315472189, 4452.109578084396, 4508.030773383738, 3952.0515076382035, 3962.405639154092, 3964.444977703124, 3998.620131087542, 4000.2599519089063, 5566.777328906879, 5583.637063590935, 5584.860378490489, 5587.189857470726, 5598.776048957996, 5744.655320680772, 5781.82654520365, 5788.27646544182, 5792.478676919098, 5869.178315035899, 5547.8890422192135, 5550.250716153349, 5553.083741182741, 5553.222548843165, 5557.027520183951, 4983.103041452501, 5040.949590504121, 5050.974745126325, 5055.34280543527, 5104.923426148611, 5963.761449542057, 6014.127951447016, 6060.272767267956, 6093.715917428541, 6144.600600960924, 5907.350191478848, 5912.349641539513, 5915.40845915405, 5915.970420147872, 5952.196453478725, 6044.576879618385, 6053.697315134314, 6074.726637301421, 6088.4215999479975, 6090.756369745338, 5559.833205003856, 5574.554035677055, 5617.859553511032, 5656.236408084856, 5731.19763233156, 5820.738066787089, 5859.44335288147, 5859.560532959959, 5860.853478662897, 5861.296644402699, 5664.0087984601705, 5669.489745922887, 5675.574331925205, 5687.971560142173, 5697.515711164598, 5516.227728117987, 5541.695206763667, 5601.019821531298, 5611.971940140274, 5649.943500564942, 5550.0564903965615, 5550.167474878801, 5554.166874968787, 5578.9163162553405, 5585.525230355465, 5607.691576963306, 5658.321001479849, 5688.658680479184, 5737.74180161902, 5751.597388182787, 5574.637648552831, 5647.0964645656495, 5655.321361436654, 5657.151427285776, 5695.629784064023], "value": 5355.344931462752, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [579.8461062485654, 617.4874853871287, 617.8578926846825, 630.4515071887458, 631.5263552335748, 30595.84702076492, 42121.578784212186, 42368.0, 43065.7846710766, 43180.136397272036, 40150.397744033864, 44101.0, 44270.77864610672, 44292.55707442925, 44302.33546496805, 8039.839203215932, 8875.245604123642, 9031.503267320295, 9042.23141033013, 10404.843927341097, 10440.477976101203, 10813.783724325509, 10816.567337306498, 10827.83758243627, 10838.0, 10997.34015959045, 11026.338419694845, 11036.668899933014, 11046.0, 11055.668329950075, 10949.671509854677, 10956.945215273912, 10973.945130274378, 10982.176336774774, 10989.06592939601, 10456.163506919429, 10509.789804203872, 10516.631917882914, 10528.578856845717, 10529.526171322308, 42149.789251053546, 42421.151576968594, 42431.36352954708, 42541.787291063345, 42556.148877022286, 3635.800030998294, 3692.464592634053, 3946.6842652587725, 4007.338789099795, 4235.597618226264, 32545.837270813496, 33523.83238083818, 33603.15992100193, 33649.49525757116, 33804.154896127795, 4364.825406983717, 4454.265046267362, 4499.505054444008, 4503.324501324795, 4511.977440112812, 356427.0, 360132.0, 361062.0, 361921.0, 362356.0, 57229.0, 57490.0, 57534.7123264381, 57590.0, 57595.0, 60209.39790602038, 60984.085238721455, 61087.69456152691, 61225.0, 61249.0, 16664.83335166633, 17315.65368692619, 17331.740023899652, 17344.306227751, 17347.392841250497, 13318.667033324244, 13600.863991360158, 13628.591142265748, 13635.045546811629, 13642.317884105954, 16286.674266514603, 16543.586410339838, 16676.0, 16731.83268167327, 16734.414295499842, 6136.754529818757, 6212.9068063979075, 6240.910749179186, 6335.809925702236, 6370.681465926685, 982.7641366072091, 1070.6466865934224, 1078.6207995537984, 1082.0477979378097, 1131.1968502363413, 32328.67671323304, 32386.514202286984, 32402.0, 32564.83717581397, 32664.762171124938, 1058.1799105692996, 1091.5470079916904, 1139.4929256480953, 1160.5357856857324, 1177.8881006304387, 16684.66630667404, 17286.654266914593, 17444.040577768345, 17466.563335916704, 17629.0, 521990.0, 524939.0, 527023.0, 527213.3639331856, 529130.0, 57784.0, 57915.0, 57924.0, 57926.0, 58017.70991145102, 1219.5731493977214, 1244.794608889523, 1325.807757875122, 1344.6974430753198, 1354.9187048777105, 32479.837600811843, 33805.15487112842, 33922.0, 34306.65693343035, 34409.82795086109, 50026.49973500364, 50116.24825627545, 50443.0, 50473.747631261605, 50524.0, 408216.0, 408524.0, 410659.0, 410965.0, 411041.0, 34985.82507087448, 41578.58421415747, 43426.56573434225, 44778.3283250745, 44901.77549112234, 47942.0, 48372.274415884494, 48490.70995209219, 48557.75721121372, 49419.50580494149, 39729.0, 41791.7910410446, 42632.147357053305, 42924.57075429331, 43400.56599433965, 41285.0, 41400.79299603483, 41787.1642567153, 42104.0, 42575.0, 40936.0, 41526.79236603918, 41601.791991041064, 41854.16291674088, 42010.579894200666, 35348.670415436725, 37014.62985370112, 37622.435663465614, 37754.62245377511, 37864.62135378611, 27857.72142278551, 28088.71911280861, 28149.859250703616, 28346.574801377585, 28409.715902840708], "value": 20825.36653688272, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [388.169317660207, 391.33277761416787, 392.6505410184936, 402.1113339519661, 416.62295622461664, 12780.552680656156, 19914.800851991477, 20585.279515216953, 20654.277100301493, 21728.456788580294, 15881.761773573406, 18630.161642726074, 19428.417147485598, 19497.22011119557, 20016.799832001674, 5802.12968054792, 5955.047192449188, 5971.611845230068, 5977.671228082454, 5980.671063091529, 5820.283016510119, 5888.0, 5937.317208521033, 5977.491913187384, 5979.46184843364, 5738.167965644979, 5834.766609335621, 5884.2056322396575, 5897.734601942923, 5900.616459930112, 5804.680742559158, 5871.765129394819, 5885.352611212763, 5906.911396329058, 5917.053271476586, 5184.300119483859, 5283.63014588979, 5309.707966061865, 5310.230016647564, 5344.22508736235, 23444.179453719207, 24006.519869602686, 24872.626910596355, 24886.0, 25008.374790630198, 2695.2857492764433, 2745.052956729925, 2838.0918106206022, 2844.573314002916, 3208.0, 15087.849121508754, 15178.468753593681, 15393.769093463607, 15422.074675519505, 15559.455419060392, 1836.669399508088, 1939.4096194319097, 2010.1758279105643, 2022.1709099269376, 2180.509385388291, 82161.0, 84895.15104848934, 85191.57404213001, 87799.12200877973, 88314.55842720809, 11333.603323883624, 11441.14191435629, 11473.196876218584, 11528.423578821026, 11658.941705291589, 15727.191372992023, 15807.446739364066, 15826.28781704826, 15944.920275398548, 15957.680846383008, 8135.430519863553, 8244.587770611566, 8306.0, 8514.531700756394, 8528.488290702579, 6747.763828265987, 7831.451798374059, 7846.372290216769, 7857.214278572097, 8101.473404228706, 7862.70265406213, 8759.386842921062, 8904.243139333099, 9190.172884440433, 9249.445033298023, 3292.8024318540965, 3356.5300857879915, 3459.3427248822645, 3465.757396982187, 3771.5851256362325, 925.9120383563685, 963.1957315641517, 986.0533887468112, 1083.2904447586843, 1100.2243418390017, 19572.902135489516, 20478.283260085824, 20478.385648430572, 20525.589488210153, 20862.582748344947, 988.9752756181153, 997.6857289953641, 1030.2427715629008, 1031.242037102729, 1092.8907109289007, 10792.622258220925, 11376.203665743318, 11428.142889283337, 11447.0, 11496.367699776425, 457083.0, 463210.0, 464063.0, 468497.0, 469050.0, 95716.52141739246, 95831.52084239674, 96609.0, 96763.0, 96876.0, 969.14230905649, 978.951052447389, 990.1484723138095, 991.6578780320777, 1000.2498126405196, 17518.824811751718, 17820.376286829898, 18189.636207275515, 18191.909040454713, 18393.448196554124, 36287.455688165224, 41644.58355416407, 44995.77502112599, 45490.31764523469, 45972.770136150444, 61332.0, 61739.691301545005, 62162.37837621566, 62760.0, 63539.36460635519, 8784.209421152127, 8799.34004949644, 8960.775980600538, 8984.550772461482, 9225.630974760934, 11455.828162577402, 14098.577042688736, 14348.713025739635, 14375.856241437452, 14472.421103155755, 12103.75792484163, 12152.392380381123, 12194.390280486117, 12225.877741222474, 12464.940480059297, 12060.879391205975, 12069.0, 12221.0, 12405.193662411913, 12413.565525206574, 12494.500219991462, 12501.06242031833, 12539.87460125387, 12574.497020119094, 12604.936975315064, 8870.64517419296, 8970.865437018581, 9059.954700226457, 9105.453672779655, 9167.0, 9475.336726429085, 12087.456064476944, 12210.877891220975, 12393.62819115428, 12593.811092833432], "value": 9919.535459108136, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1300.1678925487695, 1468.3098943496555, 1470.2501724120698, 1599.3522623337553, 1766.5230387795305, 8331.583420828956, 8654.783630409243, 8665.393422460422, 8944.64221431142, 8954.37319387643, 8785.780355491115, 8969.372143949926, 8984.730458086251, 8985.505797181153, 8990.37067405282, 2089.7283353164066, 2152.6770984352393, 2156.7411910570754, 2353.964690529639, 2389.199618127929, 2127.4681329667583, 2138.0592539282743, 2211.071350032982, 2281.6919715838317, 2294.0594356313914, 2347.1784875293683, 2399.592069348206, 2417.9395515112087, 2422.588160012793, 2423.418379588895, 2008.5279959209574, 2257.8532395394245, 2259.53679495703, 2263.0268984336644, 2265.784750448713, 2275.988620056906, 2344.542814151241, 2345.4605440748724, 2348.941276468085, 2351.8588884666974, 8953.059928707522, 8957.596908139149, 8959.0, 8963.596638151299, 8968.50673212973, 5115.335006449175, 5271.103912334912, 5276.762545685453, 5278.868028299285, 5279.128943724281, 3136.623605167372, 3229.1281354034513, 3253.056613582058, 3260.10347154532, 3302.3725492156414, 1020.4897551224387, 1050.175612144463, 1060.459165825427, 1070.9732256693567, 1074.9355038697704, 12771.425285862066, 12784.0, 12785.041121915894, 12791.48834046637, 12793.360331983456, 4530.478994915561, 4557.361969324297, 4696.342512048316, 4705.670603057822, 4742.834000809955, 10506.632267870587, 10599.258051936291, 10606.628767993083, 10607.840882386616, 10611.0, 5239.607029472805, 5270.183121616155, 5271.4464981176425, 5281.498257665516, 5288.127458969227, 4709.0, 4849.0, 4853.12643724126, 4893.510648935149, 4923.236898280772, 3987.063040185554, 4022.6982976276313, 4038.959610403917, 4098.749881286236, 4138.79306034697, 1276.2789024201297, 1281.3849352310942, 1297.6366617347157, 1297.9870201298056, 1301.1087405127519, 906.8821053263166, 949.4588084791602, 956.9712908612753, 977.4080255062759, 978.2076518020426, 5681.119426488901, 5790.305163380422, 5792.623479473821, 5929.644221346733, 6064.332923378425, 437.7920487768348, 462.95601917817754, 469.07592043673907, 470.45662260089654, 472.30806867938634, 4009.4186342980106, 4079.122988557415, 4152.6055024772595, 4155.937660935088, 4172.311568591209, 10914.23600347968, 11028.0, 11441.027512661518, 11448.427578621036, 11459.598914037968, 11121.72195695098, 11158.609448669258, 11172.21794474379, 11185.272957257752, 11215.887841121648, 8245.0, 8339.916600834036, 8448.07071222165, 8469.534175620276, 8486.74539763808, 5668.971655141698, 5797.797077102281, 5837.562182836219, 6011.969940150271, 6132.5707200495535, 10023.799524009624, 10272.589096436059, 10386.0, 10396.0, 10426.218033647658, 9154.771130721785, 10200.795984080425, 10432.0, 10465.372077675363, 10511.632092876713, 6905.413039891666, 7731.690732370867, 7746.845063098819, 7926.445148839756, 7935.166807485131, 8844.601992910462, 8863.246624037029, 8879.600417981335, 8902.287816974756, 8938.1508756668, 7897.091834439113, 8016.318612917968, 8077.151899050515, 8134.145914678874, 8148.3073938713505, 7447.590382529013, 7594.734184303523, 7705.768826935201, 7805.570693611906, 7902.051753789582, 6721.596704197764, 6936.514443989075, 6949.096617439701, 7034.261402552658, 7105.18290396611, 4895.290182923527, 5024.447310795883, 5034.823781167788, 5095.719735414587, 5235.764390602356, 5003.049420610072, 5026.296318515484, 5126.102931986962, 5137.383513978347, 5305.204219367126], "value": 4556.315874285779, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [325.9152620318718, 336.2786822266239, 337.00919297266034, 346.61698822800787, 349.62066158218335, 5414.619272085618, 5471.425500322469, 5491.560675145989, 5493.780248790049, 5503.6147469677135, 5416.702081385532, 5441.29263195784, 5452.91820622691, 5496.1755736639525, 5518.6688798672, 3858.6913046956174, 3989.6808255339574, 4070.9185816283657, 4110.260153172428, 4270.4234928284595, 4227.767472788995, 4249.405083288342, 4272.2056736170725, 4272.572742725718, 4282.357646353056, 4168.645665118469, 4214.2414365414215, 4218.388333691613, 4249.575042495741, 4256.4679415073115, 4021.6581590564692, 4117.5882411758585, 4201.159768046387, 4226.957730422687, 4230.598093181143, 3755.9436608450897, 3766.7174961877968, 3772.792496412696, 3773.3208022555928, 3776.395776675746, 5259.526642602184, 5275.235090911835, 5315.0, 5322.33470816148, 5326.360836699582, 4786.2581299898575, 4865.586425153866, 4885.975570122162, 4890.193118135503, 4907.435644900811, 5645.350784659776, 5655.858603534944, 5659.886802263973, 5663.320401551799, 5682.664573825148, 4166.625003749647, 4178.1643671265865, 4179.958200417987, 4189.036521600018, 4191.11986482839, 5624.3813180550105, 5647.971760141173, 5683.516901063374, 5899.528037756969, 5954.285485741695, 4250.53244143144, 4272.124214536013, 4272.60733988961, 4287.6998610097, 4291.806868690854, 4243.0, 4288.726974703412, 4303.612674859278, 4304.677149213759, 4332.956670433318, 4660.930086048712, 4917.459079501252, 4917.729524876167, 4919.237518184687, 4941.555260026615, 5645.463680950304, 5664.631798933056, 5713.200151978726, 5737.3975732548315, 5751.539876809845, 1435.9282035898163, 1446.7829825526044, 1449.9057561258485, 1451.1148199598238, 1453.4694836384645, 879.3273146043282, 916.2166347772692, 923.2844545477309, 928.661038720862, 934.5047125023748, 4910.435299940481, 4912.59990902591, 4936.679115857458, 4941.802327906844, 4947.183714687037, 5135.3053492347435, 5145.478715429413, 5200.153945349422, 5207.244949482304, 5210.557102646318, 4761.738104404221, 4833.371661684029, 4899.951000489949, 4916.311716359713, 4962.751862406937, 2779.277387879166, 2785.749282564579, 2788.484130435876, 2792.2740087577376, 2799.7060308667296, 5284.987557092497, 5310.309659744285, 5312.814051508179, 5335.279737235501, 5350.2242174885205, 5245.318108645928, 5247.7113758743635, 5572.269587901899, 6016.42843929826, 6051.878962420727, 6075.149479072933, 6107.786227482017, 6113.510919126459, 6119.479844213202, 6120.50047738307, 5613.691246981455, 5856.882862342814, 5888.705564721661, 5954.970225148846, 5973.790917317873, 5742.253507044057, 5756.3380211276235, 5781.8554536136935, 5801.970990145022, 5817.76728930838, 5741.5406767459335, 5845.18167456565, 6041.365656605993, 6071.939280607137, 6118.816435506942, 4150.252954468225, 4154.1068670236045, 4157.646600038909, 4187.874363769091, 4193.7903104845245, 5735.4551317624755, 5847.7368518417625, 5882.7058647066615, 5924.407559244041, 5958.285005799332, 5692.886142277214, 5738.167965644875, 5741.827745167651, 5744.454276843693, 5749.712514374348, 5694.886102277848, 5705.771769129188, 5721.828345149652, 5723.713814309184, 5780.132980053026, 5424.403315635356, 5596.664200147841, 5622.240997465454, 5631.239782629456, 5653.660780353028, 5714.885702286014, 5732.226149469769, 5733.426657334233, 5740.770369185353, 5742.712864356849, 5395.325584301962, 5619.241402410622, 5621.7189140542, 5670.432956704297, 5683.261176047087], "value": 4273.676747694023, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [763.7250589787675, 765.5253742679542, 775.4494309040581, 819.7663665855232, 867.0462491259615, 15499.767503487443, 16639.584010399747, 16643.084630345325, 16706.749398759013, 16753.832461675378, 14620.780688289684, 15305.387784488606, 15363.23183840809, 15371.154586497738, 15371.385144594204, 674.4840197249108, 813.5240884082818, 814.2061490047216, 832.5504227717056, 839.0434904209206, 828.2876726015652, 830.7632324787437, 831.2560258568577, 832.6919039955225, 832.9208725171129, 872.3544577013029, 872.6116877989298, 873.6767396063434, 873.8077622922947, 874.3442418186361, 698.0680791143803, 837.3385025829588, 862.0861886400436, 862.4092496639822, 863.8013256950874, 632.34552238433, 632.4845251120322, 632.9651869147195, 633.0093403823048, 633.1705465839765, 14048.719025619532, 14066.718665626733, 14089.2955352233, 14138.717225655531, 14146.151230926178, 14079.50721724745, 14365.640858978504, 14793.70412591753, 14893.404263829434, 15013.549593512213, 13291.0, 13314.667133321647, 13528.458861645522, 13545.59363219105, 13565.0, 4458.219811532968, 4513.232750432434, 4568.383268258809, 4633.675642705012, 4746.715197088186, 82445.17554824495, 82792.17207827965, 83322.0, 83954.58022709847, 84046.57976710139, 10863.45682715861, 11202.607908723156, 11258.493367798304, 11410.600628977945, 11852.703682407837, 21566.0, 21777.0, 21887.78112218889, 21898.562028759334, 21901.123955041938, 8401.453905496122, 8432.241098301183, 8538.231559159705, 8586.672789071477, 8853.822923541493, 4805.519448055166, 4824.758762061883, 4840.419149702058, 4932.136876046749, 5007.992533682809, 3125.890593829205, 3226.8063916165106, 3232.046546268856, 3246.935061298761, 3249.431349513826, 534.6791924845139, 597.2593983460478, 617.0, 657.2540166910495, 668.3717305732596, 584.8567101060268, 647.5531883000715, 686.2569074550586, 698.6576577477, 718.9604571748499, 10198.011387779312, 10468.714958510785, 10499.632512862014, 10621.150307975498, 11041.613543525938, 740.5834810385862, 742.1391186223955, 768.1435199752236, 772.6864330637937, 793.4445887878508, 4895.534924182197, 5110.693358398508, 5134.178531434953, 5198.2722418861385, 5256.159014557652, 118848.40575797239, 121646.0, 124943.37528312301, 127420.36289818492, 129396.0, 61689.691551542855, 99905.66506131743, 100117.70690979408, 101365.0, 101986.98013019923, 84626.15373846306, 88175.0, 89282.55358723165, 89668.5516572413, 90646.0, 10129.037741414553, 10135.949320253352, 10282.948585257025, 10456.26806123564, 10609.787804243717, 48466.0, 52581.4273215848, 54495.45504544904, 54510.7274463641, 55205.44794552003, 67567.0, 68498.65750671214, 70785.29214707787, 71173.64413177902, 77192.61403692946, 14406.135631862122, 14519.709605808035, 14566.271686415424, 14764.261786910396, 14907.403703851724, 14869.776953345925, 15013.249337533298, 15018.0, 15215.923920380328, 15633.530994070195, 13831.515896943558, 13857.72284554283, 14347.713045739236, 14803.851961480248, 15112.471063512725, 13355.17784135365, 13358.198508089547, 13817.585472435441, 13860.54295461183, 14220.431182752987, 14410.279486025447, 14773.0, 15115.924420377827, 15167.848321516643, 15310.0, 10779.0, 10866.945665271624, 11163.162762792661, 11278.661640150809, 11600.331096107842, 11845.776697094332, 11872.46573904159, 11918.986886114777, 12195.51217951272, 12298.754024919273], "value": 7793.067707347635, "unit": "score"}], "name": "dromaeo_css", "value": 7427.462870870813, "alertThreshold": 5.0}, {"lowerIsBetter": true, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [103.0, 112.0, 110.0, 110.0, 111.0, 110.0, 111.0, 110.0, 110.0, 110.0], "value": 109.7, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [142.0, 116.0, 120.0, 181.0, 118.0, 117.0, 148.0, 118.0, 145.0, 116.0], "value": 132.1, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [160.0, 161.0, 159.0, 159.0, 162.0, 160.0, 160.0, 161.0, 161.0, 160.0], "value": 160.3, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [74.0, 74.0, 75.0, 127.0, 76.0, 75.0, 75.0, 75.0, 101.0, 74.0], "value": 82.6, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [84.0, 86.0, 114.0, 84.0, 84.0, 85.0, 113.0, 84.0, 85.0, 131.0], "value": 95.0, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [118.0, 117.0, 117.0, 116.0, 117.0, 117.0, 117.0, 116.0, 116.0, 117.0], "value": 116.8, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [146.0, 146.0, 146.0, 145.0, 146.0, 145.0, 146.0, 146.0, 146.0, 145.0], "value": 145.7, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [94.0, 94.0, 95.0, 94.0, 95.0, 95.0, 94.0, 94.0, 95.0, 94.0], "value": 94.4, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [53.0, 53.0, 53.0, 52.0, 52.0, 52.0, 54.0, 53.0, 51.0, 51.0], "value": 52.4, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [66.0, 66.0, 66.0, 67.0, 68.0, 66.0, 67.0, 66.0, 70.0, 66.0], "value": 66.8, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [75.0, 78.0, 80.0, 77.0, 79.0, 75.0, 78.0, 76.0, 75.0, 78.0], "value": 77.1, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [128.0, 119.0, 118.0, 119.0, 120.0, 124.0, 124.0, 122.0, 196.0, 131.0], "value": 130.1, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [157.0, 155.0, 156.0, 154.0, 157.0, 161.0, 156.0, 157.0, 155.0, 155.0], "value": 156.3, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [63.0, 62.0, 64.0, 63.0, 63.0, 65.0, 67.0, 62.0, 61.0, 61.0], "value": 63.1, "unit": "score"}], "name": "kraken", "value": 1482.3999999999996, "alertThreshold": 2.0}]} 11:31:47 INFO - Return code: 0 11:31:47 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 11:31:47 INFO - # TBPL SUCCESS # 11:31:47 INFO - Running post-action listener: _resource_record_post_action 11:31:47 INFO - ##### 11:31:47 INFO - ##### Finished run-tests step (success) 11:31:47 INFO - ##### 11:31:47 INFO - Running post-run listener: _resource_record_post_run 11:31:47 INFO - Total resource usage - Wall time: 1192s; CPU: 13.0%; Read bytes: 0; Write bytes: 566190080; Read time: 0; Write time: 491668 11:31:47 INFO - TinderboxPrint: CPU usage
13.0% 11:31:47 INFO - TinderboxPrint: I/O read bytes / time
0 / 0 11:31:47 INFO - TinderboxPrint: I/O write bytes / time
566,190,080 / 491,668 11:31:47 INFO - TinderboxPrint: CPU idle
8,274.2 (87.0%) 11:31:47 INFO - TinderboxPrint: CPU user
1,196.2 (12.6%) 11:31:47 INFO - TinderboxPrint: Swap in / out
0 / 0 11:31:47 INFO - install - Wall time: 17s; CPU: 14.0%; Read bytes: 0; Write bytes: 268906496; Read time: 0; Write time: 263804 11:31:47 INFO - run-tests - Wall time: 1175s; CPU: 13.0%; Read bytes: 0; Write bytes: 297283584; Read time: 0; Write time: 227864 11:31:47 INFO - Running post-run listener: _upload_blobber_files 11:31:47 INFO - Blob upload gear active. 11:31:47 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 11:31:47 INFO - Files from /builds/slave/test/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 11:31:47 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Fx-Team', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 11:31:47 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Fx-Team -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 11:31:48 INFO - (blobuploader) - INFO - Open directory for files ... 11:31:48 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 11:31:48 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 11:31:48 INFO - (blobuploader) - INFO - Uploading, attempt #1. 11:31:48 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 11:31:48 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 11:31:48 INFO - (blobuploader) - INFO - Done attempting. 11:31:48 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 11:31:48 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 11:31:48 INFO - (blobuploader) - INFO - Uploading, attempt #1. 11:31:49 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 11:31:49 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 11:31:49 INFO - (blobuploader) - INFO - Done attempting. 11:31:49 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 11:31:49 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 11:31:49 INFO - (blobuploader) - INFO - Uploading, attempt #1. 11:31:53 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 11:31:53 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 11:31:53 INFO - (blobuploader) - INFO - Done attempting. 11:31:53 INFO - (blobuploader) - INFO - Iteration through files over. 11:31:53 INFO - Return code: 0 11:31:53 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 11:31:53 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 11:31:53 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/ee11f922be0bcb47078b0f6d4f7204a8b7834fbd1eeb6425fe2e38edc27179a8c77a8c0f7589e0b5f85ac088d78d96a4aa15d3b5271205131b3e26aa6cc5544d", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/34d272f91363191fd098982da55e9b1fc82f9f078e221084a73c1264998112a68283fcdad0773ced1964b5697cdc7f7add94816e19ac2f0a4c2dde73cb4ded23", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/69f3fca82759a652430abf7fe70bd51eec28567700ad63233de14b42f034c38722c9d572cceb89bb3fb34890fdf8978e177120b446a06cd07024703432292baf"} 11:31:53 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 11:31:53 INFO - Writing to file /builds/slave/test/properties/blobber_files 11:31:53 INFO - Contents: 11:31:53 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/ee11f922be0bcb47078b0f6d4f7204a8b7834fbd1eeb6425fe2e38edc27179a8c77a8c0f7589e0b5f85ac088d78d96a4aa15d3b5271205131b3e26aa6cc5544d", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/34d272f91363191fd098982da55e9b1fc82f9f078e221084a73c1264998112a68283fcdad0773ced1964b5697cdc7f7add94816e19ac2f0a4c2dde73cb4ded23", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/69f3fca82759a652430abf7fe70bd51eec28567700ad63233de14b42f034c38722c9d572cceb89bb3fb34890fdf8978e177120b446a06cd07024703432292baf"} 11:31:53 INFO - Running post-run listener: copy_logs_to_upload_dir 11:31:53 INFO - Copying logs to upload dir... 11:31:53 INFO - mkdir: /builds/slave/test/build/upload/logs 11:31:53 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1234.583028 ========= master_lag: 0.02 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 34 secs) (at 2016-07-11 11:31:53.371335) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-07-11 11:31:53.374758) ========= 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=56c518bb7cbc29fb3c9463e2000001c4-1468260325.186396-193553409 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/ee11f922be0bcb47078b0f6d4f7204a8b7834fbd1eeb6425fe2e38edc27179a8c77a8c0f7589e0b5f85ac088d78d96a4aa15d3b5271205131b3e26aa6cc5544d", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/34d272f91363191fd098982da55e9b1fc82f9f078e221084a73c1264998112a68283fcdad0773ced1964b5697cdc7f7add94816e19ac2f0a4c2dde73cb4ded23", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/69f3fca82759a652430abf7fe70bd51eec28567700ad63233de14b42f034c38722c9d572cceb89bb3fb34890fdf8978e177120b446a06cd07024703432292baf"} build_url:https://queue.taskcluster.net/v1/task/Lr0LHSGWSIezF2PiqBKcXQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011307 build_url: 'https://queue.taskcluster.net/v1/task/Lr0LHSGWSIezF2PiqBKcXQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/ee11f922be0bcb47078b0f6d4f7204a8b7834fbd1eeb6425fe2e38edc27179a8c77a8c0f7589e0b5f85ac088d78d96a4aa15d3b5271205131b3e26aa6cc5544d", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/34d272f91363191fd098982da55e9b1fc82f9f078e221084a73c1264998112a68283fcdad0773ced1964b5697cdc7f7add94816e19ac2f0a4c2dde73cb4ded23", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/69f3fca82759a652430abf7fe70bd51eec28567700ad63233de14b42f034c38722c9d572cceb89bb3fb34890fdf8978e177120b446a06cd07024703432292baf"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-07-11 11:31:53.403845) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-07-11 11:31:53.404619) ========= 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=56c518bb7cbc29fb3c9463e2000001c4-1468260325.186396-193553409 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004470 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-07-11 11:31:53.490593) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-07-11 11:31:53.491316) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-07-11 11:31:53.491951) ========= ========= Total master_lag: 0.19 =========