builder: fx-team_ubuntu64_hw_test-dromaeojs-e10s-pgo slave: talos-linux64-ix-025 starttime: 1465269205.78 results: success (0) buildid: 20160606173007 builduid: 9dd58ac981624fbb9c586a606df56dfe revision: d9f0b4e9a8add9e0931e1c549ccba22f7dbc67d3 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-06-06 20:13:25.782699) ========= master: http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-06-06 20:13:25.783156) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-06-06 20:13:25.783428) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-06-06 20:13:25.804496) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-06-06 20:13:25.804904) ========= 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=232498196343f89f466a4a9a000001c8-1465268964.299842-1328781238 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-06-06 20:13:26-- 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% 38.3M=0s 2016-06-06 20:13:26 (38.3 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.119114 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-06-06 20:13:25.943192) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-06-06 20:13:25.943888) ========= 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=232498196343f89f466a4a9a000001c8-1465268964.299842-1328781238 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.015754 ========= master_lag: 0.05 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-06-06 20:13:26.013545) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-06-06 20:13:26.013859) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev d9f0b4e9a8add9e0931e1c549ccba22f7dbc67d3 --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 d9f0b4e9a8add9e0931e1c549ccba22f7dbc67d3 --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=232498196343f89f466a4a9a000001c8-1465268964.299842-1328781238 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-06-06 20:13:26,939 truncating revision to first 12 chars 2016-06-06 20:13:26,939 Setting DEBUG logging. 2016-06-06 20:13:26,939 attempt 1/10 2016-06-06 20:13:26,940 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/d9f0b4e9a8ad?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-06-06 20:13:27,229 unpacking tar archive at: fx-team-d9f0b4e9a8ad/testing/mozharness/ program finished with exit code 0 elapsedTime=0.605709 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-06-06 20:13:26.635151) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-06-06 20:13:26.635523) ========= script_repo_revision: d9f0b4e9a8add9e0931e1c549ccba22f7dbc67d3 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-06-06 20:13:26.635976) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-06-06 20:13:26.636244) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-06-06 20:13:26.646406) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 41 secs) (at 2016-06-06 20:13:26.646832) ========= /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=232498196343f89f466a4a9a000001c8-1465268964.299842-1328781238 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 20:13:27 INFO - MultiFileLogger online at 20160606 20:13:27 in /builds/slave/test 20:13:27 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:13:27 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 20:13:27 INFO - {'append_to_log': False, 20:13:27 INFO - 'base_work_dir': '/builds/slave/test', 20:13:27 INFO - 'blob_upload_branch': 'Fx-Team', 20:13:27 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 20:13:27 INFO - 'branch': 'Fx-Team', 20:13:27 INFO - 'buildbot_json_path': 'buildprops.json', 20:13:27 INFO - 'config_files': ('talos/linux_config.py',), 20:13:27 INFO - 'default_actions': ('clobber', 20:13:27 INFO - 'read-buildbot-config', 20:13:27 INFO - 'download-and-extract', 20:13:27 INFO - 'populate-webroot', 20:13:27 INFO - 'create-virtualenv', 20:13:27 INFO - 'install', 20:13:27 INFO - 'run-tests'), 20:13:27 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 20:13:27 INFO - 'download_minidump_stackwalk': True, 20:13:27 INFO - 'download_symbols': 'ondemand', 20:13:27 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 20:13:27 INFO - 'tooltool.py': '/tools/tooltool.py', 20:13:27 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 20:13:27 INFO - '/tools/misc-python/virtualenv.py')}, 20:13:27 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 20:13:27 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 20:13:27 INFO - 'installer_path': 'installer.exe', 20:13:27 INFO - 'log_level': 'info', 20:13:27 INFO - 'log_name': 'talos', 20:13:27 INFO - 'log_to_console': True, 20:13:27 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 20:13:27 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 20:13:27 INFO - 'opt_config_files': (), 20:13:27 INFO - 'pip_index': False, 20:13:27 INFO - 'sps_profile': False, 20:13:27 INFO - 'sps_profile_interval': 0, 20:13:27 INFO - 'suite': 'dromaeojs-e10s', 20:13:27 INFO - 'system_bits': '32', 20:13:27 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 20:13:27 INFO - 'title': 'talos-linux64-ix-025', 20:13:27 INFO - 'tooltool_cache': '/builds/tooltool_cache', 20:13:27 INFO - 'use_talos_json': True, 20:13:27 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 20:13:27 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 20:13:27 INFO - 'work_dir': 'build'} 20:13:27 INFO - ##### 20:13:27 INFO - ##### Running clobber step. 20:13:27 INFO - ##### 20:13:27 INFO - Running pre-action listener: _resource_record_pre_action 20:13:27 INFO - Running main action method: clobber 20:13:27 INFO - rmtree: /builds/slave/test/build 20:13:27 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 20:13:28 INFO - Running post-action listener: _resource_record_post_action 20:13:28 INFO - ##### 20:13:28 INFO - ##### Finished clobber step (success) 20:13:28 INFO - ##### 20:13:28 INFO - ##### 20:13:28 INFO - ##### Running read-buildbot-config step. 20:13:28 INFO - ##### 20:13:28 INFO - Running pre-action listener: _resource_record_pre_action 20:13:28 INFO - Running main action method: read_buildbot_config 20:13:28 INFO - Using buildbot properties: 20:13:28 INFO - { 20:13:28 INFO - "project": "", 20:13:28 INFO - "product": "firefox", 20:13:28 INFO - "script_repo_revision": "production", 20:13:28 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs-e10s", 20:13:28 INFO - "repository": "", 20:13:28 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team pgo talos dromaeojs-e10s", 20:13:28 INFO - "buildid": "20160606173007", 20:13:28 INFO - "pgo_build": "True", 20:13:28 INFO - "basedir": "/builds/slave/test", 20:13:28 INFO - "buildnumber": 430, 20:13:28 INFO - "slavename": "talos-linux64-ix-025", 20:13:28 INFO - "master": "http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/", 20:13:28 INFO - "platform": "ubuntu64_hw", 20:13:28 INFO - "scheduler": "tests-fx-team-linux64-pgo-talos", 20:13:28 INFO - "branch": "fx-team", 20:13:28 INFO - "repo_path": "integration/fx-team", 20:13:28 INFO - "revision": "d9f0b4e9a8add9e0931e1c549ccba22f7dbc67d3", 20:13:28 INFO - "stage_platform": "linux64-pgo", 20:13:28 INFO - "builduid": "9dd58ac981624fbb9c586a606df56dfe", 20:13:28 INFO - "slavebuilddir": "test" 20:13:28 INFO - } 20:13:28 INFO - Found installer url https://queue.taskcluster.net/v1/task/a8tDyd1PQrqA0w1kRzaQvw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2. 20:13:28 INFO - Running post-action listener: _resource_record_post_action 20:13:28 INFO - ##### 20:13:28 INFO - ##### Finished read-buildbot-config step (success) 20:13:28 INFO - ##### 20:13:28 INFO - ##### 20:13:28 INFO - ##### Running download-and-extract step. 20:13:28 INFO - ##### 20:13:28 INFO - Running pre-action listener: _resource_record_pre_action 20:13:28 INFO - Running main action method: download_and_extract 20:13:28 INFO - mkdir: /builds/slave/test/build/tests 20:13:28 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:13:28 INFO - https://queue.taskcluster.net/v1/task/a8tDyd1PQrqA0w1kRzaQvw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 20:13:28 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/a8tDyd1PQrqA0w1kRzaQvw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 20:13:28 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/a8tDyd1PQrqA0w1kRzaQvw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 20:13:28 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/a8tDyd1PQrqA0w1kRzaQvw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 20:13:28 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/a8tDyd1PQrqA0w1kRzaQvw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json'}, attempt #1 20:13:28 INFO - Downloaded 1361 bytes. 20:13:28 INFO - Reading from file /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 20:13:28 INFO - Using the following test package requirements: 20:13:28 INFO - {u'common': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'], 20:13:28 INFO - u'cppunittest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 20:13:28 INFO - u'firefox-50.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 20:13:28 INFO - u'gtest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 20:13:28 INFO - u'firefox-50.0a1.en-US.linux-x86_64.gtest.tests.zip'], 20:13:28 INFO - u'jittest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 20:13:28 INFO - u'jsshell-linux-x86_64.zip'], 20:13:28 INFO - u'mochitest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 20:13:28 INFO - u'firefox-50.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 20:13:28 INFO - u'mozbase': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'], 20:13:28 INFO - u'reftest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 20:13:28 INFO - u'firefox-50.0a1.en-US.linux-x86_64.reftest.tests.zip'], 20:13:28 INFO - u'talos': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 20:13:28 INFO - u'firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip'], 20:13:28 INFO - u'web-platform': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 20:13:28 INFO - u'firefox-50.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 20:13:28 INFO - u'xpcshell': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 20:13:28 INFO - u'firefox-50.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 20:13:28 INFO - Downloading packages: [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 20:13:28 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:13:28 INFO - https://queue.taskcluster.net/v1/task/a8tDyd1PQrqA0w1kRzaQvw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 20:13:28 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/a8tDyd1PQrqA0w1kRzaQvw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 20:13:28 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/a8tDyd1PQrqA0w1kRzaQvw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 20:13:28 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/a8tDyd1PQrqA0w1kRzaQvw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 20:13:28 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/a8tDyd1PQrqA0w1kRzaQvw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 20:13:32 INFO - Downloaded 24444211 bytes. 20:13:32 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 20:13:32 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 20:13:33 INFO - Return code: 0 20:13:33 INFO - Downloading packages: [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 20:13:33 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:13:33 INFO - https://queue.taskcluster.net/v1/task/a8tDyd1PQrqA0w1kRzaQvw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 20:13:33 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/a8tDyd1PQrqA0w1kRzaQvw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 20:13:33 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/a8tDyd1PQrqA0w1kRzaQvw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 20:13:33 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/a8tDyd1PQrqA0w1kRzaQvw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 20:13:33 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/a8tDyd1PQrqA0w1kRzaQvw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 20:13:40 INFO - Downloaded 24444211 bytes. 20:13:40 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 20:13:40 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 20:13:42 INFO - Return code: 0 20:13:42 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:13:42 INFO - https://queue.taskcluster.net/v1/task/a8tDyd1PQrqA0w1kRzaQvw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 20:13:42 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/a8tDyd1PQrqA0w1kRzaQvw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 20:13:42 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/a8tDyd1PQrqA0w1kRzaQvw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 20:13:42 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/a8tDyd1PQrqA0w1kRzaQvw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 20:13:42 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/a8tDyd1PQrqA0w1kRzaQvw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 20:13:42 INFO - Downloaded 10833369 bytes. 20:13:42 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test/build/tests'] 20:13:42 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test/build/tests 20:13:43 INFO - Return code: 0 20:13:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 20:13:43 INFO - https://queue.taskcluster.net/v1/task/a8tDyd1PQrqA0w1kRzaQvw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 20:13:43 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/a8tDyd1PQrqA0w1kRzaQvw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 20:13:43 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/a8tDyd1PQrqA0w1kRzaQvw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 20:13:43 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/a8tDyd1PQrqA0w1kRzaQvw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 20:13:43 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/a8tDyd1PQrqA0w1kRzaQvw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 20:13:44 INFO - Downloaded 59201948 bytes. 20:13:44 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/a8tDyd1PQrqA0w1kRzaQvw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 20:13:44 INFO - mkdir: /builds/slave/test/properties 20:13:44 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 20:13:44 INFO - Writing to file /builds/slave/test/properties/build_url 20:13:44 INFO - Contents: 20:13:44 INFO - build_url:https://queue.taskcluster.net/v1/task/a8tDyd1PQrqA0w1kRzaQvw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 20:13:45 INFO - Running post-action listener: _resource_record_post_action 20:13:45 INFO - Running post-action listener: set_extra_try_arguments 20:13:45 INFO - ##### 20:13:45 INFO - ##### Finished download-and-extract step (success) 20:13:45 INFO - ##### 20:13:45 INFO - ##### 20:13:45 INFO - ##### Running populate-webroot step. 20:13:45 INFO - ##### 20:13:45 INFO - Running pre-action listener: _resource_record_pre_action 20:13:45 INFO - Running main action method: populate_webroot 20:13:45 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 20:13:45 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 20:13:45 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 20:13:45 INFO - '--tppagecycles', 20:13:45 INFO - '7'], 20:13:45 INFO - 'tests': ['tsvgm']}}, 20:13:45 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 20:13:45 INFO - 'tests': ['tresize', 'tcanvasmark']}, 20:13:45 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 20:13:45 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 20:13:45 INFO - 'tests': ['dromaeo_css', 'kraken']}, 20:13:45 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 20:13:45 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 20:13:45 INFO - 'talos_options': ['--disable-e10s'], 20:13:45 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 20:13:45 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 20:13:45 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 20:13:45 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 20:13:45 INFO - 'talos_options': ['--disable-e10s'], 20:13:45 INFO - 'tests': ['damp', 'tps']}, 20:13:45 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 20:13:45 INFO - 'tests': ['damp', 'tps']}, 20:13:45 INFO - 'g3': {'talos_options': ['--disable-e10s'], 20:13:45 INFO - 'tests': ['dromaeo_dom']}, 20:13:45 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 20:13:45 INFO - 'other': {'talos_options': ['--disable-e10s'], 20:13:45 INFO - 'tests': ['a11yr', 20:13:45 INFO - 'ts_paint', 20:13:45 INFO - 'tpaint', 20:13:45 INFO - 'sessionrestore', 20:13:45 INFO - 'sessionrestore_no_auto_restore', 20:13:45 INFO - 'tabpaint']}, 20:13:45 INFO - 'other-e10s': {'tests': ['a11yr', 20:13:45 INFO - 'ts_paint', 20:13:45 INFO - 'tpaint', 20:13:45 INFO - 'sessionrestore', 20:13:45 INFO - 'sessionrestore_no_auto_restore', 20:13:45 INFO - 'tabpaint']}, 20:13:45 INFO - 'other-e10s_l64': {'tests': ['a11yr', 20:13:45 INFO - 'ts_paint', 20:13:45 INFO - 'tpaint', 20:13:45 INFO - 'sessionrestore', 20:13:45 INFO - 'sessionrestore_no_auto_restore', 20:13:45 INFO - 'tabpaint']}, 20:13:45 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 20:13:45 INFO - 'ts_paint', 20:13:45 INFO - 'tpaint', 20:13:45 INFO - 'sessionrestore', 20:13:45 INFO - 'sessionrestore_no_auto_restore', 20:13:45 INFO - 'tabpaint']}, 20:13:45 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 20:13:45 INFO - 'tests': ['a11yr', 20:13:45 INFO - 'ts_paint', 20:13:45 INFO - 'tpaint', 20:13:45 INFO - 'sessionrestore', 20:13:45 INFO - 'sessionrestore_no_auto_restore', 20:13:45 INFO - 'tabpaint']}, 20:13:45 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 20:13:45 INFO - 'tests': ['a11yr', 20:13:45 INFO - 'ts_paint', 20:13:45 INFO - 'tpaint', 20:13:45 INFO - 'sessionrestore', 20:13:45 INFO - 'sessionrestore_no_auto_restore', 20:13:45 INFO - 'tabpaint']}, 20:13:45 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 20:13:45 INFO - 'tests': ['tsvgx', 20:13:45 INFO - 'tsvgr_opacity', 20:13:45 INFO - 'tart', 20:13:45 INFO - 'tscrollx', 20:13:45 INFO - 'cart']}, 20:13:45 INFO - 'svgr-e10s': {'tests': ['tsvgx', 20:13:45 INFO - 'tsvgr_opacity', 20:13:45 INFO - 'tart', 20:13:45 INFO - 'tscrollx', 20:13:45 INFO - 'cart']}, 20:13:45 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 20:13:45 INFO - 'talos_options': ['--disable-e10s'], 20:13:45 INFO - 'tests': ['tp5o']}, 20:13:45 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 20:13:45 INFO - 'tests': ['tp5o']}, 20:13:45 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 20:13:45 INFO - 'talos_options': ['--disable-e10s', 20:13:45 INFO - '--xperf_path', 20:13:45 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 20:13:45 INFO - 'tests': ['tp5n']}, 20:13:45 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 20:13:45 INFO - 'talos_options': ['--xperf_path', 20:13:45 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 20:13:45 INFO - 'tests': ['tp5n']}}, 20:13:45 INFO - 'talos.zip': {'path': '', 20:13:45 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 20:13:45 INFO - Running post-action listener: _resource_record_post_action 20:13:45 INFO - ##### 20:13:45 INFO - ##### Finished populate-webroot step (success) 20:13:45 INFO - ##### 20:13:45 INFO - ##### 20:13:45 INFO - ##### Running create-virtualenv step. 20:13:45 INFO - ##### 20:13:45 INFO - Running pre-action listener: _resource_record_pre_action 20:13:45 INFO - Running main action method: create_virtualenv 20:13:45 INFO - Creating virtualenv /builds/slave/test/build/venv 20:13:45 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:13:45 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 20:13:45 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 20:13:45 INFO - Using real prefix '/usr' 20:13:45 INFO - New python executable in /builds/slave/test/build/venv/bin/python 20:13:46 INFO - Installing distribute.............................................................................................................................................................................................done. 20:13:48 INFO - Installing pip.................done. 20:13:48 INFO - Return code: 0 20:13:48 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 20:13:48 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:13:48 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 20:13:48 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:13:48 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:13:48 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 20:13:48 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:13:48 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 0x7f9a2829df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x20948a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x215f350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21ee1c0>, '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 0x21ef0c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x21ef550>, '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': '232498196343f89f466a4a9a000001c8-1465268964.299842-1328781238', '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:13:48 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:13:48 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:13:48 INFO - Using env: {'DISPLAY': ':0', 20:13:48 INFO - 'HOME': '/home/cltbld', 20:13:48 INFO - 'LANG': 'en_US.UTF-8', 20:13:48 INFO - 'LANGUAGE': 'en_US:en', 20:13:48 INFO - 'LOGNAME': 'cltbld', 20:13:48 INFO - 'MAIL': '/var/mail/cltbld', 20:13:48 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 20:13:48 INFO - 'MOZ_NO_REMOTE': '1', 20:13:48 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 20:13:48 INFO - 'NO_EM_RESTART': '1', 20:13:48 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 20:13:48 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 20:13:48 INFO - 'PWD': '/builds/slave/test', 20:13:48 INFO - 'SHELL': '/bin/bash', 20:13:48 INFO - 'SHLVL': '1', 20:13:48 INFO - 'TERM': 'linux', 20:13:48 INFO - 'TMOUT': '86400', 20:13:48 INFO - 'USER': 'cltbld', 20:13:48 INFO - 'XDG_SESSION_COOKIE': '232498196343f89f466a4a9a000001c8-1465268964.299842-1328781238', 20:13:48 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 20:13:48 INFO - '_': '/tools/buildbot/bin/python'} 20:13:48 INFO - Ignoring indexes: https://pypi.python.org/simple/ 20:13:48 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:13:48 INFO - Cleaning up... 20:13:48 INFO - Return code: 0 20:13:48 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 20:13:48 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:13:48 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 20:13:48 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:13:48 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:13:48 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 20:13:48 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:13:48 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f9a2829df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x20948a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x215f350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21ee1c0>, '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 0x21ef0c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x21ef550>, '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': '232498196343f89f466a4a9a000001c8-1465268964.299842-1328781238', '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:13:48 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1'] in /builds/slave/test/build 20:13:48 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 20:13:48 INFO - Using env: {'DISPLAY': ':0', 20:13:48 INFO - 'HOME': '/home/cltbld', 20:13:48 INFO - 'LANG': 'en_US.UTF-8', 20:13:48 INFO - 'LANGUAGE': 'en_US:en', 20:13:48 INFO - 'LOGNAME': 'cltbld', 20:13:48 INFO - 'MAIL': '/var/mail/cltbld', 20:13:48 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 20:13:48 INFO - 'MOZ_NO_REMOTE': '1', 20:13:48 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 20:13:48 INFO - 'NO_EM_RESTART': '1', 20:13:48 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 20:13:48 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 20:13:48 INFO - 'PWD': '/builds/slave/test', 20:13:48 INFO - 'SHELL': '/bin/bash', 20:13:48 INFO - 'SHLVL': '1', 20:13:48 INFO - 'TERM': 'linux', 20:13:48 INFO - 'TMOUT': '86400', 20:13:48 INFO - 'USER': 'cltbld', 20:13:48 INFO - 'XDG_SESSION_COOKIE': '232498196343f89f466a4a9a000001c8-1465268964.299842-1328781238', 20:13:48 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 20:13:48 INFO - '_': '/tools/buildbot/bin/python'} 20:13:48 INFO - Ignoring indexes: https://pypi.python.org/simple/ 20:13:48 INFO - Downloading/unpacking psutil>=3.1.1 20:13:48 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:13:48 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:13:48 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:13:48 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:13:48 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:13:48 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:13:50 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 20:13:50 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 20:13:50 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 20:13:50 INFO - Installing collected packages: psutil 20:13:50 INFO - Running setup.py install for psutil 20:13:50 INFO - building 'psutil._psutil_linux' extension 20:13:50 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:13:50 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:13:51 INFO - building 'psutil._psutil_posix' extension 20:13:51 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:13:51 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:13:51 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 20:13:51 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 20:13:51 INFO - Successfully installed psutil 20:13:51 INFO - Cleaning up... 20:13:51 INFO - Return code: 0 20:13:51 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 20:13:51 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:13:51 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 20:13:51 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:13:51 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:13:51 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 20:13:51 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:13:51 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f9a2829df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x20948a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x215f350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21ee1c0>, '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 0x21ef0c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x21ef550>, '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': '232498196343f89f466a4a9a000001c8-1465268964.299842-1328781238', '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:13:51 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3'] in /builds/slave/test/build 20:13:51 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.3 20:13:51 INFO - Using env: {'DISPLAY': ':0', 20:13:51 INFO - 'HOME': '/home/cltbld', 20:13:51 INFO - 'LANG': 'en_US.UTF-8', 20:13:51 INFO - 'LANGUAGE': 'en_US:en', 20:13:51 INFO - 'LOGNAME': 'cltbld', 20:13:51 INFO - 'MAIL': '/var/mail/cltbld', 20:13:51 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 20:13:51 INFO - 'MOZ_NO_REMOTE': '1', 20:13:51 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 20:13:51 INFO - 'NO_EM_RESTART': '1', 20:13:51 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 20:13:51 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 20:13:51 INFO - 'PWD': '/builds/slave/test', 20:13:51 INFO - 'SHELL': '/bin/bash', 20:13:51 INFO - 'SHLVL': '1', 20:13:51 INFO - 'TERM': 'linux', 20:13:51 INFO - 'TMOUT': '86400', 20:13:51 INFO - 'USER': 'cltbld', 20:13:51 INFO - 'XDG_SESSION_COOKIE': '232498196343f89f466a4a9a000001c8-1465268964.299842-1328781238', 20:13:51 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 20:13:51 INFO - '_': '/tools/buildbot/bin/python'} 20:13:51 INFO - Ignoring indexes: https://pypi.python.org/simple/ 20:13:51 INFO - Downloading/unpacking mozsystemmonitor==0.3 20:13:51 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 20:13:51 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 20:13:51 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 20:13:51 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 20:13:51 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 20:13:51 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 20:13:53 INFO - Downloading mozsystemmonitor-0.3.tar.gz 20:13:53 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 20:13:53 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 20:13:53 INFO - Installing collected packages: mozsystemmonitor 20:13:53 INFO - Running setup.py install for mozsystemmonitor 20:13:53 INFO - Successfully installed mozsystemmonitor 20:13:53 INFO - Cleaning up... 20:13:53 INFO - Return code: 0 20:13:53 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 20:13:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 20:13:53 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 20:13:53 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:13:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 20:13:53 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 20:13:53 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:13:53 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f9a2829df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x20948a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x215f350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21ee1c0>, '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 0x21ef0c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x21ef550>, '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': '232498196343f89f466a4a9a000001c8-1465268964.299842-1328781238', '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:13:53 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1'] in /builds/slave/test/build 20:13:53 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema==2.5.1 20:13:53 INFO - Using env: {'DISPLAY': ':0', 20:13:53 INFO - 'HOME': '/home/cltbld', 20:13:53 INFO - 'LANG': 'en_US.UTF-8', 20:13:53 INFO - 'LANGUAGE': 'en_US:en', 20:13:53 INFO - 'LOGNAME': 'cltbld', 20:13:53 INFO - 'MAIL': '/var/mail/cltbld', 20:13:53 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 20:13:53 INFO - 'MOZ_NO_REMOTE': '1', 20:13:53 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 20:13:53 INFO - 'NO_EM_RESTART': '1', 20:13:53 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 20:13:53 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 20:13:53 INFO - 'PWD': '/builds/slave/test', 20:13:53 INFO - 'SHELL': '/bin/bash', 20:13:53 INFO - 'SHLVL': '1', 20:13:53 INFO - 'TERM': 'linux', 20:13:53 INFO - 'TMOUT': '86400', 20:13:53 INFO - 'USER': 'cltbld', 20:13:53 INFO - 'XDG_SESSION_COOKIE': '232498196343f89f466a4a9a000001c8-1465268964.299842-1328781238', 20:13:53 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 20:13:53 INFO - '_': '/tools/buildbot/bin/python'} 20:13:53 INFO - Ignoring indexes: https://pypi.python.org/simple/ 20:13:53 INFO - Downloading/unpacking jsonschema==2.5.1 20:13:53 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 20:13:53 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 20:13:53 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 20:13:53 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 20:13:53 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 20:13:53 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 20:13:55 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 20:13:55 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 20:13:55 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 20:13:55 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 20:13:55 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 20:13:55 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 20:13:55 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 20:13:55 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 20:13:55 INFO - Downloading functools32-3.2.3-2.tar.gz 20:13:55 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 20:13:55 INFO - warning: no files found matching '*.txt' 20:13:55 INFO - no previously-included directories found matching 'build' 20:13:55 INFO - no previously-included directories found matching 'dist' 20:13:55 INFO - no previously-included directories found matching '.git*' 20:13:55 INFO - Installing collected packages: jsonschema, functools32 20:13:56 INFO - Running setup.py install for functools32 20:13:56 INFO - warning: no files found matching '*.txt' 20:13:56 INFO - no previously-included directories found matching 'build' 20:13:56 INFO - no previously-included directories found matching 'dist' 20:13:56 INFO - no previously-included directories found matching '.git*' 20:13:56 INFO - Successfully installed jsonschema functools32 20:13:56 INFO - Cleaning up... 20:13:56 INFO - Return code: 0 20:13:56 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 20:13:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 20:13:56 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 20:13:56 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:13:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 20:13:56 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 20:13:56 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:13:56 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x7f9a2829df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x20948a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x215f350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21ee1c0>, '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 0x21ef0c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x21ef550>, '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': '232498196343f89f466a4a9a000001c8-1465268964.299842-1328781238', '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:13:56 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 20:13:56 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 20:13:56 INFO - Using env: {'DISPLAY': ':0', 20:13:56 INFO - 'HOME': '/home/cltbld', 20:13:56 INFO - 'LANG': 'en_US.UTF-8', 20:13:56 INFO - 'LANGUAGE': 'en_US:en', 20:13:56 INFO - 'LOGNAME': 'cltbld', 20:13:56 INFO - 'MAIL': '/var/mail/cltbld', 20:13:56 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 20:13:56 INFO - 'MOZ_NO_REMOTE': '1', 20:13:56 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 20:13:56 INFO - 'NO_EM_RESTART': '1', 20:13:56 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 20:13:56 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 20:13:56 INFO - 'PWD': '/builds/slave/test', 20:13:56 INFO - 'SHELL': '/bin/bash', 20:13:56 INFO - 'SHLVL': '1', 20:13:56 INFO - 'TERM': 'linux', 20:13:56 INFO - 'TMOUT': '86400', 20:13:56 INFO - 'USER': 'cltbld', 20:13:56 INFO - 'XDG_SESSION_COOKIE': '232498196343f89f466a4a9a000001c8-1465268964.299842-1328781238', 20:13:56 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 20:13:56 INFO - '_': '/tools/buildbot/bin/python'} 20:13:56 INFO - Ignoring indexes: https://pypi.python.org/simple/ 20:13:56 INFO - Downloading/unpacking blobuploader==1.2.4 20:13:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 20:13:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 20:13:56 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 20:13:56 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 20:13:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 20:13:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 20:13:58 INFO - Downloading blobuploader-1.2.4.tar.gz 20:13:58 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 20:13:58 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 20:13:58 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 20:13:58 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 20:13:58 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 20:13:58 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 20:13:58 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 20:13:58 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 20:13:58 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 20:13:58 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 20:13:58 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 20:13:58 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 20:13:58 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 20:13:58 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 20:13:58 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 20:13:58 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 20:13:59 INFO - Downloading docopt-0.6.1.tar.gz 20:13:59 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 20:13:59 INFO - Installing collected packages: blobuploader, requests, docopt 20:13:59 INFO - Running setup.py install for blobuploader 20:13:59 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 20:13:59 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 20:13:59 INFO - Running setup.py install for requests 20:13:59 INFO - Running setup.py install for docopt 20:13:59 INFO - Successfully installed blobuploader requests docopt 20:13:59 INFO - Cleaning up... 20:13:59 INFO - Return code: 0 20:13:59 INFO - Installing None into virtualenv /builds/slave/test/build/venv 20:13:59 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 20:13:59 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 20:13:59 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:13:59 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 20:13:59 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 20:13:59 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:13:59 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 0x7f9a2829df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x20948a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x215f350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21ee1c0>, '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 0x21ef0c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x21ef550>, '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': '232498196343f89f466a4a9a000001c8-1465268964.299842-1328781238', '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:13:59 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:13:59 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:13:59 INFO - Using env: {'DISPLAY': ':0', 20:13:59 INFO - 'HOME': '/home/cltbld', 20:13:59 INFO - 'LANG': 'en_US.UTF-8', 20:13:59 INFO - 'LANGUAGE': 'en_US:en', 20:13:59 INFO - 'LOGNAME': 'cltbld', 20:13:59 INFO - 'MAIL': '/var/mail/cltbld', 20:13:59 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 20:13:59 INFO - 'MOZ_NO_REMOTE': '1', 20:13:59 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 20:13:59 INFO - 'NO_EM_RESTART': '1', 20:13:59 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 20:13:59 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 20:13:59 INFO - 'PWD': '/builds/slave/test', 20:13:59 INFO - 'SHELL': '/bin/bash', 20:13:59 INFO - 'SHLVL': '1', 20:13:59 INFO - 'TERM': 'linux', 20:13:59 INFO - 'TMOUT': '86400', 20:13:59 INFO - 'USER': 'cltbld', 20:13:59 INFO - 'XDG_SESSION_COOKIE': '232498196343f89f466a4a9a000001c8-1465268964.299842-1328781238', 20:13:59 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 20:13:59 INFO - '_': '/tools/buildbot/bin/python'} 20:13:59 INFO - Ignoring indexes: https://pypi.python.org/simple/ 20:13:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 20:13:59 INFO - Running setup.py (path:/tmp/pip-lvG0Kb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 20:13:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 20:13:59 INFO - Running setup.py (path:/tmp/pip-9j_Guc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 20:14:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 20:14:00 INFO - Running setup.py (path:/tmp/pip-0FZlDY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 20:14:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 20:14:00 INFO - Running setup.py (path:/tmp/pip-9NjW5O-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 20:14:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 20:14:00 INFO - Running setup.py (path:/tmp/pip-KsOdIw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 20:14:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 20:14:00 INFO - Running setup.py (path:/tmp/pip-58C58a-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 20:14:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 20:14:00 INFO - Running setup.py (path:/tmp/pip-NiVuj6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 20:14:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 20:14:00 INFO - Running setup.py (path:/tmp/pip-aCGffE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 20:14:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 20:14:00 INFO - Running setup.py (path:/tmp/pip-aokceT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 20:14:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 20:14:00 INFO - Running setup.py (path:/tmp/pip-b2w2AN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 20:14:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 20:14:00 INFO - Running setup.py (path:/tmp/pip-mueAss-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 20:14:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 20:14:00 INFO - Running setup.py (path:/tmp/pip-4ADVYj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 20:14:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 20:14:00 INFO - Running setup.py (path:/tmp/pip-J5kRtQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 20:14:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 20:14:00 INFO - Running setup.py (path:/tmp/pip-R0ll9i-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 20:14:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 20:14:00 INFO - Running setup.py (path:/tmp/pip-kHYFE5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 20:14:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 20:14:01 INFO - Running setup.py (path:/tmp/pip-FS1r4g-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 20:14:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 20:14:01 INFO - Running setup.py (path:/tmp/pip-DGt0a0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 20:14:01 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 20:14:01 INFO - Running setup.py install for manifestparser 20:14:01 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 20:14:01 INFO - Running setup.py install for mozcrash 20:14:01 INFO - Running setup.py install for mozdebug 20:14:01 INFO - Running setup.py install for mozdevice 20:14:01 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 20:14:01 INFO - Installing dm script to /builds/slave/test/build/venv/bin 20:14:01 INFO - Running setup.py install for mozfile 20:14:01 INFO - Running setup.py install for mozhttpd 20:14:01 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 20:14:01 INFO - Running setup.py install for mozinfo 20:14:01 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 20:14:01 INFO - Running setup.py install for mozInstall 20:14:01 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 20:14:01 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 20:14:01 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 20:14:01 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 20:14:01 INFO - Running setup.py install for mozleak 20:14:02 INFO - Running setup.py install for mozlog 20:14:02 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 20:14:02 INFO - Running setup.py install for moznetwork 20:14:02 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 20:14:02 INFO - Running setup.py install for mozprocess 20:14:02 INFO - Running setup.py install for mozprofile 20:14:02 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 20:14:02 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 20:14:02 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 20:14:02 INFO - Running setup.py install for mozrunner 20:14:02 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 20:14:02 INFO - Running setup.py install for mozscreenshot 20:14:02 INFO - Running setup.py install for moztest 20:14:02 INFO - Running setup.py install for mozversion 20:14:02 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 20:14:02 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 20:14:02 INFO - Cleaning up... 20:14:02 INFO - Return code: 0 20:14:02 INFO - Installing None into virtualenv /builds/slave/test/build/venv 20:14:02 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:02 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 20:14:02 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:14:02 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:02 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 20:14:02 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:14:02 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 0x7f9a2829df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x20948a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x215f350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21ee1c0>, '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 0x21ef0c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x21ef550>, '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': '232498196343f89f466a4a9a000001c8-1465268964.299842-1328781238', '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:14:02 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:14:02 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:14:02 INFO - Using env: {'DISPLAY': ':0', 20:14:02 INFO - 'HOME': '/home/cltbld', 20:14:02 INFO - 'LANG': 'en_US.UTF-8', 20:14:02 INFO - 'LANGUAGE': 'en_US:en', 20:14:02 INFO - 'LOGNAME': 'cltbld', 20:14:02 INFO - 'MAIL': '/var/mail/cltbld', 20:14:02 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 20:14:02 INFO - 'MOZ_NO_REMOTE': '1', 20:14:02 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 20:14:02 INFO - 'NO_EM_RESTART': '1', 20:14:02 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 20:14:02 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 20:14:02 INFO - 'PWD': '/builds/slave/test', 20:14:02 INFO - 'SHELL': '/bin/bash', 20:14:02 INFO - 'SHLVL': '1', 20:14:02 INFO - 'TERM': 'linux', 20:14:02 INFO - 'TMOUT': '86400', 20:14:02 INFO - 'USER': 'cltbld', 20:14:02 INFO - 'XDG_SESSION_COOKIE': '232498196343f89f466a4a9a000001c8-1465268964.299842-1328781238', 20:14:02 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 20:14:02 INFO - '_': '/tools/buildbot/bin/python'} 20:14:03 INFO - Ignoring indexes: https://pypi.python.org/simple/ 20:14:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 20:14:03 INFO - Running setup.py (path:/tmp/pip-uYVD17-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 20:14:03 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:14:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 20:14:03 INFO - Running setup.py (path:/tmp/pip-rfUnXC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 20:14:03 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:14:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 20:14:03 INFO - Running setup.py (path:/tmp/pip-Er9h6q-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 20:14:03 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:14:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 20:14:03 INFO - Running setup.py (path:/tmp/pip-g5N_fI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 20:14:03 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:14:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 20:14:03 INFO - Running setup.py (path:/tmp/pip-Gqpgx7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 20:14:03 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:14:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 20:14:03 INFO - Running setup.py (path:/tmp/pip-kIhWLz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 20:14:03 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:14:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 20:14:03 INFO - Running setup.py (path:/tmp/pip-fv49CC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 20:14:03 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:14:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 20:14:03 INFO - Running setup.py (path:/tmp/pip-ZBFURd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 20:14:03 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:14:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 20:14:03 INFO - Running setup.py (path:/tmp/pip-2mSVgc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 20:14:03 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:14:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 20:14:03 INFO - Running setup.py (path:/tmp/pip-dtV6gv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 20:14:03 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.2 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 20:14:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 20:14:03 INFO - Running setup.py (path:/tmp/pip-2iNbg5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 20:14:03 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:14:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 20:14:03 INFO - Running setup.py (path:/tmp/pip-MNE1fb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 20:14:04 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:14:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 20:14:04 INFO - Running setup.py (path:/tmp/pip-m08D4M-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 20:14:04 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:14:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 20:14:04 INFO - Running setup.py (path:/tmp/pip-9mTcqg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 20:14:04 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:14:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 20:14:04 INFO - Running setup.py (path:/tmp/pip-jm8eLP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 20:14:04 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:14:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 20:14:04 INFO - Running setup.py (path:/tmp/pip-iSSQEs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 20:14:04 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:14:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 20:14:04 INFO - Running setup.py (path:/tmp/pip-reKgzk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 20:14:04 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:14:04 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:14:04 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:14:04 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:14:04 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:14:04 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:14:04 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.2->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 20:14:04 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 20:14:04 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 20:14:04 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 20:14:04 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 20:14:04 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 20:14:04 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 20:14:06 INFO - Downloading blessings-1.6.tar.gz 20:14:06 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 20:14:06 INFO - Installing collected packages: blessings 20:14:06 INFO - Running setup.py install for blessings 20:14:06 INFO - Successfully installed blessings 20:14:06 INFO - Cleaning up... 20:14:06 INFO - Return code: 0 20:14:06 INFO - Done creating virtualenv /builds/slave/test/build/venv. 20:14:06 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 20:14:06 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 20:14:06 INFO - Reading from file tmpfile_stdout 20:14:06 INFO - Current package versions: 20:14:06 INFO - argparse == 1.2.1 20:14:06 INFO - blessings == 1.6 20:14:06 INFO - blobuploader == 1.2.4 20:14:06 INFO - docopt == 0.6.1 20:14:06 INFO - functools32 == 3.2.3-2 20:14:06 INFO - jsonschema == 2.5.1 20:14:06 INFO - manifestparser == 1.1 20:14:06 INFO - mozInstall == 1.12 20:14:06 INFO - mozcrash == 0.17 20:14:06 INFO - mozdebug == 0.1 20:14:06 INFO - mozdevice == 0.48 20:14:06 INFO - mozfile == 1.2 20:14:06 INFO - mozhttpd == 0.7 20:14:06 INFO - mozinfo == 0.9 20:14:06 INFO - mozleak == 0.1 20:14:06 INFO - mozlog == 3.2 20:14:06 INFO - moznetwork == 0.27 20:14:06 INFO - mozprocess == 0.22 20:14:06 INFO - mozprofile == 0.28 20:14:06 INFO - mozrunner == 6.11 20:14:06 INFO - mozscreenshot == 0.1 20:14:06 INFO - mozsystemmonitor == 0.3 20:14:06 INFO - moztest == 0.7 20:14:06 INFO - mozversion == 1.4 20:14:06 INFO - psutil == 3.1.1 20:14:06 INFO - requests == 1.2.3 20:14:06 INFO - wsgiref == 0.1.2 20:14:06 INFO - Installing None into virtualenv /builds/slave/test/build/venv 20:14: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:14:06 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 20:14:06 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:14: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:14:06 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 20:14:06 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:14:06 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 0x7f9a2829df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x20948a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x215f350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21ee1c0>, '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 0x21ef0c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x21ef550>, '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': '232498196343f89f466a4a9a000001c8-1465268964.299842-1328781238', '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:14:06 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:14:06 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:14:06 INFO - Using env: {'DISPLAY': ':0', 20:14:06 INFO - 'HOME': '/home/cltbld', 20:14:06 INFO - 'LANG': 'en_US.UTF-8', 20:14:06 INFO - 'LANGUAGE': 'en_US:en', 20:14:06 INFO - 'LOGNAME': 'cltbld', 20:14:06 INFO - 'MAIL': '/var/mail/cltbld', 20:14:06 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 20:14:06 INFO - 'MOZ_NO_REMOTE': '1', 20:14:06 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 20:14:06 INFO - 'NO_EM_RESTART': '1', 20:14:06 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 20:14:06 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 20:14:06 INFO - 'PWD': '/builds/slave/test', 20:14:06 INFO - 'SHELL': '/bin/bash', 20:14:06 INFO - 'SHLVL': '1', 20:14:06 INFO - 'TERM': 'linux', 20:14:06 INFO - 'TMOUT': '86400', 20:14:06 INFO - 'USER': 'cltbld', 20:14:06 INFO - 'XDG_SESSION_COOKIE': '232498196343f89f466a4a9a000001c8-1465268964.299842-1328781238', 20:14:06 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 20:14:06 INFO - '_': '/tools/buildbot/bin/python'} 20:14:07 INFO - Ignoring indexes: https://pypi.python.org/simple/ 20:14:07 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:14:07 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:14:07 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:14:07 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:14:07 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:14:07 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:14:07 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:14:07 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:14:07 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:14:07 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:14:07 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:14:07 INFO - Cleaning up... 20:14:07 INFO - Return code: 0 20:14:07 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 20:14:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 20:14:07 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 20:14:07 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:14:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 20:14:07 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 20:14:07 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:14:07 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 0x7f9a2829df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x20948a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x215f350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21ee1c0>, '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 0x21ef0c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x21ef550>, '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': '232498196343f89f466a4a9a000001c8-1465268964.299842-1328781238', '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:14:07 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:14:07 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:14:07 INFO - Using env: {'DISPLAY': ':0', 20:14:07 INFO - 'HOME': '/home/cltbld', 20:14:07 INFO - 'LANG': 'en_US.UTF-8', 20:14:07 INFO - 'LANGUAGE': 'en_US:en', 20:14:07 INFO - 'LOGNAME': 'cltbld', 20:14:07 INFO - 'MAIL': '/var/mail/cltbld', 20:14:07 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 20:14:07 INFO - 'MOZ_NO_REMOTE': '1', 20:14:07 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 20:14:07 INFO - 'NO_EM_RESTART': '1', 20:14:07 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 20:14:07 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 20:14:07 INFO - 'PWD': '/builds/slave/test', 20:14:07 INFO - 'SHELL': '/bin/bash', 20:14:07 INFO - 'SHLVL': '1', 20:14:07 INFO - 'TERM': 'linux', 20:14:07 INFO - 'TMOUT': '86400', 20:14:07 INFO - 'USER': 'cltbld', 20:14:07 INFO - 'XDG_SESSION_COOKIE': '232498196343f89f466a4a9a000001c8-1465268964.299842-1328781238', 20:14:07 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 20:14:07 INFO - '_': '/tools/buildbot/bin/python'} 20:14:07 INFO - Ignoring indexes: https://pypi.python.org/simple/ 20:14:07 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 20:14:07 INFO - Cleaning up... 20:14:07 INFO - Return code: 0 20:14:07 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 20:14:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 20:14:07 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 20:14:07 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:14:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 20:14:07 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 20:14:07 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:14:07 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 0x7f9a2829df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x20948a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x215f350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21ee1c0>, '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 0x21ef0c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x21ef550>, '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': '232498196343f89f466a4a9a000001c8-1465268964.299842-1328781238', '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:14:07 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:14:07 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:14:07 INFO - Using env: {'DISPLAY': ':0', 20:14:07 INFO - 'HOME': '/home/cltbld', 20:14:07 INFO - 'LANG': 'en_US.UTF-8', 20:14:07 INFO - 'LANGUAGE': 'en_US:en', 20:14:07 INFO - 'LOGNAME': 'cltbld', 20:14:07 INFO - 'MAIL': '/var/mail/cltbld', 20:14:07 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 20:14:07 INFO - 'MOZ_NO_REMOTE': '1', 20:14:07 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 20:14:07 INFO - 'NO_EM_RESTART': '1', 20:14:07 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 20:14:07 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 20:14:07 INFO - 'PWD': '/builds/slave/test', 20:14:07 INFO - 'SHELL': '/bin/bash', 20:14:07 INFO - 'SHLVL': '1', 20:14:07 INFO - 'TERM': 'linux', 20:14:07 INFO - 'TMOUT': '86400', 20:14:07 INFO - 'USER': 'cltbld', 20:14:07 INFO - 'XDG_SESSION_COOKIE': '232498196343f89f466a4a9a000001c8-1465268964.299842-1328781238', 20:14:07 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 20:14:07 INFO - '_': '/tools/buildbot/bin/python'} 20:14:07 INFO - Ignoring indexes: https://pypi.python.org/simple/ 20:14:07 INFO - Downloading/unpacking flake8 20:14:07 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 20:14:07 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 20:14:07 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 20:14:07 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 20:14:07 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 20:14:07 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 20:14:09 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 20:14:09 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 20:14: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:14: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:14: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:14: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:14: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:14: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:14:09 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 20:14:09 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 20:14: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:14: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:14: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:14: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:14: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:14: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:14:09 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 20:14: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:14: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:14: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:14: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:14: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:14: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:14:10 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 20:14:10 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 20:14:10 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 20:14:10 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 20:14:10 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 20:14:10 INFO - no previously-included directories found matching 'docs/_build' 20:14:10 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 20:14:10 INFO - Running setup.py install for pep8 20:14:10 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 20:14:10 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 20:14:10 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 20:14:10 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 20:14:10 INFO - no previously-included directories found matching 'docs/_build' 20:14:10 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 20:14:10 INFO - Successfully installed flake8 mccabe pyflakes pep8 20:14:10 INFO - Cleaning up... 20:14:10 INFO - Return code: 0 20:14:10 INFO - Running post-action listener: _resource_record_post_action 20:14:10 INFO - Running post-action listener: _start_resource_monitoring 20:14:10 INFO - Starting resource monitoring. 20:14:10 INFO - ##### 20:14:10 INFO - ##### Finished create-virtualenv step (success) 20:14:10 INFO - ##### 20:14:10 INFO - ##### 20:14:10 INFO - ##### Running install step. 20:14:10 INFO - ##### 20:14:10 INFO - Running pre-action listener: _resource_record_pre_action 20:14:10 INFO - Running main action method: install 20:14:10 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 20:14:10 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 20:14:10 INFO - Reading from file tmpfile_stdout 20:14:10 INFO - Detecting whether we're running mozinstall >=1.0... 20:14:10 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 20:14:10 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 20:14:10 INFO - Reading from file tmpfile_stdout 20:14:10 INFO - Output received: 20:14:10 INFO - Usage: mozinstall [options] installer 20:14:10 INFO - Options: 20:14:10 INFO - -h, --help show this help message and exit 20:14:10 INFO - -d DEST, --destination=DEST 20:14:10 INFO - Directory to install application into. [default: 20:14:10 INFO - "/builds/slave/test"] 20:14:10 INFO - --app=APP Application being installed. [default: firefox] 20:14:10 INFO - mkdir: /builds/slave/test/build/application 20:14:10 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 20:14:10 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 20:14:27 INFO - Reading from file tmpfile_stdout 20:14:27 INFO - Output received: 20:14:27 INFO - /builds/slave/test/build/application/firefox/firefox 20:14:27 INFO - Running post-action listener: _resource_record_post_action 20:14:27 INFO - ##### 20:14:27 INFO - ##### Finished install step (success) 20:14:27 INFO - ##### 20:14:27 INFO - ##### 20:14:27 INFO - ##### Running run-tests step. 20:14:27 INFO - ##### 20:14:27 INFO - Running pre-action listener: _resource_record_pre_action 20:14:27 INFO - Running main action method: run_tests 20:14:27 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 20:14:27 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 20:14:27 INFO - Python 2.7.3 20:14:27 INFO - Return code: 0 20:14:27 INFO - grabbing minidump binary from tooltool 20:14:27 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:27 INFO - retry: Calling run_command with args: (['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'],), kwargs: {'output_timeout': 600, 'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21ee1c0>, '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 0x21ef0c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x21ef550>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 20:14:27 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:14:27 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:14:27 INFO - Calling ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] with output_timeout 600 20:14:27 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 20:14:27 INFO - Return code: 0 20:14:27 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 20:14:27 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 20:14:27 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 20:14:27 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 20:14:27 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 20:14:27 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 20:14:27 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 20:14:28 INFO - Return code: 0 20:14:28 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/a8tDyd1PQrqA0w1kRzaQvw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-025', '--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:14:28 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/a8tDyd1PQrqA0w1kRzaQvw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-025 --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:14:28 INFO - Using env: {'DISPLAY': ':0', 20:14:28 INFO - 'HOME': '/home/cltbld', 20:14:28 INFO - 'LANG': 'en_US.UTF-8', 20:14:28 INFO - 'LANGUAGE': 'en_US:en', 20:14:28 INFO - 'LOGNAME': 'cltbld', 20:14:28 INFO - 'MAIL': '/var/mail/cltbld', 20:14:28 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 20:14:28 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 20:14:28 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 20:14:28 INFO - 'MOZ_NO_REMOTE': '1', 20:14:28 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 20:14:28 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 20:14:28 INFO - 'NO_EM_RESTART': '1', 20:14:28 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 20:14:28 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 20:14:28 INFO - 'PWD': '/builds/slave/test', 20:14:28 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 20:14:28 INFO - 'SHELL': '/bin/bash', 20:14:28 INFO - 'SHLVL': '1', 20:14:28 INFO - 'TERM': 'linux', 20:14:28 INFO - 'TMOUT': '86400', 20:14:28 INFO - 'USER': 'cltbld', 20:14:28 INFO - 'XDG_SESSION_COOKIE': '232498196343f89f466a4a9a000001c8-1465268964.299842-1328781238', 20:14:28 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 20:14:28 INFO - '_': '/tools/buildbot/bin/python'} 20:14:28 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/a8tDyd1PQrqA0w1kRzaQvw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-025', '--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:14:28 INFO - mozversion application_buildid: 20160606173007 20:14:28 INFO - mozversion application_changeset: d9f0b4e9a8add9e0931e1c549ccba22f7dbc67d3 20:14:28 INFO - mozversion application_display_name: Nightly 20:14:28 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 20:14:28 INFO - mozversion application_name: Firefox 20:14:28 INFO - mozversion application_remotingname: firefox 20:14:28 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 20:14:28 INFO - mozversion application_vendor: Mozilla 20:14:28 INFO - mozversion application_version: 50.0a1 20:14:28 INFO - mozversion platform_buildid: 20160606173007 20:14:28 INFO - mozversion platform_changeset: d9f0b4e9a8add9e0931e1c549ccba22f7dbc67d3 20:14:28 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 20:14:28 INFO - mozversion platform_version: 50.0a1 20:14:28 INFO - using testdate: 1465269268 20:14:28 INFO - actual date: 1465269268 20:14:28 INFO - starting webserver on 'localhost:52528' 20:14:28 INFO - SUITE-START | Running 2 tests 20:14:28 INFO - TEST-START | dromaeo_css 20:14:28 INFO - operating with platform_type : linux_ 20:14:28 INFO - Initialising browser for dromaeo_css test... 20:14:28 INFO - TEST-INFO | started process 30922 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpPrqxUk/profile http://localhost:52528/getInfo.html) 20:14:33 INFO - PROCESS | 30922 | __metrics Screen width/height:1600/1200 20:14:33 INFO - PROCESS | 30922 | colorDepth:24 20:14:33 INFO - PROCESS | 30922 | Browser inner width/height: 1024/697 20:14:33 INFO - PROCESS | 30922 | __metrics 20:14:34 ERROR - PROCESS | 30922 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2944: TypeError: this.tabs is undefined 20:14:34 INFO - TEST-INFO | 30922: exit 0 20:14:34 INFO - Browser initialized. 20:14:34 INFO - Running cycle 1/1 for dromaeo_css test... 20:14:34 INFO - TEST-INFO | started process 31043 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpPrqxUk/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 20:14:46 INFO - PROCESS | 31043 | RSS: Main: 167493632 20:14:46 INFO - PROCESS | 31043 | 20:15:36 INFO - PROCESS | 31043 | 1465269336359 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:17:43 INFO - PROCESS | 31043 | Cycle 1(1): loaded http://localhost:52528/tests/dromaeo/cssquery-dojo.html (next: http://localhost:52528/tests/dromaeo/cssquery-ext.html) 20:17:44 INFO - PROCESS | 31043 | RSS: Main: 170074112 20:17:44 INFO - PROCESS | 31043 | 20:20:46 INFO - PROCESS | 31043 | Cycle 1(1): loaded http://localhost:52528/tests/dromaeo/cssquery-ext.html (next: http://localhost:52528/tests/dromaeo/cssquery-jquery.html) 20:20:47 INFO - PROCESS | 31043 | RSS: Main: 169062400 20:20:47 INFO - PROCESS | 31043 | 20:23:49 INFO - PROCESS | 31043 | Cycle 1(1): loaded http://localhost:52528/tests/dromaeo/cssquery-jquery.html (next: http://localhost:52528/tests/dromaeo/cssquery-mootools.html) 20:23:50 INFO - PROCESS | 31043 | RSS: Main: 170967040 20:23:50 INFO - PROCESS | 31043 | 20:26:51 INFO - PROCESS | 31043 | Cycle 1(1): loaded http://localhost:52528/tests/dromaeo/cssquery-mootools.html (next: http://localhost:52528/tests/dromaeo/cssquery-prototype.html) 20:26:52 INFO - PROCESS | 31043 | RSS: Main: 168144896 20:26:52 INFO - PROCESS | 31043 | 20:29:54 INFO - PROCESS | 31043 | Cycle 1(1): loaded http://localhost:52528/tests/dromaeo/cssquery-prototype.html (next: http://localhost:52528/tests/dromaeo/cssquery-yui.html) 20:29:55 INFO - PROCESS | 31043 | RSS: Main: 169791488 20:29:55 INFO - PROCESS | 31043 | 20:32:58 INFO - PROCESS | 31043 | Cycle 1(1): loaded http://localhost:52528/tests/dromaeo/cssquery-yui.html (next: http://localhost:52528/tests/dromaeo/cssquery-dojo.html) 20:32:58 INFO - PROCESS | 31043 | RSS: Main: 172417024 20:32:58 INFO - PROCESS | 31043 | 20:32:58 INFO - PROCESS | 31043 | __start_tp_report 20:32:58 INFO - PROCESS | 31043 | _x_x_mozilla_page_load 20:32:58 INFO - PROCESS | 31043 | _x_x_mozilla_page_load_details 20:32:58 INFO - PROCESS | 31043 | |i|pagename|runs| 20:32:58 INFO - PROCESS | 31043 | |0;dojo.html;3133.858976346065;3161.9367612647734;3183.1405520509447;3189.856456459459;3206.2625596112894;5514.5864060195445;5541.750621222044;5586.497215250627;5672.06410942194;5701.116326969316;5408.702521361323;5588.245586845775;5626.381098079208;5628.268325117729;5633.746481408336;5040.4959504049575;5074.797008119671;5173.1722924331925;5221.530062294392;5224.164133738603;858.4678539649984;5098.023699776457;5137.255098010786;5177.611679124081;5236.2931004314505;5004.924926126093;5020.874478138057;5035.496450354972;5046.924296135561;5050.242463630448;5032.597392208614;5032.949670503284;5052.317937078484;5059.16523773577;5074.238864170367;5066.873328166788;5134.5378915897745;5134.589232861362;5134.794608215667;5181.35233095863;5563.610547261694;5566.443355664442;5603.551715862721;5612.438756124396;5625.8593535161535;5895.852603684899;5935.0503919372695;5938.406159384071;6079.39206079393;6110.572259941806;6032.366601506867;6072.028475443908;6080.209572755558;6081.513478921675;6093.847653808646;5595.972020139914;5639.15412688096;5639.2668953036255;5664.405237450091;5670.4896559309445;6204.568023833168;6257.405546473078;6268.871603111484;6272.153259309935;6278.717457714414;5923.555733320019;5929.970350148308;5991.833397316744;6007.939920600826;6066.817995460143;5879.3826648202175;5970.910436343458;6029.155918171459;6036.939630603638;6103.35914728956;6053.364396738279;6054.545909056838;6057.182280392179;6057.545684073712;6079.665618391031;5898.970505147447;5945.137954996501;5989;5990.011648078018;6065.181200537959;4496.808345788369;4517.119161763425;4538.88652783683;4540.091981603692;4560.749158796231;4004.0590461241586;4010.0977280111742;4029.5567487576345;4037.1118353962083;4087.305158123126;5650.943490565124;5673.8014169504695;5712.314522257273;5722.62802917809;5855.765769369263;6055.636661800306;6116.877662446726;6118;6123.4795042421;6128.233970753656;5783.537317014629;5804;5806.4193580641595;5808.6224395414165;5808.82573522795;5042.697438153723;5145.536901678867;5163.561097306771;5199.272101905736;5218.556422704112;6255.906161407492;6257.655828929453;6258.186435763321;6265.4361107500545;6267.4045965633195;5946.524278057658;6092.238470191226;6106.1146133811235;6112.908306375319;6125.754969801158;6131.590761709946;6134.773364742421;6217;6293.181886354744;6319.778807741707;5975.521958243243;5982.641041537521;6031.939680603138;6033.507354546669;6047.153398524122;5975.223220981245;6010.54920880927;6126.6017708848785;6140.201773769381;6141.631502109888;5881.911771323519;5891.823245302648;5906.084556893688;5922.55580831448;5994.730237139252;5837.94162058374;5848.093545500455;5864.179014937998;5865.413458654271;5884.382139875252;5704.3154821421695;5735.053716136791;5766.452187042224;5773.480386765212;5779.422057794187;5803.7968671096305;5868.67722275279;5889.057750759858;5908.763649453974;5986.820395388146;5793.362730099601;5821.82534523948;5827.650340979555;5831.679257640871;5841.357450680507 20:32:58 INFO - PROCESS | 31043 | |1;ext.html;585.8798946216026;622.0731110645139;632.5919781740778;633.2907143998722;645.5610185074149;43781.78109109454;44853.7757311213;44994.55005449944;45047;48914.75542622291;47182.29226561596;47780.522194778045;47877.76061119698;47905;47942.76028619861;8855.734327970154;9047.230985366252;9062.275017998578;9062.818743625123;9088.227500662451;8957.731268061969;9003.594838232295;9044.3668943174;9059.95470022649;9066.592003359865;9053.592588333508;9109.954450227773;9113.407628504126;9118.361714679975;9150.725478235663;8966.68616598416;8997.280217582611;9007.459552426875;9014.86477702835;9058.411203271766;8883;8967.237784788236;8994.235489983359;9032.412893161923;9033.683821066297;43063.78468107671;43618.127637447076;43824.12351752979;43942.56057439448;44038.55961440376;3708.962910370889;3820.44603532489;3958.34687276599;4190.853320133811;4425.336199570058;33272.83363583191;33601.83199083989;33687.157821054425;33962;33971.6602833971;4220.3036498977635;4357.36818161368;4450.043240703264;4545.909081818345;4566.862994110182;257470;257775;258023;258190;258479;60922.695386522784;61393.69303153456;61865.45336366627;62050.379496205365;62079.689601551705;65489.67255163693;65726;66106;66158.33841661618;66315.33684663188;15222;15851.445199417965;15874.603134921488;16244.593885152966;16312;11804.11469139818;11847.052235821113;11942.104342174373;11984.041276697842;12000.099992500598;20118;20264.696029559567;20328.865469125823;20392.490187745425;20479.28322508705;7208.927910720826;7417.8145546361775;7621.847563048708;7668.194839541768;7692.730754423568;927.5686805635412;1064.3081996702206;1070.6145787516489;1096.4627332607124;1181.8168183931505;33161.17097072592;33303.83348083244;33545.83227083849;33847.32305353879;34482.48276275858;1116.0680831505783;1143.7140714821294;1190.6309044196328;1229.3238718704856;1229.84012078431;17155.828441715425;17507.47477575675;17675.646487070186;17756.822431775516;17769.7334539982;566182;566375;567186;568302;569728;60336.69831650814;60970;61284.08073878895;61763.82361763788;61906.071408928;1300.3888172558882;1375.5116933488468;1396.832380114393;1399.6920677450944;1417.2984372735357;32051;33086.338273234884;33165;33348.499772502946;33893.66106338905;53464.46535534595;53574.196387055;54008;54321.72839135779;54445;355595;356680;357273;357544;358136;28537.28656783597;28984.855075724485;29464;29476;29530.409391812474;49933;50647;50893.49106508888;51674.74162629163;51930.221046683575;42362;42945.570544294154;43212.35181472218;43316.56683433125;43616.12767744691;42802.69715625936;42809.5719042818;43117.784411077744;43144.35283470813;43243;37276.6272337284;41689.58310416978;41857;42672;42914;35560.288794224485;38317.42523862088;38355.424668629435;38799.41800872933;38844.80577597094;28969.56545651859;28974.420511590073;29238.70761292445;29436.264093397836;29446.558301625064 20:32:58 INFO - PROCESS | 31043 | |2;jquery.html;394.4280792850366;394.57780175212537;397.3185986033951;403.3828242788533;415.8752374287713;14772.261386930664;18052.638947221047;18837.152328145232;19479.220831166753;19529.902350488264;17871.10644467778;18082.5479363016;18127.093645317713;18596;18631.627367452642;5577.721113944317;5589.161625756128;5701.714914254291;5778.306603207621;5780.132980052984;5616.775328986856;5630.127330263796;5682.971585142069;5694.971525142369;5719.19931209631;5661.8584535386535;6779.593224406552;7136.14366276045;7149.320814522638;7149.356557909787;6654.168228971379;7021.438284937244;7101;7103.928960710378;7116.110486189226;6784.3894049535775;6789.015592739074;6827;6855.5543889647015;7180.066591343092;23849.642255366183;24260.636090458658;24454.510909781882;25328.366790830376;25686;2354.9882250588807;2366.6095094309417;2415.7825795678473;2597.4805038992276;2925.648922129358;14598;15328.616784580474;15595.688086238211;15865.762013569805;16687.83312166875;1910.169076451734;1945.0177660281468;2027.6654352031896;2093.958120837575;2109.820665243456;92673;94655.99999999932;96828;97049;98978.50510747472;17540.82459175392;17573.384931527336;17883;17909.910450447664;18180.090995450173;12225.938870305592;13056.151350162208;31613.36773264522;31935.84032079825;32131.35737285288;7397.8150546236775;7465.664045117983;7478.887816682754;7540.132884718218;7732.381409487228;7519.210482899326;7519.360854327443;7529.774106776806;7642.923570764221;7677.886706427536;4060.3503439449546;4094.9385759213637;4161.167766446722;4180.874573762731;4208.452901122896;1975.8024197580128;2014.7985201480028;2068.069368784023;2071.181883156175;2072.730545029167;935.7660584853786;982.9803403931882;993.7515621094726;1070.593174593665;1077.4128100185262;17408.65182696339;17658.205380757896;18700.503959683192;19953.301634442723;20158.89920550388;1042.47876061969;1045.132539991805;1046.2728403759313;1048.3133547526381;1052.9420881851418;9616.423014619146;10589;10698.251122421356;10703.464826758787;10802.72993175177;446678;446880;459526;464326;467480;91204.54397728102;92751;92916;93208.53395732978;93370;1045.9320144190604;1046.2937517175876;1048.9370637761758;1075.473018221066;1078.1105587889865;16887.493375198763;16910.746338805173;16997.320107195574;17128.914355428144;17348.39280625172;40960.38559421551;41518.58481415268;42075.368869467595;42446.787766060974;42621.14757704767;57108.42891571031;57336.71331643315;58673.413265866795;59088;59579.702101489216;7521.172671006076;7809.687612495437;7812.414068944966;8361.83276334482;8659.480431173897;9400.95299523498;10759.3544387337;12987.740245195233;13395.598132056053;13506.59480215595;11088.611898583511;11582.6525204244;11776.587819426622;11951.760964780482;12069.30969776814;11263.155263355446;11455.885441145481;11669.416529173677;11801.940990294994;12008.039356851606;11547.422628868691;11663.766724665289;12087.972522335349;12162.695932601755;12300.446479908605;7417;7682.308592226726;7887.290143887078;7898.131205567268;8072.4349295548745;11442.599509017144;11767.411629418666;11841.348725820162;11909.166358354832;12021.338826364634 20:32:58 INFO - PROCESS | 31043 | |3;mootools.html;1472.1829384691496;1490.4857824050703;1661.7922759655044;1766.1699001469306;1802.5944162563417;7881.842363152734;8488.660453581857;8564.143585641448;9047.819043619133;9074.86387704185;8637.222649961503;8911.643534258621;8934.508602026886;8956.8656470153;8968.148025937526;2388.4387169015267;2417.5648383291;2424.3333083402117;2425.8301918865686;2426.2478631624253;2336.918207862725;2382.4996750682376;2394.916177933773;2396.209250947192;2399.6640470334078;2354.693889794324;2399.78401943825;2404.110479122727;2412.8793560322;2418.008616467249;2319.5476882008015;2331.603627383349;2355.3993731598416;2365.325882123595;2365.3731761083327;2355.3993731598334;2380.131252092991;2386.4630458146953;2398.8320817542603;2407.723111842143;8872.955635221848;8919.331050171199;8921.598528066253;8958.37291389603;8968.820623587491;5151.072806894757;5162.045021671003;5226.947730522684;5228.47715228478;5230.764615592269;3342.6824451677053;3355.6141043780035;3387;3418.6068602110577;3514.525539052246;1191.7378176801176;1191.8569771627374;1215.0826126274605;1247.5571172233817;1254.4480428611382;12412.503499859995;12475.064370172182;12491.12562120652;12567.18313309641;12578;4726.493447496041;4789.592884604778;4865.756712164449;4896.730679812645;4906.411230652345;10426.905174956672;10434;10471.581136754598;10472.214583906085;10492.317999330018;5185.429602743695;5189.7405129743365;5259.053370393366;5263.7894484220205;5272.182811664198;4431.446069241345;4799.760011999386;4866.099771542276;4917.852464426073;4948.554630083309;4161.313383291784;4211.957880421157;4249.277622804131;4249.97875010623;4258.1483703258855;1246.6384748422856;1335.9064865459325;1339.4776037345443;1345.3744009035845;1349.1500354776429;902.1429641840278;941.8351788436996;949.7957939043139;979.5738853598707;992.9921130053002;5758.769649213985;5961.225040744675;5975.760969561169;6048.516118710492;6072.817815465543;910.7540963939699;935.9064093590587;938.9765155980015;955.9808803824023;978.3347323819871;4093.9795301023305;4109.91780164395;4128.3601041838565;4176.812043458051;4182.205380977604;11017.44912754359;11326.32042077478;11344.43277836105;11345.829812552818;11367.715807104889;10983.505742241618;11017.83473247902;11159.888401115884;11243.662690119147;11275.267107637977;8232.423730338938;8447.23974842255;8466.068732439428;8475.067742548315;8476.06763256029;5816.069428891357;5860.589758716849;5962.07587823888;6027.36712645166;6079.756809727562;9835.360701554377;10063.949680251844;10242.385456872611;10326.173906087644;10392.58429662805;10294.897051029393;10433.843492347773;10462.843057353994;10496;10547.683569492927;6790.93209067903;7627.580483073484;7724.1117271514495;7795.376369890509;7847.646855891385;8710.433821801562;8712.69505567302;8719.869201961848;8739.475631461879;8815.47107173546;7634.541927484369;7701.1143718473095;7701.422393320411;7988.161243069627;8066.637001335072;7697.191794861459;7750.534967901944;7789.337906277803;7840.921590784019;7936.484128531627;7066;7164.247753985756;7168.498205125799;7183.353498185188;7186.532875363085;4919.926201107058;5096.592272618108;5220.399654039682;5253.343332083489;5304.655197412156;4981.676191047571;5096.1336572781975;5154.5103215194495;5241.895162096813;5317.697164194642 20:32:58 INFO - PROCESS | 31043 | |4;prototype.html;328.3220150389446;328.8470861049614;333.81973734183543;333.9980059820538;336.27197118238996;5675.5459563234945;5689.544836413087;5694;5724.771009159634;5737.225474560933;5571.777128914849;5582.358028826686;5596.916046259309;5613.691246981414;5640.717964101799;4166.833326666937;4222.9020454681695;4330.870073897772;4370.759608221547;4376.964711409194;4379.737215767048;4381.890452738691;4393.967417656864;4398.230309695807;4406.867793966187;4357;4367.737935723851;4372.956270437303;4387;4403.1066641344205;4288.206681763868;4325.437693099909;4327.06968001878;4339.6745244106505;4339.804708788112;3780.073881898925;3788.147666774981;3800.1639639279592;3801.752886062397;3804.600516945736;5427.1316589345515;5457.945420545783;5470.5350045246205;5479.315085614298;5481.5340696040885;4789.377380940456;4992.850214493571;4993.850184494435;5000.499950005007;5024.748762561894;5834.824955251349;5838.883222335572;5904.582900103987;5940;5957.285125784933;4218.557051509609;4234.534201237861;4238.36424536322;4242.915141697149;4244.490661120654;6006.696317025662;6013.36859629737;6085.3914608539235;6092.756289748405;6115.113308570277;4299.290617048152;4308.310670292738;4310.202612516695;4336.306191009423;4339.1972485090355;4311.913761724748;4317.488878892363;4325.632321252729;4339.457567804025;4369.3664418659755;4760.309755085494;4993.775280112403;4997;5005.849824505271;5060.822871199491;5907.645541267538;5930.406959304035;5963.3302675251;5975;5977.22296101504;1512.3496896334461;1514.7578985232224;1528.64714727467;1540.2298850574712;1540.276070246982;969.3021024862088;987.9527700637348;1021.3106153346462;1037.64719995202;1052.742078190833;5628.352739434936;5700.714964251771;5735.1970724098655;5736.569757268222;5745.68398738065;6015.939840601538;6045.486133678599;6046.758129674852;6067.7269522871575;6072.514198864169;5532.5573954083575;5687.943120568824;5750.4249575042995;5793.94206057934;5872.29532456108;3286.342731453719;3299.703026727606;3307.4212012897647;3307.743057638082;3308.3714094322004;6154.261488621394;6339.366063393716;6346.524010699216;6356.618602883749;6359.650219237894;6141.140240366352;6243.531735119885;6255.155554000152;6277.18396608438;6300.613864949703;6086.330503644507;6343.302236753953;6345.397187267202;6381.298057213703;6401.391867772554;6053.667048312385;6130.938690613037;6152.661603611844;6154.630722156685;6173.012318029094;6061.272647282354;6090.386047697452;6090.390960903874;6104.206453161239;6146;6231.2522497300615;6288.245410550763;6366.707985125444;6369.20384951881;6388.712507937061;4299.290617048152;4304.763238021939;4316.330968699856;4331.653467722637;4337.132573485253;5811;6120.265568131853;6140.907886381798;6169.84575385619;6219.450025489527;6010.639361638316;6032.728527216198;6046.54650901193;6048.36492168316;6052.969735151296;5953.226080609493;5972.432618901197;6020.30766461845;6027.547933905063;6038.9396106038375;5609;5841.036229022164;5867.530597552271;5891.410858914246;5935.703214839327;6004.42957918997;6005.189299444519;6042.456178943916;6054.485368743706;6061.424164704346;5615.466530679579;5836.883262334814;5838.919799837044;5889.381614930542;5894.970525147347 20:32:58 INFO - PROCESS | 31043 | |5;yui.html;761.6039659377124;791.2680770287486;813.6094674556209;819.9631016604252;871.8866547348846;14432.855671443282;14901.180435076067;14930.552083437515;14939.477118300862;15074.623134421632;14351;14435.783463248059;14465;14520.05619634723;14568;795.3915254830046;813.4265342933218;816.244973399606;817.3910436724618;818.0347190315455;669.170228916143;780.1301548773106;792.4690457393531;803.8633432316491;804.9718259860906;846.0777752250046;850.6937502499127;853.3429259470204;853.5476197615274;855.0252711908429;841.6549214821894;841.6675413211777;841.7054031089131;842.3177226446597;843.152631605239;621.7450845153511;625.7403177681257;627.2285089340137;627.2347735762363;627.7300760672908;13528.661783455394;13590.38843252056;13590.660233494144;13609.047366684335;13610.251436171007;15204.771928421083;15271.770923436157;15435.30541125652;15500.457483988119;15766.448174313959;12312.119446975174;12392.132550721453;12520.499180032788;12567.622971310875;12669.303188324639;3858.2862170498547;3969.186316805077;4016.758994460342;4111.075008123178;4146.419501269825;70948.29051709469;72302.27697723008;72571.91142132925;72916.63541682258;73178.63410682966;11396.544138234543;11536.25014374063;11631.127665425127;11698.70753231176;12342.629721108382;21986.670199947013;22049.889750551145;22092;22198.556028879655;22213.77786222117;8016;8148.185181481805;8194;8202.38482113844;8203.138670439637;4662.673612847136;4741.383620129361;4859.611231101503;4893.975530122398;4984.7258400788305;3668.559772827278;3784.924301513954;3798.0504873781556;3803.2773772983046;3818.8472461101246;620.6555361774168;621.9378062193745;647.7409036385484;648.4326214562258;649.870025994803;619.2012304127625;696.5228818259509;698.2284575544053;712.8859382498775;730.5375588364773;8618.698345557876;9081.36822366691;9125.205848595266;9174.311926605531;9223.86164207524;555.8554775758332;602.3073465514693;624.5221759980857;668.5721138471382;682.8190529509585;4300.247456695066;4444.821359087653;4477.462704475483;4492.775361231926;4555;80602;114646;115620.42189788997;115690;116677.4166129181;62557.374426256065;79906.80139797907;84278;94714.52642736743;100911.49544252378;55183.17225241705;83653.16346836576;85939.57030214934;86688;87313;9214.723558293263;9388.57751401175;9520;9538.856917146388;9620.95189524048;39688.60311396964;45515.54484455113;45839.31241031321;45868.77065614651;47688.2846757292;61936.69031654813;74613;75361.97104231539;77429;77486.6125669368;11490.425478725863;11556.364399957747;11786.528538858693;11900.86928782205;12044.51821927113;11212.27120237182;11386.430678465878;11599.362035088152;13256.138351007154;13358.398872050975;10547;11113.277636953571;11167.664970050912;11969;12852.807207891701;10716.89283107159;10930.234883558074;10950.835737463785;11177.720556985814;12607.810882836582;11966.760664786829;12124.939375303067;12159.392030398622;12191.451384687532;12206.145569810027;10053.798924021332;10249.538770755185;10417.687469375931;10705.304155229886;10787.460626968777;9872.950635246778;10182.81053140065;10275.794484110425;10423.043560624932;11029.172812038969 20:32:58 INFO - PROCESS | 31043 | __end_tp_report 20:32:58 INFO - PROCESS | 31043 | __start_cc_report 20:32:58 INFO - PROCESS | 31043 | _x_x_mozilla_cycle_collect,363 20:32:58 INFO - PROCESS | 31043 | __end_cc_report 20:32:58 INFO - PROCESS | 31043 | __startTimestamp1465270378513__endTimestamp 20:32:58 INFO - PROCESS | 31043 | 20:32:58 INFO - PROCESS | 31043 | ------- Summary: start ------- 20:32:58 INFO - PROCESS | 31043 | Number of tests: 6 20:32:58 INFO - PROCESS | 31043 | 20:32:58 INFO - PROCESS | 31043 | [#0] dojo.html Cycles:165 Average:5571.10 Median:5831.68 stddev:760.95 (13.0%) stddev-sans-first:738.88 20:32:58 INFO - PROCESS | 31043 | Values: 3133.9 3161.9 3183.1 3189.9 3206.3 5514.6 5541.8 5586.5 5672.1 5701.1 5408.7 5588.2 5626.4 5628.3 5633.7 5040.5 5074.8 5173.2 5221.5 5224.2 858.5 5098.0 5137.3 5177.6 5236.3 5004.9 5020.9 5035.5 5046.9 5050.2 5032.6 5032.9 5052.3 5059.2 5074.2 5066.9 5134.5 5134.6 5134.8 5181.4 5563.6 5566.4 5603.6 5612.4 5625.9 5895.9 5935.1 5938.4 6079.4 6110.6 6032.4 6072.0 6080.2 6081.5 6093.8 5596.0 5639.2 5639.3 5664.4 5670.5 6204.6 6257.4 6268.9 6272.2 6278.7 5923.6 5930.0 5991.8 6007.9 6066.8 5879.4 5970.9 6029.2 6036.9 6103.4 6053.4 6054.5 6057.2 6057.5 6079.7 5899.0 5945.1 5989.0 5990.0 6065.2 4496.8 4517.1 4538.9 4540.1 4560.7 4004.1 4010.1 4029.6 4037.1 4087.3 5650.9 5673.8 5712.3 5722.6 5855.8 6055.6 6116.9 6118.0 6123.5 6128.2 5783.5 5804.0 5806.4 5808.6 5808.8 5042.7 5145.5 5163.6 5199.3 5218.6 6255.9 6257.7 6258.2 6265.4 6267.4 5946.5 6092.2 6106.1 6112.9 6125.8 6131.6 6134.8 6217.0 6293.2 6319.8 5975.5 5982.6 6031.9 6033.5 6047.2 5975.2 6010.5 6126.6 6140.2 6141.6 5881.9 5891.8 5906.1 5922.6 5994.7 5837.9 5848.1 5864.2 5865.4 5884.4 5704.3 5735.1 5766.5 5773.5 5779.4 5803.8 5868.7 5889.1 5908.8 5986.8 5793.4 5821.8 5827.7 5831.7 5841.4 20:32:58 INFO - PROCESS | 31043 | 20:32:58 INFO - PROCESS | 31043 | [#1] ext.html Cycles:180 Average:57464.75 Median:43178.35 stddev:110169.85 (255.2%) stddev-sans-first:110396.14 20:32:58 INFO - PROCESS | 31043 | Values: 585.9 622.1 632.6 633.3 645.6 43781.8 44853.8 44994.6 45047.0 48914.8 47182.3 47780.5 47877.8 47905.0 47942.8 8855.7 9047.2 9062.3 9062.8 9088.2 8957.7 9003.6 9044.4 9060.0 9066.6 9053.6 9110.0 9113.4 9118.4 9150.7 8966.7 8997.3 9007.5 9014.9 9058.4 8883.0 8967.2 8994.2 9032.4 9033.7 43063.8 43618.1 43824.1 43942.6 44038.6 3709.0 3820.4 3958.3 4190.9 4425.3 33272.8 33601.8 33687.2 33962.0 33971.7 4220.3 4357.4 4450.0 4545.9 4566.9 257470.0 257775.0 258023.0 258190.0 258479.0 60922.7 61393.7 61865.5 62050.4 62079.7 65489.7 65726.0 66106.0 66158.3 66315.3 15222.0 15851.4 15874.6 16244.6 16312.0 11804.1 11847.1 11942.1 11984.0 12000.1 20118.0 20264.7 20328.9 20392.5 20479.3 7208.9 7417.8 7621.8 7668.2 7692.7 927.6 1064.3 1070.6 1096.5 1181.8 33161.2 33303.8 33545.8 33847.3 34482.5 1116.1 1143.7 1190.6 1229.3 1229.8 17155.8 17507.5 17675.6 17756.8 17769.7 566182.0 566375.0 567186.0 568302.0 569728.0 60336.7 60970.0 61284.1 61763.8 61906.1 1300.4 1375.5 1396.8 1399.7 1417.3 32051.0 33086.3 33165.0 33348.5 33893.7 53464.5 53574.2 54008.0 54321.7 54445.0 355595.0 356680.0 357273.0 357544.0 358136.0 28537.3 28984.9 29464.0 29476.0 29530.4 49933.0 50647.0 50893.5 51674.7 51930.2 42362.0 42945.6 43212.4 43316.6 43616.1 42802.7 42809.6 43117.8 43144.4 43243.0 37276.6 41689.6 41857.0 42672.0 42914.0 35560.3 38317.4 38355.4 38799.4 38844.8 28969.6 28974.4 29238.7 29436.3 29446.6 20:32:58 INFO - PROCESS | 31043 | 20:32:58 INFO - PROCESS | 31043 | [#2] jquery.html Cycles:180 Average:29092.22 Median:2761.56 stddev:75832.70 (2746.0%) stddev-sans-first:76014.82 20:32:58 INFO - PROCESS | 31043 | Values: 394.4 394.6 397.3 403.4 415.9 14772.3 18052.6 18837.2 19479.2 19529.9 17871.1 18082.5 18127.1 18596.0 18631.6 5577.7 5589.2 5701.7 5778.3 5780.1 5616.8 5630.1 5683.0 5695.0 5719.2 5661.9 6779.6 7136.1 7149.3 7149.4 6654.2 7021.4 7101.0 7103.9 7116.1 6784.4 6789.0 6827.0 6855.6 7180.1 23849.6 24260.6 24454.5 25328.4 25686.0 2355.0 2366.6 2415.8 2597.5 2925.6 14598.0 15328.6 15595.7 15865.8 16687.8 1910.2 1945.0 2027.7 2094.0 2109.8 92673.0 94656.0 96828.0 97049.0 98978.5 17540.8 17573.4 17883.0 17909.9 18180.1 12225.9 13056.2 31613.4 31935.8 32131.4 7397.8 7465.7 7478.9 7540.1 7732.4 7519.2 7519.4 7529.8 7642.9 7677.9 4060.4 4094.9 4161.2 4180.9 4208.5 1975.8 2014.8 2068.1 2071.2 2072.7 935.8 983.0 993.8 1070.6 1077.4 17408.7 17658.2 18700.5 19953.3 20158.9 1042.5 1045.1 1046.3 1048.3 1052.9 9616.4 10589.0 10698.3 10703.5 10802.7 446678.0 446880.0 459526.0 464326.0 467480.0 91204.5 92751.0 92916.0 93208.5 93370.0 1045.9 1046.3 1048.9 1075.5 1078.1 16887.5 16910.7 16997.3 17128.9 17348.4 40960.4 41518.6 42075.4 42446.8 42621.1 57108.4 57336.7 58673.4 59088.0 59579.7 7521.2 7809.7 7812.4 8361.8 8659.5 9401.0 10759.4 12987.7 13395.6 13506.6 11088.6 11582.7 11776.6 11951.8 12069.3 11263.2 11455.9 11669.4 11801.9 12008.0 11547.4 11663.8 12088.0 12162.7 12300.4 7417.0 7682.3 7887.3 7898.1 8072.4 11442.6 11767.4 11841.3 11909.2 12021.3 20:32:58 INFO - PROCESS | 31043 | 20:32:58 INFO - PROCESS | 31043 | [#3] mootools.html Cycles:180 Average:5888.41 Median:4901.57 stddev:3342.95 (68.2%) stddev-sans-first:3335.86 20:32:58 INFO - PROCESS | 31043 | Values: 1472.2 1490.5 1661.8 1766.2 1802.6 7881.8 8488.7 8564.1 9047.8 9074.9 8637.2 8911.6 8934.5 8956.9 8968.1 2388.4 2417.6 2424.3 2425.8 2426.2 2336.9 2382.5 2394.9 2396.2 2399.7 2354.7 2399.8 2404.1 2412.9 2418.0 2319.5 2331.6 2355.4 2365.3 2365.4 2355.4 2380.1 2386.5 2398.8 2407.7 8873.0 8919.3 8921.6 8958.4 8968.8 5151.1 5162.0 5226.9 5228.5 5230.8 3342.7 3355.6 3387.0 3418.6 3514.5 1191.7 1191.9 1215.1 1247.6 1254.4 12412.5 12475.1 12491.1 12567.2 12578.0 4726.5 4789.6 4865.8 4896.7 4906.4 10426.9 10434.0 10471.6 10472.2 10492.3 5185.4 5189.7 5259.1 5263.8 5272.2 4431.4 4799.8 4866.1 4917.9 4948.6 4161.3 4212.0 4249.3 4250.0 4258.1 1246.6 1335.9 1339.5 1345.4 1349.2 902.1 941.8 949.8 979.6 993.0 5758.8 5961.2 5975.8 6048.5 6072.8 910.8 935.9 939.0 956.0 978.3 4094.0 4109.9 4128.4 4176.8 4182.2 11017.4 11326.3 11344.4 11345.8 11367.7 10983.5 11017.8 11159.9 11243.7 11275.3 8232.4 8447.2 8466.1 8475.1 8476.1 5816.1 5860.6 5962.1 6027.4 6079.8 9835.4 10063.9 10242.4 10326.2 10392.6 10294.9 10433.8 10462.8 10496.0 10547.7 6790.9 7627.6 7724.1 7795.4 7847.6 8710.4 8712.7 8719.9 8739.5 8815.5 7634.5 7701.1 7701.4 7988.2 8066.6 7697.2 7750.5 7789.3 7840.9 7936.5 7066.0 7164.2 7168.5 7183.4 7186.5 4919.9 5096.6 5220.4 5253.3 5304.7 4981.7 5096.1 5154.5 5241.9 5317.7 20:32:58 INFO - PROCESS | 31043 | 20:32:58 INFO - PROCESS | 31043 | [#4] prototype.html Cycles:180 Average:4996.87 Median:5697.36 stddev:1484.10 (26.0%) stddev-sans-first:1446.30 20:32:58 INFO - PROCESS | 31043 | Values: 328.3 328.8 333.8 334.0 336.3 5675.5 5689.5 5694.0 5724.8 5737.2 5571.8 5582.4 5596.9 5613.7 5640.7 4166.8 4222.9 4330.9 4370.8 4377.0 4379.7 4381.9 4394.0 4398.2 4406.9 4357.0 4367.7 4373.0 4387.0 4403.1 4288.2 4325.4 4327.1 4339.7 4339.8 3780.1 3788.1 3800.2 3801.8 3804.6 5427.1 5457.9 5470.5 5479.3 5481.5 4789.4 4992.9 4993.9 5000.5 5024.7 5834.8 5838.9 5904.6 5940.0 5957.3 4218.6 4234.5 4238.4 4242.9 4244.5 6006.7 6013.4 6085.4 6092.8 6115.1 4299.3 4308.3 4310.2 4336.3 4339.2 4311.9 4317.5 4325.6 4339.5 4369.4 4760.3 4993.8 4997.0 5005.8 5060.8 5907.6 5930.4 5963.3 5975.0 5977.2 1512.3 1514.8 1528.6 1540.2 1540.3 969.3 988.0 1021.3 1037.6 1052.7 5628.4 5700.7 5735.2 5736.6 5745.7 6015.9 6045.5 6046.8 6067.7 6072.5 5532.6 5687.9 5750.4 5793.9 5872.3 3286.3 3299.7 3307.4 3307.7 3308.4 6154.3 6339.4 6346.5 6356.6 6359.7 6141.1 6243.5 6255.2 6277.2 6300.6 6086.3 6343.3 6345.4 6381.3 6401.4 6053.7 6130.9 6152.7 6154.6 6173.0 6061.3 6090.4 6090.4 6104.2 6146.0 6231.3 6288.2 6366.7 6369.2 6388.7 4299.3 4304.8 4316.3 4331.7 4337.1 5811.0 6120.3 6140.9 6169.8 6219.5 6010.6 6032.7 6046.5 6048.4 6053.0 5953.2 5972.4 6020.3 6027.5 6038.9 5609.0 5841.0 5867.5 5891.4 5935.7 6004.4 6005.2 6042.5 6054.5 6061.4 5615.5 5836.9 5838.9 5889.4 5895.0 20:32:58 INFO - PROCESS | 31043 | 20:32:58 INFO - PROCESS | 31043 | [#5] yui.html Cycles:180 Average:19396.32 Median:25197.16 stddev:27880.01 (110.6%) stddev-sans-first:27923.11 20:32:58 INFO - PROCESS | 31043 | Values: 761.6 791.3 813.6 820.0 871.9 14432.9 14901.2 14930.6 14939.5 15074.6 14351.0 14435.8 14465.0 14520.1 14568.0 795.4 813.4 816.2 817.4 818.0 669.2 780.1 792.5 803.9 805.0 846.1 850.7 853.3 853.5 855.0 841.7 841.7 841.7 842.3 843.2 621.7 625.7 627.2 627.2 627.7 13528.7 13590.4 13590.7 13609.0 13610.3 15204.8 15271.8 15435.3 15500.5 15766.4 12312.1 12392.1 12520.5 12567.6 12669.3 3858.3 3969.2 4016.8 4111.1 4146.4 70948.3 72302.3 72571.9 72916.6 73178.6 11396.5 11536.3 11631.1 11698.7 12342.6 21986.7 22049.9 22092.0 22198.6 22213.8 8016.0 8148.2 8194.0 8202.4 8203.1 4662.7 4741.4 4859.6 4894.0 4984.7 3668.6 3784.9 3798.1 3803.3 3818.8 620.7 621.9 647.7 648.4 649.9 619.2 696.5 698.2 712.9 730.5 8618.7 9081.4 9125.2 9174.3 9223.9 555.9 602.3 624.5 668.6 682.8 4300.2 4444.8 4477.5 4492.8 4555.0 80602.0 114646.0 115620.4 115690.0 116677.4 62557.4 79906.8 84278.0 94714.5 100911.5 55183.2 83653.2 85939.6 86688.0 87313.0 9214.7 9388.6 9520.0 9538.9 9621.0 39688.6 45515.5 45839.3 45868.8 47688.3 61936.7 74613.0 75362.0 77429.0 77486.6 11490.4 11556.4 11786.5 11900.9 12044.5 11212.3 11386.4 11599.4 13256.1 13358.4 10547.0 11113.3 11167.7 11969.0 12852.8 10716.9 10930.2 10950.8 11177.7 12607.8 11966.8 12124.9 12159.4 12191.5 12206.1 10053.8 10249.5 10417.7 10705.3 10787.5 9873.0 10182.8 10275.8 10423.0 11029.2 20:32:58 INFO - PROCESS | 31043 | -------- Summary: end -------- 20:32:58 INFO - PROCESS | 31043 | 20:32:59 INFO - TEST-INFO | 31043: exit 0 20:32:59 INFO - TEST-OK | dromaeo_css | took 1110569ms 20:32:59 INFO - TEST-START | kraken 20:32:59 INFO - operating with platform_type : linux_ 20:32:59 INFO - Initialising browser for kraken test... 20:32:59 INFO - TEST-INFO | started process 31281 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp38KTMN/profile http://localhost:52528/getInfo.html) 20:33:03 INFO - PROCESS | 31281 | __metrics Screen width/height:1600/1200 20:33:03 INFO - PROCESS | 31281 | colorDepth:24 20:33:03 INFO - PROCESS | 31281 | Browser inner width/height: 1024/697 20:33:03 INFO - PROCESS | 31281 | __metrics 20:33:04 ERROR - PROCESS | 31281 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2944: TypeError: this.tabs is undefined 20:33:05 INFO - TEST-INFO | 31281: exit 0 20:33:05 INFO - Browser initialized. 20:33:05 INFO - Running cycle 1/1 for kraken test... 20:33:05 INFO - TEST-INFO | started process 31402 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp38KTMN/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 20:33:17 INFO - PROCESS | 31402 | RSS: Main: 167190528 20:33:17 INFO - PROCESS | 31402 | 20:33:19 INFO - PROCESS | 31402 | Cycle 1(1): loaded http://localhost:52528/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:52528/tests/kraken/driver.html?testName=audio-beat-detection) 20:33:20 INFO - PROCESS | 31402 | RSS: Main: 172331008 20:33:20 INFO - PROCESS | 31402 | 20:33:23 INFO - PROCESS | 31402 | Cycle 1(1): loaded http://localhost:52528/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:52528/tests/kraken/driver.html?testName=audio-dft) 20:33:23 INFO - PROCESS | 31402 | RSS: Main: 171966464 20:33:23 INFO - PROCESS | 31402 | 20:33:26 INFO - PROCESS | 31402 | Cycle 1(1): loaded http://localhost:52528/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:52528/tests/kraken/driver.html?testName=audio-fft) 20:33:27 INFO - PROCESS | 31402 | RSS: Main: 166387712 20:33:27 INFO - PROCESS | 31402 | 20:33:29 INFO - PROCESS | 31402 | Cycle 1(1): loaded http://localhost:52528/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:52528/tests/kraken/driver.html?testName=audio-oscillator) 20:33:30 INFO - PROCESS | 31402 | RSS: Main: 167489536 20:33:30 INFO - PROCESS | 31402 | 20:33:32 INFO - PROCESS | 31402 | Cycle 1(1): loaded http://localhost:52528/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:52528/tests/kraken/driver.html?testName=imaging-gaussian-blur) 20:33:33 INFO - PROCESS | 31402 | RSS: Main: 167841792 20:33:33 INFO - PROCESS | 31402 | 20:33:36 INFO - PROCESS | 31402 | Cycle 1(1): loaded http://localhost:52528/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:52528/tests/kraken/driver.html?testName=imaging-darkroom) 20:33:36 INFO - PROCESS | 31402 | RSS: Main: 167927808 20:33:36 INFO - PROCESS | 31402 | 20:33:40 INFO - PROCESS | 31402 | Cycle 1(1): loaded http://localhost:52528/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:52528/tests/kraken/driver.html?testName=imaging-desaturate) 20:33:40 INFO - PROCESS | 31402 | RSS: Main: 166023168 20:33:40 INFO - PROCESS | 31402 | 20:33:43 INFO - PROCESS | 31402 | Cycle 1(1): loaded http://localhost:52528/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:52528/tests/kraken/driver.html?testName=json-parse-financial) 20:33:44 INFO - PROCESS | 31402 | RSS: Main: 166948864 20:33:44 INFO - PROCESS | 31402 | 20:33:45 INFO - PROCESS | 31402 | Cycle 1(1): loaded http://localhost:52528/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:52528/tests/kraken/driver.html?testName=json-stringify-tinderbox) 20:33:46 INFO - PROCESS | 31402 | RSS: Main: 167079936 20:33:46 INFO - PROCESS | 31402 | 20:33:48 INFO - PROCESS | 31402 | Cycle 1(1): loaded http://localhost:52528/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:52528/tests/kraken/driver.html?testName=stanford-crypto-aes) 20:33:48 INFO - PROCESS | 31402 | RSS: Main: 167604224 20:33:48 INFO - PROCESS | 31402 | 20:33:51 INFO - PROCESS | 31402 | Cycle 1(1): loaded http://localhost:52528/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:52528/tests/kraken/driver.html?testName=stanford-crypto-ccm) 20:33:51 INFO - PROCESS | 31402 | RSS: Main: 168169472 20:33:51 INFO - PROCESS | 31402 | 20:33:54 INFO - PROCESS | 31402 | Cycle 1(1): loaded http://localhost:52528/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:52528/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 20:33:54 INFO - PROCESS | 31402 | RSS: Main: 168460288 20:33:54 INFO - PROCESS | 31402 | 20:33:57 INFO - PROCESS | 31402 | Cycle 1(1): loaded http://localhost:52528/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:52528/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 20:33:58 INFO - PROCESS | 31402 | RSS: Main: 168095744 20:33:58 INFO - PROCESS | 31402 | 20:33:59 INFO - PROCESS | 31402 | Cycle 1(1): loaded http://localhost:52528/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:52528/tests/kraken/driver.html?testName=ai-astar) 20:34:00 INFO - PROCESS | 31402 | RSS: Main: 169209856 20:34:00 INFO - PROCESS | 31402 | 20:34:00 INFO - PROCESS | 31402 | __start_tp_report 20:34:00 INFO - PROCESS | 31402 | _x_x_mozilla_page_load 20:34:00 INFO - PROCESS | 31402 | _x_x_mozilla_page_load_details 20:34:00 INFO - PROCESS | 31402 | |i|pagename|runs| 20:34:00 INFO - PROCESS | 31402 | |0;ai-astar;111;109;112;110;112;114;114;111;112;112 20:34:00 INFO - PROCESS | 31402 | |1;audio-beat-detection;157;133;160;181;134;158;149;128;180;128 20:34:00 INFO - PROCESS | 31402 | |2;audio-dft;171;161;162;164;162;165;179;164;163;163 20:34:00 INFO - PROCESS | 31402 | |3;audio-fft;77;75;75;165;76;75;75;76;164;75 20:34:00 INFO - PROCESS | 31402 | |4;audio-oscillator;86;86;150;85;85;86;157;87;85;159 20:34:00 INFO - PROCESS | 31402 | |5;imaging-gaussian-blur;117;118;117;117;119;118;118;117;117;117 20:34:00 INFO - PROCESS | 31402 | |6;imaging-darkroom;147;146;147;146;147;147;147;147;147;147 20:34:00 INFO - PROCESS | 31402 | |7;imaging-desaturate;96;95;96;95;96;95;95;97;96;95 20:34:00 INFO - PROCESS | 31402 | |8;json-parse-financial;54;56;55;55;56;57;60;55;55;54 20:34:00 INFO - PROCESS | 31402 | |9;json-stringify-tinderbox;62;61;62;62;63;62;62;64;63;62 20:34:00 INFO - PROCESS | 31402 | |10;stanford-crypto-aes;79;81;80;81;82;81;81;81;109;81 20:34:00 INFO - PROCESS | 31402 | |11;stanford-crypto-ccm;127;122;124;123;141;123;124;126;134;124 20:34:00 INFO - PROCESS | 31402 | |12;stanford-crypto-pbkdf2;171;162;165;158;161;162;175;159;164;159 20:34:00 INFO - PROCESS | 31402 | |13;stanford-crypto-sha256-iterative;65;65;66;63;67;63;64;61;63;62 20:34:00 INFO - PROCESS | 31402 | __end_tp_report 20:34:00 INFO - PROCESS | 31402 | __start_cc_report 20:34:00 INFO - PROCESS | 31402 | _x_x_mozilla_cycle_collect,930 20:34:00 INFO - PROCESS | 31402 | __end_cc_report 20:34:00 INFO - PROCESS | 31402 | __startTimestamp1465270440199__endTimestamp 20:34:00 INFO - PROCESS | 31402 | 20:34:00 INFO - PROCESS | 31402 | ------- Summary: start ------- 20:34:00 INFO - PROCESS | 31402 | Number of tests: 14 20:34:00 INFO - PROCESS | 31402 | 20:34:00 INFO - PROCESS | 31402 | [#0] ai-astar Cycles:10 Average:111.70 Median:112.00 stddev:1.57 (1.4%) stddev-sans-first:1.64 20:34:00 INFO - PROCESS | 31402 | Values: 111.0 109.0 112.0 110.0 112.0 114.0 114.0 111.0 112.0 112.0 20:34:00 INFO - PROCESS | 31402 | 20:34:00 INFO - PROCESS | 31402 | [#1] audio-beat-detection Cycles:10 Average:150.80 Median:157.50 stddev:19.95 (12.7%) stddev-sans-first:21.03 20:34:00 INFO - PROCESS | 31402 | Values: 157.0 133.0 160.0 181.0 134.0 158.0 149.0 128.0 180.0 128.0 20:34:00 INFO - PROCESS | 31402 | 20:34:00 INFO - PROCESS | 31402 | [#2] audio-dft Cycles:10 Average:165.40 Median:164.00 stddev:5.52 (3.4%) stddev-sans-first:5.47 20:34:00 INFO - PROCESS | 31402 | Values: 171.0 161.0 162.0 164.0 162.0 165.0 179.0 164.0 163.0 163.0 20:34:00 INFO - PROCESS | 31402 | 20:34:00 INFO - PROCESS | 31402 | [#3] audio-fft Cycles:10 Average:93.30 Median:75.00 stddev:37.53 (50.0%) stddev-sans-first:39.34 20:34:00 INFO - PROCESS | 31402 | Values: 77.0 75.0 75.0 165.0 76.0 75.0 75.0 76.0 164.0 75.0 20:34:00 INFO - PROCESS | 31402 | 20:34:00 INFO - PROCESS | 31402 | [#4] audio-oscillator Cycles:10 Average:106.60 Median:85.50 stddev:33.71 (39.4%) stddev-sans-first:34.92 20:34:00 INFO - PROCESS | 31402 | Values: 86.0 86.0 150.0 85.0 85.0 86.0 157.0 87.0 85.0 159.0 20:34:00 INFO - PROCESS | 31402 | 20:34:00 INFO - PROCESS | 31402 | [#5] imaging-gaussian-blur Cycles:10 Average:117.50 Median:117.50 stddev:0.71 (0.6%) stddev-sans-first:0.73 20:34:00 INFO - PROCESS | 31402 | Values: 117.0 118.0 117.0 117.0 119.0 118.0 118.0 117.0 117.0 117.0 20:34:00 INFO - PROCESS | 31402 | 20:34:00 INFO - PROCESS | 31402 | [#6] imaging-darkroom Cycles:10 Average:146.80 Median:147.00 stddev:0.42 (0.3%) stddev-sans-first:0.44 20:34:00 INFO - PROCESS | 31402 | Values: 147.0 146.0 147.0 146.0 147.0 147.0 147.0 147.0 147.0 147.0 20:34:00 INFO - PROCESS | 31402 | 20:34:00 INFO - PROCESS | 31402 | [#7] imaging-desaturate Cycles:10 Average:95.60 Median:96.00 stddev:0.70 (0.7%) stddev-sans-first:0.73 20:34:00 INFO - PROCESS | 31402 | Values: 96.0 95.0 96.0 95.0 96.0 95.0 95.0 97.0 96.0 95.0 20:34:00 INFO - PROCESS | 31402 | 20:34:00 INFO - PROCESS | 31402 | [#8] json-parse-financial Cycles:10 Average:55.70 Median:55.50 stddev:1.77 (3.2%) stddev-sans-first:1.76 20:34:00 INFO - PROCESS | 31402 | Values: 54.0 56.0 55.0 55.0 56.0 57.0 60.0 55.0 55.0 54.0 20:34:00 INFO - PROCESS | 31402 | 20:34:00 INFO - PROCESS | 31402 | [#9] json-stringify-tinderbox Cycles:10 Average:62.30 Median:62.00 stddev:0.82 (1.3%) stddev-sans-first:0.87 20:34:00 INFO - PROCESS | 31402 | Values: 62.0 61.0 62.0 62.0 63.0 62.0 62.0 64.0 63.0 62.0 20:34:00 INFO - PROCESS | 31402 | 20:34:00 INFO - PROCESS | 31402 | [#10] stanford-crypto-aes Cycles:10 Average:83.60 Median:81.00 stddev:8.96 (11.1%) stddev-sans-first:9.35 20:34:00 INFO - PROCESS | 31402 | Values: 79.0 81.0 80.0 81.0 82.0 81.0 81.0 81.0 109.0 81.0 20:34:00 INFO - PROCESS | 31402 | 20:34:00 INFO - PROCESS | 31402 | [#11] stanford-crypto-ccm Cycles:10 Average:126.80 Median:125.00 stddev:6.05 (4.8%) stddev-sans-first:6.42 20:34:00 INFO - PROCESS | 31402 | Values: 127.0 122.0 124.0 123.0 141.0 123.0 124.0 126.0 134.0 124.0 20:34:00 INFO - PROCESS | 31402 | 20:34:00 INFO - PROCESS | 31402 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:163.60 Median:163.00 stddev:5.50 (3.4%) stddev-sans-first:5.14 20:34:00 INFO - PROCESS | 31402 | Values: 171.0 162.0 165.0 158.0 161.0 162.0 175.0 159.0 164.0 159.0 20:34:00 INFO - PROCESS | 31402 | 20:34:00 INFO - PROCESS | 31402 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:63.90 Median:64.50 stddev:1.85 (2.9%) stddev-sans-first:1.92 20:34:00 INFO - PROCESS | 31402 | Values: 65.0 65.0 66.0 63.0 67.0 63.0 64.0 61.0 63.0 62.0 20:34:00 INFO - PROCESS | 31402 | -------- Summary: end -------- 20:34:00 INFO - PROCESS | 31402 | 20:34:01 INFO - TEST-INFO | 31402: exit 0 20:34:01 INFO - TEST-OK | kraken | took 61880ms 20:34:01 INFO - SUITE-END | took 1172s 20:34:01 INFO - Completed test suite (00:19:32) 20:34:01 INFO - javascript benchmark 20:34:01 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 7442.1046081188015, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3133.858976346065, 3161.9367612647734, 3183.1405520509447, 3189.856456459459, 3206.2625596112894, 5514.5864060195445, 5541.750621222044, 5586.497215250627, 5672.06410942194, 5701.116326969316, 5408.702521361323, 5588.245586845775, 5626.381098079208, 5628.268325117729, 5633.746481408336, 5040.4959504049575, 5074.797008119671, 5173.1722924331925, 5221.530062294392, 5224.164133738603, 858.4678539649984, 5098.023699776457, 5137.255098010786, 5177.611679124081, 5236.2931004314505, 5004.924926126093, 5020.874478138057, 5035.496450354972, 5046.924296135561, 5050.242463630448, 5032.597392208614, 5032.949670503284, 5052.317937078484, 5059.16523773577, 5074.238864170367, 5066.873328166788, 5134.5378915897745, 5134.589232861362, 5134.794608215667, 5181.35233095863, 5563.610547261694, 5566.443355664442, 5603.551715862721, 5612.438756124396, 5625.8593535161535, 5895.852603684899, 5935.0503919372695, 5938.406159384071, 6079.39206079393, 6110.572259941806, 6032.366601506867, 6072.028475443908, 6080.209572755558, 6081.513478921675, 6093.847653808646, 5595.972020139914, 5639.15412688096, 5639.2668953036255, 5664.405237450091, 5670.4896559309445, 6204.568023833168, 6257.405546473078, 6268.871603111484, 6272.153259309935, 6278.717457714414, 5923.555733320019, 5929.970350148308, 5991.833397316744, 6007.939920600826, 6066.817995460143, 5879.3826648202175, 5970.910436343458, 6029.155918171459, 6036.939630603638, 6103.35914728956, 6053.364396738279, 6054.545909056838, 6057.182280392179, 6057.545684073712, 6079.665618391031, 5898.970505147447, 5945.137954996501, 5989.0, 5990.011648078018, 6065.181200537959, 4496.808345788369, 4517.119161763425, 4538.88652783683, 4540.091981603692, 4560.749158796231, 4004.0590461241586, 4010.0977280111742, 4029.5567487576345, 4037.1118353962083, 4087.305158123126, 5650.943490565124, 5673.8014169504695, 5712.314522257273, 5722.62802917809, 5855.765769369263, 6055.636661800306, 6116.877662446726, 6118.0, 6123.4795042421, 6128.233970753656, 5783.537317014629, 5804.0, 5806.4193580641595, 5808.6224395414165, 5808.82573522795, 5042.697438153723, 5145.536901678867, 5163.561097306771, 5199.272101905736, 5218.556422704112, 6255.906161407492, 6257.655828929453, 6258.186435763321, 6265.4361107500545, 6267.4045965633195, 5946.524278057658, 6092.238470191226, 6106.1146133811235, 6112.908306375319, 6125.754969801158, 6131.590761709946, 6134.773364742421, 6217.0, 6293.181886354744, 6319.778807741707, 5975.521958243243, 5982.641041537521, 6031.939680603138, 6033.507354546669, 6047.153398524122, 5975.223220981245, 6010.54920880927, 6126.6017708848785, 6140.201773769381, 6141.631502109888, 5881.911771323519, 5891.823245302648, 5906.084556893688, 5922.55580831448, 5994.730237139252, 5837.94162058374, 5848.093545500455, 5864.179014937998, 5865.413458654271, 5884.382139875252, 5704.3154821421695, 5735.053716136791, 5766.452187042224, 5773.480386765212, 5779.422057794187, 5803.7968671096305, 5868.67722275279, 5889.057750759858, 5908.763649453974, 5986.820395388146, 5793.362730099601, 5821.82534523948, 5827.650340979555, 5831.679257640871, 5841.357450680507], "value": 5518.993307879568, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [585.8798946216026, 622.0731110645139, 632.5919781740778, 633.2907143998722, 645.5610185074149, 43781.78109109454, 44853.7757311213, 44994.55005449944, 45047.0, 48914.75542622291, 47182.29226561596, 47780.522194778045, 47877.76061119698, 47905.0, 47942.76028619861, 8855.734327970154, 9047.230985366252, 9062.275017998578, 9062.818743625123, 9088.227500662451, 8957.731268061969, 9003.594838232295, 9044.3668943174, 9059.95470022649, 9066.592003359865, 9053.592588333508, 9109.954450227773, 9113.407628504126, 9118.361714679975, 9150.725478235663, 8966.68616598416, 8997.280217582611, 9007.459552426875, 9014.86477702835, 9058.411203271766, 8883.0, 8967.237784788236, 8994.235489983359, 9032.412893161923, 9033.683821066297, 43063.78468107671, 43618.127637447076, 43824.12351752979, 43942.56057439448, 44038.55961440376, 3708.962910370889, 3820.44603532489, 3958.34687276599, 4190.853320133811, 4425.336199570058, 33272.83363583191, 33601.83199083989, 33687.157821054425, 33962.0, 33971.6602833971, 4220.3036498977635, 4357.36818161368, 4450.043240703264, 4545.909081818345, 4566.862994110182, 257470.0, 257775.0, 258023.0, 258190.0, 258479.0, 60922.695386522784, 61393.69303153456, 61865.45336366627, 62050.379496205365, 62079.689601551705, 65489.67255163693, 65726.0, 66106.0, 66158.33841661618, 66315.33684663188, 15222.0, 15851.445199417965, 15874.603134921488, 16244.593885152966, 16312.0, 11804.11469139818, 11847.052235821113, 11942.104342174373, 11984.041276697842, 12000.099992500598, 20118.0, 20264.696029559567, 20328.865469125823, 20392.490187745425, 20479.28322508705, 7208.927910720826, 7417.8145546361775, 7621.847563048708, 7668.194839541768, 7692.730754423568, 927.5686805635412, 1064.3081996702206, 1070.6145787516489, 1096.4627332607124, 1181.8168183931505, 33161.17097072592, 33303.83348083244, 33545.83227083849, 33847.32305353879, 34482.48276275858, 1116.0680831505783, 1143.7140714821294, 1190.6309044196328, 1229.3238718704856, 1229.84012078431, 17155.828441715425, 17507.47477575675, 17675.646487070186, 17756.822431775516, 17769.7334539982, 566182.0, 566375.0, 567186.0, 568302.0, 569728.0, 60336.69831650814, 60970.0, 61284.08073878895, 61763.82361763788, 61906.071408928, 1300.3888172558882, 1375.5116933488468, 1396.832380114393, 1399.6920677450944, 1417.2984372735357, 32051.0, 33086.338273234884, 33165.0, 33348.499772502946, 33893.66106338905, 53464.46535534595, 53574.196387055, 54008.0, 54321.72839135779, 54445.0, 355595.0, 356680.0, 357273.0, 357544.0, 358136.0, 28537.28656783597, 28984.855075724485, 29464.0, 29476.0, 29530.409391812474, 49933.0, 50647.0, 50893.49106508888, 51674.74162629163, 51930.221046683575, 42362.0, 42945.570544294154, 43212.35181472218, 43316.56683433125, 43616.12767744691, 42802.69715625936, 42809.5719042818, 43117.784411077744, 43144.35283470813, 43243.0, 37276.6272337284, 41689.58310416978, 41857.0, 42672.0, 42914.0, 35560.288794224485, 38317.42523862088, 38355.424668629435, 38799.41800872933, 38844.80577597094, 28969.56545651859, 28974.420511590073, 29238.70761292445, 29436.264093397836, 29446.558301625064], "value": 20566.787394933755, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [394.4280792850366, 394.57780175212537, 397.3185986033951, 403.3828242788533, 415.8752374287713, 14772.261386930664, 18052.638947221047, 18837.152328145232, 19479.220831166753, 19529.902350488264, 17871.10644467778, 18082.5479363016, 18127.093645317713, 18596.0, 18631.627367452642, 5577.721113944317, 5589.161625756128, 5701.714914254291, 5778.306603207621, 5780.132980052984, 5616.775328986856, 5630.127330263796, 5682.971585142069, 5694.971525142369, 5719.19931209631, 5661.8584535386535, 6779.593224406552, 7136.14366276045, 7149.320814522638, 7149.356557909787, 6654.168228971379, 7021.438284937244, 7101.0, 7103.928960710378, 7116.110486189226, 6784.3894049535775, 6789.015592739074, 6827.0, 6855.5543889647015, 7180.066591343092, 23849.642255366183, 24260.636090458658, 24454.510909781882, 25328.366790830376, 25686.0, 2354.9882250588807, 2366.6095094309417, 2415.7825795678473, 2597.4805038992276, 2925.648922129358, 14598.0, 15328.616784580474, 15595.688086238211, 15865.762013569805, 16687.83312166875, 1910.169076451734, 1945.0177660281468, 2027.6654352031896, 2093.958120837575, 2109.820665243456, 92673.0, 94655.99999999932, 96828.0, 97049.0, 98978.50510747472, 17540.82459175392, 17573.384931527336, 17883.0, 17909.910450447664, 18180.090995450173, 12225.938870305592, 13056.151350162208, 31613.36773264522, 31935.84032079825, 32131.35737285288, 7397.8150546236775, 7465.664045117983, 7478.887816682754, 7540.132884718218, 7732.381409487228, 7519.210482899326, 7519.360854327443, 7529.774106776806, 7642.923570764221, 7677.886706427536, 4060.3503439449546, 4094.9385759213637, 4161.167766446722, 4180.874573762731, 4208.452901122896, 1975.8024197580128, 2014.7985201480028, 2068.069368784023, 2071.181883156175, 2072.730545029167, 935.7660584853786, 982.9803403931882, 993.7515621094726, 1070.593174593665, 1077.4128100185262, 17408.65182696339, 17658.205380757896, 18700.503959683192, 19953.301634442723, 20158.89920550388, 1042.47876061969, 1045.132539991805, 1046.2728403759313, 1048.3133547526381, 1052.9420881851418, 9616.423014619146, 10589.0, 10698.251122421356, 10703.464826758787, 10802.72993175177, 446678.0, 446880.0, 459526.0, 464326.0, 467480.0, 91204.54397728102, 92751.0, 92916.0, 93208.53395732978, 93370.0, 1045.9320144190604, 1046.2937517175876, 1048.9370637761758, 1075.473018221066, 1078.1105587889865, 16887.493375198763, 16910.746338805173, 16997.320107195574, 17128.914355428144, 17348.39280625172, 40960.38559421551, 41518.58481415268, 42075.368869467595, 42446.787766060974, 42621.14757704767, 57108.42891571031, 57336.71331643315, 58673.413265866795, 59088.0, 59579.702101489216, 7521.172671006076, 7809.687612495437, 7812.414068944966, 8361.83276334482, 8659.480431173897, 9400.95299523498, 10759.3544387337, 12987.740245195233, 13395.598132056053, 13506.59480215595, 11088.611898583511, 11582.6525204244, 11776.587819426622, 11951.760964780482, 12069.30969776814, 11263.155263355446, 11455.885441145481, 11669.416529173677, 11801.940990294994, 12008.039356851606, 11547.422628868691, 11663.766724665289, 12087.972522335349, 12162.695932601755, 12300.446479908605, 7417.0, 7682.308592226726, 7887.290143887078, 7898.131205567268, 8072.4349295548745, 11442.599509017144, 11767.411629418666, 11841.348725820162, 11909.166358354832, 12021.338826364634], "value": 9681.000253012837, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1472.1829384691496, 1490.4857824050703, 1661.7922759655044, 1766.1699001469306, 1802.5944162563417, 7881.842363152734, 8488.660453581857, 8564.143585641448, 9047.819043619133, 9074.86387704185, 8637.222649961503, 8911.643534258621, 8934.508602026886, 8956.8656470153, 8968.148025937526, 2388.4387169015267, 2417.5648383291, 2424.3333083402117, 2425.8301918865686, 2426.2478631624253, 2336.918207862725, 2382.4996750682376, 2394.916177933773, 2396.209250947192, 2399.6640470334078, 2354.693889794324, 2399.78401943825, 2404.110479122727, 2412.8793560322, 2418.008616467249, 2319.5476882008015, 2331.603627383349, 2355.3993731598416, 2365.325882123595, 2365.3731761083327, 2355.3993731598334, 2380.131252092991, 2386.4630458146953, 2398.8320817542603, 2407.723111842143, 8872.955635221848, 8919.331050171199, 8921.598528066253, 8958.37291389603, 8968.820623587491, 5151.072806894757, 5162.045021671003, 5226.947730522684, 5228.47715228478, 5230.764615592269, 3342.6824451677053, 3355.6141043780035, 3387.0, 3418.6068602110577, 3514.525539052246, 1191.7378176801176, 1191.8569771627374, 1215.0826126274605, 1247.5571172233817, 1254.4480428611382, 12412.503499859995, 12475.064370172182, 12491.12562120652, 12567.18313309641, 12578.0, 4726.493447496041, 4789.592884604778, 4865.756712164449, 4896.730679812645, 4906.411230652345, 10426.905174956672, 10434.0, 10471.581136754598, 10472.214583906085, 10492.317999330018, 5185.429602743695, 5189.7405129743365, 5259.053370393366, 5263.7894484220205, 5272.182811664198, 4431.446069241345, 4799.760011999386, 4866.099771542276, 4917.852464426073, 4948.554630083309, 4161.313383291784, 4211.957880421157, 4249.277622804131, 4249.97875010623, 4258.1483703258855, 1246.6384748422856, 1335.9064865459325, 1339.4776037345443, 1345.3744009035845, 1349.1500354776429, 902.1429641840278, 941.8351788436996, 949.7957939043139, 979.5738853598707, 992.9921130053002, 5758.769649213985, 5961.225040744675, 5975.760969561169, 6048.516118710492, 6072.817815465543, 910.7540963939699, 935.9064093590587, 938.9765155980015, 955.9808803824023, 978.3347323819871, 4093.9795301023305, 4109.91780164395, 4128.3601041838565, 4176.812043458051, 4182.205380977604, 11017.44912754359, 11326.32042077478, 11344.43277836105, 11345.829812552818, 11367.715807104889, 10983.505742241618, 11017.83473247902, 11159.888401115884, 11243.662690119147, 11275.267107637977, 8232.423730338938, 8447.23974842255, 8466.068732439428, 8475.067742548315, 8476.06763256029, 5816.069428891357, 5860.589758716849, 5962.07587823888, 6027.36712645166, 6079.756809727562, 9835.360701554377, 10063.949680251844, 10242.385456872611, 10326.173906087644, 10392.58429662805, 10294.897051029393, 10433.843492347773, 10462.843057353994, 10496.0, 10547.683569492927, 6790.93209067903, 7627.580483073484, 7724.1117271514495, 7795.376369890509, 7847.646855891385, 8710.433821801562, 8712.69505567302, 8719.869201961848, 8739.475631461879, 8815.47107173546, 7634.541927484369, 7701.1143718473095, 7701.422393320411, 7988.161243069627, 8066.637001335072, 7697.191794861459, 7750.534967901944, 7789.337906277803, 7840.921590784019, 7936.484128531627, 7066.0, 7164.247753985756, 7168.498205125799, 7183.353498185188, 7186.532875363085, 4919.926201107058, 5096.592272618108, 5220.399654039682, 5253.343332083489, 5304.655197412156, 4981.676191047571, 5096.1336572781975, 5154.5103215194495, 5241.895162096813, 5317.697164194642], "value": 4724.626609012527, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [328.3220150389446, 328.8470861049614, 333.81973734183543, 333.9980059820538, 336.27197118238996, 5675.5459563234945, 5689.544836413087, 5694.0, 5724.771009159634, 5737.225474560933, 5571.777128914849, 5582.358028826686, 5596.916046259309, 5613.691246981414, 5640.717964101799, 4166.833326666937, 4222.9020454681695, 4330.870073897772, 4370.759608221547, 4376.964711409194, 4379.737215767048, 4381.890452738691, 4393.967417656864, 4398.230309695807, 4406.867793966187, 4357.0, 4367.737935723851, 4372.956270437303, 4387.0, 4403.1066641344205, 4288.206681763868, 4325.437693099909, 4327.06968001878, 4339.6745244106505, 4339.804708788112, 3780.073881898925, 3788.147666774981, 3800.1639639279592, 3801.752886062397, 3804.600516945736, 5427.1316589345515, 5457.945420545783, 5470.5350045246205, 5479.315085614298, 5481.5340696040885, 4789.377380940456, 4992.850214493571, 4993.850184494435, 5000.499950005007, 5024.748762561894, 5834.824955251349, 5838.883222335572, 5904.582900103987, 5940.0, 5957.285125784933, 4218.557051509609, 4234.534201237861, 4238.36424536322, 4242.915141697149, 4244.490661120654, 6006.696317025662, 6013.36859629737, 6085.3914608539235, 6092.756289748405, 6115.113308570277, 4299.290617048152, 4308.310670292738, 4310.202612516695, 4336.306191009423, 4339.1972485090355, 4311.913761724748, 4317.488878892363, 4325.632321252729, 4339.457567804025, 4369.3664418659755, 4760.309755085494, 4993.775280112403, 4997.0, 5005.849824505271, 5060.822871199491, 5907.645541267538, 5930.406959304035, 5963.3302675251, 5975.0, 5977.22296101504, 1512.3496896334461, 1514.7578985232224, 1528.64714727467, 1540.2298850574712, 1540.276070246982, 969.3021024862088, 987.9527700637348, 1021.3106153346462, 1037.64719995202, 1052.742078190833, 5628.352739434936, 5700.714964251771, 5735.1970724098655, 5736.569757268222, 5745.68398738065, 6015.939840601538, 6045.486133678599, 6046.758129674852, 6067.7269522871575, 6072.514198864169, 5532.5573954083575, 5687.943120568824, 5750.4249575042995, 5793.94206057934, 5872.29532456108, 3286.342731453719, 3299.703026727606, 3307.4212012897647, 3307.743057638082, 3308.3714094322004, 6154.261488621394, 6339.366063393716, 6346.524010699216, 6356.618602883749, 6359.650219237894, 6141.140240366352, 6243.531735119885, 6255.155554000152, 6277.18396608438, 6300.613864949703, 6086.330503644507, 6343.302236753953, 6345.397187267202, 6381.298057213703, 6401.391867772554, 6053.667048312385, 6130.938690613037, 6152.661603611844, 6154.630722156685, 6173.012318029094, 6061.272647282354, 6090.386047697452, 6090.390960903874, 6104.206453161239, 6146.0, 6231.2522497300615, 6288.245410550763, 6366.707985125444, 6369.20384951881, 6388.712507937061, 4299.290617048152, 4304.763238021939, 4316.330968699856, 4331.653467722637, 4337.132573485253, 5811.0, 6120.265568131853, 6140.907886381798, 6169.84575385619, 6219.450025489527, 6010.639361638316, 6032.728527216198, 6046.54650901193, 6048.36492168316, 6052.969735151296, 5953.226080609493, 5972.432618901197, 6020.30766461845, 6027.547933905063, 6038.9396106038375, 5609.0, 5841.036229022164, 5867.530597552271, 5891.410858914246, 5935.703214839327, 6004.42957918997, 6005.189299444519, 6042.456178943916, 6054.485368743706, 6061.424164704346, 5615.466530679579, 5836.883262334814, 5838.919799837044, 5889.381614930542, 5894.970525147347], "value": 4518.391009836576, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [761.6039659377124, 791.2680770287486, 813.6094674556209, 819.9631016604252, 871.8866547348846, 14432.855671443282, 14901.180435076067, 14930.552083437515, 14939.477118300862, 15074.623134421632, 14351.0, 14435.783463248059, 14465.0, 14520.05619634723, 14568.0, 795.3915254830046, 813.4265342933218, 816.244973399606, 817.3910436724618, 818.0347190315455, 669.170228916143, 780.1301548773106, 792.4690457393531, 803.8633432316491, 804.9718259860906, 846.0777752250046, 850.6937502499127, 853.3429259470204, 853.5476197615274, 855.0252711908429, 841.6549214821894, 841.6675413211777, 841.7054031089131, 842.3177226446597, 843.152631605239, 621.7450845153511, 625.7403177681257, 627.2285089340137, 627.2347735762363, 627.7300760672908, 13528.661783455394, 13590.38843252056, 13590.660233494144, 13609.047366684335, 13610.251436171007, 15204.771928421083, 15271.770923436157, 15435.30541125652, 15500.457483988119, 15766.448174313959, 12312.119446975174, 12392.132550721453, 12520.499180032788, 12567.622971310875, 12669.303188324639, 3858.2862170498547, 3969.186316805077, 4016.758994460342, 4111.075008123178, 4146.419501269825, 70948.29051709469, 72302.27697723008, 72571.91142132925, 72916.63541682258, 73178.63410682966, 11396.544138234543, 11536.25014374063, 11631.127665425127, 11698.70753231176, 12342.629721108382, 21986.670199947013, 22049.889750551145, 22092.0, 22198.556028879655, 22213.77786222117, 8016.0, 8148.185181481805, 8194.0, 8202.38482113844, 8203.138670439637, 4662.673612847136, 4741.383620129361, 4859.611231101503, 4893.975530122398, 4984.7258400788305, 3668.559772827278, 3784.924301513954, 3798.0504873781556, 3803.2773772983046, 3818.8472461101246, 620.6555361774168, 621.9378062193745, 647.7409036385484, 648.4326214562258, 649.870025994803, 619.2012304127625, 696.5228818259509, 698.2284575544053, 712.8859382498775, 730.5375588364773, 8618.698345557876, 9081.36822366691, 9125.205848595266, 9174.311926605531, 9223.86164207524, 555.8554775758332, 602.3073465514693, 624.5221759980857, 668.5721138471382, 682.8190529509585, 4300.247456695066, 4444.821359087653, 4477.462704475483, 4492.775361231926, 4555.0, 80602.0, 114646.0, 115620.42189788997, 115690.0, 116677.4166129181, 62557.374426256065, 79906.80139797907, 84278.0, 94714.52642736743, 100911.49544252378, 55183.17225241705, 83653.16346836576, 85939.57030214934, 86688.0, 87313.0, 9214.723558293263, 9388.57751401175, 9520.0, 9538.856917146388, 9620.95189524048, 39688.60311396964, 45515.54484455113, 45839.31241031321, 45868.77065614651, 47688.2846757292, 61936.69031654813, 74613.0, 75361.97104231539, 77429.0, 77486.6125669368, 11490.425478725863, 11556.364399957747, 11786.528538858693, 11900.86928782205, 12044.51821927113, 11212.27120237182, 11386.430678465878, 11599.362035088152, 13256.138351007154, 13358.398872050975, 10547.0, 11113.277636953571, 11167.664970050912, 11969.0, 12852.807207891701, 10716.89283107159, 10930.234883558074, 10950.835737463785, 11177.720556985814, 12607.810882836582, 11966.760664786829, 12124.939375303067, 12159.392030398622, 12191.451384687532, 12206.145569810027, 10053.798924021332, 10249.538770755185, 10417.687469375931, 10705.304155229886, 10787.460626968777, 9872.950635246778, 10182.81053140065, 10275.794484110425, 10423.043560624932, 11029.172812038969], "value": 7241.595002904496, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1543.5999999999997, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [111.0, 109.0, 112.0, 110.0, 112.0, 114.0, 114.0, 111.0, 112.0, 112.0], "value": 111.7, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [157.0, 133.0, 160.0, 181.0, 134.0, 158.0, 149.0, 128.0, 180.0, 128.0], "value": 150.8, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [171.0, 161.0, 162.0, 164.0, 162.0, 165.0, 179.0, 164.0, 163.0, 163.0], "value": 165.4, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [77.0, 75.0, 75.0, 165.0, 76.0, 75.0, 75.0, 76.0, 164.0, 75.0], "value": 93.3, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [86.0, 86.0, 150.0, 85.0, 85.0, 86.0, 157.0, 87.0, 85.0, 159.0], "value": 106.6, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [117.0, 118.0, 117.0, 117.0, 119.0, 118.0, 118.0, 117.0, 117.0, 117.0], "value": 117.5, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [147.0, 146.0, 147.0, 146.0, 147.0, 147.0, 147.0, 147.0, 147.0, 147.0], "value": 146.8, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [96.0, 95.0, 96.0, 95.0, 96.0, 95.0, 95.0, 97.0, 96.0, 95.0], "value": 95.6, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [54.0, 56.0, 55.0, 55.0, 56.0, 57.0, 60.0, 55.0, 55.0, 54.0], "value": 55.7, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [62.0, 61.0, 62.0, 62.0, 63.0, 62.0, 62.0, 64.0, 63.0, 62.0], "value": 62.3, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [79.0, 81.0, 80.0, 81.0, 82.0, 81.0, 81.0, 81.0, 109.0, 81.0], "value": 83.6, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [127.0, 122.0, 124.0, 123.0, 141.0, 123.0, 124.0, 126.0, 134.0, 124.0], "value": 126.8, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [171.0, 162.0, 165.0, 158.0, 161.0, 162.0, 175.0, 159.0, 164.0, 159.0], "value": 163.6, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [65.0, 65.0, 66.0, 63.0, 67.0, 63.0, 64.0, 61.0, 63.0, 62.0], "value": 63.9, "unit": "score"}]}]} 20:34:01 INFO - Return code: 0 20:34:01 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 20:34:01 ERROR - # TBPL SUCCESS # 20:34:01 INFO - Running post-action listener: _resource_record_post_action 20:34:01 INFO - ##### 20:34:01 INFO - ##### Finished run-tests step (success) 20:34:01 INFO - ##### 20:34:01 INFO - Running post-run listener: _resource_record_post_run 20:34:01 INFO - Total resource usage - Wall time: 1191s; CPU: 13.0%; Read bytes: 12288; Write bytes: 541450240; Read time: 284; Write time: 480696 20:34:01 INFO - TinderboxPrint: CPU usage
13.5% 20:34:01 INFO - TinderboxPrint: I/O read bytes / time
12,288 / 284 20:34:01 INFO - TinderboxPrint: I/O write bytes / time
541,450,240 / 480,696 20:34:01 INFO - TinderboxPrint: CPU idle
8,222.1 (86.5%) 20:34:01 INFO - TinderboxPrint: CPU user
1,225.1 (12.9%) 20:34:01 INFO - TinderboxPrint: Swap in / out
0 / 0 20:34:01 INFO - install - Wall time: 17s; CPU: 14.0%; Read bytes: 0; Write bytes: 247951360; Read time: 0; Write time: 257828 20:34:01 INFO - run-tests - Wall time: 1174s; CPU: 13.0%; Read bytes: 12288; Write bytes: 292794368; Read time: 284; Write time: 222836 20:34:02 INFO - Running post-run listener: _upload_blobber_files 20:34:02 INFO - Blob upload gear active. 20:34:02 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 20:34:02 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:34:02 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:34:02 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:34:02 INFO - (blobuploader) - INFO - Open directory for files ... 20:34:02 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 20:34:02 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 20:34:02 INFO - (blobuploader) - INFO - Uploading, attempt #1. 20:34:07 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 20:34:07 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 20:34:07 INFO - (blobuploader) - INFO - Done attempting. 20:34:07 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 20:34:07 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 20:34:07 INFO - (blobuploader) - INFO - Uploading, attempt #1. 20:34:07 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 20:34:07 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 20:34:07 INFO - (blobuploader) - INFO - Done attempting. 20:34:07 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 20:34:07 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 20:34:07 INFO - (blobuploader) - INFO - Uploading, attempt #1. 20:34:08 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 20:34:08 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 20:34:08 INFO - (blobuploader) - INFO - Done attempting. 20:34:08 INFO - (blobuploader) - INFO - Iteration through files over. 20:34:08 INFO - Return code: 0 20:34:08 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 20:34:08 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 20:34:08 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/f38b86463710aa86b3abc1cbe21bcea9457349cb0f1ec9b89eca418dafd9dbd88b51ee9e1c9290d61ae0fac1c018972254af4fe0c407c7c083691868cba7b9ce", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/464b0d2e4bb0d3e53d971b8711518e33d4ba0be816d1dc22e5e76e464916486eab8ea3f44a6cf9ebae78b9aafacab13fa68a7dbff844ffe73d693ddbd2e91bbf", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/878364dbea75de092d0b330755f76742fbf6b284fb28adeec4a2ffb3b479518e39d57a3d4c5d03739d76d63dd1ab3d4ee573178d85e9f41038561c783f2663d7"} 20:34:08 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 20:34:08 INFO - Writing to file /builds/slave/test/properties/blobber_files 20:34:08 INFO - Contents: 20:34:08 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/f38b86463710aa86b3abc1cbe21bcea9457349cb0f1ec9b89eca418dafd9dbd88b51ee9e1c9290d61ae0fac1c018972254af4fe0c407c7c083691868cba7b9ce", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/464b0d2e4bb0d3e53d971b8711518e33d4ba0be816d1dc22e5e76e464916486eab8ea3f44a6cf9ebae78b9aafacab13fa68a7dbff844ffe73d693ddbd2e91bbf", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/878364dbea75de092d0b330755f76742fbf6b284fb28adeec4a2ffb3b479518e39d57a3d4c5d03739d76d63dd1ab3d4ee573178d85e9f41038561c783f2663d7"} 20:34:08 INFO - Running post-run listener: copy_logs_to_upload_dir 20:34:08 INFO - Copying logs to upload dir... 20:34:08 INFO - mkdir: /builds/slave/test/build/upload/logs 20:34:08 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1241.150904 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 41 secs) (at 2016-06-06 20:34:07.803248) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-06-06 20:34:07.807006) ========= 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=232498196343f89f466a4a9a000001c8-1465268964.299842-1328781238 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/f38b86463710aa86b3abc1cbe21bcea9457349cb0f1ec9b89eca418dafd9dbd88b51ee9e1c9290d61ae0fac1c018972254af4fe0c407c7c083691868cba7b9ce", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/464b0d2e4bb0d3e53d971b8711518e33d4ba0be816d1dc22e5e76e464916486eab8ea3f44a6cf9ebae78b9aafacab13fa68a7dbff844ffe73d693ddbd2e91bbf", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/878364dbea75de092d0b330755f76742fbf6b284fb28adeec4a2ffb3b479518e39d57a3d4c5d03739d76d63dd1ab3d4ee573178d85e9f41038561c783f2663d7"} build_url:https://queue.taskcluster.net/v1/task/a8tDyd1PQrqA0w1kRzaQvw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011367 build_url: 'https://queue.taskcluster.net/v1/task/a8tDyd1PQrqA0w1kRzaQvw/artifacts/public/build/firefox-50.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/f38b86463710aa86b3abc1cbe21bcea9457349cb0f1ec9b89eca418dafd9dbd88b51ee9e1c9290d61ae0fac1c018972254af4fe0c407c7c083691868cba7b9ce", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/464b0d2e4bb0d3e53d971b8711518e33d4ba0be816d1dc22e5e76e464916486eab8ea3f44a6cf9ebae78b9aafacab13fa68a7dbff844ffe73d693ddbd2e91bbf", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/878364dbea75de092d0b330755f76742fbf6b284fb28adeec4a2ffb3b479518e39d57a3d4c5d03739d76d63dd1ab3d4ee573178d85e9f41038561c783f2663d7"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-06-06 20:34:07.833206) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-06-06 20:34:07.833640) ========= 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=232498196343f89f466a4a9a000001c8-1465268964.299842-1328781238 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004434 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-06-06 20:34:07.917404) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-06-06 20:34:07.917810) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-06-06 20:34:07.918142) ========= ========= Total master_lag: 0.19 =========