builder: fx-team_ubuntu64_hw_test-dromaeojs-e10s-pgo slave: talos-linux64-ix-030 starttime: 1462590874.93 results: success (0) buildid: 20160506173008 builduid: de7cd31f18374dd492cfd83a4637eb21 revision: 738ec20418cc728910419aa60f98ae62b429facf ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-05-06 20:14:34.931303) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-05-06 20:14:34.931778) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-05-06 20:14:34.932064) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-05-06 20:14:34.953308) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-05-06 20:14:34.953763) ========= 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=4ac8d263c7293b36a1be1aed000001be-1462589747.683929-1800753746 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-05-06 20:14:35-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 46.7M=0s 2016-05-06 20:14:35 (46.7 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.321367 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-05-06 20:14:35.288593) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-05-06 20:14:35.288914) ========= 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=4ac8d263c7293b36a1be1aed000001be-1462589747.683929-1800753746 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.019836 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-05-06 20:14:35.339307) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-05-06 20:14:35.342972) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev 738ec20418cc728910419aa60f98ae62b429facf --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 738ec20418cc728910419aa60f98ae62b429facf --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=4ac8d263c7293b36a1be1aed000001be-1462589747.683929-1800753746 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-05-06 20:14:35,517 truncating revision to first 12 chars 2016-05-06 20:14:35,517 Setting DEBUG logging. 2016-05-06 20:14:35,517 attempt 1/10 2016-05-06 20:14:35,517 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/738ec20418cc?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-05-06 20:14:36,763 unpacking tar archive at: fx-team-738ec20418cc/testing/mozharness/ program finished with exit code 0 elapsedTime=1.567711 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-05-06 20:14:36.924000) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-05-06 20:14:36.924383) ========= script_repo_revision: 738ec20418cc728910419aa60f98ae62b429facf ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-05-06 20:14:36.924849) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-05-06 20:14:36.925130) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-05-06 20:14:36.935346) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 43 secs) (at 2016-05-06 20:14:36.935707) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --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-e10s', '--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=4ac8d263c7293b36a1be1aed000001be-1462589747.683929-1800753746 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 20:14:37 INFO - MultiFileLogger online at 20160506 20:14:37 in /builds/slave/test 20:14:37 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team 20:14:37 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 20:14:37 INFO - {'append_to_log': False, 20:14:37 INFO - 'base_work_dir': '/builds/slave/test', 20:14:37 INFO - 'blob_upload_branch': 'Fx-Team', 20:14:37 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 20:14:37 INFO - 'branch': 'Fx-Team', 20:14:37 INFO - 'buildbot_json_path': 'buildprops.json', 20:14:37 INFO - 'config_files': ('talos/linux_config.py',), 20:14:37 INFO - 'default_actions': ('clobber', 20:14:37 INFO - 'read-buildbot-config', 20:14:37 INFO - 'download-and-extract', 20:14:37 INFO - 'populate-webroot', 20:14:37 INFO - 'create-virtualenv', 20:14:37 INFO - 'install', 20:14:37 INFO - 'run-tests'), 20:14:37 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 20:14:37 INFO - 'download_minidump_stackwalk': True, 20:14:37 INFO - 'download_symbols': 'ondemand', 20:14:37 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 20:14:37 INFO - 'tooltool.py': '/tools/tooltool.py', 20:14:37 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 20:14:37 INFO - '/tools/misc-python/virtualenv.py')}, 20:14:37 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 20:14:37 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 20:14:37 INFO - 'installer_path': 'installer.exe', 20:14:37 INFO - 'log_level': 'info', 20:14:37 INFO - 'log_name': 'talos', 20:14:37 INFO - 'log_to_console': True, 20:14:37 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 20:14:37 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 20:14:37 INFO - 'opt_config_files': (), 20:14:37 INFO - 'pip_index': False, 20:14:37 INFO - 'sps_profile': False, 20:14:37 INFO - 'sps_profile_interval': 0, 20:14:37 INFO - 'suite': 'dromaeojs-e10s', 20:14:37 INFO - 'system_bits': '32', 20:14:37 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 20:14:37 INFO - 'title': 'talos-linux64-ix-030', 20:14:37 INFO - 'tooltool_cache': '/builds/tooltool_cache', 20:14:37 INFO - 'use_talos_json': True, 20:14:37 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 20:14:37 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 20:14:37 INFO - 'work_dir': 'build'} 20:14:37 INFO - ##### 20:14:37 INFO - ##### Running clobber step. 20:14:37 INFO - ##### 20:14:37 INFO - Running pre-action listener: _resource_record_pre_action 20:14:37 INFO - Running main action method: clobber 20:14:37 INFO - rmtree: /builds/slave/test/build 20:14:37 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 20:14:37 INFO - Running post-action listener: _resource_record_post_action 20:14:37 INFO - ##### 20:14:37 INFO - ##### Finished clobber step (success) 20:14:37 INFO - ##### 20:14:37 INFO - ##### 20:14:37 INFO - ##### Running read-buildbot-config step. 20:14:37 INFO - ##### 20:14:37 INFO - Running pre-action listener: _resource_record_pre_action 20:14:37 INFO - Running main action method: read_buildbot_config 20:14:37 INFO - Using buildbot properties: 20:14:37 INFO - { 20:14:37 INFO - "project": "", 20:14:37 INFO - "product": "firefox", 20:14:37 INFO - "script_repo_revision": "production", 20:14:37 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs-e10s", 20:14:37 INFO - "repository": "", 20:14:37 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team pgo talos dromaeojs-e10s", 20:14:37 INFO - "buildid": "20160506173008", 20:14:37 INFO - "pgo_build": "True", 20:14:37 INFO - "basedir": "/builds/slave/test", 20:14:37 INFO - "buildnumber": 437, 20:14:37 INFO - "slavename": "talos-linux64-ix-030", 20:14:37 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 20:14:37 INFO - "platform": "ubuntu64_hw", 20:14:37 INFO - "scheduler": "tests-fx-team-linux64-pgo-talos", 20:14:37 INFO - "branch": "fx-team", 20:14:37 INFO - "repo_path": "integration/fx-team", 20:14:37 INFO - "revision": "738ec20418cc728910419aa60f98ae62b429facf", 20:14:37 INFO - "stage_platform": "linux64-pgo", 20:14:37 INFO - "builduid": "de7cd31f18374dd492cfd83a4637eb21", 20:14:37 INFO - "slavebuilddir": "test" 20:14:37 INFO - } 20:14:37 INFO - Found installer url https://queue.taskcluster.net/v1/task/QiNtwmCuTauZmovrygHVeQ/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2. 20:14:37 INFO - Running post-action listener: _resource_record_post_action 20:14:37 INFO - ##### 20:14:37 INFO - ##### Finished read-buildbot-config step (success) 20:14:37 INFO - ##### 20:14:37 INFO - ##### 20:14:37 INFO - ##### Running download-and-extract step. 20:14:37 INFO - ##### 20:14:37 INFO - Running pre-action listener: _resource_record_pre_action 20:14:37 INFO - Running main action method: download_and_extract 20:14:37 INFO - mkdir: /builds/slave/test/build/tests 20:14:37 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 20:14:37 INFO - https://queue.taskcluster.net/v1/task/QiNtwmCuTauZmovrygHVeQ/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 20:14:37 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QiNtwmCuTauZmovrygHVeQ/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json 20:14:37 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QiNtwmCuTauZmovrygHVeQ/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json 20:14:37 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QiNtwmCuTauZmovrygHVeQ/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json 20:14:37 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QiNtwmCuTauZmovrygHVeQ/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json'}, attempt #1 20:14:40 INFO - Downloaded 1361 bytes. 20:14:40 INFO - Reading from file /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json 20:14:40 INFO - Using the following test package requirements: 20:14:40 INFO - {u'common': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip'], 20:14:40 INFO - u'cppunittest': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 20:14:40 INFO - u'firefox-49.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 20:14:40 INFO - u'gtest': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 20:14:40 INFO - u'firefox-49.0a1.en-US.linux-x86_64.gtest.tests.zip'], 20:14:40 INFO - u'jittest': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 20:14:40 INFO - u'jsshell-linux-x86_64.zip'], 20:14:40 INFO - u'mochitest': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 20:14:40 INFO - u'firefox-49.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 20:14:40 INFO - u'mozbase': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip'], 20:14:40 INFO - u'reftest': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 20:14:40 INFO - u'firefox-49.0a1.en-US.linux-x86_64.reftest.tests.zip'], 20:14:40 INFO - u'talos': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 20:14:40 INFO - u'firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip'], 20:14:40 INFO - u'web-platform': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 20:14:40 INFO - u'firefox-49.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 20:14:40 INFO - u'xpcshell': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 20:14:40 INFO - u'firefox-49.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 20:14:40 INFO - Downloading packages: [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 20:14: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')]} 20:14:40 INFO - https://queue.taskcluster.net/v1/task/QiNtwmCuTauZmovrygHVeQ/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 20:14:40 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QiNtwmCuTauZmovrygHVeQ/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip 20:14:40 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QiNtwmCuTauZmovrygHVeQ/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip 20:14:40 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QiNtwmCuTauZmovrygHVeQ/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip 20:14:40 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QiNtwmCuTauZmovrygHVeQ/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 20:14:43 INFO - Downloaded 23894091 bytes. 20:14:43 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 20:14:43 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 20:14:44 INFO - Return code: 0 20:14:44 INFO - Downloading packages: [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 20:14:44 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')]} 20:14:44 INFO - https://queue.taskcluster.net/v1/task/QiNtwmCuTauZmovrygHVeQ/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 20:14:44 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QiNtwmCuTauZmovrygHVeQ/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip 20:14:44 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QiNtwmCuTauZmovrygHVeQ/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip 20:14:44 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QiNtwmCuTauZmovrygHVeQ/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip 20:14:44 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QiNtwmCuTauZmovrygHVeQ/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 20:14:57 INFO - Downloaded 23894091 bytes. 20:14:57 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 20:14:57 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 20:14:58 INFO - Return code: 0 20:14:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 20:14:58 INFO - https://queue.taskcluster.net/v1/task/QiNtwmCuTauZmovrygHVeQ/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 20:14:58 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QiNtwmCuTauZmovrygHVeQ/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip 20:14:58 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QiNtwmCuTauZmovrygHVeQ/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip 20:14:58 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QiNtwmCuTauZmovrygHVeQ/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip 20:14:58 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QiNtwmCuTauZmovrygHVeQ/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 20:15:00 INFO - Downloaded 10840152 bytes. 20:15:00 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test/build/tests'] 20:15:00 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test/build/tests 20:15:00 INFO - Return code: 0 20:15:00 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')]} 20:15:00 INFO - https://queue.taskcluster.net/v1/task/QiNtwmCuTauZmovrygHVeQ/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 20:15:00 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QiNtwmCuTauZmovrygHVeQ/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 20:15:00 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QiNtwmCuTauZmovrygHVeQ/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 20:15:00 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QiNtwmCuTauZmovrygHVeQ/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 20:15:00 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QiNtwmCuTauZmovrygHVeQ/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 20:15:01 INFO - Downloaded 58388400 bytes. 20:15:01 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/QiNtwmCuTauZmovrygHVeQ/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 20:15:01 INFO - mkdir: /builds/slave/test/properties 20:15:01 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 20:15:01 INFO - Writing to file /builds/slave/test/properties/build_url 20:15:01 INFO - Contents: 20:15:01 INFO - build_url:https://queue.taskcluster.net/v1/task/QiNtwmCuTauZmovrygHVeQ/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 20:15:03 INFO - Running post-action listener: _resource_record_post_action 20:15:03 INFO - Running post-action listener: set_extra_try_arguments 20:15:03 INFO - ##### 20:15:03 INFO - ##### Finished download-and-extract step (success) 20:15:03 INFO - ##### 20:15:03 INFO - ##### 20:15:03 INFO - ##### Running populate-webroot step. 20:15:03 INFO - ##### 20:15:03 INFO - Running pre-action listener: _resource_record_pre_action 20:15:03 INFO - Running main action method: populate_webroot 20:15:03 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 20:15:03 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 20:15:03 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 20:15:03 INFO - '--tppagecycles', 20:15:03 INFO - '7'], 20:15:03 INFO - 'tests': ['tsvgm']}}, 20:15:03 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 20:15:03 INFO - 'tests': ['tresize', 'tcanvasmark']}, 20:15:03 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 20:15:03 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 20:15:03 INFO - 'tests': ['dromaeo_css', 'kraken']}, 20:15:03 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 20:15:03 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 20:15:03 INFO - 'talos_options': ['--disable-e10s'], 20:15:03 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 20:15:03 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 20:15:03 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 20:15:03 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 20:15:03 INFO - 'talos_options': ['--disable-e10s'], 20:15:03 INFO - 'tests': ['damp', 'tps']}, 20:15:03 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 20:15:03 INFO - 'tests': ['damp', 'tps']}, 20:15:03 INFO - 'g3': {'talos_options': ['--disable-e10s'], 20:15:03 INFO - 'tests': ['dromaeo_dom']}, 20:15:03 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 20:15:03 INFO - 'other': {'talos_options': ['--disable-e10s'], 20:15:03 INFO - 'tests': ['a11yr', 20:15:03 INFO - 'ts_paint', 20:15:03 INFO - 'tpaint', 20:15:03 INFO - 'sessionrestore', 20:15:03 INFO - 'sessionrestore_no_auto_restore', 20:15:03 INFO - 'tabpaint']}, 20:15:03 INFO - 'other-e10s': {'tests': ['a11yr', 20:15:03 INFO - 'ts_paint', 20:15:03 INFO - 'tpaint', 20:15:03 INFO - 'sessionrestore', 20:15:03 INFO - 'sessionrestore_no_auto_restore', 20:15:03 INFO - 'tabpaint']}, 20:15:03 INFO - 'other-e10s_l64': {'tests': ['a11yr', 20:15:03 INFO - 'ts_paint', 20:15:03 INFO - 'tpaint', 20:15:03 INFO - 'sessionrestore', 20:15:03 INFO - 'sessionrestore_no_auto_restore', 20:15:03 INFO - 'tabpaint']}, 20:15:03 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 20:15:03 INFO - 'ts_paint', 20:15:03 INFO - 'tpaint', 20:15:03 INFO - 'sessionrestore', 20:15:03 INFO - 'sessionrestore_no_auto_restore', 20:15:03 INFO - 'tabpaint']}, 20:15:03 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 20:15:03 INFO - 'tests': ['a11yr', 20:15:03 INFO - 'ts_paint', 20:15:03 INFO - 'tpaint', 20:15:03 INFO - 'sessionrestore', 20:15:03 INFO - 'sessionrestore_no_auto_restore', 20:15:03 INFO - 'tabpaint']}, 20:15:03 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 20:15:03 INFO - 'tests': ['a11yr', 20:15:03 INFO - 'ts_paint', 20:15:03 INFO - 'tpaint', 20:15:03 INFO - 'sessionrestore', 20:15:03 INFO - 'sessionrestore_no_auto_restore', 20:15:03 INFO - 'tabpaint']}, 20:15:03 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 20:15:03 INFO - 'tests': ['tsvgx', 20:15:03 INFO - 'tsvgr_opacity', 20:15:03 INFO - 'tart', 20:15:03 INFO - 'tscrollx', 20:15:03 INFO - 'cart']}, 20:15:03 INFO - 'svgr-e10s': {'tests': ['tsvgx', 20:15:03 INFO - 'tsvgr_opacity', 20:15:03 INFO - 'tart', 20:15:03 INFO - 'tscrollx', 20:15:03 INFO - 'cart']}, 20:15:03 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 20:15:03 INFO - 'talos_options': ['--disable-e10s'], 20:15:03 INFO - 'tests': ['tp5o']}, 20:15:03 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 20:15:03 INFO - 'tests': ['tp5o']}, 20:15:03 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 20:15:03 INFO - 'talos_options': ['--disable-e10s', 20:15:03 INFO - '--xperf_path', 20:15:03 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 20:15:03 INFO - 'tests': ['tp5n']}, 20:15:03 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 20:15:03 INFO - 'talos_options': ['--xperf_path', 20:15:03 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 20:15:03 INFO - 'tests': ['tp5n']}}, 20:15:03 INFO - 'talos.zip': {'path': '', 20:15:03 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 20:15:03 INFO - Running post-action listener: _resource_record_post_action 20:15:03 INFO - ##### 20:15:03 INFO - ##### Finished populate-webroot step (success) 20:15:03 INFO - ##### 20:15:03 INFO - ##### 20:15:03 INFO - ##### Running create-virtualenv step. 20:15:03 INFO - ##### 20:15:03 INFO - Running pre-action listener: _resource_record_pre_action 20:15:03 INFO - Running main action method: create_virtualenv 20:15:03 INFO - Creating virtualenv /builds/slave/test/build/venv 20:15:03 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 20:15:03 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 20:15:03 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 20:15:03 INFO - Using real prefix '/usr' 20:15:03 INFO - New python executable in /builds/slave/test/build/venv/bin/python 20:15:04 INFO - Installing distribute.............................................................................................................................................................................................done. 20:15:05 INFO - Installing pip.................done. 20:15:06 INFO - Return code: 0 20:15:06 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 20:15:06 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')]} 20:15:06 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 20:15:06 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:15:06 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')]} 20:15:06 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 20:15:06 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:15:06 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 0x7f5c33cc5f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29348a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x29ff770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a8e9c0>, '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 0x2a8f8c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2a8fd50>, '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': '4ac8d263c7293b36a1be1aed000001be-1462589747.683929-1800753746', '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 20:15:06 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 20:15:06 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 20:15:06 INFO - Using env: {'DISPLAY': ':0', 20:15:06 INFO - 'HOME': '/home/cltbld', 20:15:06 INFO - 'LANG': 'en_US.UTF-8', 20:15:06 INFO - 'LANGUAGE': 'en_US:en', 20:15:06 INFO - 'LOGNAME': 'cltbld', 20:15:06 INFO - 'MAIL': '/var/mail/cltbld', 20:15:06 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 20:15:06 INFO - 'MOZ_NO_REMOTE': '1', 20:15:06 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 20:15:06 INFO - 'NO_EM_RESTART': '1', 20:15:06 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 20:15:06 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 20:15:06 INFO - 'PWD': '/builds/slave/test', 20:15:06 INFO - 'SHELL': '/bin/bash', 20:15:06 INFO - 'SHLVL': '1', 20:15:06 INFO - 'TERM': 'linux', 20:15:06 INFO - 'TMOUT': '86400', 20:15:06 INFO - 'USER': 'cltbld', 20:15:06 INFO - 'XDG_SESSION_COOKIE': '4ac8d263c7293b36a1be1aed000001be-1462589747.683929-1800753746', 20:15:06 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 20:15:06 INFO - '_': '/tools/buildbot/bin/python'} 20:15:06 INFO - Ignoring indexes: https://pypi.python.org/simple/ 20:15:06 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 20:15:06 INFO - Cleaning up... 20:15:06 INFO - Return code: 0 20:15:06 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 20:15:06 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')]} 20:15:06 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 20:15:06 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:15:06 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')]} 20:15:06 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 20:15:06 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:15:06 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>=0.7.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f5c33cc5f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29348a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x29ff770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a8e9c0>, '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 0x2a8f8c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2a8fd50>, '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': '4ac8d263c7293b36a1be1aed000001be-1462589747.683929-1800753746', '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 20:15:06 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>=0.7.1'] in /builds/slave/test/build 20:15:06 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>=0.7.1 20:15:06 INFO - Using env: {'DISPLAY': ':0', 20:15:06 INFO - 'HOME': '/home/cltbld', 20:15:06 INFO - 'LANG': 'en_US.UTF-8', 20:15:06 INFO - 'LANGUAGE': 'en_US:en', 20:15:06 INFO - 'LOGNAME': 'cltbld', 20:15:06 INFO - 'MAIL': '/var/mail/cltbld', 20:15:06 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 20:15:06 INFO - 'MOZ_NO_REMOTE': '1', 20:15:06 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 20:15:06 INFO - 'NO_EM_RESTART': '1', 20:15:06 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 20:15:06 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 20:15:06 INFO - 'PWD': '/builds/slave/test', 20:15:06 INFO - 'SHELL': '/bin/bash', 20:15:06 INFO - 'SHLVL': '1', 20:15:06 INFO - 'TERM': 'linux', 20:15:06 INFO - 'TMOUT': '86400', 20:15:06 INFO - 'USER': 'cltbld', 20:15:06 INFO - 'XDG_SESSION_COOKIE': '4ac8d263c7293b36a1be1aed000001be-1462589747.683929-1800753746', 20:15:06 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 20:15:06 INFO - '_': '/tools/buildbot/bin/python'} 20:15:06 INFO - Ignoring indexes: https://pypi.python.org/simple/ 20:15:06 INFO - Downloading/unpacking psutil>=0.7.1 20:15:06 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 20:15:06 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 20:15:06 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 20:15:06 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 20:15:06 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 20:15:06 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 20:15:08 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 20:15:08 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 20:15:08 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 20:15:08 INFO - Installing collected packages: psutil 20:15:08 INFO - Running setup.py install for psutil 20:15:08 INFO - building 'psutil._psutil_linux' extension 20:15:08 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 20:15:08 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 20:15:08 INFO - building 'psutil._psutil_posix' extension 20:15:08 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 20:15:08 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 20:15:08 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 20:15:08 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 20:15:08 INFO - Successfully installed psutil 20:15:08 INFO - Cleaning up... 20:15:08 INFO - Return code: 0 20:15:08 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 20:15:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 20:15:08 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 20:15:08 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:15:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 20:15:08 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 20:15:08 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:15:08 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.0.0']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f5c33cc5f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29348a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x29ff770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a8e9c0>, '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 0x2a8f8c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2a8fd50>, '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': '4ac8d263c7293b36a1be1aed000001be-1462589747.683929-1800753746', '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 20:15:08 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.0.0'] in /builds/slave/test/build 20:15:08 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.0.0 20:15:08 INFO - Using env: {'DISPLAY': ':0', 20:15:08 INFO - 'HOME': '/home/cltbld', 20:15:08 INFO - 'LANG': 'en_US.UTF-8', 20:15:08 INFO - 'LANGUAGE': 'en_US:en', 20:15:08 INFO - 'LOGNAME': 'cltbld', 20:15:08 INFO - 'MAIL': '/var/mail/cltbld', 20:15:08 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 20:15:08 INFO - 'MOZ_NO_REMOTE': '1', 20:15:08 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 20:15:08 INFO - 'NO_EM_RESTART': '1', 20:15:08 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 20:15:08 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 20:15:08 INFO - 'PWD': '/builds/slave/test', 20:15:08 INFO - 'SHELL': '/bin/bash', 20:15:08 INFO - 'SHLVL': '1', 20:15:08 INFO - 'TERM': 'linux', 20:15:08 INFO - 'TMOUT': '86400', 20:15:08 INFO - 'USER': 'cltbld', 20:15:08 INFO - 'XDG_SESSION_COOKIE': '4ac8d263c7293b36a1be1aed000001be-1462589747.683929-1800753746', 20:15:08 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 20:15:08 INFO - '_': '/tools/buildbot/bin/python'} 20:15:09 INFO - Ignoring indexes: https://pypi.python.org/simple/ 20:15:09 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 20:15:09 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 20:15:09 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 20:15:09 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 20:15:09 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 20:15:09 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 20:15:09 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 20:15:11 INFO - Downloading mozsystemmonitor-0.0.tar.gz 20:15:11 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 20:15:11 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 20:15:11 INFO - Installing collected packages: mozsystemmonitor 20:15:11 INFO - Running setup.py install for mozsystemmonitor 20:15:11 INFO - Successfully installed mozsystemmonitor 20:15:11 INFO - Cleaning up... 20:15:11 INFO - Return code: 0 20:15:11 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 20:15: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')]} 20:15:11 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 20:15:11 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:15: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')]} 20:15:11 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 20:15:11 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:15:11 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 0x7f5c33cc5f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29348a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x29ff770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a8e9c0>, '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 0x2a8f8c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2a8fd50>, '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': '4ac8d263c7293b36a1be1aed000001be-1462589747.683929-1800753746', '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 20:15:11 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 20:15:11 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 20:15:11 INFO - Using env: {'DISPLAY': ':0', 20:15:11 INFO - 'HOME': '/home/cltbld', 20:15:11 INFO - 'LANG': 'en_US.UTF-8', 20:15:11 INFO - 'LANGUAGE': 'en_US:en', 20:15:11 INFO - 'LOGNAME': 'cltbld', 20:15:11 INFO - 'MAIL': '/var/mail/cltbld', 20:15:11 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 20:15:11 INFO - 'MOZ_NO_REMOTE': '1', 20:15:11 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 20:15:11 INFO - 'NO_EM_RESTART': '1', 20:15:11 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 20:15:11 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 20:15:11 INFO - 'PWD': '/builds/slave/test', 20:15:11 INFO - 'SHELL': '/bin/bash', 20:15:11 INFO - 'SHLVL': '1', 20:15:11 INFO - 'TERM': 'linux', 20:15:11 INFO - 'TMOUT': '86400', 20:15:11 INFO - 'USER': 'cltbld', 20:15:11 INFO - 'XDG_SESSION_COOKIE': '4ac8d263c7293b36a1be1aed000001be-1462589747.683929-1800753746', 20:15:11 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 20:15:11 INFO - '_': '/tools/buildbot/bin/python'} 20:15:11 INFO - Ignoring indexes: https://pypi.python.org/simple/ 20:15:11 INFO - Downloading/unpacking blobuploader==1.2.4 20:15:11 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 20:15:11 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 20:15:11 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 20:15:11 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 20:15:11 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 20:15:11 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 20:15:13 INFO - Downloading blobuploader-1.2.4.tar.gz 20:15:13 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 20:15:13 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 20:15:13 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 20:15:13 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 20:15:13 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 20:15:13 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 20:15:13 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 20:15:13 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 20:15:13 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 20:15:13 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 20:15:13 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 20:15:13 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 20:15:13 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 20:15:13 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 20:15:13 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 20:15:13 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 20:15:14 INFO - Downloading docopt-0.6.1.tar.gz 20:15:14 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 20:15:14 INFO - Installing collected packages: blobuploader, requests, docopt 20:15:14 INFO - Running setup.py install for blobuploader 20:15:14 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 20:15:14 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 20:15:14 INFO - Running setup.py install for requests 20:15:14 INFO - Running setup.py install for docopt 20:15:14 INFO - Successfully installed blobuploader requests docopt 20:15:14 INFO - Cleaning up... 20:15:14 INFO - Return code: 0 20:15:14 INFO - Installing None into virtualenv /builds/slave/test/build/venv 20:15:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 20:15:14 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 20:15:14 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:15:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 20:15:14 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 20:15:14 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:15:14 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 0x7f5c33cc5f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29348a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x29ff770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a8e9c0>, '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 0x2a8f8c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2a8fd50>, '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': '4ac8d263c7293b36a1be1aed000001be-1462589747.683929-1800753746', '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 20:15:14 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 20:15:14 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 20:15:14 INFO - Using env: {'DISPLAY': ':0', 20:15:14 INFO - 'HOME': '/home/cltbld', 20:15:14 INFO - 'LANG': 'en_US.UTF-8', 20:15:14 INFO - 'LANGUAGE': 'en_US:en', 20:15:14 INFO - 'LOGNAME': 'cltbld', 20:15:14 INFO - 'MAIL': '/var/mail/cltbld', 20:15:14 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 20:15:14 INFO - 'MOZ_NO_REMOTE': '1', 20:15:14 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 20:15:14 INFO - 'NO_EM_RESTART': '1', 20:15:14 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 20:15:14 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 20:15:14 INFO - 'PWD': '/builds/slave/test', 20:15:14 INFO - 'SHELL': '/bin/bash', 20:15:14 INFO - 'SHLVL': '1', 20:15:14 INFO - 'TERM': 'linux', 20:15:14 INFO - 'TMOUT': '86400', 20:15:14 INFO - 'USER': 'cltbld', 20:15:14 INFO - 'XDG_SESSION_COOKIE': '4ac8d263c7293b36a1be1aed000001be-1462589747.683929-1800753746', 20:15:14 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 20:15:14 INFO - '_': '/tools/buildbot/bin/python'} 20:15:14 INFO - Ignoring indexes: https://pypi.python.org/simple/ 20:15:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 20:15:14 INFO - Running setup.py (path:/tmp/pip-7KBF89-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 20:15:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 20:15:14 INFO - Running setup.py (path:/tmp/pip-tiRmT2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 20:15:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 20:15:15 INFO - Running setup.py (path:/tmp/pip-gYqJun-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 20:15:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 20:15:15 INFO - Running setup.py (path:/tmp/pip-iqlQTC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 20:15:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 20:15:15 INFO - Running setup.py (path:/tmp/pip-T9Oubt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 20:15:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 20:15:15 INFO - Running setup.py (path:/tmp/pip-uv3d1r-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 20:15:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 20:15:15 INFO - Running setup.py (path:/tmp/pip-9TYzgG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 20:15:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 20:15:15 INFO - Running setup.py (path:/tmp/pip-zHt3nA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 20:15:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 20:15:15 INFO - Running setup.py (path:/tmp/pip-S1wiPo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 20:15:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 20:15:15 INFO - Running setup.py (path:/tmp/pip-MYC18M-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 20:15:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 20:15:15 INFO - Running setup.py (path:/tmp/pip-mEi17O-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 20:15:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 20:15:15 INFO - Running setup.py (path:/tmp/pip-ec54sk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 20:15:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 20:15:15 INFO - Running setup.py (path:/tmp/pip-j4KoqM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 20:15:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 20:15:15 INFO - Running setup.py (path:/tmp/pip-D6F2GF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 20:15:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 20:15:15 INFO - Running setup.py (path:/tmp/pip-OlauV0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 20:15:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 20:15:15 INFO - Running setup.py (path:/tmp/pip-M2L6If-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 20:15:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 20:15:16 INFO - Running setup.py (path:/tmp/pip-Db8z04-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 20:15:16 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 20:15:16 INFO - Running setup.py install for manifestparser 20:15:16 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 20:15:16 INFO - Running setup.py install for mozcrash 20:15:16 INFO - Running setup.py install for mozdebug 20:15:16 INFO - Running setup.py install for mozdevice 20:15:16 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 20:15:16 INFO - Installing dm script to /builds/slave/test/build/venv/bin 20:15:16 INFO - Running setup.py install for mozfile 20:15:16 INFO - Running setup.py install for mozhttpd 20:15:16 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 20:15:16 INFO - Running setup.py install for mozinfo 20:15:16 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 20:15:16 INFO - Running setup.py install for mozInstall 20:15:16 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 20:15:16 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 20:15:16 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 20:15:16 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 20:15:16 INFO - Running setup.py install for mozleak 20:15:17 INFO - Running setup.py install for mozlog 20:15:17 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 20:15:17 INFO - Running setup.py install for moznetwork 20:15:17 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 20:15:17 INFO - Running setup.py install for mozprocess 20:15:17 INFO - Running setup.py install for mozprofile 20:15:17 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 20:15:17 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 20:15:17 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 20:15:17 INFO - Running setup.py install for mozrunner 20:15:17 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 20:15:17 INFO - Running setup.py install for mozscreenshot 20:15:17 INFO - Running setup.py install for moztest 20:15:17 INFO - Running setup.py install for mozversion 20:15:17 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 20:15:17 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 20:15:17 INFO - Cleaning up... 20:15:17 INFO - Return code: 0 20:15:17 INFO - Installing None into virtualenv /builds/slave/test/build/venv 20:15:17 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')]} 20:15:17 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 20:15:17 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:15:17 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')]} 20:15:17 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 20:15:17 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:15:17 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 0x7f5c33cc5f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29348a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x29ff770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a8e9c0>, '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 0x2a8f8c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2a8fd50>, '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': '4ac8d263c7293b36a1be1aed000001be-1462589747.683929-1800753746', '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 20:15:17 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 20:15:17 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 20:15:17 INFO - Using env: {'DISPLAY': ':0', 20:15:17 INFO - 'HOME': '/home/cltbld', 20:15:17 INFO - 'LANG': 'en_US.UTF-8', 20:15:17 INFO - 'LANGUAGE': 'en_US:en', 20:15:17 INFO - 'LOGNAME': 'cltbld', 20:15:17 INFO - 'MAIL': '/var/mail/cltbld', 20:15:17 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 20:15:17 INFO - 'MOZ_NO_REMOTE': '1', 20:15:17 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 20:15:17 INFO - 'NO_EM_RESTART': '1', 20:15:17 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 20:15:17 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 20:15:17 INFO - 'PWD': '/builds/slave/test', 20:15:17 INFO - 'SHELL': '/bin/bash', 20:15:17 INFO - 'SHLVL': '1', 20:15:17 INFO - 'TERM': 'linux', 20:15:17 INFO - 'TMOUT': '86400', 20:15:17 INFO - 'USER': 'cltbld', 20:15:17 INFO - 'XDG_SESSION_COOKIE': '4ac8d263c7293b36a1be1aed000001be-1462589747.683929-1800753746', 20:15:17 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 20:15:17 INFO - '_': '/tools/buildbot/bin/python'} 20:15:18 INFO - Ignoring indexes: https://pypi.python.org/simple/ 20:15:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 20:15:18 INFO - Running setup.py (path:/tmp/pip-6fv3JV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 20:15:18 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)) 20:15:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 20:15:18 INFO - Running setup.py (path:/tmp/pip-OTImsX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 20:15:18 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)) 20:15:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 20:15:18 INFO - Running setup.py (path:/tmp/pip-M8dhPh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 20:15:18 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)) 20:15:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 20:15:18 INFO - Running setup.py (path:/tmp/pip-CKD7Q1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 20:15:18 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)) 20:15:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 20:15:18 INFO - Running setup.py (path:/tmp/pip-EMI1A1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 20:15:18 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)) 20:15:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 20:15:18 INFO - Running setup.py (path:/tmp/pip-pHHa2D-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 20:15:18 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)) 20:15:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 20:15:18 INFO - Running setup.py (path:/tmp/pip-4RDuWz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 20:15:18 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)) 20:15:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 20:15:18 INFO - Running setup.py (path:/tmp/pip-O0lSFB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 20:15:18 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)) 20:15:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 20:15:18 INFO - Running setup.py (path:/tmp/pip-pd09LY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 20:15:18 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)) 20:15:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 20:15:18 INFO - Running setup.py (path:/tmp/pip-FxQYab-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 20:15:18 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.1 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 20:15:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 20:15:18 INFO - Running setup.py (path:/tmp/pip-J5DWAB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 20:15:18 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)) 20:15:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 20:15:18 INFO - Running setup.py (path:/tmp/pip-cZLIgP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 20:15:18 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.22 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 20:15:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 20:15:18 INFO - Running setup.py (path:/tmp/pip-sXOqKi-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 20:15:19 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)) 20:15:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 20:15:19 INFO - Running setup.py (path:/tmp/pip-6Be3Zd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 20:15:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.11 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 20:15:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 20:15:19 INFO - Running setup.py (path:/tmp/pip-p9ls_J-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 20:15:19 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)) 20:15:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 20:15:19 INFO - Running setup.py (path:/tmp/pip-JxXwgX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 20:15:19 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)) 20:15:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 20:15:19 INFO - Running setup.py (path:/tmp/pip-NwIaN4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 20:15:19 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)) 20:15:19 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)) 20:15:19 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)) 20:15:19 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)) 20:15:19 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)) 20:15:19 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)) 20:15:19 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 20:15:19 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 20:15:19 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 20:15:19 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 20:15:19 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 20:15:19 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 20:15:19 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 20:15:21 INFO - Downloading blessings-1.6.tar.gz 20:15:21 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 20:15:21 INFO - Installing collected packages: blessings 20:15:21 INFO - Running setup.py install for blessings 20:15:21 INFO - Successfully installed blessings 20:15:21 INFO - Cleaning up... 20:15:21 INFO - Return code: 0 20:15:21 INFO - Done creating virtualenv /builds/slave/test/build/venv. 20:15:21 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 20:15:21 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 20:15:21 INFO - Reading from file tmpfile_stdout 20:15:21 INFO - Current package versions: 20:15:21 INFO - argparse == 1.2.1 20:15:21 INFO - blessings == 1.6 20:15:21 INFO - blobuploader == 1.2.4 20:15:21 INFO - docopt == 0.6.1 20:15:21 INFO - manifestparser == 1.1 20:15:21 INFO - mozInstall == 1.12 20:15:21 INFO - mozcrash == 0.17 20:15:21 INFO - mozdebug == 0.1 20:15:21 INFO - mozdevice == 0.48 20:15:21 INFO - mozfile == 1.2 20:15:21 INFO - mozhttpd == 0.7 20:15:21 INFO - mozinfo == 0.9 20:15:21 INFO - mozleak == 0.1 20:15:21 INFO - mozlog == 3.1 20:15:21 INFO - moznetwork == 0.27 20:15:21 INFO - mozprocess == 0.22 20:15:21 INFO - mozprofile == 0.28 20:15:21 INFO - mozrunner == 6.11 20:15:21 INFO - mozscreenshot == 0.1 20:15:21 INFO - mozsystemmonitor == 0.0 20:15:21 INFO - moztest == 0.7 20:15:21 INFO - mozversion == 1.4 20:15:21 INFO - psutil == 3.1.1 20:15:21 INFO - requests == 1.2.3 20:15:21 INFO - wsgiref == 0.1.2 20:15:21 INFO - Installing None into virtualenv /builds/slave/test/build/venv 20:15: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')]} 20:15:21 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 20:15:21 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:15: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')]} 20:15:21 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 20:15:21 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:15:21 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 0x7f5c33cc5f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29348a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x29ff770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a8e9c0>, '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 0x2a8f8c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2a8fd50>, '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': '4ac8d263c7293b36a1be1aed000001be-1462589747.683929-1800753746', '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 20:15:21 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 20:15:21 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 20:15:21 INFO - Using env: {'DISPLAY': ':0', 20:15:21 INFO - 'HOME': '/home/cltbld', 20:15:21 INFO - 'LANG': 'en_US.UTF-8', 20:15:21 INFO - 'LANGUAGE': 'en_US:en', 20:15:21 INFO - 'LOGNAME': 'cltbld', 20:15:21 INFO - 'MAIL': '/var/mail/cltbld', 20:15:21 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 20:15:21 INFO - 'MOZ_NO_REMOTE': '1', 20:15:21 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 20:15:21 INFO - 'NO_EM_RESTART': '1', 20:15:21 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 20:15:21 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 20:15:21 INFO - 'PWD': '/builds/slave/test', 20:15:21 INFO - 'SHELL': '/bin/bash', 20:15:21 INFO - 'SHLVL': '1', 20:15:21 INFO - 'TERM': 'linux', 20:15:21 INFO - 'TMOUT': '86400', 20:15:21 INFO - 'USER': 'cltbld', 20:15:21 INFO - 'XDG_SESSION_COOKIE': '4ac8d263c7293b36a1be1aed000001be-1462589747.683929-1800753746', 20:15:21 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 20:15:21 INFO - '_': '/tools/buildbot/bin/python'} 20:15:21 INFO - Ignoring indexes: https://pypi.python.org/simple/ 20:15:21 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)) 20:15:21 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)) 20:15:21 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)) 20:15:21 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)) 20:15:21 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)) 20:15:21 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)) 20:15:21 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)) 20:15:21 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)) 20:15:21 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)) 20:15:21 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)) 20:15:21 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)) 20:15:21 INFO - Cleaning up... 20:15:21 INFO - Return code: 0 20:15:21 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 20:15: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')]} 20:15:21 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 20:15:21 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:15: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')]} 20:15:21 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 20:15:21 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:15:21 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 0x7f5c33cc5f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29348a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x29ff770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a8e9c0>, '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 0x2a8f8c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2a8fd50>, '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': '4ac8d263c7293b36a1be1aed000001be-1462589747.683929-1800753746', '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 20:15:21 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 20:15:21 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 20:15:21 INFO - Using env: {'DISPLAY': ':0', 20:15:21 INFO - 'HOME': '/home/cltbld', 20:15:21 INFO - 'LANG': 'en_US.UTF-8', 20:15:21 INFO - 'LANGUAGE': 'en_US:en', 20:15:21 INFO - 'LOGNAME': 'cltbld', 20:15:21 INFO - 'MAIL': '/var/mail/cltbld', 20:15:21 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 20:15:21 INFO - 'MOZ_NO_REMOTE': '1', 20:15:21 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 20:15:21 INFO - 'NO_EM_RESTART': '1', 20:15:21 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 20:15:21 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 20:15:21 INFO - 'PWD': '/builds/slave/test', 20:15:21 INFO - 'SHELL': '/bin/bash', 20:15:21 INFO - 'SHLVL': '1', 20:15:21 INFO - 'TERM': 'linux', 20:15:21 INFO - 'TMOUT': '86400', 20:15:21 INFO - 'USER': 'cltbld', 20:15:21 INFO - 'XDG_SESSION_COOKIE': '4ac8d263c7293b36a1be1aed000001be-1462589747.683929-1800753746', 20:15:21 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 20:15:21 INFO - '_': '/tools/buildbot/bin/python'} 20:15:22 INFO - Ignoring indexes: https://pypi.python.org/simple/ 20:15:22 INFO - Downloading/unpacking jsonschema 20:15:22 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 20:15:22 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 20:15:22 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 20:15:22 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 20:15:22 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 20:15:22 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 20:15:23 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 20:15:24 INFO - Downloading/unpacking functools32 (from jsonschema) 20:15:24 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 20:15:24 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 20:15:24 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 20:15:24 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 20:15:24 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 20:15:24 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 20:15:24 INFO - Downloading functools32-3.2.3-2.tar.gz 20:15:24 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 20:15:24 INFO - warning: no files found matching '*.txt' 20:15:24 INFO - no previously-included directories found matching 'build' 20:15:24 INFO - no previously-included directories found matching 'dist' 20:15:24 INFO - no previously-included directories found matching '.git*' 20:15:24 INFO - Installing collected packages: jsonschema, functools32 20:15:24 INFO - Running setup.py install for functools32 20:15:24 INFO - warning: no files found matching '*.txt' 20:15:24 INFO - no previously-included directories found matching 'build' 20:15:24 INFO - no previously-included directories found matching 'dist' 20:15:24 INFO - no previously-included directories found matching '.git*' 20:15:24 INFO - Successfully installed jsonschema functools32 20:15:24 INFO - Cleaning up... 20:15:24 INFO - Return code: 0 20:15:24 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 20:15:24 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')]} 20:15:24 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 20:15:24 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:15:24 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')]} 20:15:24 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 20:15:24 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:15:24 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', 'flake8']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f5c33cc5f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29348a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x29ff770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a8e9c0>, '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 0x2a8f8c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2a8fd50>, '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': '4ac8d263c7293b36a1be1aed000001be-1462589747.683929-1800753746', '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 20:15:24 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', 'flake8'] in /builds/slave/test/build 20:15:24 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 flake8 20:15:24 INFO - Using env: {'DISPLAY': ':0', 20:15:24 INFO - 'HOME': '/home/cltbld', 20:15:24 INFO - 'LANG': 'en_US.UTF-8', 20:15:24 INFO - 'LANGUAGE': 'en_US:en', 20:15:24 INFO - 'LOGNAME': 'cltbld', 20:15:24 INFO - 'MAIL': '/var/mail/cltbld', 20:15:24 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 20:15:24 INFO - 'MOZ_NO_REMOTE': '1', 20:15:24 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 20:15:24 INFO - 'NO_EM_RESTART': '1', 20:15:24 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 20:15:24 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 20:15:24 INFO - 'PWD': '/builds/slave/test', 20:15:24 INFO - 'SHELL': '/bin/bash', 20:15:24 INFO - 'SHLVL': '1', 20:15:24 INFO - 'TERM': 'linux', 20:15:24 INFO - 'TMOUT': '86400', 20:15:24 INFO - 'USER': 'cltbld', 20:15:24 INFO - 'XDG_SESSION_COOKIE': '4ac8d263c7293b36a1be1aed000001be-1462589747.683929-1800753746', 20:15:24 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 20:15:24 INFO - '_': '/tools/buildbot/bin/python'} 20:15:24 INFO - Ignoring indexes: https://pypi.python.org/simple/ 20:15:24 INFO - Downloading/unpacking flake8 20:15:24 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 20:15:24 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 20:15:24 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 20:15:24 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 20:15:24 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 20:15:24 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 20:15:26 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 20:15:26 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 20:15:26 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 20:15:26 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 20:15:26 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 20:15:26 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 20:15:26 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 20:15:26 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 20:15:26 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 20:15:26 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 20:15:26 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 20:15:26 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 20:15:26 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 20:15:26 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 20:15:26 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 20:15:26 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 20:15:26 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 20:15:26 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 20:15:26 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 20:15:26 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 20:15:26 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 20:15:26 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 20:15:26 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 20:15:27 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 20:15:27 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 20:15:27 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 20:15:27 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 20:15:27 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 20:15:27 INFO - no previously-included directories found matching 'docs/_build' 20:15:27 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 20:15:27 INFO - Running setup.py install for pep8 20:15:27 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 20:15:27 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 20:15:27 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 20:15:27 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 20:15:27 INFO - no previously-included directories found matching 'docs/_build' 20:15:27 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 20:15:27 INFO - Successfully installed flake8 mccabe pyflakes pep8 20:15:27 INFO - Cleaning up... 20:15:27 INFO - Return code: 0 20:15:27 INFO - Running post-action listener: _resource_record_post_action 20:15:27 INFO - Running post-action listener: _start_resource_monitoring 20:15:27 INFO - Starting resource monitoring. 20:15:27 INFO - ##### 20:15:27 INFO - ##### Finished create-virtualenv step (success) 20:15:27 INFO - ##### 20:15:27 INFO - ##### 20:15:27 INFO - ##### Running install step. 20:15:27 INFO - ##### 20:15:27 INFO - Running pre-action listener: _resource_record_pre_action 20:15:27 INFO - Running main action method: install 20:15:27 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 20:15:27 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 20:15:27 INFO - Reading from file tmpfile_stdout 20:15:27 INFO - Detecting whether we're running mozinstall >=1.0... 20:15:27 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 20:15:27 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 20:15:27 INFO - Reading from file tmpfile_stdout 20:15:27 INFO - Output received: 20:15:27 INFO - Usage: mozinstall [options] installer 20:15:27 INFO - Options: 20:15:27 INFO - -h, --help show this help message and exit 20:15:27 INFO - -d DEST, --destination=DEST 20:15:27 INFO - Directory to install application into. [default: 20:15:27 INFO - "/builds/slave/test"] 20:15:27 INFO - --app=APP Application being installed. [default: firefox] 20:15:27 INFO - mkdir: /builds/slave/test/build/application 20:15:27 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 20:15:27 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 20:15:44 INFO - Reading from file tmpfile_stdout 20:15:44 INFO - Output received: 20:15:44 INFO - /builds/slave/test/build/application/firefox/firefox 20:15:44 INFO - Running post-action listener: _resource_record_post_action 20:15:44 INFO - ##### 20:15:44 INFO - ##### Finished install step (success) 20:15:44 INFO - ##### 20:15:44 INFO - ##### 20:15:44 INFO - ##### Running run-tests step. 20:15:44 INFO - ##### 20:15:44 INFO - Running pre-action listener: _resource_record_pre_action 20:15:44 INFO - Running main action method: run_tests 20:15:44 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 20:15:44 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 20:15:44 INFO - Python 2.7.3 20:15:44 INFO - Return code: 0 20:15:44 INFO - grabbing minidump binary from tooltool 20:15:44 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')]} 20:15:44 INFO - retry: Calling run_command with args: (['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'],), kwargs: {'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a8e9c0>, '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 0x2a8f8c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2a8fd50>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 20:15:44 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 20:15:44 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 20:15:44 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 20:15:44 INFO - Return code: 0 20:15:44 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 20:15:44 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 20:15:44 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 20:15:44 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 20:15:44 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 20:15:44 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 20:15:44 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 20:15:45 INFO - Return code: 0 20:15:45 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-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/QiNtwmCuTauZmovrygHVeQ/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-030', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test/build 20:15:45 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-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/QiNtwmCuTauZmovrygHVeQ/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-030 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log 20:15:45 INFO - Using env: {'DISPLAY': ':0', 20:15:45 INFO - 'HOME': '/home/cltbld', 20:15:45 INFO - 'LANG': 'en_US.UTF-8', 20:15:45 INFO - 'LANGUAGE': 'en_US:en', 20:15:45 INFO - 'LOGNAME': 'cltbld', 20:15:45 INFO - 'MAIL': '/var/mail/cltbld', 20:15:45 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 20:15:45 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 20:15:45 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 20:15:45 INFO - 'MOZ_NO_REMOTE': '1', 20:15:45 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 20:15:45 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 20:15:45 INFO - 'NO_EM_RESTART': '1', 20:15:45 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 20:15:45 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 20:15:45 INFO - 'PWD': '/builds/slave/test', 20:15:45 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 20:15:45 INFO - 'SHELL': '/bin/bash', 20:15:45 INFO - 'SHLVL': '1', 20:15:45 INFO - 'TERM': 'linux', 20:15:45 INFO - 'TMOUT': '86400', 20:15:45 INFO - 'USER': 'cltbld', 20:15:45 INFO - 'XDG_SESSION_COOKIE': '4ac8d263c7293b36a1be1aed000001be-1462589747.683929-1800753746', 20:15:45 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 20:15:45 INFO - '_': '/tools/buildbot/bin/python'} 20:15:45 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/QiNtwmCuTauZmovrygHVeQ/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-030', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 20:15:45 INFO - mozversion application_buildid: 20160506173008 20:15:45 INFO - mozversion application_changeset: 738ec20418cc728910419aa60f98ae62b429facf 20:15:45 INFO - mozversion application_display_name: Nightly 20:15:45 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 20:15:45 INFO - mozversion application_name: Firefox 20:15:45 INFO - mozversion application_remotingname: firefox 20:15:45 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 20:15:45 INFO - mozversion application_vendor: Mozilla 20:15:45 INFO - mozversion application_version: 49.0a1 20:15:45 INFO - mozversion platform_buildid: 20160506173008 20:15:45 INFO - mozversion platform_changeset: 738ec20418cc728910419aa60f98ae62b429facf 20:15:45 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 20:15:45 INFO - mozversion platform_version: 49.0a1 20:15:45 INFO - using testdate: 1462590945 20:15:45 INFO - actual date: 1462590945 20:15:45 INFO - starting webserver on 'localhost:39177' 20:15:45 INFO - SUITE-START | Running 2 tests 20:15:45 INFO - TEST-START | dromaeo_css 20:15:45 INFO - operating with platform_type : linux_ 20:15:45 INFO - Initialising browser for dromaeo_css test... 20:15:45 INFO - TEST-INFO | started process 24396 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpkAqhb0/profile http://localhost:39177/getInfo.html) 20:15:49 INFO - PROCESS | 24396 | 20:15:49 INFO - PROCESS | 24396 | (process:24462): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 20:15:50 INFO - PROCESS | 24396 | __metrics Screen width/height:1600/1200 20:15:50 INFO - PROCESS | 24396 | colorDepth:24 20:15:50 INFO - PROCESS | 24396 | Browser inner width/height: 1024/697 20:15:50 INFO - PROCESS | 24396 | __metrics 20:15:50 ERROR - PROCESS | 24396 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2946: TypeError: this.tabs is undefined 20:15:51 INFO - TEST-INFO | 24396: exit 0 20:15:51 INFO - Browser initialized. 20:15:51 INFO - Running cycle 1/1 for dromaeo_css test... 20:15:51 INFO - TEST-INFO | started process 24513 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpkAqhb0/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 20:15:53 INFO - PROCESS | 24513 | 20:15:53 INFO - PROCESS | 24513 | (process:24575): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 20:16:03 INFO - PROCESS | 24513 | RSS: Main: 163008512 20:16:03 INFO - PROCESS | 24513 | 20:16:53 INFO - PROCESS | 24513 | 1462591013257 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] 20:19:00 INFO - PROCESS | 24513 | Cycle 1(1): loaded http://localhost:39177/tests/dromaeo/cssquery-dojo.html (next: http://localhost:39177/tests/dromaeo/cssquery-ext.html) 20:19:01 INFO - PROCESS | 24513 | RSS: Main: 166412288 20:19:01 INFO - PROCESS | 24513 | 20:22:03 INFO - PROCESS | 24513 | Cycle 1(1): loaded http://localhost:39177/tests/dromaeo/cssquery-ext.html (next: http://localhost:39177/tests/dromaeo/cssquery-jquery.html) 20:22:04 INFO - PROCESS | 24513 | RSS: Main: 167108608 20:22:04 INFO - PROCESS | 24513 | 20:25:06 INFO - PROCESS | 24513 | Cycle 1(1): loaded http://localhost:39177/tests/dromaeo/cssquery-jquery.html (next: http://localhost:39177/tests/dromaeo/cssquery-mootools.html) 20:25:07 INFO - PROCESS | 24513 | RSS: Main: 167931904 20:25:07 INFO - PROCESS | 24513 | 20:28:08 INFO - PROCESS | 24513 | Cycle 1(1): loaded http://localhost:39177/tests/dromaeo/cssquery-mootools.html (next: http://localhost:39177/tests/dromaeo/cssquery-prototype.html) 20:28:09 INFO - PROCESS | 24513 | RSS: Main: 165941248 20:28:09 INFO - PROCESS | 24513 | 20:31:11 INFO - PROCESS | 24513 | Cycle 1(1): loaded http://localhost:39177/tests/dromaeo/cssquery-prototype.html (next: http://localhost:39177/tests/dromaeo/cssquery-yui.html) 20:31:12 INFO - PROCESS | 24513 | RSS: Main: 166797312 20:31:12 INFO - PROCESS | 24513 | 20:34:14 INFO - PROCESS | 24513 | Cycle 1(1): loaded http://localhost:39177/tests/dromaeo/cssquery-yui.html (next: http://localhost:39177/tests/dromaeo/cssquery-dojo.html) 20:34:14 INFO - PROCESS | 24513 | RSS: Main: 169185280 20:34:14 INFO - PROCESS | 24513 | 20:34:14 INFO - PROCESS | 24513 | __start_tp_report 20:34:14 INFO - PROCESS | 24513 | _x_x_mozilla_page_load 20:34:14 INFO - PROCESS | 24513 | _x_x_mozilla_page_load_details 20:34:14 INFO - PROCESS | 24513 | |i|pagename|runs| 20:34:14 INFO - PROCESS | 24513 | |0;dojo.html;3208.887688930887;3235.4984977328522;3247.3342964692233;3262.380147771923;3268.689474499923;5463.153211252257;5474.7810087596545;5567.415421380752;5599;5602.24369710089;5432.13085906255;5486.61593688442;5500.147477141039;5518.806841760539;5604.915926261109;4949.802007919688;4984.127777638899;5066.620003499734;5111.309973153614;5154.716490593016;746.9918101326626;4889.242167464049;4978.6514943953935;5067.923981140286;5106.897862042757;5007.7496125193775;5009;5035.018171456586;5037.546620804127;5039.949600504003;5056.039352523009;5058.190689489701;5067.315912351823;5070;5079.212722028092;4887.780049897763;4958.181899986498;4969.155243608559;4978.4025916890205;5053.797848086072;5397.433269506724;5447.346318441772;5476.2333273341765;5492.395836457987;5514.641548299388;5761.423857614247;5921.082232254007;5932.851678708023;5939.287285525721;6001.219841420588;5810.854728631776;5880.470757631791;5931.555133365015;5986.8503287417725;6007.3992600739575;5564.415736347666;5573;5576.86057848557;5583.944160558383;5594.664320140804;5992.161097446361;6007.15899774032;6149.938500615026;6192.411720886508;6203.937960620427;5761.654300741969;5826.6795326256615;5850.210221620112;5859.824205273849;5865.794697185578;5945.435183657545;5948.434898684618;5952;5955.13650520672;5966.254218222723;5678.801241956594;5832.679202643811;5835.503982161479;5889.764409423575;5902.76388944446;5910.083936989773;5943.257092863392;5944.464998150187;5953.642781433128;5993.9700301498215;4469.396631454777;4489.349044388546;4494.820207191676;4499.52754960731;4533.365328853963;3943.369060950234;3983.880483585497;4002.4996875390575;4019.537753158366;4068.16602596467;5490.8078217263;5491.807786727445;5538.086215774432;5566.359868615161;5615.9157612635845;5916.2013128228;5936.910946335808;5946.108083787466;5959.165716799652;5962.165296858443;5381.327334083239;5545.140503222007;5579.832605021856;5607.663540187602;5632.633878797865;5032.547070763576;5058.696478211319;5075.6193285502995;5080.466551012164;5081.923771143436;6078.422549857756;6084.056971169476;6118.479929205978;6120.357362476965;6125.479334256638;5715.885682286331;5832.9708351457975;5957.16599676037;6009.789657361971;6027.035674292092;6218.867174890155;6268.623882567061;6278.277998030102;6281.811545653638;6286.968565157145;5858.677772722541;5937.703114844327;5951.613145145551;5956.5532585055425;6005.819825405245;5843.29880414353;5853.795117170878;5863.091220860773;5924.526037917042;5982.880342393215;5740.770369185186;5785.595008349544;5793.681347525758;5799.246098007401;5801.3908539602735;5657.264555607745;5729.341125770589;5750.396208398058;5783.132530120515;5793.739281732416;5677.205191273142;5711.228984087261;5767.134929760569;5815.41845815415;5816.127580862904;5860.150278209721;5904.704764761831;5958.046712525975;5965.6718880461995;5969.074793407029;5623.493885550321;5645.689487078086;5730.341010783646;5775.220345253337;5793 20:34:14 INFO - PROCESS | 24513 | |1;ext.html;577.1227733844556;638.2883085359824;650.9283978762338;657.4378906035337;658.5719282466395;43994.78002609986;45220.547794522085;45504.772476137616;49011.26483102756;49414;45912.54087459124;46728;46730.299045514344;46748.766256168754;46756.29865552019;8786.86819697705;9069.093090690943;9074.092590740906;9078.319126065539;9082.409643373192;9016.819663606724;9094.181523662868;9123.406978546407;9127.315451341143;9130.954345228265;9087.363884528086;9147.862782058275;9157.221636160933;9158.954205228965;9198.954005229998;9083.863742043875;9111.817763644756;9138.817223655557;9153.588088536031;9160.862587061167;8962.596683149273;9031.909680903238;9062.456252624797;9067.954660226722;9104.226140778042;43103.13793724108;43182;43526.56473435288;43563.564364356585;43759;3697.242065376591;3865.323568375523;4138.337865941435;4192.308269135589;4259.041715613993;32043.51934720981;32427.837860810545;32452.513212301834;32489.350212995607;33622;4381.430414046154;4428.601425871655;4450.688451808374;4503.504614492404;4588.17412865684;244414;324481;325764.9999999976;327291.36354318314;327996;35325.64674353275;36017.27965440677;36113.63886361155;37944.24111517809;61292.38707612956;36953.815230923676;37010;37219.25561488755;37228.62771372306;37334.813325933195;14698.926505367404;14802.62993425173;14826.703465930621;14877.256137193097;14880.702385952436;12308.446119924445;12408.62774116778;12415.503379864886;12427.813582796265;12587.93706031464;8339.291160251325;8345.207205315486;8357.206065423776;8361.456505327134;8401.95799021001;3243.8540265688102;3253.137918451612;3289.4703962657477;3300.9174770630925;3314.751393645486;1119.171812858479;1135.6820090374708;1136.5851464215666;1152.2280072351546;1227.7605866856056;31813;32543.67456325454;32570.511442328385;33064;33203;1121.058311018748;1145.9484323205477;1149.4367759797806;1190.4166958190424;1212.854457465092;16840.83159168417;16847.410340638264;16900.32398704038;17052.914735426242;17070.573235669206;483380;486251;487171;488208;489455;60388.396116039155;61271.6936415324;61572.07641885375;61723.691381542805;62229.68885155545;1429.078244532271;1432.9426822927176;1468.5374107156213;1480.3634437191895;1491.1574960147482;28355.574666380435;31252.843735781174;31303.373932521677;31546.684533155294;31749;51627.48372516377;52118.47881521136;52219;52255.73872130615;52278.738606306724;415346;419389;419987;421775;422141;28218.2945426366;28463.857680711462;29038;29065;29086.56370154407;47821;49006.26490602715;49168.75415622899;49242.507574923795;49737.75131124466;39175;41570;42637.786811065744;43343;43803.78098109489;41745.58254417417;42724.78637606792;43198.35202472028;43308.78345608252;43586.564134358254;42949.570504294556;43262.78368608137;43823.780881095394;43870;46802.53197467982;36612.26775464529;37723.43414848834;38072.069030573366;38766.80616596899;39030.2193956125;29043.854780726808;29315;29447.142379428547;29468;29597.852010739807 20:34:14 INFO - PROCESS | 24513 | |2;jquery.html;386.52457477302914;386.6578078400615;389.43337444018954;395.5470985721351;410.0670973535207;13762.999999999975;17669.116544172804;18453;19478.928658923734;19501.41495755126;16918.40785572505;17151.056691881942;18453.16960736767;19512.31706890259;19538.70691939622;5678.43215678433;5738.995675756726;5758.222639943596;5767.826965191051;5805.680687562182;5693.8576535586735;5710.343310519302;5728.79949201778;5731.570132240078;5737.139429085629;5189.844304670866;5503.889922201553;5509.504144626982;5591.608587398884;5706.3437704663875;5413.404525502211;5551.278333816598;5573.888522229553;5756.165356023395;5783.971080144573;5619.960307343154;5634.830955071355;5639.436056394327;5653.632513886584;5668.716564171775;12672.239665620093;16695.41566045195;19772.604547909104;20851.791482085137;20943.5811283775;2205.228170140454;2241.652543855705;2334.2297041976108;2534.51844149611;2637.604359346094;9264.814703705888;9425.38734982224;9714.708558743177;9813.460259685715;9858.507074646239;1882.9717554236697;1950.9804901951084;1966.9311574094982;1986.0169216238055;1999.0704322489967;80282;81090.51275897973;81945;82148.58925705393;83673.58163209267;11126.499307531181;11212.495437705324;11231.438428078563;11308.660740177807;11371.658850234506;13777;14128.222947737768;15817.920910395604;15824.525264242091;15843.762343564857;7936.547601793239;7942.722004729807;8245.299149572234;8277.089520152778;8331.16688331162;7692.807679808049;7793.142754297023;7814.06231252242;7823.139454660097;7874.291313781787;4670.462896766915;4723.220668589644;4765.594924431392;4780.49804770501;4812.927806082912;1982.2368388170657;2033.5627840014467;2045.7442819647545;2053.1274208461346;2083.7916208379042;935.2377812083266;1054.146141625286;1089.656758121205;1094.0973696700096;1134.9375784331776;18757.155927983;19129.808701912803;19194.616107677768;19255.903720481587;19317.903410482857;1000.51975051974;1047.863777708893;1062.2245760594808;1065.9680209593569;1098.9230753847155;10251.692449226535;10333.534990925426;10793.568257269779;10926.945365273123;10962.232643715022;442571;494704;497516;508936;512000;95393.5230323844;98795;100111.49498272596;100196.49901750445;100321.99678003126;1134.0417347341647;1175.5297880847559;1192.5349113845607;1204.0367705835297;1212.4665147335145;16897.91551042237;17198.484045478657;17370.478885633453;17634.29462821524;18005.909970450062;39040.80479597584;39447.408288876264;39728.80135599303;40445.1910961785;40524.18951620892;55168.44831551793;55301.72349138228;55583.44416555783;56443.71778141083;56617;8037.8392432152195;8315.376346774137;8380.24577788002;8394.45436046655;8422.326213902996;9306.48814315192;11180.322951557331;13698.931505342409;13812.861871381157;13938.094023888414;11571.537138514364;11953.163278570417;11977.880221197676;11999.460024298753;12182.208156469802;11737.061035117342;11783.52865885355;11848.585299514476;12029.819552706542;12137.393130343271;12072.396380181131;12102;12283.38583070825;12303.32331721728;12314.753704925672;8271.2142346477;8275.50346979183;8447.113053129578;8501.659933602587;8610.698625548075;8584.356173287153;11327.263727857662;11563.88436115628;11579.363135027654;12013.038956883254 20:34:14 INFO - PROCESS | 24513 | |3;mootools.html;1524.6188452886781;1576.6846630673867;1721.259858260948;1879.4173806120111;1880.6050729346837;7999.880001799963;8285.544295063784;8437.240648341649;9068.8639670405;9092.318076144282;8301.252887240147;8470.745877623682;8572.314214862812;8688.174623410765;8697.956510217457;2332.3469428559947;2366.8698221597806;2384.4396566806786;2388.22382725614;2390.2351247600773;2366.9171578994738;2376.607859703147;2396.496735685508;2398.604230301998;2401.231605886117;2267.3651377614297;2307.8153747700144;2339.6724458575727;2400.471896182837;2401.795847352977;2317.0615900560133;2323.3146221864504;2333.8132949364012;2339.1579031548713;2339.181286549711;2323.233333000106;2332.8017118544944;2333.358326460237;2333.4749681321737;2340.4499942513494;8618.09510001447;8633.35249856257;8678.522681252529;8731.825363492759;8736.475811451333;5047.7476126193915;5170;5204.167333226704;5220.086484865172;5222.6605270657665;3321.4353559894876;3352.949705754416;3395.609504906918;3433.8454769535433;3440.518327434161;1043.906048455635;1068.433730123036;1073.4579037586047;1073.7584043590207;1109.8002359575273;12136.15046946714;12449.439775210047;12449.439775210138;12468.376581170996;12474.563390281388;4589.632829373642;4615.169269531517;4702.271147972001;4710;4711.623070154379;10490.42302673345;10501.107405870434;10531.420771857622;10565.683029509128;10567.260291779501;5218.895622087537;5222.92165617516;5258.631895767336;5348.5186333230195;5359.839204823861;4252.149570085933;4624.791884365211;4736.123817093849;4767.833125840579;4789.616830653539;4082.4692789937117;4103.302438585448;4140.574443725434;4142.544320124784;4207.579242075829;1306.7778477658821;1331.3210262766058;1337.832770903637;1341.2958196946681;1346.8855147312588;782.5148407987084;987.629638885418;990.8315586350337;1017.5319353097658;1030.1501261459177;5749.741261643236;5855.502282305966;5857.912131318034;5982.4316689914385;6025.608335458269;425.5914322250674;434.90214701691866;442.287916454508;443.7670223132881;448.08143306222115;4092.3861420786525;4101.630853223224;4104.179164167179;4128.653393854965;4137.793110344471;10619.893801062046;11007.669769906915;11035.668929932115;11117.777644447066;11131.443427828739;10891.292066015683;10924.399158046384;10942.288751231144;10945.507452164671;10972.890271097347;8284.71003514886;8317.168283171755;8346.33229341639;8360.414770965974;8364.916350836414;5797.826065218051;5863.442972917566;5915.852103697442;5924.348321684697;5977.9402205977385;9776.951115244377;10076.899231007596;10094.899051009395;10125.291229613857;10267.691969240936;10310.07209351162;10323.793524129625;10339.431331276552;10412.271141020055;10429.374237545771;7139.32176443237;7394.667239974322;7670.7315243966195;7783.532988020737;7842.529448233125;8490.32077433816;8520.062793092879;8523.91476085256;8568.828623427622;8599.570021498776;7432;7645.082590089225;7668.69325227007;7838.059432868093;7934.166912474107;7493.625318734151;7497.700091996259;7573.431992600466;7573.9242607575425;7595.240475952361;6982.197047339621;7000.089988301488;7035.929640703527;7039.929600704132;7052.858942821217;4725.574698277172;4900.436449808318;4969.130402179532;4974.602031837517;5020.272060551272;4941.950580494149;5089.872753181052;5254.89490210186;5349.277847490539;5413.756380962787 20:34:14 INFO - PROCESS | 24513 | |4;prototype.html;310.199684813182;311.6104868913858;315.19624956361275;319.07150192938553;322.0595860088541;5424.430434804343;5458.9454105459035;5487.890242195153;5519.641223320481;5581.776728930843;5402.621816472849;5409.6213265071465;5424.186372044195;5435.619506634537;5465.6447330923465;4036.8788936331957;4139.482564679415;4173.372384769942;4295.935560966588;4299.5485474025245;4234.576542345756;4252.319628859384;4260.211860805745;4268.445102136718;4282.079352939118;4236.216299984513;4247.299195632732;4250.341197114452;4257.233697934371;4273.337632666941;3967.960320396788;4176.519700234481;4177.185448837478;4181.874543763692;4251.4685664291965;3591.2099338145567;3613.5844377896615;3618.6200448952745;3625.078708284613;3649.8685407523753;5307.575393968512;5347.46525347466;5349.779841365828;5352.732363381815;5352.946470535323;4563.247064234397;4816.230667366243;4828.830990915336;4844.95155048452;4865.9026819463415;5752.568557358215;5788.18965344852;5790.652560846363;5802.100674395433;5806.419358064202;4028.8187031583357;4037.607025576201;4042.3734321180264;4052.959470405317;4065.7560546367017;5892.970535147339;5995.34051254366;6007.849803754897;6046.788362407338;6054.39456054391;4098.938515922264;4111.814968326433;4121.62905338515;4123.835046598162;4133.958660413417;4149.834006639761;4159.812808423628;4173.499180098347;4198.916021679549;4218.978905105455;4670.929936050962;4792;4848;4876.122297986326;4893.7063776173545;5821.417858214145;5833.095870140135;5846.123081537803;5849.619774714715;5887.4406931341455;1369.0211498778422;1379.0555317002977;1388.9027668142257;1391.5616580777023;1395.2186775405805;891.9697749099671;897.2866571076011;941.091846368258;945.6996629634253;947.9526023698787;5237.921431178535;5403.351597808288;5421.132618780976;5441.564674826083;5463.562914966793;5660.349059858169;5722.942770572325;5799.217105690678;5818.5054270386645;5876.177335173079;5294.708791016454;5364.8658783529945;5430.13117901134;5444.673319600836;5488.588355873326;3062.647795503501;3067.4171907337536;3068.5243787213017;3070.1710538154575;3080.614923134608;5929.110633405024;5958.493528050078;5976.581639285295;5995.640261584319;6019.779418011343;6186.505079593621;6216.222972128484;6218.921633791212;6221.760166340114;6236.345183755731;6233.470155036782;6296.827594479989;6323.430891219812;6324.43080122782;6353.618782873043;5958.463738263577;6039.758409663565;6053.788117415869;6064.848378790565;6113.29697084841;5946.1972633693895;5978.236420256122;6005.279366476051;6006.249218847644;6045.939540604538;6023.695387595972;6189.164462797465;6191.288001879841;6254.530185406335;6266.122742815918;4148.879802453261;4153.335466325373;4172.645325147397;4176.979115104405;4181.91636167281;6047.274327080602;6060.151578778887;6074.147385047603;6087.726052327745;6099.908501372394;5588.273524441796;5858.7110835616095;5881.235439392852;5891.204687367322;5893.970530147321;5842.970785146047;5862.530997520103;5883.028955455136;5893.823185304448;5902.543579597376;5294.417614062373;5648.604597678123;5722.341930677859;5789.855253618524;5798.913016304675;5779.479846813807;5836.299644042742;5878.382769809279;5928.191901470093;5954.910676339771;5717.714114294352;5743.655380677173;5776.364599893925;5779.190913272229;5789.56578256624 20:34:14 INFO - PROCESS | 24513 | |5;yui.html;751.526538280883;799.7723494436045;837.5477242289162;845.6786421159958;862.7627402464321;13733.862661373383;14530.709385812277;14549.927250363733;14575.562733118024;14596.635084122901;13470.730585388286;13488.797668034988;13512.59462216135;13515.729685406286;13535.323233838319;679.4055201698501;807.475141158246;831.9500829950192;833.7623777223492;835.5237514616671;817.4890693316677;819.889314942484;820.0897004325194;825.2366560931144;825.3438516379463;874.5496069524169;881.299367003234;882.0209567380202;883.7392969074107;883.8762573239752;868.6395146014428;872.5898827551073;874.191372979991;874.3529787956929;877.5743764274354;636.4462917261966;639.692947385253;640.0814830717889;640.3468462168609;642.6529673976094;14366.13803171813;14393.280335983263;14404.207768572724;14430.567082987527;14449.277536123152;14414.063085899488;14548.418063277457;14577.562673119823;14597.92701036488;14821.77767333491;11855.762884742257;11903.583374581847;11955;12110.273383597012;12203.145779795417;3879.534455865314;3884.864029758945;3892.1048158923604;3896.240233154536;3969.821358038895;53533.732331338484;54917.1762423564;56562.15156772652;56566.43433565653;56930.715346423414;10172.84740728875;10227.926067762777;10339.793204135874;10359.94820025895;10403.84394234087;20551.4862128448;20638.174473021212;20646.483837904172;20667.27664531764;20674.276400325918;8210.220029097345;8315.916840831514;8323.375746819012;8442.282405995436;8660.956695216484;4765.499622539653;4793.592544633745;4801.4958429365115;4872.537108974712;4900.926486102711;3474.947875781865;3562.358775420449;3562.4656301554974;3577.5349204603235;3582.9283414331567;614.8124821929355;618.326024633152;622.819382379114;633.7971849008366;638.6902352359102;667.5060455263167;699.653671432644;778.7936196907824;814.1044850664222;821.6261600971544;10123.898761012442;10254.743631409274;10605.151587872951;10635.202359823044;10664.680059598224;776.1927595300937;788.5662885413115;799.8120441696196;812.8374325134997;829.9875501867476;4519.54804519552;4782.689125206851;4823.204171311764;4827.831025914076;4864.197407427806;71678;73459.63270183722;73605.6319718398;73953.26046739463;74159.25840741524;64234;64443.20011199015;64959.35040649533;65312.40781756954;65501;46347;46466.303005454945;49875.25187122196;50899;52440.73779631077;9844.507774611384;9867.611374360491;9876.35803672759;9971.202303815822;10019.298649094493;33088;33504.832475837466;33863;33945.49081763726;34686.306273874885;43793.56206437895;46753;47385.763071184425;47417.28874066823;47984.520154798;12785.744285114431;12802.231866088065;12858.549950751678;12954.676133096747;13173.802392963922;14074;14111;14174.220417876702;14475.203863787592;14713.55859324222;12285.631431057083;12470.189437686522;12562.811557826457;12752.234865908074;12990.350482476028;12501.499940002663;12589.622311330675;12740.87259127434;12861.421236044212;13006.934965325112;11626.128040396836;11834.289942603471;12010.879891201326;12579.74840503203;12639.115261931576;11131.554737810397;11135.88864111381;11155.832662509907;11341.26281791681;11572.305661660328;11317.264377815416;11467.846342255947;11543.71140721455;11624.244424112405;11639.359835209145 20:34:14 INFO - PROCESS | 24513 | __end_tp_report 20:34:14 INFO - PROCESS | 24513 | __start_cc_report 20:34:14 INFO - PROCESS | 24513 | _x_x_mozilla_cycle_collect,367 20:34:14 INFO - PROCESS | 24513 | __end_cc_report 20:34:14 INFO - PROCESS | 24513 | __startTimestamp1462592054981__endTimestamp 20:34:14 INFO - PROCESS | 24513 | 20:34:14 INFO - PROCESS | 24513 | ------- Summary: start ------- 20:34:14 INFO - PROCESS | 24513 | Number of tests: 6 20:34:14 INFO - PROCESS | 24513 | 20:34:14 INFO - PROCESS | 24513 | [#0] dojo.html Cycles:165 Average:5477.72 Median:5730.34 stddev:733.98 (12.8%) stddev-sans-first:714.32 20:34:14 INFO - PROCESS | 24513 | Values: 3208.9 3235.5 3247.3 3262.4 3268.7 5463.2 5474.8 5567.4 5599.0 5602.2 5432.1 5486.6 5500.1 5518.8 5604.9 4949.8 4984.1 5066.6 5111.3 5154.7 747.0 4889.2 4978.7 5067.9 5106.9 5007.7 5009.0 5035.0 5037.5 5039.9 5056.0 5058.2 5067.3 5070.0 5079.2 4887.8 4958.2 4969.2 4978.4 5053.8 5397.4 5447.3 5476.2 5492.4 5514.6 5761.4 5921.1 5932.9 5939.3 6001.2 5810.9 5880.5 5931.6 5986.9 6007.4 5564.4 5573.0 5576.9 5583.9 5594.7 5992.2 6007.2 6149.9 6192.4 6203.9 5761.7 5826.7 5850.2 5859.8 5865.8 5945.4 5948.4 5952.0 5955.1 5966.3 5678.8 5832.7 5835.5 5889.8 5902.8 5910.1 5943.3 5944.5 5953.6 5994.0 4469.4 4489.3 4494.8 4499.5 4533.4 3943.4 3983.9 4002.5 4019.5 4068.2 5490.8 5491.8 5538.1 5566.4 5615.9 5916.2 5936.9 5946.1 5959.2 5962.2 5381.3 5545.1 5579.8 5607.7 5632.6 5032.5 5058.7 5075.6 5080.5 5081.9 6078.4 6084.1 6118.5 6120.4 6125.5 5715.9 5833.0 5957.2 6009.8 6027.0 6218.9 6268.6 6278.3 6281.8 6287.0 5858.7 5937.7 5951.6 5956.6 6005.8 5843.3 5853.8 5863.1 5924.5 5982.9 5740.8 5785.6 5793.7 5799.2 5801.4 5657.3 5729.3 5750.4 5783.1 5793.7 5677.2 5711.2 5767.1 5815.4 5816.1 5860.2 5904.7 5958.0 5965.7 5969.1 5623.5 5645.7 5730.3 5775.2 5793.0 20:34:14 INFO - PROCESS | 24513 | 20:34:14 INFO - PROCESS | 24513 | [#1] ext.html Cycles:180 Average:56385.78 Median:213200.02 stddev:109245.52 (51.2%) stddev-sans-first:109471.62 20:34:14 INFO - PROCESS | 24513 | Values: 577.1 638.3 650.9 657.4 658.6 43994.8 45220.5 45504.8 49011.3 49414.0 45912.5 46728.0 46730.3 46748.8 46756.3 8786.9 9069.1 9074.1 9078.3 9082.4 9016.8 9094.2 9123.4 9127.3 9131.0 9087.4 9147.9 9157.2 9159.0 9199.0 9083.9 9111.8 9138.8 9153.6 9160.9 8962.6 9031.9 9062.5 9068.0 9104.2 43103.1 43182.0 43526.6 43563.6 43759.0 3697.2 3865.3 4138.3 4192.3 4259.0 32043.5 32427.8 32452.5 32489.4 33622.0 4381.4 4428.6 4450.7 4503.5 4588.2 244414.0 324481.0 325765.0 327291.4 327996.0 35325.6 36017.3 36113.6 37944.2 61292.4 36953.8 37010.0 37219.3 37228.6 37334.8 14698.9 14802.6 14826.7 14877.3 14880.7 12308.4 12408.6 12415.5 12427.8 12587.9 8339.3 8345.2 8357.2 8361.5 8402.0 3243.9 3253.1 3289.5 3300.9 3314.8 1119.2 1135.7 1136.6 1152.2 1227.8 31813.0 32543.7 32570.5 33064.0 33203.0 1121.1 1145.9 1149.4 1190.4 1212.9 16840.8 16847.4 16900.3 17052.9 17070.6 483380.0 486251.0 487171.0 488208.0 489455.0 60388.4 61271.7 61572.1 61723.7 62229.7 1429.1 1432.9 1468.5 1480.4 1491.2 28355.6 31252.8 31303.4 31546.7 31749.0 51627.5 52118.5 52219.0 52255.7 52278.7 415346.0 419389.0 419987.0 421775.0 422141.0 28218.3 28463.9 29038.0 29065.0 29086.6 47821.0 49006.3 49168.8 49242.5 49737.8 39175.0 41570.0 42637.8 43343.0 43803.8 41745.6 42724.8 43198.4 43308.8 43586.6 42949.6 43262.8 43823.8 43870.0 46802.5 36612.3 37723.4 38072.1 38766.8 39030.2 29043.9 29315.0 29447.1 29468.0 29597.9 20:34:14 INFO - PROCESS | 24513 | 20:34:14 INFO - PROCESS | 24513 | [#2] jquery.html Cycles:180 Average:28895.03 Median:2223.44 stddev:81262.06 (3654.8%) stddev-sans-first:81461.83 20:34:14 INFO - PROCESS | 24513 | Values: 386.5 386.7 389.4 395.5 410.1 13763.0 17669.1 18453.0 19478.9 19501.4 16918.4 17151.1 18453.2 19512.3 19538.7 5678.4 5739.0 5758.2 5767.8 5805.7 5693.9 5710.3 5728.8 5731.6 5737.1 5189.8 5503.9 5509.5 5591.6 5706.3 5413.4 5551.3 5573.9 5756.2 5784.0 5620.0 5634.8 5639.4 5653.6 5668.7 12672.2 16695.4 19772.6 20851.8 20943.6 2205.2 2241.7 2334.2 2534.5 2637.6 9264.8 9425.4 9714.7 9813.5 9858.5 1883.0 1951.0 1966.9 1986.0 1999.1 80282.0 81090.5 81945.0 82148.6 83673.6 11126.5 11212.5 11231.4 11308.7 11371.7 13777.0 14128.2 15817.9 15824.5 15843.8 7936.5 7942.7 8245.3 8277.1 8331.2 7692.8 7793.1 7814.1 7823.1 7874.3 4670.5 4723.2 4765.6 4780.5 4812.9 1982.2 2033.6 2045.7 2053.1 2083.8 935.2 1054.1 1089.7 1094.1 1134.9 18757.2 19129.8 19194.6 19255.9 19317.9 1000.5 1047.9 1062.2 1066.0 1098.9 10251.7 10333.5 10793.6 10926.9 10962.2 442571.0 494704.0 497516.0 508936.0 512000.0 95393.5 98795.0 100111.5 100196.5 100322.0 1134.0 1175.5 1192.5 1204.0 1212.5 16897.9 17198.5 17370.5 17634.3 18005.9 39040.8 39447.4 39728.8 40445.2 40524.2 55168.4 55301.7 55583.4 56443.7 56617.0 8037.8 8315.4 8380.2 8394.5 8422.3 9306.5 11180.3 13698.9 13812.9 13938.1 11571.5 11953.2 11977.9 11999.5 12182.2 11737.1 11783.5 11848.6 12029.8 12137.4 12072.4 12102.0 12283.4 12303.3 12314.8 8271.2 8275.5 8447.1 8501.7 8610.7 8584.4 11327.3 11563.9 11579.4 12013.0 20:34:14 INFO - PROCESS | 24513 | 20:34:14 INFO - PROCESS | 24513 | [#3] mootools.html Cycles:180 Average:5788.69 Median:445.92 stddev:3316.87 (743.8%) stddev-sans-first:3310.69 20:34:14 INFO - PROCESS | 24513 | Values: 1524.6 1576.7 1721.3 1879.4 1880.6 7999.9 8285.5 8437.2 9068.9 9092.3 8301.3 8470.7 8572.3 8688.2 8698.0 2332.3 2366.9 2384.4 2388.2 2390.2 2366.9 2376.6 2396.5 2398.6 2401.2 2267.4 2307.8 2339.7 2400.5 2401.8 2317.1 2323.3 2333.8 2339.2 2339.2 2323.2 2332.8 2333.4 2333.5 2340.4 8618.1 8633.4 8678.5 8731.8 8736.5 5047.7 5170.0 5204.2 5220.1 5222.7 3321.4 3352.9 3395.6 3433.8 3440.5 1043.9 1068.4 1073.5 1073.8 1109.8 12136.2 12449.4 12449.4 12468.4 12474.6 4589.6 4615.2 4702.3 4710.0 4711.6 10490.4 10501.1 10531.4 10565.7 10567.3 5218.9 5222.9 5258.6 5348.5 5359.8 4252.1 4624.8 4736.1 4767.8 4789.6 4082.5 4103.3 4140.6 4142.5 4207.6 1306.8 1331.3 1337.8 1341.3 1346.9 782.5 987.6 990.8 1017.5 1030.2 5749.7 5855.5 5857.9 5982.4 6025.6 425.6 434.9 442.3 443.8 448.1 4092.4 4101.6 4104.2 4128.7 4137.8 10619.9 11007.7 11035.7 11117.8 11131.4 10891.3 10924.4 10942.3 10945.5 10972.9 8284.7 8317.2 8346.3 8360.4 8364.9 5797.8 5863.4 5915.9 5924.3 5977.9 9777.0 10076.9 10094.9 10125.3 10267.7 10310.1 10323.8 10339.4 10412.3 10429.4 7139.3 7394.7 7670.7 7783.5 7842.5 8490.3 8520.1 8523.9 8568.8 8599.6 7432.0 7645.1 7668.7 7838.1 7934.2 7493.6 7497.7 7573.4 7573.9 7595.2 6982.2 7000.1 7035.9 7039.9 7052.9 4725.6 4900.4 4969.1 4974.6 5020.3 4942.0 5089.9 5254.9 5349.3 5413.8 20:34:14 INFO - PROCESS | 24513 | 20:34:14 INFO - PROCESS | 24513 | [#4] prototype.html Cycles:180 Average:4848.25 Median:5464.60 stddev:1475.84 (27.0%) stddev-sans-first:1440.14 20:34:14 INFO - PROCESS | 24513 | Values: 310.2 311.6 315.2 319.1 322.1 5424.4 5458.9 5487.9 5519.6 5581.8 5402.6 5409.6 5424.2 5435.6 5465.6 4036.9 4139.5 4173.4 4295.9 4299.5 4234.6 4252.3 4260.2 4268.4 4282.1 4236.2 4247.3 4250.3 4257.2 4273.3 3968.0 4176.5 4177.2 4181.9 4251.5 3591.2 3613.6 3618.6 3625.1 3649.9 5307.6 5347.5 5349.8 5352.7 5352.9 4563.2 4816.2 4828.8 4845.0 4865.9 5752.6 5788.2 5790.7 5802.1 5806.4 4028.8 4037.6 4042.4 4053.0 4065.8 5893.0 5995.3 6007.8 6046.8 6054.4 4098.9 4111.8 4121.6 4123.8 4134.0 4149.8 4159.8 4173.5 4198.9 4219.0 4670.9 4792.0 4848.0 4876.1 4893.7 5821.4 5833.1 5846.1 5849.6 5887.4 1369.0 1379.1 1388.9 1391.6 1395.2 892.0 897.3 941.1 945.7 948.0 5237.9 5403.4 5421.1 5441.6 5463.6 5660.3 5722.9 5799.2 5818.5 5876.2 5294.7 5364.9 5430.1 5444.7 5488.6 3062.6 3067.4 3068.5 3070.2 3080.6 5929.1 5958.5 5976.6 5995.6 6019.8 6186.5 6216.2 6218.9 6221.8 6236.3 6233.5 6296.8 6323.4 6324.4 6353.6 5958.5 6039.8 6053.8 6064.8 6113.3 5946.2 5978.2 6005.3 6006.2 6045.9 6023.7 6189.2 6191.3 6254.5 6266.1 4148.9 4153.3 4172.6 4177.0 4181.9 6047.3 6060.2 6074.1 6087.7 6099.9 5588.3 5858.7 5881.2 5891.2 5894.0 5843.0 5862.5 5883.0 5893.8 5902.5 5294.4 5648.6 5722.3 5789.9 5798.9 5779.5 5836.3 5878.4 5928.2 5954.9 5717.7 5743.7 5776.4 5779.2 5789.6 20:34:14 INFO - PROCESS | 24513 | 20:34:14 INFO - PROCESS | 24513 | [#5] yui.html Cycles:180 Average:15661.81 Median:23881.69 stddev:18733.78 (78.4%) stddev-sans-first:18752.87 20:34:14 INFO - PROCESS | 24513 | Values: 751.5 799.8 837.5 845.7 862.8 13733.9 14530.7 14549.9 14575.6 14596.6 13470.7 13488.8 13512.6 13515.7 13535.3 679.4 807.5 832.0 833.8 835.5 817.5 819.9 820.1 825.2 825.3 874.5 881.3 882.0 883.7 883.9 868.6 872.6 874.2 874.4 877.6 636.4 639.7 640.1 640.3 642.7 14366.1 14393.3 14404.2 14430.6 14449.3 14414.1 14548.4 14577.6 14597.9 14821.8 11855.8 11903.6 11955.0 12110.3 12203.1 3879.5 3884.9 3892.1 3896.2 3969.8 53533.7 54917.2 56562.2 56566.4 56930.7 10172.8 10227.9 10339.8 10359.9 10403.8 20551.5 20638.2 20646.5 20667.3 20674.3 8210.2 8315.9 8323.4 8442.3 8661.0 4765.5 4793.6 4801.5 4872.5 4900.9 3474.9 3562.4 3562.5 3577.5 3582.9 614.8 618.3 622.8 633.8 638.7 667.5 699.7 778.8 814.1 821.6 10123.9 10254.7 10605.2 10635.2 10664.7 776.2 788.6 799.8 812.8 830.0 4519.5 4782.7 4823.2 4827.8 4864.2 71678.0 73459.6 73605.6 73953.3 74159.3 64234.0 64443.2 64959.4 65312.4 65501.0 46347.0 46466.3 49875.3 50899.0 52440.7 9844.5 9867.6 9876.4 9971.2 10019.3 33088.0 33504.8 33863.0 33945.5 34686.3 43793.6 46753.0 47385.8 47417.3 47984.5 12785.7 12802.2 12858.5 12954.7 13173.8 14074.0 14111.0 14174.2 14475.2 14713.6 12285.6 12470.2 12562.8 12752.2 12990.4 12501.5 12589.6 12740.9 12861.4 13006.9 11626.1 11834.3 12010.9 12579.7 12639.1 11131.6 11135.9 11155.8 11341.3 11572.3 11317.3 11467.8 11543.7 11624.2 11639.4 20:34:14 INFO - PROCESS | 24513 | -------- Summary: end -------- 20:34:14 INFO - PROCESS | 24513 | 20:34:15 INFO - TEST-INFO | 24513: exit 0 20:34:15 INFO - TEST-OK | dromaeo_css | took 1110041ms 20:34:15 INFO - TEST-START | kraken 20:34:15 INFO - operating with platform_type : linux_ 20:34:15 INFO - Initialising browser for kraken test... 20:34:15 INFO - TEST-INFO | started process 24747 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpEtfGpC/profile http://localhost:39177/getInfo.html) 20:34:19 INFO - PROCESS | 24747 | 20:34:19 INFO - PROCESS | 24747 | (process:24818): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 20:34:20 INFO - PROCESS | 24747 | __metrics Screen width/height:1600/1200 20:34:20 INFO - PROCESS | 24747 | colorDepth:24 20:34:20 INFO - PROCESS | 24747 | Browser inner width/height: 1024/697 20:34:20 INFO - PROCESS | 24747 | __metrics 20:34:20 ERROR - PROCESS | 24747 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2946: TypeError: this.tabs is undefined 20:34:21 INFO - TEST-INFO | 24747: exit 0 20:34:21 INFO - Browser initialized. 20:34:21 INFO - Running cycle 1/1 for kraken test... 20:34:21 INFO - TEST-INFO | started process 24870 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpEtfGpC/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 20:34:23 INFO - PROCESS | 24870 | 20:34:23 INFO - PROCESS | 24870 | (process:24930): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 20:34:33 INFO - PROCESS | 24870 | RSS: Main: 163647488 20:34:33 INFO - PROCESS | 24870 | 20:34:35 INFO - PROCESS | 24870 | Cycle 1(1): loaded http://localhost:39177/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:39177/tests/kraken/driver.html?testName=audio-beat-detection) 20:34:36 INFO - PROCESS | 24870 | RSS: Main: 167653376 20:34:36 INFO - PROCESS | 24870 | 20:34:39 INFO - PROCESS | 24870 | Cycle 1(1): loaded http://localhost:39177/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:39177/tests/kraken/driver.html?testName=audio-dft) 20:34:39 INFO - PROCESS | 24870 | RSS: Main: 168206336 20:34:39 INFO - PROCESS | 24870 | 20:34:42 INFO - PROCESS | 24870 | Cycle 1(1): loaded http://localhost:39177/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:39177/tests/kraken/driver.html?testName=audio-fft) 20:34:43 INFO - PROCESS | 24870 | RSS: Main: 162512896 20:34:43 INFO - PROCESS | 24870 | 20:34:45 INFO - PROCESS | 24870 | Cycle 1(1): loaded http://localhost:39177/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:39177/tests/kraken/driver.html?testName=audio-oscillator) 20:34:46 INFO - PROCESS | 24870 | RSS: Main: 163090432 20:34:46 INFO - PROCESS | 24870 | 20:34:48 INFO - PROCESS | 24870 | Cycle 1(1): loaded http://localhost:39177/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:39177/tests/kraken/driver.html?testName=imaging-gaussian-blur) 20:34:49 INFO - PROCESS | 24870 | RSS: Main: 163491840 20:34:49 INFO - PROCESS | 24870 | 20:34:52 INFO - PROCESS | 24870 | Cycle 1(1): loaded http://localhost:39177/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:39177/tests/kraken/driver.html?testName=imaging-darkroom) 20:34:52 INFO - PROCESS | 24870 | RSS: Main: 163627008 20:34:52 INFO - PROCESS | 24870 | 20:34:56 INFO - PROCESS | 24870 | Cycle 1(1): loaded http://localhost:39177/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:39177/tests/kraken/driver.html?testName=imaging-desaturate) 20:34:56 INFO - PROCESS | 24870 | RSS: Main: 163631104 20:34:56 INFO - PROCESS | 24870 | 20:34:59 INFO - PROCESS | 24870 | Cycle 1(1): loaded http://localhost:39177/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:39177/tests/kraken/driver.html?testName=json-parse-financial) 20:35:00 INFO - PROCESS | 24870 | RSS: Main: 163725312 20:35:00 INFO - PROCESS | 24870 | 20:35:01 INFO - PROCESS | 24870 | Cycle 1(1): loaded http://localhost:39177/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:39177/tests/kraken/driver.html?testName=json-stringify-tinderbox) 20:35:02 INFO - PROCESS | 24870 | RSS: Main: 163475456 20:35:02 INFO - PROCESS | 24870 | 20:35:04 INFO - PROCESS | 24870 | Cycle 1(1): loaded http://localhost:39177/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:39177/tests/kraken/driver.html?testName=stanford-crypto-aes) 20:35:04 INFO - PROCESS | 24870 | RSS: Main: 163618816 20:35:04 INFO - PROCESS | 24870 | 20:35:06 INFO - PROCESS | 24870 | Cycle 1(1): loaded http://localhost:39177/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:39177/tests/kraken/driver.html?testName=stanford-crypto-ccm) 20:35:07 INFO - PROCESS | 24870 | RSS: Main: 164577280 20:35:07 INFO - PROCESS | 24870 | 20:35:10 INFO - PROCESS | 24870 | Cycle 1(1): loaded http://localhost:39177/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:39177/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 20:35:10 INFO - PROCESS | 24870 | RSS: Main: 164352000 20:35:10 INFO - PROCESS | 24870 | 20:35:13 INFO - PROCESS | 24870 | Cycle 1(1): loaded http://localhost:39177/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:39177/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 20:35:14 INFO - PROCESS | 24870 | RSS: Main: 164487168 20:35:14 INFO - PROCESS | 24870 | 20:35:15 INFO - PROCESS | 24870 | Cycle 1(1): loaded http://localhost:39177/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:39177/tests/kraken/driver.html?testName=ai-astar) 20:35:16 INFO - PROCESS | 24870 | RSS: Main: 165892096 20:35:16 INFO - PROCESS | 24870 | 20:35:16 INFO - PROCESS | 24870 | __start_tp_report 20:35:16 INFO - PROCESS | 24870 | _x_x_mozilla_page_load 20:35:16 INFO - PROCESS | 24870 | _x_x_mozilla_page_load_details 20:35:16 INFO - PROCESS | 24870 | |i|pagename|runs| 20:35:16 INFO - PROCESS | 24870 | |0;ai-astar;107;111;109;110;112;113;106;110;111;112 20:35:16 INFO - PROCESS | 24870 | |1;audio-beat-detection;155;127;152;173;130;155;160;131;178;131 20:35:16 INFO - PROCESS | 24870 | |2;audio-dft;162;167;161;162;161;163;174;163;163;161 20:35:16 INFO - PROCESS | 24870 | |3;audio-fft;75;78;75;156;77;76;75;75;159;78 20:35:16 INFO - PROCESS | 24870 | |4;audio-oscillator;93;93;146;93;95;92;139;91;92;159 20:35:16 INFO - PROCESS | 24870 | |5;imaging-gaussian-blur;117;118;118;117;117;117;117;117;118;116 20:35:16 INFO - PROCESS | 24870 | |6;imaging-darkroom;146;147;145;146;147;146;146;147;147;147 20:35:16 INFO - PROCESS | 24870 | |7;imaging-desaturate;95;98;96;96;95;95;95;96;96;95 20:35:16 INFO - PROCESS | 24870 | |8;json-parse-financial;60;60;62;59;59;61;59;78;57;56 20:35:16 INFO - PROCESS | 24870 | |9;json-stringify-tinderbox;59;60;59;59;62;58;59;60;62;60 20:35:16 INFO - PROCESS | 24870 | |10;stanford-crypto-aes;79;80;80;80;80;86;80;80;87;80 20:35:16 INFO - PROCESS | 24870 | |11;stanford-crypto-ccm;128;139;126;123;125;129;125;144;216;126 20:35:16 INFO - PROCESS | 24870 | |12;stanford-crypto-pbkdf2;174;191;174;172;178;173;172;176;169;172 20:35:16 INFO - PROCESS | 24870 | |13;stanford-crypto-sha256-iterative;67;65;67;66;68;65;65;65;64;66 20:35:16 INFO - PROCESS | 24870 | __end_tp_report 20:35:16 INFO - PROCESS | 24870 | __start_cc_report 20:35:16 INFO - PROCESS | 24870 | _x_x_mozilla_cycle_collect,853 20:35:16 INFO - PROCESS | 24870 | __end_cc_report 20:35:16 INFO - PROCESS | 24870 | __startTimestamp1462592116234__endTimestamp 20:35:16 INFO - PROCESS | 24870 | 20:35:16 INFO - PROCESS | 24870 | ------- Summary: start ------- 20:35:16 INFO - PROCESS | 24870 | Number of tests: 14 20:35:16 INFO - PROCESS | 24870 | 20:35:16 INFO - PROCESS | 24870 | [#0] ai-astar Cycles:10 Average:110.10 Median:111.00 stddev:2.23 (2.0%) stddev-sans-first:2.07 20:35:16 INFO - PROCESS | 24870 | Values: 107.0 111.0 109.0 110.0 112.0 113.0 106.0 110.0 111.0 112.0 20:35:16 INFO - PROCESS | 24870 | 20:35:16 INFO - PROCESS | 24870 | [#1] audio-beat-detection Cycles:10 Average:149.20 Median:155.00 stddev:18.59 (12.0%) stddev-sans-first:19.60 20:35:16 INFO - PROCESS | 24870 | Values: 155.0 127.0 152.0 173.0 130.0 155.0 160.0 131.0 178.0 131.0 20:35:16 INFO - PROCESS | 24870 | 20:35:16 INFO - PROCESS | 24870 | [#2] audio-dft Cycles:10 Average:163.70 Median:163.00 stddev:4.03 (2.5%) stddev-sans-first:4.23 20:35:16 INFO - PROCESS | 24870 | Values: 162.0 167.0 161.0 162.0 161.0 163.0 174.0 163.0 163.0 161.0 20:35:16 INFO - PROCESS | 24870 | 20:35:16 INFO - PROCESS | 24870 | [#3] audio-fft Cycles:10 Average:92.40 Median:75.50 stddev:34.34 (45.5%) stddev-sans-first:35.84 20:35:16 INFO - PROCESS | 24870 | Values: 75.0 78.0 75.0 156.0 77.0 76.0 75.0 75.0 159.0 78.0 20:35:16 INFO - PROCESS | 24870 | 20:35:16 INFO - PROCESS | 24870 | [#4] audio-oscillator Cycles:10 Average:109.30 Median:92.50 stddev:27.15 (29.4%) stddev-sans-first:28.15 20:35:16 INFO - PROCESS | 24870 | Values: 93.0 93.0 146.0 93.0 95.0 92.0 139.0 91.0 92.0 159.0 20:35:16 INFO - PROCESS | 24870 | 20:35:16 INFO - PROCESS | 24870 | [#5] imaging-gaussian-blur Cycles:10 Average:117.20 Median:117.00 stddev:0.63 (0.5%) stddev-sans-first:0.67 20:35:16 INFO - PROCESS | 24870 | Values: 117.0 118.0 118.0 117.0 117.0 117.0 117.0 117.0 118.0 116.0 20:35:16 INFO - PROCESS | 24870 | 20:35:16 INFO - PROCESS | 24870 | [#6] imaging-darkroom Cycles:10 Average:146.40 Median:147.00 stddev:0.70 (0.5%) stddev-sans-first:0.73 20:35:16 INFO - PROCESS | 24870 | Values: 146.0 147.0 145.0 146.0 147.0 146.0 146.0 147.0 147.0 147.0 20:35:16 INFO - PROCESS | 24870 | 20:35:16 INFO - PROCESS | 24870 | [#7] imaging-desaturate Cycles:10 Average:95.70 Median:96.00 stddev:0.95 (1.0%) stddev-sans-first:0.97 20:35:16 INFO - PROCESS | 24870 | Values: 95.0 98.0 96.0 96.0 95.0 95.0 95.0 96.0 96.0 95.0 20:35:16 INFO - PROCESS | 24870 | 20:35:16 INFO - PROCESS | 24870 | [#8] json-parse-financial Cycles:10 Average:61.10 Median:60.00 stddev:6.19 (10.3%) stddev-sans-first:6.55 20:35:16 INFO - PROCESS | 24870 | Values: 60.0 60.0 62.0 59.0 59.0 61.0 59.0 78.0 57.0 56.0 20:35:16 INFO - PROCESS | 24870 | 20:35:16 INFO - PROCESS | 24870 | [#9] json-stringify-tinderbox Cycles:10 Average:59.80 Median:60.00 stddev:1.32 (2.2%) stddev-sans-first:1.36 20:35:16 INFO - PROCESS | 24870 | Values: 59.0 60.0 59.0 59.0 62.0 58.0 59.0 60.0 62.0 60.0 20:35:16 INFO - PROCESS | 24870 | 20:35:16 INFO - PROCESS | 24870 | [#10] stanford-crypto-aes Cycles:10 Average:81.20 Median:80.00 stddev:2.82 (3.5%) stddev-sans-first:2.88 20:35:16 INFO - PROCESS | 24870 | Values: 79.0 80.0 80.0 80.0 80.0 86.0 80.0 80.0 87.0 80.0 20:35:16 INFO - PROCESS | 24870 | 20:35:16 INFO - PROCESS | 24870 | [#11] stanford-crypto-ccm Cycles:10 Average:138.10 Median:128.50 stddev:28.19 (21.9%) stddev-sans-first:29.66 20:35:16 INFO - PROCESS | 24870 | Values: 128.0 139.0 126.0 123.0 125.0 129.0 125.0 144.0 216.0 126.0 20:35:16 INFO - PROCESS | 24870 | 20:35:16 INFO - PROCESS | 24870 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:175.10 Median:174.00 stddev:6.10 (3.5%) stddev-sans-first:6.46 20:35:16 INFO - PROCESS | 24870 | Values: 174.0 191.0 174.0 172.0 178.0 173.0 172.0 176.0 169.0 172.0 20:35:16 INFO - PROCESS | 24870 | 20:35:16 INFO - PROCESS | 24870 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:65.80 Median:66.00 stddev:1.23 (1.9%) stddev-sans-first:1.22 20:35:16 INFO - PROCESS | 24870 | Values: 67.0 65.0 67.0 66.0 68.0 65.0 65.0 65.0 64.0 66.0 20:35:16 INFO - PROCESS | 24870 | -------- Summary: end -------- 20:35:16 INFO - PROCESS | 24870 | 20:35:17 INFO - TEST-INFO | 24870: exit 0 20:35:17 INFO - TEST-OK | kraken | took 61489ms 20:35:17 INFO - SUITE-END | took 1171s 20:35:17 INFO - Completed test suite (00:19:31) 20:35:17 INFO - javascript benchmark 20:35:17 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3208.887688930887, 3235.4984977328522, 3247.3342964692233, 3262.380147771923, 3268.689474499923, 5463.153211252257, 5474.7810087596545, 5567.415421380752, 5599.0, 5602.24369710089, 5432.13085906255, 5486.61593688442, 5500.147477141039, 5518.806841760539, 5604.915926261109, 4949.802007919688, 4984.127777638899, 5066.620003499734, 5111.309973153614, 5154.716490593016, 746.9918101326626, 4889.242167464049, 4978.6514943953935, 5067.923981140286, 5106.897862042757, 5007.7496125193775, 5009.0, 5035.018171456586, 5037.546620804127, 5039.949600504003, 5056.039352523009, 5058.190689489701, 5067.315912351823, 5070.0, 5079.212722028092, 4887.780049897763, 4958.181899986498, 4969.155243608559, 4978.4025916890205, 5053.797848086072, 5397.433269506724, 5447.346318441772, 5476.2333273341765, 5492.395836457987, 5514.641548299388, 5761.423857614247, 5921.082232254007, 5932.851678708023, 5939.287285525721, 6001.219841420588, 5810.854728631776, 5880.470757631791, 5931.555133365015, 5986.8503287417725, 6007.3992600739575, 5564.415736347666, 5573.0, 5576.86057848557, 5583.944160558383, 5594.664320140804, 5992.161097446361, 6007.15899774032, 6149.938500615026, 6192.411720886508, 6203.937960620427, 5761.654300741969, 5826.6795326256615, 5850.210221620112, 5859.824205273849, 5865.794697185578, 5945.435183657545, 5948.434898684618, 5952.0, 5955.13650520672, 5966.254218222723, 5678.801241956594, 5832.679202643811, 5835.503982161479, 5889.764409423575, 5902.76388944446, 5910.083936989773, 5943.257092863392, 5944.464998150187, 5953.642781433128, 5993.9700301498215, 4469.396631454777, 4489.349044388546, 4494.820207191676, 4499.52754960731, 4533.365328853963, 3943.369060950234, 3983.880483585497, 4002.4996875390575, 4019.537753158366, 4068.16602596467, 5490.8078217263, 5491.807786727445, 5538.086215774432, 5566.359868615161, 5615.9157612635845, 5916.2013128228, 5936.910946335808, 5946.108083787466, 5959.165716799652, 5962.165296858443, 5381.327334083239, 5545.140503222007, 5579.832605021856, 5607.663540187602, 5632.633878797865, 5032.547070763576, 5058.696478211319, 5075.6193285502995, 5080.466551012164, 5081.923771143436, 6078.422549857756, 6084.056971169476, 6118.479929205978, 6120.357362476965, 6125.479334256638, 5715.885682286331, 5832.9708351457975, 5957.16599676037, 6009.789657361971, 6027.035674292092, 6218.867174890155, 6268.623882567061, 6278.277998030102, 6281.811545653638, 6286.968565157145, 5858.677772722541, 5937.703114844327, 5951.613145145551, 5956.5532585055425, 6005.819825405245, 5843.29880414353, 5853.795117170878, 5863.091220860773, 5924.526037917042, 5982.880342393215, 5740.770369185186, 5785.595008349544, 5793.681347525758, 5799.246098007401, 5801.3908539602735, 5657.264555607745, 5729.341125770589, 5750.396208398058, 5783.132530120515, 5793.739281732416, 5677.205191273142, 5711.228984087261, 5767.134929760569, 5815.41845815415, 5816.127580862904, 5860.150278209721, 5904.704764761831, 5958.046712525975, 5965.6718880461995, 5969.074793407029, 5623.493885550321, 5645.689487078086, 5730.341010783646, 5775.220345253337, 5793.0], "value": 5429.709866402864, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [577.1227733844556, 638.2883085359824, 650.9283978762338, 657.4378906035337, 658.5719282466395, 43994.78002609986, 45220.547794522085, 45504.772476137616, 49011.26483102756, 49414.0, 45912.54087459124, 46728.0, 46730.299045514344, 46748.766256168754, 46756.29865552019, 8786.86819697705, 9069.093090690943, 9074.092590740906, 9078.319126065539, 9082.409643373192, 9016.819663606724, 9094.181523662868, 9123.406978546407, 9127.315451341143, 9130.954345228265, 9087.363884528086, 9147.862782058275, 9157.221636160933, 9158.954205228965, 9198.954005229998, 9083.863742043875, 9111.817763644756, 9138.817223655557, 9153.588088536031, 9160.862587061167, 8962.596683149273, 9031.909680903238, 9062.456252624797, 9067.954660226722, 9104.226140778042, 43103.13793724108, 43182.0, 43526.56473435288, 43563.564364356585, 43759.0, 3697.242065376591, 3865.323568375523, 4138.337865941435, 4192.308269135589, 4259.041715613993, 32043.51934720981, 32427.837860810545, 32452.513212301834, 32489.350212995607, 33622.0, 4381.430414046154, 4428.601425871655, 4450.688451808374, 4503.504614492404, 4588.17412865684, 244414.0, 324481.0, 325764.9999999976, 327291.36354318314, 327996.0, 35325.64674353275, 36017.27965440677, 36113.63886361155, 37944.24111517809, 61292.38707612956, 36953.815230923676, 37010.0, 37219.25561488755, 37228.62771372306, 37334.813325933195, 14698.926505367404, 14802.62993425173, 14826.703465930621, 14877.256137193097, 14880.702385952436, 12308.446119924445, 12408.62774116778, 12415.503379864886, 12427.813582796265, 12587.93706031464, 8339.291160251325, 8345.207205315486, 8357.206065423776, 8361.456505327134, 8401.95799021001, 3243.8540265688102, 3253.137918451612, 3289.4703962657477, 3300.9174770630925, 3314.751393645486, 1119.171812858479, 1135.6820090374708, 1136.5851464215666, 1152.2280072351546, 1227.7605866856056, 31813.0, 32543.67456325454, 32570.511442328385, 33064.0, 33203.0, 1121.058311018748, 1145.9484323205477, 1149.4367759797806, 1190.4166958190424, 1212.854457465092, 16840.83159168417, 16847.410340638264, 16900.32398704038, 17052.914735426242, 17070.573235669206, 483380.0, 486251.0, 487171.0, 488208.0, 489455.0, 60388.396116039155, 61271.6936415324, 61572.07641885375, 61723.691381542805, 62229.68885155545, 1429.078244532271, 1432.9426822927176, 1468.5374107156213, 1480.3634437191895, 1491.1574960147482, 28355.574666380435, 31252.843735781174, 31303.373932521677, 31546.684533155294, 31749.0, 51627.48372516377, 52118.47881521136, 52219.0, 52255.73872130615, 52278.738606306724, 415346.0, 419389.0, 419987.0, 421775.0, 422141.0, 28218.2945426366, 28463.857680711462, 29038.0, 29065.0, 29086.56370154407, 47821.0, 49006.26490602715, 49168.75415622899, 49242.507574923795, 49737.75131124466, 39175.0, 41570.0, 42637.786811065744, 43343.0, 43803.78098109489, 41745.58254417417, 42724.78637606792, 43198.35202472028, 43308.78345608252, 43586.564134358254, 42949.570504294556, 43262.78368608137, 43823.780881095394, 43870.0, 46802.53197467982, 36612.26775464529, 37723.43414848834, 38072.069030573366, 38766.80616596899, 39030.2193956125, 29043.854780726808, 29315.0, 29447.142379428547, 29468.0, 29597.852010739807], "value": 19154.898714011935, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [386.52457477302914, 386.6578078400615, 389.43337444018954, 395.5470985721351, 410.0670973535207, 13762.999999999975, 17669.116544172804, 18453.0, 19478.928658923734, 19501.41495755126, 16918.40785572505, 17151.056691881942, 18453.16960736767, 19512.31706890259, 19538.70691939622, 5678.43215678433, 5738.995675756726, 5758.222639943596, 5767.826965191051, 5805.680687562182, 5693.8576535586735, 5710.343310519302, 5728.79949201778, 5731.570132240078, 5737.139429085629, 5189.844304670866, 5503.889922201553, 5509.504144626982, 5591.608587398884, 5706.3437704663875, 5413.404525502211, 5551.278333816598, 5573.888522229553, 5756.165356023395, 5783.971080144573, 5619.960307343154, 5634.830955071355, 5639.436056394327, 5653.632513886584, 5668.716564171775, 12672.239665620093, 16695.41566045195, 19772.604547909104, 20851.791482085137, 20943.5811283775, 2205.228170140454, 2241.652543855705, 2334.2297041976108, 2534.51844149611, 2637.604359346094, 9264.814703705888, 9425.38734982224, 9714.708558743177, 9813.460259685715, 9858.507074646239, 1882.9717554236697, 1950.9804901951084, 1966.9311574094982, 1986.0169216238055, 1999.0704322489967, 80282.0, 81090.51275897973, 81945.0, 82148.58925705393, 83673.58163209267, 11126.499307531181, 11212.495437705324, 11231.438428078563, 11308.660740177807, 11371.658850234506, 13777.0, 14128.222947737768, 15817.920910395604, 15824.525264242091, 15843.762343564857, 7936.547601793239, 7942.722004729807, 8245.299149572234, 8277.089520152778, 8331.16688331162, 7692.807679808049, 7793.142754297023, 7814.06231252242, 7823.139454660097, 7874.291313781787, 4670.462896766915, 4723.220668589644, 4765.594924431392, 4780.49804770501, 4812.927806082912, 1982.2368388170657, 2033.5627840014467, 2045.7442819647545, 2053.1274208461346, 2083.7916208379042, 935.2377812083266, 1054.146141625286, 1089.656758121205, 1094.0973696700096, 1134.9375784331776, 18757.155927983, 19129.808701912803, 19194.616107677768, 19255.903720481587, 19317.903410482857, 1000.51975051974, 1047.863777708893, 1062.2245760594808, 1065.9680209593569, 1098.9230753847155, 10251.692449226535, 10333.534990925426, 10793.568257269779, 10926.945365273123, 10962.232643715022, 442571.0, 494704.0, 497516.0, 508936.0, 512000.0, 95393.5230323844, 98795.0, 100111.49498272596, 100196.49901750445, 100321.99678003126, 1134.0417347341647, 1175.5297880847559, 1192.5349113845607, 1204.0367705835297, 1212.4665147335145, 16897.91551042237, 17198.484045478657, 17370.478885633453, 17634.29462821524, 18005.909970450062, 39040.80479597584, 39447.408288876264, 39728.80135599303, 40445.1910961785, 40524.18951620892, 55168.44831551793, 55301.72349138228, 55583.44416555783, 56443.71778141083, 56617.0, 8037.8392432152195, 8315.376346774137, 8380.24577788002, 8394.45436046655, 8422.326213902996, 9306.48814315192, 11180.322951557331, 13698.931505342409, 13812.861871381157, 13938.094023888414, 11571.537138514364, 11953.163278570417, 11977.880221197676, 11999.460024298753, 12182.208156469802, 11737.061035117342, 11783.52865885355, 11848.585299514476, 12029.819552706542, 12137.393130343271, 12072.396380181131, 12102.0, 12283.38583070825, 12303.32331721728, 12314.753704925672, 8271.2142346477, 8275.50346979183, 8447.113053129578, 8501.659933602587, 8610.698625548075, 8584.356173287153, 11327.263727857662, 11563.88436115628, 11579.363135027654, 12013.038956883254], "value": 9166.418354171434, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1524.6188452886781, 1576.6846630673867, 1721.259858260948, 1879.4173806120111, 1880.6050729346837, 7999.880001799963, 8285.544295063784, 8437.240648341649, 9068.8639670405, 9092.318076144282, 8301.252887240147, 8470.745877623682, 8572.314214862812, 8688.174623410765, 8697.956510217457, 2332.3469428559947, 2366.8698221597806, 2384.4396566806786, 2388.22382725614, 2390.2351247600773, 2366.9171578994738, 2376.607859703147, 2396.496735685508, 2398.604230301998, 2401.231605886117, 2267.3651377614297, 2307.8153747700144, 2339.6724458575727, 2400.471896182837, 2401.795847352977, 2317.0615900560133, 2323.3146221864504, 2333.8132949364012, 2339.1579031548713, 2339.181286549711, 2323.233333000106, 2332.8017118544944, 2333.358326460237, 2333.4749681321737, 2340.4499942513494, 8618.09510001447, 8633.35249856257, 8678.522681252529, 8731.825363492759, 8736.475811451333, 5047.7476126193915, 5170.0, 5204.167333226704, 5220.086484865172, 5222.6605270657665, 3321.4353559894876, 3352.949705754416, 3395.609504906918, 3433.8454769535433, 3440.518327434161, 1043.906048455635, 1068.433730123036, 1073.4579037586047, 1073.7584043590207, 1109.8002359575273, 12136.15046946714, 12449.439775210047, 12449.439775210138, 12468.376581170996, 12474.563390281388, 4589.632829373642, 4615.169269531517, 4702.271147972001, 4710.0, 4711.623070154379, 10490.42302673345, 10501.107405870434, 10531.420771857622, 10565.683029509128, 10567.260291779501, 5218.895622087537, 5222.92165617516, 5258.631895767336, 5348.5186333230195, 5359.839204823861, 4252.149570085933, 4624.791884365211, 4736.123817093849, 4767.833125840579, 4789.616830653539, 4082.4692789937117, 4103.302438585448, 4140.574443725434, 4142.544320124784, 4207.579242075829, 1306.7778477658821, 1331.3210262766058, 1337.832770903637, 1341.2958196946681, 1346.8855147312588, 782.5148407987084, 987.629638885418, 990.8315586350337, 1017.5319353097658, 1030.1501261459177, 5749.741261643236, 5855.502282305966, 5857.912131318034, 5982.4316689914385, 6025.608335458269, 425.5914322250674, 434.90214701691866, 442.287916454508, 443.7670223132881, 448.08143306222115, 4092.3861420786525, 4101.630853223224, 4104.179164167179, 4128.653393854965, 4137.793110344471, 10619.893801062046, 11007.669769906915, 11035.668929932115, 11117.777644447066, 11131.443427828739, 10891.292066015683, 10924.399158046384, 10942.288751231144, 10945.507452164671, 10972.890271097347, 8284.71003514886, 8317.168283171755, 8346.33229341639, 8360.414770965974, 8364.916350836414, 5797.826065218051, 5863.442972917566, 5915.852103697442, 5924.348321684697, 5977.9402205977385, 9776.951115244377, 10076.899231007596, 10094.899051009395, 10125.291229613857, 10267.691969240936, 10310.07209351162, 10323.793524129625, 10339.431331276552, 10412.271141020055, 10429.374237545771, 7139.32176443237, 7394.667239974322, 7670.7315243966195, 7783.532988020737, 7842.529448233125, 8490.32077433816, 8520.062793092879, 8523.91476085256, 8568.828623427622, 8599.570021498776, 7432.0, 7645.082590089225, 7668.69325227007, 7838.059432868093, 7934.166912474107, 7493.625318734151, 7497.700091996259, 7573.431992600466, 7573.9242607575425, 7595.240475952361, 6982.197047339621, 7000.089988301488, 7035.929640703527, 7039.929600704132, 7052.858942821217, 4725.574698277172, 4900.436449808318, 4969.130402179532, 4974.602031837517, 5020.272060551272, 4941.950580494149, 5089.872753181052, 5254.89490210186, 5349.277847490539, 5413.756380962787], "value": 4558.3429223753665, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [310.199684813182, 311.6104868913858, 315.19624956361275, 319.07150192938553, 322.0595860088541, 5424.430434804343, 5458.9454105459035, 5487.890242195153, 5519.641223320481, 5581.776728930843, 5402.621816472849, 5409.6213265071465, 5424.186372044195, 5435.619506634537, 5465.6447330923465, 4036.8788936331957, 4139.482564679415, 4173.372384769942, 4295.935560966588, 4299.5485474025245, 4234.576542345756, 4252.319628859384, 4260.211860805745, 4268.445102136718, 4282.079352939118, 4236.216299984513, 4247.299195632732, 4250.341197114452, 4257.233697934371, 4273.337632666941, 3967.960320396788, 4176.519700234481, 4177.185448837478, 4181.874543763692, 4251.4685664291965, 3591.2099338145567, 3613.5844377896615, 3618.6200448952745, 3625.078708284613, 3649.8685407523753, 5307.575393968512, 5347.46525347466, 5349.779841365828, 5352.732363381815, 5352.946470535323, 4563.247064234397, 4816.230667366243, 4828.830990915336, 4844.95155048452, 4865.9026819463415, 5752.568557358215, 5788.18965344852, 5790.652560846363, 5802.100674395433, 5806.419358064202, 4028.8187031583357, 4037.607025576201, 4042.3734321180264, 4052.959470405317, 4065.7560546367017, 5892.970535147339, 5995.34051254366, 6007.849803754897, 6046.788362407338, 6054.39456054391, 4098.938515922264, 4111.814968326433, 4121.62905338515, 4123.835046598162, 4133.958660413417, 4149.834006639761, 4159.812808423628, 4173.499180098347, 4198.916021679549, 4218.978905105455, 4670.929936050962, 4792.0, 4848.0, 4876.122297986326, 4893.7063776173545, 5821.417858214145, 5833.095870140135, 5846.123081537803, 5849.619774714715, 5887.4406931341455, 1369.0211498778422, 1379.0555317002977, 1388.9027668142257, 1391.5616580777023, 1395.2186775405805, 891.9697749099671, 897.2866571076011, 941.091846368258, 945.6996629634253, 947.9526023698787, 5237.921431178535, 5403.351597808288, 5421.132618780976, 5441.564674826083, 5463.562914966793, 5660.349059858169, 5722.942770572325, 5799.217105690678, 5818.5054270386645, 5876.177335173079, 5294.708791016454, 5364.8658783529945, 5430.13117901134, 5444.673319600836, 5488.588355873326, 3062.647795503501, 3067.4171907337536, 3068.5243787213017, 3070.1710538154575, 3080.614923134608, 5929.110633405024, 5958.493528050078, 5976.581639285295, 5995.640261584319, 6019.779418011343, 6186.505079593621, 6216.222972128484, 6218.921633791212, 6221.760166340114, 6236.345183755731, 6233.470155036782, 6296.827594479989, 6323.430891219812, 6324.43080122782, 6353.618782873043, 5958.463738263577, 6039.758409663565, 6053.788117415869, 6064.848378790565, 6113.29697084841, 5946.1972633693895, 5978.236420256122, 6005.279366476051, 6006.249218847644, 6045.939540604538, 6023.695387595972, 6189.164462797465, 6191.288001879841, 6254.530185406335, 6266.122742815918, 4148.879802453261, 4153.335466325373, 4172.645325147397, 4176.979115104405, 4181.91636167281, 6047.274327080602, 6060.151578778887, 6074.147385047603, 6087.726052327745, 6099.908501372394, 5588.273524441796, 5858.7110835616095, 5881.235439392852, 5891.204687367322, 5893.970530147321, 5842.970785146047, 5862.530997520103, 5883.028955455136, 5893.823185304448, 5902.543579597376, 5294.417614062373, 5648.604597678123, 5722.341930677859, 5789.855253618524, 5798.913016304675, 5779.479846813807, 5836.299644042742, 5878.382769809279, 5928.191901470093, 5954.910676339771, 5717.714114294352, 5743.655380677173, 5776.364599893925, 5779.190913272229, 5789.56578256624], "value": 4363.240998421563, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [751.526538280883, 799.7723494436045, 837.5477242289162, 845.6786421159958, 862.7627402464321, 13733.862661373383, 14530.709385812277, 14549.927250363733, 14575.562733118024, 14596.635084122901, 13470.730585388286, 13488.797668034988, 13512.59462216135, 13515.729685406286, 13535.323233838319, 679.4055201698501, 807.475141158246, 831.9500829950192, 833.7623777223492, 835.5237514616671, 817.4890693316677, 819.889314942484, 820.0897004325194, 825.2366560931144, 825.3438516379463, 874.5496069524169, 881.299367003234, 882.0209567380202, 883.7392969074107, 883.8762573239752, 868.6395146014428, 872.5898827551073, 874.191372979991, 874.3529787956929, 877.5743764274354, 636.4462917261966, 639.692947385253, 640.0814830717889, 640.3468462168609, 642.6529673976094, 14366.13803171813, 14393.280335983263, 14404.207768572724, 14430.567082987527, 14449.277536123152, 14414.063085899488, 14548.418063277457, 14577.562673119823, 14597.92701036488, 14821.77767333491, 11855.762884742257, 11903.583374581847, 11955.0, 12110.273383597012, 12203.145779795417, 3879.534455865314, 3884.864029758945, 3892.1048158923604, 3896.240233154536, 3969.821358038895, 53533.732331338484, 54917.1762423564, 56562.15156772652, 56566.43433565653, 56930.715346423414, 10172.84740728875, 10227.926067762777, 10339.793204135874, 10359.94820025895, 10403.84394234087, 20551.4862128448, 20638.174473021212, 20646.483837904172, 20667.27664531764, 20674.276400325918, 8210.220029097345, 8315.916840831514, 8323.375746819012, 8442.282405995436, 8660.956695216484, 4765.499622539653, 4793.592544633745, 4801.4958429365115, 4872.537108974712, 4900.926486102711, 3474.947875781865, 3562.358775420449, 3562.4656301554974, 3577.5349204603235, 3582.9283414331567, 614.8124821929355, 618.326024633152, 622.819382379114, 633.7971849008366, 638.6902352359102, 667.5060455263167, 699.653671432644, 778.7936196907824, 814.1044850664222, 821.6261600971544, 10123.898761012442, 10254.743631409274, 10605.151587872951, 10635.202359823044, 10664.680059598224, 776.1927595300937, 788.5662885413115, 799.8120441696196, 812.8374325134997, 829.9875501867476, 4519.54804519552, 4782.689125206851, 4823.204171311764, 4827.831025914076, 4864.197407427806, 71678.0, 73459.63270183722, 73605.6319718398, 73953.26046739463, 74159.25840741524, 64234.0, 64443.20011199015, 64959.35040649533, 65312.40781756954, 65501.0, 46347.0, 46466.303005454945, 49875.25187122196, 50899.0, 52440.73779631077, 9844.507774611384, 9867.611374360491, 9876.35803672759, 9971.202303815822, 10019.298649094493, 33088.0, 33504.832475837466, 33863.0, 33945.49081763726, 34686.306273874885, 43793.56206437895, 46753.0, 47385.763071184425, 47417.28874066823, 47984.520154798, 12785.744285114431, 12802.231866088065, 12858.549950751678, 12954.676133096747, 13173.802392963922, 14074.0, 14111.0, 14174.220417876702, 14475.203863787592, 14713.55859324222, 12285.631431057083, 12470.189437686522, 12562.811557826457, 12752.234865908074, 12990.350482476028, 12501.499940002663, 12589.622311330675, 12740.87259127434, 12861.421236044212, 13006.934965325112, 11626.128040396836, 11834.289942603471, 12010.879891201326, 12579.74840503203, 12639.115261931576, 11131.554737810397, 11135.88864111381, 11155.832662509907, 11341.26281791681, 11572.305661660328, 11317.264377815416, 11467.846342255947, 11543.71140721455, 11624.244424112405, 11639.359835209145], "value": 7012.100286919062, "unit": "score"}], "name": "dromaeo_css", "value": 7144.312094395586, "alertThreshold": 5.0}, {"lowerIsBetter": true, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [107.0, 111.0, 109.0, 110.0, 112.0, 113.0, 106.0, 110.0, 111.0, 112.0], "value": 110.1, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [155.0, 127.0, 152.0, 173.0, 130.0, 155.0, 160.0, 131.0, 178.0, 131.0], "value": 149.2, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [162.0, 167.0, 161.0, 162.0, 161.0, 163.0, 174.0, 163.0, 163.0, 161.0], "value": 163.7, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [75.0, 78.0, 75.0, 156.0, 77.0, 76.0, 75.0, 75.0, 159.0, 78.0], "value": 92.4, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [93.0, 93.0, 146.0, 93.0, 95.0, 92.0, 139.0, 91.0, 92.0, 159.0], "value": 109.3, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [117.0, 118.0, 118.0, 117.0, 117.0, 117.0, 117.0, 117.0, 118.0, 116.0], "value": 117.2, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [146.0, 147.0, 145.0, 146.0, 147.0, 146.0, 146.0, 147.0, 147.0, 147.0], "value": 146.4, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [95.0, 98.0, 96.0, 96.0, 95.0, 95.0, 95.0, 96.0, 96.0, 95.0], "value": 95.7, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [60.0, 60.0, 62.0, 59.0, 59.0, 61.0, 59.0, 78.0, 57.0, 56.0], "value": 61.1, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [59.0, 60.0, 59.0, 59.0, 62.0, 58.0, 59.0, 60.0, 62.0, 60.0], "value": 59.8, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [79.0, 80.0, 80.0, 80.0, 80.0, 86.0, 80.0, 80.0, 87.0, 80.0], "value": 81.2, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [128.0, 139.0, 126.0, 123.0, 125.0, 129.0, 125.0, 144.0, 216.0, 126.0], "value": 138.1, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [174.0, 191.0, 174.0, 172.0, 178.0, 173.0, 172.0, 176.0, 169.0, 172.0], "value": 175.1, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [67.0, 65.0, 67.0, 66.0, 68.0, 65.0, 65.0, 65.0, 64.0, 66.0], "value": 65.8, "unit": "score"}], "name": "kraken", "value": 1565.0999999999997, "alertThreshold": 2.0}]} 20:35:17 INFO - Return code: 0 20:35:17 INFO - Validating PERFHERDER_DATA against /builds/slave/test/build/tests/talos/treeherder-schemas/performance-artifact.json 20:35:17 ERROR - # TBPL SUCCESS # 20:35:17 INFO - Running post-action listener: _resource_record_post_action 20:35:17 INFO - ##### 20:35:17 INFO - ##### Finished run-tests step (success) 20:35:17 INFO - ##### 20:35:17 INFO - Running post-run listener: _resource_record_post_run 20:35:18 INFO - Total resource usage - Wall time: 1189s; CPU: 13.0%; Read bytes: 4096; Write bytes: 538222592; Read time: 12; Write time: 600824 20:35:18 INFO - install - Wall time: 17s; CPU: 14.0%; Read bytes: 0; Write bytes: 244776960; Read time: 0; Write time: 268816 20:35:18 INFO - run-tests - Wall time: 1173s; CPU: 13.0%; Read bytes: 4096; Write bytes: 293445632; Read time: 12; Write time: 332008 20:35:18 INFO - Running post-run listener: _upload_blobber_files 20:35:18 INFO - Blob upload gear active. 20:35:18 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 20:35:18 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 20:35:18 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'] 20:35:18 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 20:35:19 INFO - (blobuploader) - INFO - Open directory for files ... 20:35:19 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 20:35:19 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 20:35:19 INFO - (blobuploader) - INFO - Uploading, attempt #1. 20:35:19 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 20:35:19 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 20:35:19 INFO - (blobuploader) - INFO - Done attempting. 20:35:19 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 20:35:19 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 20:35:19 INFO - (blobuploader) - INFO - Uploading, attempt #1. 20:35:20 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 20:35:20 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 20:35:20 INFO - (blobuploader) - INFO - Done attempting. 20:35:20 INFO - (blobuploader) - INFO - Iteration through files over. 20:35:20 INFO - Return code: 0 20:35:20 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 20:35:20 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 20:35:20 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/3c54866877aa9bf371c3f3c1925aa242c29e963b2311a477a5418df11d34c2c04f8a7bd037035aa8d7a287914472565d28e5a0c3d963cc16dc369e84bf424208", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/25b2d3007b5180b0b59aa0d04bf830a31f576084b5cfa53ba42220bf29f06b9f46633775bd800720282c7ac5c8edcfc4cf782c3b083d185b7ccbb0b9ba38d424"} 20:35:20 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 20:35:20 INFO - Writing to file /builds/slave/test/properties/blobber_files 20:35:20 INFO - Contents: 20:35:20 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/3c54866877aa9bf371c3f3c1925aa242c29e963b2311a477a5418df11d34c2c04f8a7bd037035aa8d7a287914472565d28e5a0c3d963cc16dc369e84bf424208", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/25b2d3007b5180b0b59aa0d04bf830a31f576084b5cfa53ba42220bf29f06b9f46633775bd800720282c7ac5c8edcfc4cf782c3b083d185b7ccbb0b9ba38d424"} 20:35:20 INFO - Running post-run listener: copy_logs_to_upload_dir 20:35:20 INFO - Copying logs to upload dir... 20:35:20 INFO - mkdir: /builds/slave/test/build/upload/logs 20:35:20 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1243.647540 ========= master_lag: 0.03 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 43 secs) (at 2016-05-06 20:35:20.611418) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-05-06 20:35:20.614964) ========= 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=4ac8d263c7293b36a1be1aed000001be-1462589747.683929-1800753746 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/3c54866877aa9bf371c3f3c1925aa242c29e963b2311a477a5418df11d34c2c04f8a7bd037035aa8d7a287914472565d28e5a0c3d963cc16dc369e84bf424208", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/25b2d3007b5180b0b59aa0d04bf830a31f576084b5cfa53ba42220bf29f06b9f46633775bd800720282c7ac5c8edcfc4cf782c3b083d185b7ccbb0b9ba38d424"} build_url:https://queue.taskcluster.net/v1/task/QiNtwmCuTauZmovrygHVeQ/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011399 build_url: 'https://queue.taskcluster.net/v1/task/QiNtwmCuTauZmovrygHVeQ/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/3c54866877aa9bf371c3f3c1925aa242c29e963b2311a477a5418df11d34c2c04f8a7bd037035aa8d7a287914472565d28e5a0c3d963cc16dc369e84bf424208", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/25b2d3007b5180b0b59aa0d04bf830a31f576084b5cfa53ba42220bf29f06b9f46633775bd800720282c7ac5c8edcfc4cf782c3b083d185b7ccbb0b9ba38d424"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-05-06 20:35:20.641001) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-05-06 20:35:20.641334) ========= 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=4ac8d263c7293b36a1be1aed000001be-1462589747.683929-1800753746 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004421 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-05-06 20:35:20.728292) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-05-06 20:35:20.728646) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-05-06 20:35:20.728932) ========= ========= Total master_lag: 0.18 =========