builder: mozilla-aurora_ubuntu64_hw_test-dromaeojs-e10s-pgo slave: talos-linux64-ix-043 starttime: 1464648648.56 results: success (0) buildid: 20160530120549 builduid: 7997d47d310b490c9d491deb39fe4327 revision: 3c7a33fe0b6472bf47264c2390c5bc19f1a6dce4 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-05-30 15:50:48.563998) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-05-30 15:50:48.564502) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-05-30 15:50:48.564781) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-05-30 15:50:48.599837) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-05-30 15:50:48.600158) ========= 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=d2a8c569965ab8367867b893000001a1-1464647802.778318-1934851532 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-05-30 15:50:48-- 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% 61.7M=0s 2016-05-30 15:50:48 (61.7 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.067251 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-05-30 15:50:48.686705) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-05-30 15:50:48.687056) ========= 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=d2a8c569965ab8367867b893000001a1-1464647802.778318-1934851532 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.017266 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-05-30 15:50:48.739290) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-05-30 15:50:48.740056) ========= bash -c 'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev 3c7a33fe0b6472bf47264c2390c5bc19f1a6dce4 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev 3c7a33fe0b6472bf47264c2390c5bc19f1a6dce4 --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=d2a8c569965ab8367867b893000001a1-1464647802.778318-1934851532 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-05-30 15:50:48,925 truncating revision to first 12 chars 2016-05-30 15:50:48,925 Setting DEBUG logging. 2016-05-30 15:50:48,925 attempt 1/10 2016-05-30 15:50:48,925 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/releases/mozilla-aurora/3c7a33fe0b64?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-05-30 15:50:49,258 unpacking tar archive at: mozilla-aurora-3c7a33fe0b64/testing/mozharness/ program finished with exit code 0 elapsedTime=0.675915 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-05-30 15:50:49.437586) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-05-30 15:50:49.437871) ========= script_repo_revision: 3c7a33fe0b6472bf47264c2390c5bc19f1a6dce4 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-05-30 15:50:49.438246) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-05-30 15:50:49.438529) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-05-30 15:50:49.465962) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 31 secs) (at 2016-05-30 15:50:49.466247) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Aurora --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora 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', 'Mozilla-Aurora', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-Aurora'] 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=d2a8c569965ab8367867b893000001a1-1464647802.778318-1934851532 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 15:50:49 INFO - MultiFileLogger online at 20160530 15:50:49 in /builds/slave/test 15:50:49 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Aurora --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora 15:50:49 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 15:50:49 INFO - {'append_to_log': False, 15:50:49 INFO - 'base_work_dir': '/builds/slave/test', 15:50:49 INFO - 'blob_upload_branch': 'Mozilla-Aurora', 15:50:49 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 15:50:49 INFO - 'branch': 'Mozilla-Aurora', 15:50:49 INFO - 'buildbot_json_path': 'buildprops.json', 15:50:49 INFO - 'config_files': ('talos/linux_config.py',), 15:50:49 INFO - 'default_actions': ('clobber', 15:50:49 INFO - 'read-buildbot-config', 15:50:49 INFO - 'download-and-extract', 15:50:49 INFO - 'populate-webroot', 15:50:49 INFO - 'create-virtualenv', 15:50:49 INFO - 'install', 15:50:49 INFO - 'run-tests'), 15:50:49 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 15:50:49 INFO - 'download_minidump_stackwalk': True, 15:50:49 INFO - 'download_symbols': 'ondemand', 15:50:49 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 15:50:49 INFO - 'tooltool.py': '/tools/tooltool.py', 15:50:49 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 15:50:49 INFO - '/tools/misc-python/virtualenv.py')}, 15:50:49 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 15:50:49 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 15:50:49 INFO - 'installer_path': 'installer.exe', 15:50:49 INFO - 'log_level': 'info', 15:50:49 INFO - 'log_name': 'talos', 15:50:49 INFO - 'log_to_console': True, 15:50:49 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 15:50:49 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 15:50:49 INFO - 'opt_config_files': (), 15:50:49 INFO - 'pip_index': False, 15:50:49 INFO - 'sps_profile': False, 15:50:49 INFO - 'sps_profile_interval': 0, 15:50:49 INFO - 'suite': 'dromaeojs-e10s', 15:50:49 INFO - 'system_bits': '32', 15:50:49 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 15:50:49 INFO - 'title': 'talos-linux64-ix-043', 15:50:49 INFO - 'tooltool_cache': '/builds/tooltool_cache', 15:50:49 INFO - 'use_talos_json': True, 15:50:49 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 15:50:49 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 15:50:49 INFO - 'work_dir': 'build'} 15:50:49 INFO - ##### 15:50:49 INFO - ##### Running clobber step. 15:50:49 INFO - ##### 15:50:49 INFO - Running pre-action listener: _resource_record_pre_action 15:50:49 INFO - Running main action method: clobber 15:50:49 INFO - rmtree: /builds/slave/test/build 15:50:49 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 15:50:50 INFO - Running post-action listener: _resource_record_post_action 15:50:50 INFO - ##### 15:50:50 INFO - ##### Running read-buildbot-config step. 15:50:50 INFO - ##### 15:50:50 INFO - Running pre-action listener: _resource_record_pre_action 15:50:50 INFO - Running main action method: read_buildbot_config 15:50:50 INFO - Using buildbot properties: 15:50:50 INFO - { 15:50:50 INFO - "project": "", 15:50:50 INFO - "product": "firefox", 15:50:50 INFO - "script_repo_revision": "production", 15:50:50 INFO - "builddir": "mozilla-aurora_ubuntu64_hw_test-dromaeojs-e10s", 15:50:50 INFO - "repository": "", 15:50:50 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-aurora pgo talos dromaeojs-e10s", 15:50:50 INFO - "buildid": "20160530120549", 15:50:50 INFO - "pgo_build": "True", 15:50:50 INFO - "basedir": "/builds/slave/test", 15:50:50 INFO - "buildnumber": 342, 15:50:50 INFO - "slavename": "talos-linux64-ix-043", 15:50:50 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 15:50:50 INFO - "platform": "ubuntu64_hw", 15:50:50 INFO - "scheduler": "tests-mozilla-aurora-linux64-pgo-talos", 15:50:50 INFO - "branch": "mozilla-aurora", 15:50:50 INFO - "repo_path": "releases/mozilla-aurora", 15:50:50 INFO - "revision": "3c7a33fe0b6472bf47264c2390c5bc19f1a6dce4", 15:50:50 INFO - "stage_platform": "linux64-pgo", 15:50:50 INFO - "builduid": "7997d47d310b490c9d491deb39fe4327", 15:50:50 INFO - "slavebuilddir": "test" 15:50:50 INFO - } 15:50:50 INFO - Found installer url https://queue.taskcluster.net/v1/task/PFkRtY74QaCv8vwtlU479g/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.tar.bz2. 15:50:50 INFO - Running post-action listener: _resource_record_post_action 15:50:50 INFO - ##### 15:50:50 INFO - ##### Running download-and-extract step. 15:50:50 INFO - ##### 15:50:50 INFO - Running pre-action listener: _resource_record_pre_action 15:50:50 INFO - Running main action method: download_and_extract 15:50:50 INFO - mkdir: /builds/slave/test/build/tests 15:50:50 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:50:50 INFO - https://queue.taskcluster.net/v1/task/PFkRtY74QaCv8vwtlU479g/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 15:50:50 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/PFkRtY74QaCv8vwtlU479g/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.test_packages.json 15:50:50 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/PFkRtY74QaCv8vwtlU479g/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.test_packages.json 15:50:50 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/PFkRtY74QaCv8vwtlU479g/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-48.0a2.en-US.linux-x86_64.test_packages.json 15:50:50 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/PFkRtY74QaCv8vwtlU479g/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-48.0a2.en-US.linux-x86_64.test_packages.json'}, attempt #1 15:50:54 INFO - Downloaded 1361 bytes. 15:50:54 INFO - Reading from file /builds/slave/test/build/firefox-48.0a2.en-US.linux-x86_64.test_packages.json 15:50:54 INFO - Using the following test package requirements: 15:50:54 INFO - {u'common': [u'firefox-48.0a2.en-US.linux-x86_64.common.tests.zip'], 15:50:54 INFO - u'cppunittest': [u'firefox-48.0a2.en-US.linux-x86_64.common.tests.zip', 15:50:54 INFO - u'firefox-48.0a2.en-US.linux-x86_64.cppunittest.tests.zip'], 15:50:54 INFO - u'gtest': [u'firefox-48.0a2.en-US.linux-x86_64.common.tests.zip', 15:50:54 INFO - u'firefox-48.0a2.en-US.linux-x86_64.gtest.tests.zip'], 15:50:54 INFO - u'jittest': [u'firefox-48.0a2.en-US.linux-x86_64.common.tests.zip', 15:50:54 INFO - u'jsshell-linux-x86_64.zip'], 15:50:54 INFO - u'mochitest': [u'firefox-48.0a2.en-US.linux-x86_64.common.tests.zip', 15:50:54 INFO - u'firefox-48.0a2.en-US.linux-x86_64.mochitest.tests.zip'], 15:50:54 INFO - u'mozbase': [u'firefox-48.0a2.en-US.linux-x86_64.common.tests.zip'], 15:50:54 INFO - u'reftest': [u'firefox-48.0a2.en-US.linux-x86_64.common.tests.zip', 15:50:54 INFO - u'firefox-48.0a2.en-US.linux-x86_64.reftest.tests.zip'], 15:50:54 INFO - u'talos': [u'firefox-48.0a2.en-US.linux-x86_64.common.tests.zip', 15:50:54 INFO - u'firefox-48.0a2.en-US.linux-x86_64.talos.tests.zip'], 15:50:54 INFO - u'web-platform': [u'firefox-48.0a2.en-US.linux-x86_64.common.tests.zip', 15:50:54 INFO - u'firefox-48.0a2.en-US.linux-x86_64.web-platform.tests.zip'], 15:50:54 INFO - u'xpcshell': [u'firefox-48.0a2.en-US.linux-x86_64.common.tests.zip', 15:50:54 INFO - u'firefox-48.0a2.en-US.linux-x86_64.xpcshell.tests.zip']} 15:50:54 INFO - Downloading packages: [u'firefox-48.0a2.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 15:50:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:50:54 INFO - https://queue.taskcluster.net/v1/task/PFkRtY74QaCv8vwtlU479g/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 15:50:54 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/PFkRtY74QaCv8vwtlU479g/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.common.tests.zip 15:50:54 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/PFkRtY74QaCv8vwtlU479g/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.common.tests.zip 15:50:54 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/PFkRtY74QaCv8vwtlU479g/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-48.0a2.en-US.linux-x86_64.common.tests.zip 15:50:54 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/PFkRtY74QaCv8vwtlU479g/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-48.0a2.en-US.linux-x86_64.common.tests.zip'}, attempt #1 15:50:57 INFO - Downloaded 24173994 bytes. 15:50:57 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-48.0a2.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 15:50:57 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-48.0a2.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 15:50:58 INFO - Return code: 0 15:50:58 INFO - Downloading packages: [u'firefox-48.0a2.en-US.linux-x86_64.common.tests.zip', u'firefox-48.0a2.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 15:50:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:50:58 INFO - https://queue.taskcluster.net/v1/task/PFkRtY74QaCv8vwtlU479g/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 15:50:58 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/PFkRtY74QaCv8vwtlU479g/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.common.tests.zip 15:50:58 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/PFkRtY74QaCv8vwtlU479g/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.common.tests.zip 15:50:58 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/PFkRtY74QaCv8vwtlU479g/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-48.0a2.en-US.linux-x86_64.common.tests.zip 15:50:58 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/PFkRtY74QaCv8vwtlU479g/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-48.0a2.en-US.linux-x86_64.common.tests.zip'}, attempt #1 15:50:59 INFO - Downloaded 24173994 bytes. 15:50:59 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-48.0a2.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 15:50:59 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-48.0a2.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 15:51:01 INFO - Return code: 0 15:51:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:51:01 INFO - https://queue.taskcluster.net/v1/task/PFkRtY74QaCv8vwtlU479g/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 15:51:01 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/PFkRtY74QaCv8vwtlU479g/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.talos.tests.zip 15:51:01 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/PFkRtY74QaCv8vwtlU479g/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.talos.tests.zip 15:51:01 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/PFkRtY74QaCv8vwtlU479g/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-48.0a2.en-US.linux-x86_64.talos.tests.zip 15:51:01 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/PFkRtY74QaCv8vwtlU479g/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-48.0a2.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 15:51:02 INFO - Downloaded 10840145 bytes. 15:51:02 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-48.0a2.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test/build/tests'] 15:51:02 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-48.0a2.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test/build/tests 15:51:02 INFO - Return code: 0 15:51: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')]} 15:51:02 INFO - https://queue.taskcluster.net/v1/task/PFkRtY74QaCv8vwtlU479g/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 15:51:02 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/PFkRtY74QaCv8vwtlU479g/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.tar.bz2 15:51:02 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/PFkRtY74QaCv8vwtlU479g/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.tar.bz2 15:51:02 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/PFkRtY74QaCv8vwtlU479g/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-48.0a2.en-US.linux-x86_64.tar.bz2 15:51:02 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/PFkRtY74QaCv8vwtlU479g/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-48.0a2.en-US.linux-x86_64.tar.bz2'}, attempt #1 15:51:04 INFO - Downloaded 62800628 bytes. 15:51:04 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/PFkRtY74QaCv8vwtlU479g/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.tar.bz2 15:51:04 INFO - mkdir: /builds/slave/test/properties 15:51:04 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 15:51:04 INFO - Writing to file /builds/slave/test/properties/build_url 15:51:04 INFO - Contents: 15:51:04 INFO - build_url:https://queue.taskcluster.net/v1/task/PFkRtY74QaCv8vwtlU479g/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.tar.bz2 15:51:04 INFO - Running post-action listener: _resource_record_post_action 15:51:04 INFO - Running post-action listener: set_extra_try_arguments 15:51:04 INFO - ##### 15:51:04 INFO - ##### Running populate-webroot step. 15:51:04 INFO - ##### 15:51:04 INFO - Running pre-action listener: _resource_record_pre_action 15:51:04 INFO - Running main action method: populate_webroot 15:51:04 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 15:51:04 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 15:51:04 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 15:51:04 INFO - '--tppagecycles', 15:51:04 INFO - '7'], 15:51:04 INFO - 'tests': ['tsvgm']}}, 15:51:04 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 15:51:04 INFO - 'tests': ['tresize', 'tcanvasmark']}, 15:51:04 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 15:51:04 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 15:51:04 INFO - 'tests': ['dromaeo_css', 'kraken']}, 15:51:04 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 15:51:04 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:51:04 INFO - 'talos_options': ['--disable-e10s'], 15:51:04 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 15:51:04 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:51:04 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 15:51:04 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:51:04 INFO - 'talos_options': ['--disable-e10s'], 15:51:04 INFO - 'tests': ['damp', 'tps']}, 15:51:04 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:51:04 INFO - 'tests': ['damp', 'tps']}, 15:51:04 INFO - 'g3': {'talos_options': ['--disable-e10s'], 15:51:04 INFO - 'tests': ['dromaeo_dom']}, 15:51:04 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 15:51:04 INFO - 'other': {'talos_options': ['--disable-e10s'], 15:51:04 INFO - 'tests': ['a11yr', 15:51:04 INFO - 'ts_paint', 15:51:04 INFO - 'tpaint', 15:51:04 INFO - 'sessionrestore', 15:51:04 INFO - 'sessionrestore_no_auto_restore', 15:51:04 INFO - 'tabpaint']}, 15:51:04 INFO - 'other-e10s': {'tests': ['a11yr', 15:51:04 INFO - 'ts_paint', 15:51:04 INFO - 'tpaint', 15:51:04 INFO - 'sessionrestore', 15:51:04 INFO - 'sessionrestore_no_auto_restore', 15:51:04 INFO - 'tabpaint']}, 15:51:04 INFO - 'other-e10s_l64': {'tests': ['a11yr', 15:51:04 INFO - 'ts_paint', 15:51:04 INFO - 'tpaint', 15:51:04 INFO - 'sessionrestore', 15:51:04 INFO - 'sessionrestore_no_auto_restore', 15:51:04 INFO - 'tabpaint']}, 15:51:04 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 15:51:04 INFO - 'ts_paint', 15:51:04 INFO - 'tpaint', 15:51:04 INFO - 'sessionrestore', 15:51:04 INFO - 'sessionrestore_no_auto_restore', 15:51:04 INFO - 'tabpaint']}, 15:51:04 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 15:51:04 INFO - 'tests': ['a11yr', 15:51:04 INFO - 'ts_paint', 15:51:04 INFO - 'tpaint', 15:51:04 INFO - 'sessionrestore', 15:51:04 INFO - 'sessionrestore_no_auto_restore', 15:51:04 INFO - 'tabpaint']}, 15:51:04 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 15:51:04 INFO - 'tests': ['a11yr', 15:51:04 INFO - 'ts_paint', 15:51:04 INFO - 'tpaint', 15:51:04 INFO - 'sessionrestore', 15:51:04 INFO - 'sessionrestore_no_auto_restore', 15:51:04 INFO - 'tabpaint']}, 15:51:04 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 15:51:04 INFO - 'tests': ['tsvgx', 15:51:04 INFO - 'tsvgr_opacity', 15:51:04 INFO - 'tart', 15:51:04 INFO - 'tscrollx', 15:51:04 INFO - 'cart']}, 15:51:04 INFO - 'svgr-e10s': {'tests': ['tsvgx', 15:51:04 INFO - 'tsvgr_opacity', 15:51:04 INFO - 'tart', 15:51:04 INFO - 'tscrollx', 15:51:04 INFO - 'cart']}, 15:51:04 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:51:04 INFO - 'talos_options': ['--disable-e10s'], 15:51:04 INFO - 'tests': ['tp5o']}, 15:51:04 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:51:04 INFO - 'tests': ['tp5o']}, 15:51:04 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:51:04 INFO - 'talos_options': ['--disable-e10s', 15:51:04 INFO - '--xperf_path', 15:51:04 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 15:51:04 INFO - 'tests': ['tp5n']}, 15:51:04 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:51:04 INFO - 'talos_options': ['--xperf_path', 15:51:04 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 15:51:04 INFO - 'tests': ['tp5n']}}, 15:51:04 INFO - 'talos.zip': {'path': '', 15:51:04 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 15:51:04 INFO - Running post-action listener: _resource_record_post_action 15:51:04 INFO - ##### 15:51:04 INFO - ##### Running create-virtualenv step. 15:51:04 INFO - ##### 15:51:04 INFO - Running pre-action listener: _resource_record_pre_action 15:51:04 INFO - Running main action method: create_virtualenv 15:51:04 INFO - Creating virtualenv /builds/slave/test/build/venv 15:51:04 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 15:51:04 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 15:51:04 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 15:51:04 INFO - Using real prefix '/usr' 15:51:04 INFO - New python executable in /builds/slave/test/build/venv/bin/python 15:51:05 INFO - Installing distribute.............................................................................................................................................................................................done. 15:51:07 INFO - Installing pip.................done. 15:51:07 INFO - Return code: 0 15:51:07 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 15:51: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')]} 15:51:07 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:51:07 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:51: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')]} 15:51:07 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:51:07 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:51: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', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f5e9df40f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x277a8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x28455a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28d4410>, '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 0x28d5310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x28d57a0>, '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': 'd2a8c569965ab8367867b893000001a1-1464647802.778318-1934851532', '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 15:51: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', 'pip>=1.5'] in /builds/slave/test/build 15:51: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 pip>=1.5 15:51:07 INFO - Using env: {'DISPLAY': ':0', 15:51:07 INFO - 'HOME': '/home/cltbld', 15:51:07 INFO - 'LANG': 'en_US.UTF-8', 15:51:07 INFO - 'LANGUAGE': 'en_US:en', 15:51:07 INFO - 'LOGNAME': 'cltbld', 15:51:07 INFO - 'MAIL': '/var/mail/cltbld', 15:51:07 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:51:07 INFO - 'MOZ_NO_REMOTE': '1', 15:51:07 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:51:07 INFO - 'NO_EM_RESTART': '1', 15:51:07 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:51:07 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:51:07 INFO - 'PWD': '/builds/slave/test', 15:51:07 INFO - 'SHELL': '/bin/bash', 15:51:07 INFO - 'SHLVL': '1', 15:51:07 INFO - 'TERM': 'linux', 15:51:07 INFO - 'TMOUT': '86400', 15:51:07 INFO - 'USER': 'cltbld', 15:51:07 INFO - 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1464647802.778318-1934851532', 15:51:07 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:51:07 INFO - '_': '/tools/buildbot/bin/python'} 15:51:07 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:51:07 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 15:51:07 INFO - Cleaning up... 15:51:07 INFO - Return code: 0 15:51:07 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 15:51: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')]} 15:51:07 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:51:07 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:51: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')]} 15:51:07 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:51:07 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:51: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', 'psutil>=0.7.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f5e9df40f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x277a8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x28455a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28d4410>, '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 0x28d5310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x28d57a0>, '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': 'd2a8c569965ab8367867b893000001a1-1464647802.778318-1934851532', '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 15:51: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', 'psutil>=0.7.1'] in /builds/slave/test/build 15:51: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 psutil>=0.7.1 15:51:07 INFO - Using env: {'DISPLAY': ':0', 15:51:07 INFO - 'HOME': '/home/cltbld', 15:51:07 INFO - 'LANG': 'en_US.UTF-8', 15:51:07 INFO - 'LANGUAGE': 'en_US:en', 15:51:07 INFO - 'LOGNAME': 'cltbld', 15:51:07 INFO - 'MAIL': '/var/mail/cltbld', 15:51:07 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:51:07 INFO - 'MOZ_NO_REMOTE': '1', 15:51:07 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:51:07 INFO - 'NO_EM_RESTART': '1', 15:51:07 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:51:07 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:51:07 INFO - 'PWD': '/builds/slave/test', 15:51:07 INFO - 'SHELL': '/bin/bash', 15:51:07 INFO - 'SHLVL': '1', 15:51:07 INFO - 'TERM': 'linux', 15:51:07 INFO - 'TMOUT': '86400', 15:51:07 INFO - 'USER': 'cltbld', 15:51:07 INFO - 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1464647802.778318-1934851532', 15:51:07 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:51:07 INFO - '_': '/tools/buildbot/bin/python'} 15:51:07 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:51:07 INFO - Downloading/unpacking psutil>=0.7.1 15:51: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 15:51: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 15:51: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 15:51: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 15:51: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 15:51: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 15:51:09 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 15:51:09 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 15:51:09 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 15:51:09 INFO - Installing collected packages: psutil 15:51:09 INFO - Running setup.py install for psutil 15:51:09 INFO - building 'psutil._psutil_linux' extension 15:51:09 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 15:51:10 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 15:51:10 INFO - building 'psutil._psutil_posix' extension 15:51:10 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 15:51:10 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 15:51:10 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 15:51:10 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 15:51:10 INFO - Successfully installed psutil 15:51:10 INFO - Cleaning up... 15:51:10 INFO - Return code: 0 15:51:10 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 15:51:10 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')]} 15:51:10 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:51:10 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:51:10 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')]} 15:51:10 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:51:10 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:51:10 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f5e9df40f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x277a8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x28455a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28d4410>, '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 0x28d5310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x28d57a0>, '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': 'd2a8c569965ab8367867b893000001a1-1464647802.778318-1934851532', '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 15:51:10 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0'] in /builds/slave/test/build 15:51:10 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.0.0 15:51:10 INFO - Using env: {'DISPLAY': ':0', 15:51:10 INFO - 'HOME': '/home/cltbld', 15:51:10 INFO - 'LANG': 'en_US.UTF-8', 15:51:10 INFO - 'LANGUAGE': 'en_US:en', 15:51:10 INFO - 'LOGNAME': 'cltbld', 15:51:10 INFO - 'MAIL': '/var/mail/cltbld', 15:51:10 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:51:10 INFO - 'MOZ_NO_REMOTE': '1', 15:51:10 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:51:10 INFO - 'NO_EM_RESTART': '1', 15:51:10 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:51:10 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:51:10 INFO - 'PWD': '/builds/slave/test', 15:51:10 INFO - 'SHELL': '/bin/bash', 15:51:10 INFO - 'SHLVL': '1', 15:51:10 INFO - 'TERM': 'linux', 15:51:10 INFO - 'TMOUT': '86400', 15:51:10 INFO - 'USER': 'cltbld', 15:51:10 INFO - 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1464647802.778318-1934851532', 15:51:10 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:51:10 INFO - '_': '/tools/buildbot/bin/python'} 15:51:10 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:51:10 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 15:51:10 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:51:10 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:51:10 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:51:10 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:51:10 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:51:10 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:51:12 INFO - Downloading mozsystemmonitor-0.0.tar.gz 15:51:12 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 15:51:12 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 15:51:12 INFO - Installing collected packages: mozsystemmonitor 15:51:12 INFO - Running setup.py install for mozsystemmonitor 15:51:12 INFO - Successfully installed mozsystemmonitor 15:51:12 INFO - Cleaning up... 15:51:12 INFO - Return code: 0 15:51:12 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 15:51:12 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')]} 15:51:12 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:51:12 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:51:12 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')]} 15:51:12 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:51:12 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:51:12 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 0x7f5e9df40f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x277a8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x28455a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28d4410>, '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 0x28d5310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x28d57a0>, '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': 'd2a8c569965ab8367867b893000001a1-1464647802.778318-1934851532', '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 15:51:12 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 15:51:12 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 15:51:12 INFO - Using env: {'DISPLAY': ':0', 15:51:12 INFO - 'HOME': '/home/cltbld', 15:51:12 INFO - 'LANG': 'en_US.UTF-8', 15:51:12 INFO - 'LANGUAGE': 'en_US:en', 15:51:12 INFO - 'LOGNAME': 'cltbld', 15:51:12 INFO - 'MAIL': '/var/mail/cltbld', 15:51:12 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:51:12 INFO - 'MOZ_NO_REMOTE': '1', 15:51:12 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:51:12 INFO - 'NO_EM_RESTART': '1', 15:51:12 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:51:12 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:51:12 INFO - 'PWD': '/builds/slave/test', 15:51:12 INFO - 'SHELL': '/bin/bash', 15:51:12 INFO - 'SHLVL': '1', 15:51:12 INFO - 'TERM': 'linux', 15:51:12 INFO - 'TMOUT': '86400', 15:51:12 INFO - 'USER': 'cltbld', 15:51:12 INFO - 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1464647802.778318-1934851532', 15:51:12 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:51:12 INFO - '_': '/tools/buildbot/bin/python'} 15:51:12 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:51:12 INFO - Downloading/unpacking blobuploader==1.2.4 15:51:12 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:51:12 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:51:12 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:51:12 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:51:12 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:51:12 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:51:14 INFO - Downloading blobuploader-1.2.4.tar.gz 15:51:14 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 15:51:14 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 15:51:14 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:51:14 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:51:14 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:51:14 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:51:14 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:51:14 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:51:15 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 15:51:15 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 15:51:15 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 15:51:15 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 15:51:15 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 15:51:15 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 15:51:15 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 15:51:15 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 15:51:15 INFO - Downloading docopt-0.6.1.tar.gz 15:51:15 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 15:51:15 INFO - Installing collected packages: blobuploader, requests, docopt 15:51:15 INFO - Running setup.py install for blobuploader 15:51:15 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 15:51:15 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 15:51:15 INFO - Running setup.py install for requests 15:51:16 INFO - Running setup.py install for docopt 15:51:16 INFO - Successfully installed blobuploader requests docopt 15:51:16 INFO - Cleaning up... 15:51:16 INFO - Return code: 0 15:51:16 INFO - Installing None into virtualenv /builds/slave/test/build/venv 15:51:16 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')]} 15:51:16 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:51:16 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:51:16 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')]} 15:51:16 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:51:16 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:51:16 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 0x7f5e9df40f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x277a8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x28455a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28d4410>, '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 0x28d5310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x28d57a0>, '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': 'd2a8c569965ab8367867b893000001a1-1464647802.778318-1934851532', '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 15:51:16 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 15:51:16 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 15:51:16 INFO - Using env: {'DISPLAY': ':0', 15:51:16 INFO - 'HOME': '/home/cltbld', 15:51:16 INFO - 'LANG': 'en_US.UTF-8', 15:51:16 INFO - 'LANGUAGE': 'en_US:en', 15:51:16 INFO - 'LOGNAME': 'cltbld', 15:51:16 INFO - 'MAIL': '/var/mail/cltbld', 15:51:16 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:51:16 INFO - 'MOZ_NO_REMOTE': '1', 15:51:16 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:51:16 INFO - 'NO_EM_RESTART': '1', 15:51:16 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:51:16 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:51:16 INFO - 'PWD': '/builds/slave/test', 15:51:16 INFO - 'SHELL': '/bin/bash', 15:51:16 INFO - 'SHLVL': '1', 15:51:16 INFO - 'TERM': 'linux', 15:51:16 INFO - 'TMOUT': '86400', 15:51:16 INFO - 'USER': 'cltbld', 15:51:16 INFO - 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1464647802.778318-1934851532', 15:51:16 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:51:16 INFO - '_': '/tools/buildbot/bin/python'} 15:51:16 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:51:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 15:51:16 INFO - Running setup.py (path:/tmp/pip-PjTCxT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 15:51:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 15:51:16 INFO - Running setup.py (path:/tmp/pip-pZZRXy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 15:51:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 15:51:16 INFO - Running setup.py (path:/tmp/pip-6su4xH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 15:51:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 15:51:16 INFO - Running setup.py (path:/tmp/pip-r58nw9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 15:51:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 15:51:16 INFO - Running setup.py (path:/tmp/pip-mkqk9s-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 15:51:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 15:51:16 INFO - Running setup.py (path:/tmp/pip-e9y2ou-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 15:51:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 15:51:16 INFO - Running setup.py (path:/tmp/pip-4XNOTa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 15:51:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 15:51:16 INFO - Running setup.py (path:/tmp/pip-ZqlpQF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 15:51:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 15:51:16 INFO - Running setup.py (path:/tmp/pip-LYVJkx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 15:51:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 15:51:17 INFO - Running setup.py (path:/tmp/pip-jBuHy0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 15:51:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 15:51:17 INFO - Running setup.py (path:/tmp/pip-loocCO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 15:51:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 15:51:17 INFO - Running setup.py (path:/tmp/pip-0_QW1h-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 15:51:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 15:51:17 INFO - Running setup.py (path:/tmp/pip-mB1qVD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 15:51:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 15:51:17 INFO - Running setup.py (path:/tmp/pip-TLFiSQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 15:51:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 15:51:17 INFO - Running setup.py (path:/tmp/pip-ePXgWJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 15:51:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 15:51:17 INFO - Running setup.py (path:/tmp/pip-EERujv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 15:51:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 15:51:17 INFO - Running setup.py (path:/tmp/pip-LzPKWV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 15:51:17 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 15:51:17 INFO - Running setup.py install for manifestparser 15:51:17 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 15:51:17 INFO - Running setup.py install for mozcrash 15:51:17 INFO - Running setup.py install for mozdebug 15:51:17 INFO - Running setup.py install for mozdevice 15:51:18 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 15:51:18 INFO - Installing dm script to /builds/slave/test/build/venv/bin 15:51:18 INFO - Running setup.py install for mozfile 15:51:18 INFO - Running setup.py install for mozhttpd 15:51:18 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 15:51:18 INFO - Running setup.py install for mozinfo 15:51:18 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 15:51:18 INFO - Running setup.py install for mozInstall 15:51:18 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 15:51:18 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 15:51:18 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 15:51:18 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 15:51:18 INFO - Running setup.py install for mozleak 15:51:18 INFO - Running setup.py install for mozlog 15:51:18 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 15:51:18 INFO - Running setup.py install for moznetwork 15:51:18 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 15:51:18 INFO - Running setup.py install for mozprocess 15:51:18 INFO - Running setup.py install for mozprofile 15:51:18 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 15:51:18 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 15:51:18 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 15:51:18 INFO - Running setup.py install for mozrunner 15:51:19 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 15:51:19 INFO - Running setup.py install for mozscreenshot 15:51:19 INFO - Running setup.py install for moztest 15:51:19 INFO - Running setup.py install for mozversion 15:51:19 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 15:51:19 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 15:51:19 INFO - Cleaning up... 15:51:19 INFO - Return code: 0 15:51:19 INFO - Installing None into virtualenv /builds/slave/test/build/venv 15:51:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:51:19 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:51:19 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:51:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:51:19 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:51:19 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:51:19 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 0x7f5e9df40f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x277a8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x28455a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28d4410>, '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 0x28d5310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x28d57a0>, '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': 'd2a8c569965ab8367867b893000001a1-1464647802.778318-1934851532', '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 15:51:19 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 15:51:19 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 15:51:19 INFO - Using env: {'DISPLAY': ':0', 15:51:19 INFO - 'HOME': '/home/cltbld', 15:51:19 INFO - 'LANG': 'en_US.UTF-8', 15:51:19 INFO - 'LANGUAGE': 'en_US:en', 15:51:19 INFO - 'LOGNAME': 'cltbld', 15:51:19 INFO - 'MAIL': '/var/mail/cltbld', 15:51:19 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:51:19 INFO - 'MOZ_NO_REMOTE': '1', 15:51:19 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:51:19 INFO - 'NO_EM_RESTART': '1', 15:51:19 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:51:19 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:51:19 INFO - 'PWD': '/builds/slave/test', 15:51:19 INFO - 'SHELL': '/bin/bash', 15:51:19 INFO - 'SHLVL': '1', 15:51:19 INFO - 'TERM': 'linux', 15:51:19 INFO - 'TMOUT': '86400', 15:51:19 INFO - 'USER': 'cltbld', 15:51:19 INFO - 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1464647802.778318-1934851532', 15:51:19 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:51:19 INFO - '_': '/tools/buildbot/bin/python'} 15:51:19 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:51:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 15:51:19 INFO - Running setup.py (path:/tmp/pip-fQYkoU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 15:51:19 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)) 15:51:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 15:51:19 INFO - Running setup.py (path:/tmp/pip-_vcWHl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 15:51:19 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)) 15:51:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 15:51:19 INFO - Running setup.py (path:/tmp/pip-n4ciKY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 15:51:19 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)) 15:51:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 15:51:19 INFO - Running setup.py (path:/tmp/pip-6lsb9I-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 15:51:19 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)) 15:51:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 15:51:19 INFO - Running setup.py (path:/tmp/pip-z5O22Y-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 15:51:20 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)) 15:51:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 15:51:20 INFO - Running setup.py (path:/tmp/pip-ESPFCp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 15:51:20 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)) 15:51:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 15:51:20 INFO - Running setup.py (path:/tmp/pip-I75WXk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 15:51:20 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)) 15:51:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 15:51:20 INFO - Running setup.py (path:/tmp/pip-GSkDL_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 15:51:20 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)) 15:51:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 15:51:20 INFO - Running setup.py (path:/tmp/pip-BJaK8J-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 15:51:20 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)) 15:51:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 15:51:20 INFO - Running setup.py (path:/tmp/pip-dmsIy5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 15:51:20 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.1 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 15:51:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 15:51:20 INFO - Running setup.py (path:/tmp/pip-OxLRbX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 15:51:20 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)) 15:51:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 15:51:20 INFO - Running setup.py (path:/tmp/pip-J3Tdww-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 15:51:20 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)) 15:51:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 15:51:20 INFO - Running setup.py (path:/tmp/pip-6oYa0H-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 15:51:20 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)) 15:51:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 15:51:20 INFO - Running setup.py (path:/tmp/pip-kHuSyM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 15:51:20 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)) 15:51:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 15:51:20 INFO - Running setup.py (path:/tmp/pip-fcV84P-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 15:51:20 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)) 15:51:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 15:51:20 INFO - Running setup.py (path:/tmp/pip-P83suS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 15:51:20 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)) 15:51:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 15:51:20 INFO - Running setup.py (path:/tmp/pip-tPVPwK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 15:51:20 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)) 15:51:20 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)) 15:51:20 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)) 15:51:20 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)) 15:51:20 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)) 15:51:20 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)) 15:51:20 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 15:51:20 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 15:51:20 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 15:51:20 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 15:51:20 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 15:51:20 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 15:51:20 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 15:51:22 INFO - Downloading blessings-1.6.tar.gz 15:51:22 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 15:51:22 INFO - Installing collected packages: blessings 15:51:22 INFO - Running setup.py install for blessings 15:51:22 INFO - Successfully installed blessings 15:51:22 INFO - Cleaning up... 15:51:22 INFO - Return code: 0 15:51:22 INFO - Done creating virtualenv /builds/slave/test/build/venv. 15:51:22 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 15:51:22 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 15:51:23 INFO - Reading from file tmpfile_stdout 15:51:23 INFO - Current package versions: 15:51:23 INFO - argparse == 1.2.1 15:51:23 INFO - blessings == 1.6 15:51:23 INFO - blobuploader == 1.2.4 15:51:23 INFO - docopt == 0.6.1 15:51:23 INFO - manifestparser == 1.1 15:51:23 INFO - mozInstall == 1.12 15:51:23 INFO - mozcrash == 0.17 15:51:23 INFO - mozdebug == 0.1 15:51:23 INFO - mozdevice == 0.48 15:51:23 INFO - mozfile == 1.2 15:51:23 INFO - mozhttpd == 0.7 15:51:23 INFO - mozinfo == 0.9 15:51:23 INFO - mozleak == 0.1 15:51:23 INFO - mozlog == 3.1 15:51:23 INFO - moznetwork == 0.27 15:51:23 INFO - mozprocess == 0.22 15:51:23 INFO - mozprofile == 0.28 15:51:23 INFO - mozrunner == 6.11 15:51:23 INFO - mozscreenshot == 0.1 15:51:23 INFO - mozsystemmonitor == 0.0 15:51:23 INFO - moztest == 0.7 15:51:23 INFO - mozversion == 1.4 15:51:23 INFO - psutil == 3.1.1 15:51:23 INFO - requests == 1.2.3 15:51:23 INFO - wsgiref == 0.1.2 15:51:23 INFO - Installing None into virtualenv /builds/slave/test/build/venv 15:51:23 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')]} 15:51:23 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:51:23 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:51:23 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')]} 15:51:23 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:51:23 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:51:23 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 0x7f5e9df40f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x277a8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x28455a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28d4410>, '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 0x28d5310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x28d57a0>, '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': 'd2a8c569965ab8367867b893000001a1-1464647802.778318-1934851532', '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 15:51:23 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 15:51:23 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 15:51:23 INFO - Using env: {'DISPLAY': ':0', 15:51:23 INFO - 'HOME': '/home/cltbld', 15:51:23 INFO - 'LANG': 'en_US.UTF-8', 15:51:23 INFO - 'LANGUAGE': 'en_US:en', 15:51:23 INFO - 'LOGNAME': 'cltbld', 15:51:23 INFO - 'MAIL': '/var/mail/cltbld', 15:51:23 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:51:23 INFO - 'MOZ_NO_REMOTE': '1', 15:51:23 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:51:23 INFO - 'NO_EM_RESTART': '1', 15:51:23 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:51:23 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:51:23 INFO - 'PWD': '/builds/slave/test', 15:51:23 INFO - 'SHELL': '/bin/bash', 15:51:23 INFO - 'SHLVL': '1', 15:51:23 INFO - 'TERM': 'linux', 15:51:23 INFO - 'TMOUT': '86400', 15:51:23 INFO - 'USER': 'cltbld', 15:51:23 INFO - 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1464647802.778318-1934851532', 15:51:23 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:51:23 INFO - '_': '/tools/buildbot/bin/python'} 15:51:23 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:51:23 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)) 15:51:23 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)) 15:51:23 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)) 15:51:23 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)) 15:51:23 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)) 15:51:23 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)) 15:51:23 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)) 15:51:23 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)) 15:51:23 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)) 15:51:23 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)) 15:51:23 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)) 15:51:23 INFO - Cleaning up... 15:51:23 INFO - Return code: 0 15:51:23 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 15:51:23 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')]} 15:51:23 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:51:23 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:51:23 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')]} 15:51:23 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:51:23 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:51:23 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 0x7f5e9df40f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x277a8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x28455a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28d4410>, '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 0x28d5310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x28d57a0>, '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': 'd2a8c569965ab8367867b893000001a1-1464647802.778318-1934851532', '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 15:51:23 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 15:51:23 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 15:51:23 INFO - Using env: {'DISPLAY': ':0', 15:51:23 INFO - 'HOME': '/home/cltbld', 15:51:23 INFO - 'LANG': 'en_US.UTF-8', 15:51:23 INFO - 'LANGUAGE': 'en_US:en', 15:51:23 INFO - 'LOGNAME': 'cltbld', 15:51:23 INFO - 'MAIL': '/var/mail/cltbld', 15:51:23 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:51:23 INFO - 'MOZ_NO_REMOTE': '1', 15:51:23 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:51:23 INFO - 'NO_EM_RESTART': '1', 15:51:23 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:51:23 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:51:23 INFO - 'PWD': '/builds/slave/test', 15:51:23 INFO - 'SHELL': '/bin/bash', 15:51:23 INFO - 'SHLVL': '1', 15:51:23 INFO - 'TERM': 'linux', 15:51:23 INFO - 'TMOUT': '86400', 15:51:23 INFO - 'USER': 'cltbld', 15:51:23 INFO - 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1464647802.778318-1934851532', 15:51:23 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:51:23 INFO - '_': '/tools/buildbot/bin/python'} 15:51:23 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:51:23 INFO - Downloading/unpacking jsonschema 15:51:23 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 15:51:23 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 15:51:23 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 15:51:23 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 15:51:23 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 15:51:23 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 15:51:25 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 15:51:25 INFO - Downloading/unpacking functools32 (from jsonschema) 15:51:25 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 15:51:25 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 15:51:25 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 15:51:25 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 15:51:25 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 15:51:25 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 15:51:25 INFO - Downloading functools32-3.2.3-2.tar.gz 15:51:25 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 15:51:25 INFO - warning: no files found matching '*.txt' 15:51:25 INFO - no previously-included directories found matching 'build' 15:51:25 INFO - no previously-included directories found matching 'dist' 15:51:25 INFO - no previously-included directories found matching '.git*' 15:51:25 INFO - Installing collected packages: jsonschema, functools32 15:51:25 INFO - Running setup.py install for functools32 15:51:25 INFO - warning: no files found matching '*.txt' 15:51:25 INFO - no previously-included directories found matching 'build' 15:51:25 INFO - no previously-included directories found matching 'dist' 15:51:25 INFO - no previously-included directories found matching '.git*' 15:51:25 INFO - Successfully installed jsonschema functools32 15:51:25 INFO - Cleaning up... 15:51:26 INFO - Return code: 0 15:51:26 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 15:51:26 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:51:26 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:51:26 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:51:26 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:51:26 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:51:26 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:51:26 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 0x7f5e9df40f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x277a8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x28455a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28d4410>, '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 0x28d5310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x28d57a0>, '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': 'd2a8c569965ab8367867b893000001a1-1464647802.778318-1934851532', '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 15:51:26 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 15:51:26 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 15:51:26 INFO - Using env: {'DISPLAY': ':0', 15:51:26 INFO - 'HOME': '/home/cltbld', 15:51:26 INFO - 'LANG': 'en_US.UTF-8', 15:51:26 INFO - 'LANGUAGE': 'en_US:en', 15:51:26 INFO - 'LOGNAME': 'cltbld', 15:51:26 INFO - 'MAIL': '/var/mail/cltbld', 15:51:26 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:51:26 INFO - 'MOZ_NO_REMOTE': '1', 15:51:26 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:51:26 INFO - 'NO_EM_RESTART': '1', 15:51:26 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:51:26 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:51:26 INFO - 'PWD': '/builds/slave/test', 15:51:26 INFO - 'SHELL': '/bin/bash', 15:51:26 INFO - 'SHLVL': '1', 15:51:26 INFO - 'TERM': 'linux', 15:51:26 INFO - 'TMOUT': '86400', 15:51:26 INFO - 'USER': 'cltbld', 15:51:26 INFO - 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1464647802.778318-1934851532', 15:51:26 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:51:26 INFO - '_': '/tools/buildbot/bin/python'} 15:51:26 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:51:26 INFO - Downloading/unpacking flake8 15:51:26 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:51:26 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:51:26 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:51:26 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:51:26 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:51:26 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:51:28 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 15:51:28 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 15:51:28 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 15:51:28 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 15:51:28 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 15:51:28 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 15:51:28 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 15:51:28 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 15:51:28 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 15:51:28 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 15:51:28 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 15:51:28 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 15:51:28 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 15:51:28 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 15:51:28 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 15:51:28 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 15:51:28 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 15:51:28 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 15:51:28 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 15:51:28 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 15:51:28 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 15:51:28 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 15:51:28 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 15:51:28 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 15:51:28 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 15:51:28 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 15:51:28 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 15:51:28 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 15:51:28 INFO - no previously-included directories found matching 'docs/_build' 15:51:28 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 15:51:28 INFO - Running setup.py install for pep8 15:51:28 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 15:51:28 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 15:51:28 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 15:51:28 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 15:51:28 INFO - no previously-included directories found matching 'docs/_build' 15:51:29 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 15:51:29 INFO - Successfully installed flake8 mccabe pyflakes pep8 15:51:29 INFO - Cleaning up... 15:51:29 INFO - Return code: 0 15:51:29 INFO - Running post-action listener: _resource_record_post_action 15:51:29 INFO - Running post-action listener: _start_resource_monitoring 15:51:29 INFO - Starting resource monitoring. 15:51:29 INFO - ##### 15:51:29 INFO - ##### Running install step. 15:51:29 INFO - ##### 15:51:29 INFO - Running pre-action listener: _resource_record_pre_action 15:51:29 INFO - Running main action method: install 15:51:29 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 15:51:29 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 15:51:29 INFO - Reading from file tmpfile_stdout 15:51:29 INFO - Detecting whether we're running mozinstall >=1.0... 15:51:29 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 15:51:29 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 15:51:29 INFO - Reading from file tmpfile_stdout 15:51:29 INFO - Output received: 15:51:29 INFO - Usage: mozinstall [options] installer 15:51:29 INFO - Options: 15:51:29 INFO - -h, --help show this help message and exit 15:51:29 INFO - -d DEST, --destination=DEST 15:51:29 INFO - Directory to install application into. [default: 15:51:29 INFO - "/builds/slave/test"] 15:51:29 INFO - --app=APP Application being installed. [default: firefox] 15:51:29 INFO - mkdir: /builds/slave/test/build/application 15:51:29 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-48.0a2.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 15:51:29 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-48.0a2.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 15:51:44 INFO - Reading from file tmpfile_stdout 15:51:45 INFO - Output received: 15:51:45 INFO - /builds/slave/test/build/application/firefox/firefox 15:51:45 INFO - Running post-action listener: _resource_record_post_action 15:51:45 INFO - ##### 15:51:45 INFO - ##### Running run-tests step. 15:51:45 INFO - ##### 15:51:45 INFO - Running pre-action listener: _resource_record_pre_action 15:51:45 INFO - Running main action method: run_tests 15:51:45 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 15:51:45 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 15:51:45 INFO - Python 2.7.3 15:51:45 INFO - Return code: 0 15:51:45 INFO - grabbing minidump binary from tooltool 15:51:45 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:51:45 INFO - retry: Calling run_command with args: (['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'],), kwargs: {'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28d4410>, '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 0x28d5310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x28d57a0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 15:51:45 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 15:51:45 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 15:51:45 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 15:51:45 INFO - Return code: 0 15:51:45 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 15:51:45 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 15:51:45 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 15:51:45 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 15:51:45 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 15:51:45 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 15:51:45 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 15:51:46 INFO - Return code: 0 15:51:46 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Aurora', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/PFkRtY74QaCv8vwtlU479g/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-043', '--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 15:51:46 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Mozilla-Aurora --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/PFkRtY74QaCv8vwtlU479g/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-043 --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 15:51:46 INFO - Using env: {'DISPLAY': ':0', 15:51:46 INFO - 'HOME': '/home/cltbld', 15:51:46 INFO - 'LANG': 'en_US.UTF-8', 15:51:46 INFO - 'LANGUAGE': 'en_US:en', 15:51:46 INFO - 'LOGNAME': 'cltbld', 15:51:46 INFO - 'MAIL': '/var/mail/cltbld', 15:51:46 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 15:51:46 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 15:51:46 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:51:46 INFO - 'MOZ_NO_REMOTE': '1', 15:51:46 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 15:51:46 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:51:46 INFO - 'NO_EM_RESTART': '1', 15:51:46 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:51:46 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:51:46 INFO - 'PWD': '/builds/slave/test', 15:51:46 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 15:51:46 INFO - 'SHELL': '/bin/bash', 15:51:46 INFO - 'SHLVL': '1', 15:51:46 INFO - 'TERM': 'linux', 15:51:46 INFO - 'TMOUT': '86400', 15:51:46 INFO - 'USER': 'cltbld', 15:51:46 INFO - 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1464647802.778318-1934851532', 15:51:46 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:51:46 INFO - '_': '/tools/buildbot/bin/python'} 15:51:46 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Aurora', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/PFkRtY74QaCv8vwtlU479g/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-043', '--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 15:51:46 INFO - mozversion application_buildid: 20160530120549 15:51:46 INFO - mozversion application_changeset: 3c7a33fe0b6472bf47264c2390c5bc19f1a6dce4 15:51:46 INFO - mozversion application_display_name: FirefoxDeveloperEdition 15:51:46 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 15:51:46 INFO - mozversion application_name: Firefox 15:51:46 INFO - mozversion application_remotingname: firefox-dev 15:51:46 INFO - mozversion application_repository: https://hg.mozilla.org/releases/mozilla-aurora 15:51:46 INFO - mozversion application_vendor: Mozilla 15:51:46 INFO - mozversion application_version: 48.0a2 15:51:46 INFO - mozversion platform_buildid: 20160530120549 15:51:46 INFO - mozversion platform_changeset: 3c7a33fe0b6472bf47264c2390c5bc19f1a6dce4 15:51:46 INFO - mozversion platform_repository: https://hg.mozilla.org/releases/mozilla-aurora 15:51:46 INFO - mozversion platform_version: 48.0a2 15:51:46 INFO - using testdate: 1464648706 15:51:46 INFO - actual date: 1464648706 15:51:46 INFO - starting webserver on 'localhost:48306' 15:51:46 INFO - SUITE-START | Running 2 tests 15:51:46 INFO - TEST-START | dromaeo_css 15:51:46 INFO - operating with platform_type : linux_ 15:51:46 INFO - Initialising browser for dromaeo_css test... 15:51:46 INFO - TEST-INFO | started process 12222 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp2AKkBt/profile http://localhost:48306/getInfo.html) 15:51:50 INFO - PROCESS | 12222 | 15:51:50 INFO - PROCESS | 12222 | (process:12299): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 15:51:50 INFO - PROCESS | 12222 | __metrics Screen width/height:1600/1200 15:51:50 INFO - PROCESS | 12222 | colorDepth:24 15:51:50 INFO - PROCESS | 12222 | Browser inner width/height: 1024/697 15:51:50 INFO - PROCESS | 12222 | __metrics 15:51:51 ERROR - PROCESS | 12222 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2940: TypeError: this.tabs is undefined 15:51:52 INFO - TEST-INFO | 12222: exit 0 15:51:52 INFO - Browser initialized. 15:51:52 INFO - Running cycle 1/1 for dromaeo_css test... 15:51:52 INFO - TEST-INFO | started process 12350 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp2AKkBt/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 15:51:54 INFO - PROCESS | 12350 | 15:51:54 INFO - PROCESS | 12350 | (process:12419): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 15:52:04 INFO - PROCESS | 12350 | RSS: Main: 151924736 15:52:04 INFO - PROCESS | 12350 | 15:52:53 INFO - PROCESS | 12350 | 1464648773754 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] 15:55:01 INFO - PROCESS | 12350 | Cycle 1(1): loaded http://localhost:48306/tests/dromaeo/cssquery-dojo.html (next: http://localhost:48306/tests/dromaeo/cssquery-ext.html) 15:55:02 INFO - PROCESS | 12350 | RSS: Main: 155701248 15:55:02 INFO - PROCESS | 12350 | 15:58:04 INFO - PROCESS | 12350 | Cycle 1(1): loaded http://localhost:48306/tests/dromaeo/cssquery-ext.html (next: http://localhost:48306/tests/dromaeo/cssquery-jquery.html) 15:58:04 INFO - PROCESS | 12350 | RSS: Main: 153767936 15:58:04 INFO - PROCESS | 12350 | 16:01:06 INFO - PROCESS | 12350 | Cycle 1(1): loaded http://localhost:48306/tests/dromaeo/cssquery-jquery.html (next: http://localhost:48306/tests/dromaeo/cssquery-mootools.html) 16:01:07 INFO - PROCESS | 12350 | RSS: Main: 153477120 16:01:07 INFO - PROCESS | 12350 | 16:04:08 INFO - PROCESS | 12350 | Cycle 1(1): loaded http://localhost:48306/tests/dromaeo/cssquery-mootools.html (next: http://localhost:48306/tests/dromaeo/cssquery-prototype.html) 16:04:09 INFO - PROCESS | 12350 | RSS: Main: 152780800 16:04:09 INFO - PROCESS | 12350 | 16:07:11 INFO - PROCESS | 12350 | Cycle 1(1): loaded http://localhost:48306/tests/dromaeo/cssquery-prototype.html (next: http://localhost:48306/tests/dromaeo/cssquery-yui.html) 16:07:12 INFO - PROCESS | 12350 | RSS: Main: 154787840 16:07:12 INFO - PROCESS | 12350 | 16:10:14 INFO - PROCESS | 12350 | Cycle 1(1): loaded http://localhost:48306/tests/dromaeo/cssquery-yui.html (next: http://localhost:48306/tests/dromaeo/cssquery-dojo.html) 16:10:14 INFO - PROCESS | 12350 | RSS: Main: 156213248 16:10:14 INFO - PROCESS | 12350 | 16:10:14 INFO - PROCESS | 12350 | __start_tp_report 16:10:14 INFO - PROCESS | 12350 | _x_x_mozilla_page_load 16:10:14 INFO - PROCESS | 12350 | _x_x_mozilla_page_load_details 16:10:14 INFO - PROCESS | 12350 | |i|pagename|runs| 16:10:14 INFO - PROCESS | 12350 | |0;dojo.html;3374.4938259261116;3435.5877294724637;3436.6047904490993;3486.2678837444137;3492.5459690240264;5669.773209071632;5680;5693.202951586776;5694.829155125348;5698.401667824881;5650.463205995434;5693.03218452863;5708.8858222835515;5710.229119068925;5754.1944127822135;5087.567556757671;5151.356080489939;5190.974045129769;5215.947840521584;5219.608529360295;4989.052080104769;5262;5319.468053194669;5319.574434045287;5324.7071411072375;5114.335136432259;5125.103106956286;5167.095758242312;5210.687358758487;5265.76304066318;5157.432682404932;5178.093833579109;5179.818706345279;5190.792368305263;5210.166373380279;5130.410002849682;5152.072626927152;5184.300119483859;5209.1404918188455;5249.055170069386;5464.972675136639;5485.177223416479;5493.972530137364;5522.088855338904;5570.470805273492;6012.6392416455155;6035.155078289043;6089.969550152266;6099.847503812396;6109.327973922865;6085.756569737206;6105.481034112106;6137.447629713302;6147.415995480422;6155.846103847395;5523.7790488380415;5716.314042314907;5719.170720245583;5752.28096487939;5773.162891380768;6164.845878853064;6184.721687524072;6189.473894718909;6193.163922870445;6199.101130336076;5914.4381283777975;5951.375105613848;5969.194158788508;5982.820515384546;6025.427584379477;6039.275286965504;6050.818475445743;6055.909161362583;6068.6358818471035;6070.362611925772;5989.101634754822;5998.880022399615;6004.099385092184;6012.909806352908;6014.909776353358;5844.035734103911;5938.138969849348;6014.578979471395;6023.5181185505935;6125.357545073132;4574.5882870541145;4579.610733087658;4587.174308624413;4610.9308360374625;4613.238815595456;4093.099518106012;4117.382392641128;4129.752214867118;4130.648894843972;4153.792310384469;5851.180834683148;5885.529157667376;5979.342272350038;6007.609505382136;6041.879162416727;5949.434803693643;6139.614800607407;6221.751129954841;6240.438360547572;6245.6252624842655;5893.263342082239;5904.498117659961;5905.970470147622;5907.7046147692445;5918.171455996164;5090.338256026767;5242.816501422508;5269.947300527022;5283.894322113536;5308.893822123536;6416.647084410402;6441;6451.419372256426;6481.416672499403;6501.47988160946;6051.304100028553;6180.905523574123;6206.317305096436;6235.314115447207;6254.21822272216;6251.218597675291;6328.968355158195;6353.0152826312;6361.681915904093;6385.233771947396;6027.336992930686;6030.276366836008;6030.517558595214;6041.879162416815;6047.727852246748;5974.4324289192455;6111.113888486056;6115.5719099664375;6126.264848218064;6148.538859585638;5893.499052580579;5905.793297234576;5923.170756094237;5923.703814809329;5954.374790647093;5839.620424672383;5872.236609240942;5905.498032667271;5921.230240068936;5926.585139040226;5701.771929122954;5753.539716822561;5765.884682306414;5832.475077243069;5846.093855452412;5950.315713692808;5993.6104153231645;6059.272887253558;6064;6098.817035488943;5889.734961926638;5906.350301466749;5909.202257695156;5915;5918.437748413894 16:10:14 INFO - PROCESS | 12350 | |1;ext.html;672.7914346552568;682.9043933849259;685.6366125953243;687.4843867099676;744.4863044499299;31906.361872762533;40547;41122;41265.58734412659;41292.17415651685;43038.784806076;43664;43746;43968.34047489282;44016.3397549037;8734.170253825892;8941.329400294971;8952.283817294634;8995.14546118121;9012.639494420215;8841.73474795754;8865.290776737878;8904.51025193614;8926.642934282621;8941.50821704806;9105.226055785266;9203.493807840567;9272.814543709123;9283.025282345325;9284.72145835626;9142.63429462824;9197.356185067049;9213.63145474187;9221.077892210726;9244.907550924505;9061.456312621263;9149.725508234764;9158.084191580856;9163.587638556215;9164.95417522908;43251;43689.126217475794;43806.34290485645;43899.34150987738;43978.56021439777;3800.20195758891;3822.7515211511163;3842.3660096084113;3843.7693738375788;4033.4756481657196;33448;33725.325493489996;34275.65724342749;34600.65399346025;34715.826420867736;4069.206504731549;4085.4484644573195;4139.337705967061;4170.791460426966;4176.686748493845;229318;230165;230474.8476257625;231472;232093;39868.401973970416;62253.06620400697;65092.34907650958;65169.34830651728;65345.67327163429;37997.81001094977;38131.618683812805;38219.61780382161;38225.23549528994;38271.234575308335;15553.688926221412;15689.68620627581;15712.371505139667;15716.764248536281;15769.68460630781;12577.182483138567;12610.558630447891;12659.936700316439;12660.936695316464;12737.681557961125;9188.90811091894;9245;9355.391899526508;9407.388519746195;9434;3598.8560457581925;3608.242269123461;3640.9453858192146;3642.5264715586804;3683.208110256308;1152.291340825403;1158.1314014489133;1191.5472120594118;1244.9190802597802;1282.602393258093;32831.50752738711;33223.66776332254;33588.3282334352;33682.326353472796;33851.661483385345;1247.9891288056704;1266.7276535544718;1286.292539103508;1308.941097650589;1319.3139567424885;17289.308427663003;17393.565160870825;17485;17498.56253593645;17618.559536011704;501762;508219;529176;532555;535518;54429.183562246595;55788.72105639446;55945.720271398386;56433.435665643636;56675.43324566784;1479.201231335067;1557.8520040596125;1565.223471359992;1577.1798664694525;1580.2730743857953;31079.689203108584;31556.526652100696;31839.88560400375;32277.35445291128;32864.50703239405;54004.72997635144;54371;54646.453535464134;54646.726766365915;54765.726171368886;439741;444817;445460;446288;446447;31420.52869206918;31542.211444714067;31685;31750.523742143425;31787.6821231794;51359.74320128375;51671.741641291555;52209.21686174635;52874.2068868975;52903.20645190248;41555.79222103991;42815.14369712526;42872.78563607162;42951.57048429476;43656;42765.5723442774;42946;42974.78512607542;43687;43863.56136438595;43114.353284701385;43200.56799431965;43499.34750978675;43735.12529749451;44514.55485445104;37541.061473463385;37766.43350349802;37861.81069094637;38011;38372.23255534929;29539.55690664685;29724;29801.10596682103;30151.849240753654;30239.244018899702 16:10:14 INFO - PROCESS | 12350 | |2;jquery.html;415.0950926979188;422.4782393743728;426.6565414841053;428.0753572283866;433.43003949806;18754.2498300068;19395.903020484897;19399.321023764172;19829.504262393446;20953.790462095374;12501.874981250185;12794.360281985886;12877.162984406006;20213.59572808543;20225.797742022576;5270.92093618596;5367.221752845835;5408.378036525811;5411.648242864221;5418.9458105419035;5377.623566350357;5767.33675627304;5770.278715160605;5771.942280577204;5772.971135144318;5633.239512665799;5642.830715078554;5667.5749318801045;5681.403452637475;5700.201971723941;5415;5898.793542226002;5900.64596124234;5901.026330655458;5903.79336723217;5332.440093790135;5333.2266821310695;5358.33020872391;5358.517733404013;5366.758495867695;14876.851231487655;14879.776803347959;14884.479043233543;14960.551183464513;16551.586210344718;2469.172827102923;2500.7999360051335;2561.4492884030024;2727.699953005168;2948.82307061577;10492.317999330018;10573.365598064063;10595.682129536126;10673.306235094695;10774.622888198875;2061.402193363923;2127.4468638154035;2129.33990462957;2132.605467988427;2149.6453085240914;76591;79009;79334.99999999942;80054.599727001;80764.59617701932;11526.250793698382;11746.76506469883;11829.467673954692;11866.228695134789;11894.286342819285;16579.91710041442;16719.247633856507;16743;16770.74843877343;16874.831251687327;8495.872561911576;8577.699780507652;8594.183552562497;8900.42147260426;8925.33060020501;8685.43544669607;8704.956475217583;8733.912660873437;8810.471371717718;8849.89376327959;4921.87695307613;5005;5058.696478211245;5215.374155101412;5228.241904923765;1896.9620607587772;2075.886170743884;2117.7458704955197;2164.729408823897;2170.24041585447;1009.1724785675822;1108.257467496779;1117.1286396610656;1162.7035106047904;1226.4603574427224;18979.525511862037;19016.714749278774;19202.423927282205;19290.22839086449;19524.51188720265;1110.8064315094105;1111.4664960818852;1113.5434471866495;1173.7828501727208;1203.6629743671785;10799;10955.50700218492;11024.338539687644;11073.224874258725;11088.390138542296;489537;496132;496350;498100;508530;90719.54640226888;92620;93984.53007735054;94213;95388;1117.3072694929197;1119.1997721628911;1119.731264496515;1122.5846436818267;1169.0997931592626;17140.485785426456;17190.570235744206;17200.741988869926;17376.82623173752;17557.82442175562;39433.40849887311;40108.79945600253;40403;41045.38431923583;41882.1623567533;53937.73031134819;55658.44341556533;55976;56587.43412565822;56629.43370566241;8919.643214271617;9038.347376245249;9123;9176.623506474083;9404.059594040542;12877.871221288042;12998.415071322002;13089;13256.270905100311;13385.263810490516;11550.249233799776;11680.70798230051;11736.589219377282;11929;12040.578579749666;11146.609868654557;11176.16178786578;11265.436728163722;11347;11462.94268528652;11885.94057029744;11892;11935.403229838299;12093.879061209627;12249.081318901297;8798.296136309207;8808.735737927873;9139.954300228455;9191.080891910755;9213;11692.298462092302;12055.698607534881;12168;12171.14801963854;12244.3475524791 16:10:14 INFO - PROCESS | 12350 | |3;mootools.html;1624.6263359427328;1628.430049482681;1818.5817262029732;1909.284018493065;1946.182603306611;7613.314801667849;8010.759677209686;8259.545724985132;8307.376946728997;8422.83154336913;8520.403571749965;8575.442596231256;8598.570071496431;8690.782730431742;8692.043875173726;2398.4963157736897;2424.1273141668985;2443.376938880583;2450.7059152901675;2453.4479742057983;2399.796017338528;2413.6862207913036;2419.2742177346813;2442.829001969863;2450.779429851313;2428.3322086426197;2436.792872605831;2456.078970386105;2465.938351541208;2470.777630013298;2424.6363045543135;2437.573424650679;2446.620773780076;2447.0823441209545;2457.054034196838;2287.9199228026937;2299.6895419118373;2300.723913130418;2300.9309720708407;2311.4914718761847;8780.736577902673;8843.646254149826;8854.734357969272;8889.111088891124;8925.866112008325;5357.544608708265;5400.486953739389;5411;5414.945850541483;5440.972795135999;3362.2266878618057;3418.538497302882;3458.3774920514297;3481.442969124928;3483.878064267764;1028.7428142964259;1082.5832054659013;1083.0739717541467;1083.9295445796;1087.423665457301;12567.057470689735;12570.057245706608;12587.244765314019;12603.873961260453;12613.180143290656;4624.861254162381;4658.720476771405;4707.152712511713;4738.241881298975;4803.063402636522;10552.050315471644;10553.947230263799;10642.042216200425;10679.78640427187;10705.197110216764;5265.236540701577;5308.097623404031;5343.278657381282;5371.113766228528;5372.650777699437;4211.642010429086;4877.487863774323;4883.780229889663;4993.500649934977;5005.649604527721;4237.957620423818;4258.6380157686945;4293.742375457483;4308.46144231971;4348.34774783785;1355.1327150623608;1422.2035660030417;1432.133559196671;1442.2067862675697;1454.665426951807;956.4596003258137;1078.1698092468755;1096.5887792077972;1117.3240189685287;1127.9943600281947;5613.298337707786;5936.892403196889;6031.276246850318;6106.053561697944;6112.17485639433;989.3964681544396;995.9194274212416;1034.4362322534237;1056.1234175634206;1060.7401186709305;4228.302330115496;4248.74507529543;4258.8296468140925;4261.275583150872;4281.207976524291;10529.578816847394;10808.675739727822;10891.074258687942;10933.453327333602;10978.451077446096;9745.220382369393;10859.83710244347;10860.348379097279;10870.565177392815;10872.238943274053;8234.752957411287;8303.418760686814;8317.95841020779;8357.623906924204;8374.2881855043;6011.879762404815;6144.969275153596;6157.507399408126;6246.718897649707;6253.1245625613365;9089.363744537819;9089.727308180765;9164.404313719588;9241.907580924373;9309.20871725911;9265.490398027903;9400.623975041195;9997.900020999698;10041.899581004389;10172.186225101826;6785.5250132490255;7542.6605802740105;7551.773446796605;7558.659860306189;7604.315611594983;8389.538575378412;8419.8737018946;8429.4942303462;8438.746837594881;8466.872996905175;7465.514741541782;7734.8839767402405;7788.260115289038;7790.337821285254;7798.571078590732;7583.9620801895635;7610.543367397974;7662.425318101276;7736.651850666621;7751;7118.786436406916;7147.463940204401;7151.8569628608175;7181.281871812777;7197.280271972761;5128.769205385841;5186.455422180617;5286.709230992333;5300.575953923754;5308.495692909168;5282.718079011638;5296.470352964673;5347.919781203363;5485.6982865942755;5511.5039646432015 16:10:14 INFO - PROCESS | 12350 | |4;prototype.html;337.4656330954532;342.2299825392867;342.53073289593254;356.8491614543097;357.8693776771476;6480.351964803517;6536.575122617039;6675.732970681173;6733.898991515125;6757.966210168955;6596.505262105337;6614.437772789307;6630.767923122692;6646.634435106067;6650.933490665092;4957;4957.206846904496;4964.205727083668;4968.180250258703;4992.051510213066;4994.400671919375;4998.7250701211415;5004.949950500503;5011.899762004758;5016.548510634042;4951.133551628469;4958.752062396884;4960.355153829997;4962.528559786814;4974.204127339626;4723.055388922229;4898.338724272213;4946.431160416562;4964.578010869062;4969.726665033421;4218.641415479688;4222;4233.111046680201;4234.9364759528635;4238.131183107455;6295.307516173218;6303.432691057827;6308.526860485436;6312.116303717483;6314.579219675582;5695.373508914016;5696.430356964312;5696.601237913348;5699.8005069822775;5725.055365864628;6934.2719014503255;6964.338387853146;6965.407940325078;6968.895466568006;6969.930300697029;4645.558671926162;4662.230731929228;4665.393498845162;4713.363695901078;4826.372571565709;7217.242189570072;7248.238934911811;7335.48651594394;7371.37343325818;7390.5196162249285;4936.703797772145;4945.184044632667;4945.23348880924;4948.455669876311;4957.405111386656;5009.799608015712;5023.447420783711;5026.572741317029;5028.673136246132;5032.521910418504;5759.712014399263;5780.132980052942;5788.594798364158;5801.390853960358;5807;6854.760083397057;6951.756688515878;7005.369516743517;7070.292970702992;7082.575045497184;1772.087375001875;1796.362291386539;1797.2361746257789;1801.0814484612943;1805.5666640006305;1117.3296022386503;1158.7914175448332;1163.8428812110258;1187.7743228786676;1192.0761409907218;6763.458923286125;6895.931040689529;6900.102986611809;6917.619530925847;6944.409725173316;7290.4167666586545;7333.449991250677;7349.412047036224;7351.669174887036;7355.742549010759;6831.555948863308;6855.314468553105;6873.037774711544;6873.175218973755;6881.552699074544;3875.4380614810693;3940.0543869471694;3961.069148750041;3963.207358528306;3979.1643754811234;7583.696652133964;7612.733554325683;7619.390448764197;7630.046244219473;7637.885431718529;7349.4855360124275;7391.593462359622;7445.739399121005;7458;7469.141048779351;7613.238676132342;7623.809404764926;7640.426967977424;7646.65590048438;7650.4644674872225;7114.079198616241;7315.524490908287;7316.268373162641;7318.487705860752;7320.341169294789;7152;7171.533850299714;7183.245759195209;7210.315020073084;7216.097987751531;7580.62096895142;7586.734464293723;7612;7613.428992825449;7617.314441700273;4983.401991761012;4997.275395067768;5001.64988450805;5008.1235783736975;5009.023240468219;7128.750493732695;7294.562326260441;7303.780886573411;7306.96346518264;7341.15576708664;7009.1939426966555;7062.940558916203;7068.222495525385;7072.752453664303;7074.292570742885;7047.295270472911;7055.259197784364;7058.682359293947;7062.788116356517;7080.822979425349;6868.622225777431;6875.243723190545;6889.689963951734;6914.308569143045;6928.099347085048;6886.621235831877;7112.50212485121;7138.928610713826;7188.38898693596;7190.101237345332;6591.373819487141;6761.357671021246;6947.722091116501;6955.756548520778;6983.895241571279 16:10:14 INFO - PROCESS | 12350 | |5;yui.html;849.3205435651478;911.9316051296155;931.8974912759595;934.4725946029238;961.2742379503474;15169.469068582603;15218.467353642625;15232;15235.238238088094;15255;15685.686286274296;15770.053796772201;15787.28957196926;15801.525954221363;15832.129232892186;886.7871710789397;910.599336292031;917.3670167584379;924.9213816825578;927.0868194828089;922.8154369126169;929.2705226397279;930.483581612205;930.5486838883136;933.1508327422048;961.4952150121172;962.8266911955845;969.2294625772528;970.6166064404556;973.1873885305743;960.5437417226831;964.4117088575963;965.020504188253;965.7199412170462;966.1642679082613;700.6951975890504;701.7649087555675;704.7568588836895;705.1115594351154;707.2114592229627;15833.52499425019;15858.048517088897;15868.285927133307;15906.920465397714;15926.522204333889;14077.296135193199;14267.429302827979;14367.137971721626;14506.1296322221;14518.927405362905;12076.879231207664;12092.818607720803;12176.878231217752;12393.132480726354;12458.252504849737;3940.5271367435803;4023.1752490739327;4026.57720939303;4033.657139143176;4069.3895915612893;57060;57582.424175758126;57588.13617795694;57699;58227.41772582305;11191.552337906556;11200.21598488098;11232;11474.77050459003;11715.4142292885;20117.798822011886;20170.798292017185;20194.09126589307;20438.386848394573;20502;8296.70961516344;8323.209295116954;8476.915230847613;8486.19381158789;8634.525101119372;4973.452920178777;5014.17266151081;5027.874303142377;5079.796808127633;5210.583153347723;3660.2313514162324;3687.354712925281;3691.593924668284;3709.4621279914263;3709.6104908984707;664.6643445060214;667.7095463473307;676.2223443040542;687.4328678839977;696.084648686975;771.7491815159983;778.8559116563454;779.6530543907907;780.6994307191773;789.676232744572;10257.33327333721;10379.896201038044;10441.216908731723;10499.94750026245;10584.100351470057;644.9548531602836;759.3279947246726;781.6560713286136;788.9053313602404;807.9474834135763;4820.878149182468;4844.346013288232;4888.706677599355;4957.157283261782;4989.800407983713;64101.35898641047;64962;65311;65524;65538.34461655418;56486;56830.43169568334;57789.71105144447;57850.42149578535;58445.70777146087;51870.22194667083;51937.48062519327;52329;53010;53124;9671.758206044906;9732.367396119229;9774.80450390974;9830.508474576385;9852.310338276251;36449.271014579026;37597;38219.72088675776;39087.21825563416;39526.60473395229;49034.26448603202;49330.75334623304;49873;49944.50055499398;50573;11906;11999;12040.277583345027;12124.333161676192;12162.635120946386;13755.931220344235;14273.357698903366;14701.779473308123;14727;15618.9219053904;13751.113751113671;13948.372323245681;14000.369983350978;14180.432782688576;14757.114573125647;13129;13380.933095334462;13437.462501499831;13644.65888352799;13788;11715.1799374043;11966.46150923193;12080.21478603888;12952.611421657366;13445.260510672008;11038.613648522263;11359.091272697999;11444.94277528607;11458.885411145782;11824.822627660764;10785.568577256821;11023.779524409627;11207.271527351022;11417.657470275904;11475.426228688699 16:10:14 INFO - PROCESS | 12350 | __end_tp_report 16:10:14 INFO - PROCESS | 12350 | __start_cc_report 16:10:14 INFO - PROCESS | 12350 | _x_x_mozilla_cycle_collect,324 16:10:14 INFO - PROCESS | 12350 | __end_cc_report 16:10:14 INFO - PROCESS | 12350 | __startTimestamp1464649814806__endTimestamp 16:10:14 INFO - PROCESS | 12350 | 16:10:14 INFO - PROCESS | 12350 | ------- Summary: start ------- 16:10:14 INFO - PROCESS | 12350 | Number of tests: 6 16:10:14 INFO - PROCESS | 12350 | 16:10:14 INFO - PROCESS | 12350 | [#0] dojo.html Cycles:165 Average:5667.34 Median:5906.35 stddev:638.43 (10.8%) stddev-sans-first:614.53 16:10:14 INFO - PROCESS | 12350 | Values: 3374.5 3435.6 3436.6 3486.3 3492.5 5669.8 5680.0 5693.2 5694.8 5698.4 5650.5 5693.0 5708.9 5710.2 5754.2 5087.6 5151.4 5191.0 5215.9 5219.6 4989.1 5262.0 5319.5 5319.6 5324.7 5114.3 5125.1 5167.1 5210.7 5265.8 5157.4 5178.1 5179.8 5190.8 5210.2 5130.4 5152.1 5184.3 5209.1 5249.1 5465.0 5485.2 5494.0 5522.1 5570.5 6012.6 6035.2 6090.0 6099.8 6109.3 6085.8 6105.5 6137.4 6147.4 6155.8 5523.8 5716.3 5719.2 5752.3 5773.2 6164.8 6184.7 6189.5 6193.2 6199.1 5914.4 5951.4 5969.2 5982.8 6025.4 6039.3 6050.8 6055.9 6068.6 6070.4 5989.1 5998.9 6004.1 6012.9 6014.9 5844.0 5938.1 6014.6 6023.5 6125.4 4574.6 4579.6 4587.2 4610.9 4613.2 4093.1 4117.4 4129.8 4130.6 4153.8 5851.2 5885.5 5979.3 6007.6 6041.9 5949.4 6139.6 6221.8 6240.4 6245.6 5893.3 5904.5 5906.0 5907.7 5918.2 5090.3 5242.8 5269.9 5283.9 5308.9 6416.6 6441.0 6451.4 6481.4 6501.5 6051.3 6180.9 6206.3 6235.3 6254.2 6251.2 6329.0 6353.0 6361.7 6385.2 6027.3 6030.3 6030.5 6041.9 6047.7 5974.4 6111.1 6115.6 6126.3 6148.5 5893.5 5905.8 5923.2 5923.7 5954.4 5839.6 5872.2 5905.5 5921.2 5926.6 5701.8 5753.5 5765.9 5832.5 5846.1 5950.3 5993.6 6059.3 6064.0 6098.8 5889.7 5906.4 5909.2 5915.0 5918.4 16:10:14 INFO - PROCESS | 12350 | 16:10:14 INFO - PROCESS | 12350 | [#1] ext.html Cycles:180 Average:56363.00 Median:4173.74 stddev:111035.70 (2660.3%) stddev-sans-first:111268.45 16:10:14 INFO - PROCESS | 12350 | Values: 672.8 682.9 685.6 687.5 744.5 31906.4 40547.0 41122.0 41265.6 41292.2 43038.8 43664.0 43746.0 43968.3 44016.3 8734.2 8941.3 8952.3 8995.1 9012.6 8841.7 8865.3 8904.5 8926.6 8941.5 9105.2 9203.5 9272.8 9283.0 9284.7 9142.6 9197.4 9213.6 9221.1 9244.9 9061.5 9149.7 9158.1 9163.6 9165.0 43251.0 43689.1 43806.3 43899.3 43978.6 3800.2 3822.8 3842.4 3843.8 4033.5 33448.0 33725.3 34275.7 34600.7 34715.8 4069.2 4085.4 4139.3 4170.8 4176.7 229318.0 230165.0 230474.8 231472.0 232093.0 39868.4 62253.1 65092.3 65169.3 65345.7 37997.8 38131.6 38219.6 38225.2 38271.2 15553.7 15689.7 15712.4 15716.8 15769.7 12577.2 12610.6 12659.9 12660.9 12737.7 9188.9 9245.0 9355.4 9407.4 9434.0 3598.9 3608.2 3640.9 3642.5 3683.2 1152.3 1158.1 1191.5 1244.9 1282.6 32831.5 33223.7 33588.3 33682.3 33851.7 1248.0 1266.7 1286.3 1308.9 1319.3 17289.3 17393.6 17485.0 17498.6 17618.6 501762.0 508219.0 529176.0 532555.0 535518.0 54429.2 55788.7 55945.7 56433.4 56675.4 1479.2 1557.9 1565.2 1577.2 1580.3 31079.7 31556.5 31839.9 32277.4 32864.5 54004.7 54371.0 54646.5 54646.7 54765.7 439741.0 444817.0 445460.0 446288.0 446447.0 31420.5 31542.2 31685.0 31750.5 31787.7 51359.7 51671.7 52209.2 52874.2 52903.2 41555.8 42815.1 42872.8 42951.6 43656.0 42765.6 42946.0 42974.8 43687.0 43863.6 43114.4 43200.6 43499.3 43735.1 44514.6 37541.1 37766.4 37861.8 38011.0 38372.2 29539.6 29724.0 29801.1 30151.8 30239.2 16:10:14 INFO - PROCESS | 12350 | 16:10:14 INFO - PROCESS | 12350 | [#2] jquery.html Cycles:180 Average:28982.19 Median:2130.97 stddev:82001.63 (3848.1%) stddev-sans-first:82203.61 16:10:14 INFO - PROCESS | 12350 | Values: 415.1 422.5 426.7 428.1 433.4 18754.2 19395.9 19399.3 19829.5 20953.8 12501.9 12794.4 12877.2 20213.6 20225.8 5270.9 5367.2 5408.4 5411.6 5418.9 5377.6 5767.3 5770.3 5771.9 5773.0 5633.2 5642.8 5667.6 5681.4 5700.2 5415.0 5898.8 5900.6 5901.0 5903.8 5332.4 5333.2 5358.3 5358.5 5366.8 14876.9 14879.8 14884.5 14960.6 16551.6 2469.2 2500.8 2561.4 2727.7 2948.8 10492.3 10573.4 10595.7 10673.3 10774.6 2061.4 2127.4 2129.3 2132.6 2149.6 76591.0 79009.0 79335.0 80054.6 80764.6 11526.3 11746.8 11829.5 11866.2 11894.3 16579.9 16719.2 16743.0 16770.7 16874.8 8495.9 8577.7 8594.2 8900.4 8925.3 8685.4 8705.0 8733.9 8810.5 8849.9 4921.9 5005.0 5058.7 5215.4 5228.2 1897.0 2075.9 2117.7 2164.7 2170.2 1009.2 1108.3 1117.1 1162.7 1226.5 18979.5 19016.7 19202.4 19290.2 19524.5 1110.8 1111.5 1113.5 1173.8 1203.7 10799.0 10955.5 11024.3 11073.2 11088.4 489537.0 496132.0 496350.0 498100.0 508530.0 90719.5 92620.0 93984.5 94213.0 95388.0 1117.3 1119.2 1119.7 1122.6 1169.1 17140.5 17190.6 17200.7 17376.8 17557.8 39433.4 40108.8 40403.0 41045.4 41882.2 53937.7 55658.4 55976.0 56587.4 56629.4 8919.6 9038.3 9123.0 9176.6 9404.1 12877.9 12998.4 13089.0 13256.3 13385.3 11550.2 11680.7 11736.6 11929.0 12040.6 11146.6 11176.2 11265.4 11347.0 11462.9 11885.9 11892.0 11935.4 12093.9 12249.1 8798.3 8808.7 9140.0 9191.1 9213.0 11692.3 12055.7 12168.0 12171.1 12244.3 16:10:14 INFO - PROCESS | 12350 | 16:10:14 INFO - PROCESS | 12350 | [#3] mootools.html Cycles:180 Average:5815.14 Median:4938.64 stddev:3202.86 (64.9%) stddev-sans-first:3196.36 16:10:14 INFO - PROCESS | 12350 | Values: 1624.6 1628.4 1818.6 1909.3 1946.2 7613.3 8010.8 8259.5 8307.4 8422.8 8520.4 8575.4 8598.6 8690.8 8692.0 2398.5 2424.1 2443.4 2450.7 2453.4 2399.8 2413.7 2419.3 2442.8 2450.8 2428.3 2436.8 2456.1 2465.9 2470.8 2424.6 2437.6 2446.6 2447.1 2457.1 2287.9 2299.7 2300.7 2300.9 2311.5 8780.7 8843.6 8854.7 8889.1 8925.9 5357.5 5400.5 5411.0 5414.9 5441.0 3362.2 3418.5 3458.4 3481.4 3483.9 1028.7 1082.6 1083.1 1083.9 1087.4 12567.1 12570.1 12587.2 12603.9 12613.2 4624.9 4658.7 4707.2 4738.2 4803.1 10552.1 10553.9 10642.0 10679.8 10705.2 5265.2 5308.1 5343.3 5371.1 5372.7 4211.6 4877.5 4883.8 4993.5 5005.6 4238.0 4258.6 4293.7 4308.5 4348.3 1355.1 1422.2 1432.1 1442.2 1454.7 956.5 1078.2 1096.6 1117.3 1128.0 5613.3 5936.9 6031.3 6106.1 6112.2 989.4 995.9 1034.4 1056.1 1060.7 4228.3 4248.7 4258.8 4261.3 4281.2 10529.6 10808.7 10891.1 10933.5 10978.5 9745.2 10859.8 10860.3 10870.6 10872.2 8234.8 8303.4 8318.0 8357.6 8374.3 6011.9 6145.0 6157.5 6246.7 6253.1 9089.4 9089.7 9164.4 9241.9 9309.2 9265.5 9400.6 9997.9 10041.9 10172.2 6785.5 7542.7 7551.8 7558.7 7604.3 8389.5 8419.9 8429.5 8438.7 8466.9 7465.5 7734.9 7788.3 7790.3 7798.6 7584.0 7610.5 7662.4 7736.7 7751.0 7118.8 7147.5 7151.9 7181.3 7197.3 5128.8 5186.5 5286.7 5300.6 5308.5 5282.7 5296.5 5347.9 5485.7 5511.5 16:10:14 INFO - PROCESS | 12350 | 16:10:14 INFO - PROCESS | 12350 | [#4] prototype.html Cycles:180 Average:5871.62 Median:6759.66 stddev:1803.75 (26.7%) stddev-sans-first:1760.33 16:10:14 INFO - PROCESS | 12350 | Values: 337.5 342.2 342.5 356.8 357.9 6480.4 6536.6 6675.7 6733.9 6758.0 6596.5 6614.4 6630.8 6646.6 6650.9 4957.0 4957.2 4964.2 4968.2 4992.1 4994.4 4998.7 5004.9 5011.9 5016.5 4951.1 4958.8 4960.4 4962.5 4974.2 4723.1 4898.3 4946.4 4964.6 4969.7 4218.6 4222.0 4233.1 4234.9 4238.1 6295.3 6303.4 6308.5 6312.1 6314.6 5695.4 5696.4 5696.6 5699.8 5725.1 6934.3 6964.3 6965.4 6968.9 6969.9 4645.6 4662.2 4665.4 4713.4 4826.4 7217.2 7248.2 7335.5 7371.4 7390.5 4936.7 4945.2 4945.2 4948.5 4957.4 5009.8 5023.4 5026.6 5028.7 5032.5 5759.7 5780.1 5788.6 5801.4 5807.0 6854.8 6951.8 7005.4 7070.3 7082.6 1772.1 1796.4 1797.2 1801.1 1805.6 1117.3 1158.8 1163.8 1187.8 1192.1 6763.5 6895.9 6900.1 6917.6 6944.4 7290.4 7333.4 7349.4 7351.7 7355.7 6831.6 6855.3 6873.0 6873.2 6881.6 3875.4 3940.1 3961.1 3963.2 3979.2 7583.7 7612.7 7619.4 7630.0 7637.9 7349.5 7391.6 7445.7 7458.0 7469.1 7613.2 7623.8 7640.4 7646.7 7650.5 7114.1 7315.5 7316.3 7318.5 7320.3 7152.0 7171.5 7183.2 7210.3 7216.1 7580.6 7586.7 7612.0 7613.4 7617.3 4983.4 4997.3 5001.6 5008.1 5009.0 7128.8 7294.6 7303.8 7307.0 7341.2 7009.2 7062.9 7068.2 7072.8 7074.3 7047.3 7055.3 7058.7 7062.8 7080.8 6868.6 6875.2 6889.7 6914.3 6928.1 6886.6 7112.5 7138.9 7188.4 7190.1 6591.4 6761.4 6947.7 6955.8 6983.9 16:10:14 INFO - PROCESS | 12350 | 16:10:14 INFO - PROCESS | 12350 | [#5] yui.html Cycles:180 Average:15803.52 Median:4832.61 stddev:18077.46 (374.1%) stddev-sans-first:18093.29 16:10:14 INFO - PROCESS | 12350 | Values: 849.3 911.9 931.9 934.5 961.3 15169.5 15218.5 15232.0 15235.2 15255.0 15685.7 15770.1 15787.3 15801.5 15832.1 886.8 910.6 917.4 924.9 927.1 922.8 929.3 930.5 930.5 933.2 961.5 962.8 969.2 970.6 973.2 960.5 964.4 965.0 965.7 966.2 700.7 701.8 704.8 705.1 707.2 15833.5 15858.0 15868.3 15906.9 15926.5 14077.3 14267.4 14367.1 14506.1 14518.9 12076.9 12092.8 12176.9 12393.1 12458.3 3940.5 4023.2 4026.6 4033.7 4069.4 57060.0 57582.4 57588.1 57699.0 58227.4 11191.6 11200.2 11232.0 11474.8 11715.4 20117.8 20170.8 20194.1 20438.4 20502.0 8296.7 8323.2 8476.9 8486.2 8634.5 4973.5 5014.2 5027.9 5079.8 5210.6 3660.2 3687.4 3691.6 3709.5 3709.6 664.7 667.7 676.2 687.4 696.1 771.7 778.9 779.7 780.7 789.7 10257.3 10379.9 10441.2 10499.9 10584.1 645.0 759.3 781.7 788.9 807.9 4820.9 4844.3 4888.7 4957.2 4989.8 64101.4 64962.0 65311.0 65524.0 65538.3 56486.0 56830.4 57789.7 57850.4 58445.7 51870.2 51937.5 52329.0 53010.0 53124.0 9671.8 9732.4 9774.8 9830.5 9852.3 36449.3 37597.0 38219.7 39087.2 39526.6 49034.3 49330.8 49873.0 49944.5 50573.0 11906.0 11999.0 12040.3 12124.3 12162.6 13755.9 14273.4 14701.8 14727.0 15618.9 13751.1 13948.4 14000.4 14180.4 14757.1 13129.0 13380.9 13437.5 13644.7 13788.0 11715.2 11966.5 12080.2 12952.6 13445.3 11038.6 11359.1 11444.9 11458.9 11824.8 10785.6 11023.8 11207.3 11417.7 11475.4 16:10:14 INFO - PROCESS | 12350 | -------- Summary: end -------- 16:10:14 INFO - PROCESS | 12350 | 16:10:15 INFO - TEST-INFO | 12350: exit 0 16:10:15 INFO - TEST-OK | dromaeo_css | took 1109317ms 16:10:15 INFO - TEST-START | kraken 16:10:15 INFO - operating with platform_type : linux_ 16:10:15 INFO - Initialising browser for kraken test... 16:10:15 INFO - TEST-INFO | started process 12591 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpxSIxYS/profile http://localhost:48306/getInfo.html) 16:10:19 INFO - PROCESS | 12591 | 16:10:19 INFO - PROCESS | 12591 | (process:12669): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 16:10:19 INFO - PROCESS | 12591 | __metrics Screen width/height:1600/1200 16:10:19 INFO - PROCESS | 12591 | colorDepth:24 16:10:19 INFO - PROCESS | 12591 | Browser inner width/height: 1024/697 16:10:19 INFO - PROCESS | 12591 | __metrics 16:10:20 ERROR - PROCESS | 12591 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2940: TypeError: this.tabs is undefined 16:10:21 INFO - TEST-INFO | 12591: exit 0 16:10:21 INFO - Browser initialized. 16:10:21 INFO - Running cycle 1/1 for kraken test... 16:10:21 INFO - TEST-INFO | started process 12720 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpxSIxYS/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 16:10:23 INFO - PROCESS | 12720 | 16:10:23 INFO - PROCESS | 12720 | (process:12794): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 16:10:33 INFO - PROCESS | 12720 | RSS: Main: 152190976 16:10:33 INFO - PROCESS | 12720 | 16:10:35 INFO - PROCESS | 12720 | Cycle 1(1): loaded http://localhost:48306/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:48306/tests/kraken/driver.html?testName=audio-beat-detection) 16:10:36 INFO - PROCESS | 12720 | RSS: Main: 157040640 16:10:36 INFO - PROCESS | 12720 | 16:10:39 INFO - PROCESS | 12720 | Cycle 1(1): loaded http://localhost:48306/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:48306/tests/kraken/driver.html?testName=audio-dft) 16:10:39 INFO - PROCESS | 12720 | RSS: Main: 157392896 16:10:39 INFO - PROCESS | 12720 | 16:10:42 INFO - PROCESS | 12720 | Cycle 1(1): loaded http://localhost:48306/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:48306/tests/kraken/driver.html?testName=audio-fft) 16:10:43 INFO - PROCESS | 12720 | RSS: Main: 157114368 16:10:43 INFO - PROCESS | 12720 | 16:10:45 INFO - PROCESS | 12720 | Cycle 1(1): loaded http://localhost:48306/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:48306/tests/kraken/driver.html?testName=audio-oscillator) 16:10:46 INFO - PROCESS | 12720 | RSS: Main: 157216768 16:10:46 INFO - PROCESS | 12720 | 16:10:48 INFO - PROCESS | 12720 | Cycle 1(1): loaded http://localhost:48306/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:48306/tests/kraken/driver.html?testName=imaging-gaussian-blur) 16:10:48 INFO - PROCESS | 12720 | RSS: Main: 156860416 16:10:48 INFO - PROCESS | 12720 | 16:10:51 INFO - PROCESS | 12720 | Cycle 1(1): loaded http://localhost:48306/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:48306/tests/kraken/driver.html?testName=imaging-darkroom) 16:10:52 INFO - PROCESS | 12720 | RSS: Main: 157540352 16:10:52 INFO - PROCESS | 12720 | 16:10:55 INFO - PROCESS | 12720 | Cycle 1(1): loaded http://localhost:48306/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:48306/tests/kraken/driver.html?testName=imaging-desaturate) 16:10:56 INFO - PROCESS | 12720 | RSS: Main: 157286400 16:10:56 INFO - PROCESS | 12720 | 16:10:59 INFO - PROCESS | 12720 | Cycle 1(1): loaded http://localhost:48306/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:48306/tests/kraken/driver.html?testName=json-parse-financial) 16:10:59 INFO - PROCESS | 12720 | RSS: Main: 157159424 16:10:59 INFO - PROCESS | 12720 | 16:11:01 INFO - PROCESS | 12720 | Cycle 1(1): loaded http://localhost:48306/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:48306/tests/kraken/driver.html?testName=json-stringify-tinderbox) 16:11:02 INFO - PROCESS | 12720 | RSS: Main: 157159424 16:11:02 INFO - PROCESS | 12720 | 16:11:03 INFO - PROCESS | 12720 | Cycle 1(1): loaded http://localhost:48306/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:48306/tests/kraken/driver.html?testName=stanford-crypto-aes) 16:11:04 INFO - PROCESS | 12720 | RSS: Main: 157138944 16:11:04 INFO - PROCESS | 12720 | 16:11:06 INFO - PROCESS | 12720 | Cycle 1(1): loaded http://localhost:48306/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:48306/tests/kraken/driver.html?testName=stanford-crypto-ccm) 16:11:06 INFO - PROCESS | 12720 | RSS: Main: 157138944 16:11:06 INFO - PROCESS | 12720 | 16:11:09 INFO - PROCESS | 12720 | Cycle 1(1): loaded http://localhost:48306/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:48306/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 16:11:10 INFO - PROCESS | 12720 | RSS: Main: 158117888 16:11:10 INFO - PROCESS | 12720 | 16:11:12 INFO - PROCESS | 12720 | Cycle 1(1): loaded http://localhost:48306/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:48306/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 16:11:13 INFO - PROCESS | 12720 | RSS: Main: 157577216 16:11:13 INFO - PROCESS | 12720 | 16:11:15 INFO - PROCESS | 12720 | Cycle 1(1): loaded http://localhost:48306/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:48306/tests/kraken/driver.html?testName=ai-astar) 16:11:15 INFO - PROCESS | 12720 | RSS: Main: 159498240 16:11:15 INFO - PROCESS | 12720 | 16:11:15 INFO - PROCESS | 12720 | __start_tp_report 16:11:15 INFO - PROCESS | 12720 | _x_x_mozilla_page_load 16:11:15 INFO - PROCESS | 12720 | _x_x_mozilla_page_load_details 16:11:15 INFO - PROCESS | 12720 | |i|pagename|runs| 16:11:15 INFO - PROCESS | 12720 | |0;ai-astar;108;112;103;109;112;114;101;111;112;110 16:11:15 INFO - PROCESS | 12720 | |1;audio-beat-detection;156;126;156;178;127;157;159;126;186;138 16:11:15 INFO - PROCESS | 12720 | |2;audio-dft;162;167;164;168;161;162;162;162;161;161 16:11:15 INFO - PROCESS | 12720 | |3;audio-fft;76;72;76;168;74;74;76;73;170;76 16:11:15 INFO - PROCESS | 12720 | |4;audio-oscillator;93;95;155;103;94;93;139;94;92;144 16:11:15 INFO - PROCESS | 12720 | |5;imaging-gaussian-blur;118;117;117;118;117;117;118;117;117;118 16:11:15 INFO - PROCESS | 12720 | |6;imaging-darkroom;146;147;148;146;146;147;147;148;149;148 16:11:15 INFO - PROCESS | 12720 | |7;imaging-desaturate;94;95;95;95;95;95;95;94;95;94 16:11:15 INFO - PROCESS | 12720 | |8;json-parse-financial;52;56;55;56;57;56;57;72;54;54 16:11:15 INFO - PROCESS | 12720 | |9;json-stringify-tinderbox;56;57;57;58;58;57;57;57;57;57 16:11:15 INFO - PROCESS | 12720 | |10;stanford-crypto-aes;75;80;73;74;75;75;76;74;77;74 16:11:15 INFO - PROCESS | 12720 | |11;stanford-crypto-ccm;126;120;113;118;129;112;109;113;128;136 16:11:15 INFO - PROCESS | 12720 | |12;stanford-crypto-pbkdf2;159;161;159;163;159;156;161;159;161;159 16:11:15 INFO - PROCESS | 12720 | |13;stanford-crypto-sha256-iterative;63;72;66;66;65;65;64;64;65;64 16:11:15 INFO - PROCESS | 12720 | __end_tp_report 16:11:15 INFO - PROCESS | 12720 | __start_cc_report 16:11:15 INFO - PROCESS | 12720 | _x_x_mozilla_cycle_collect,839 16:11:15 INFO - PROCESS | 12720 | __end_cc_report 16:11:15 INFO - PROCESS | 12720 | __startTimestamp1464649875312__endTimestamp 16:11:15 INFO - PROCESS | 12720 | 16:11:15 INFO - PROCESS | 12720 | ------- Summary: start ------- 16:11:15 INFO - PROCESS | 12720 | Number of tests: 14 16:11:15 INFO - PROCESS | 12720 | 16:11:15 INFO - PROCESS | 12720 | [#0] ai-astar Cycles:10 Average:109.20 Median:111.50 stddev:4.18 (3.8%) stddev-sans-first:4.42 16:11:15 INFO - PROCESS | 12720 | Values: 108.0 112.0 103.0 109.0 112.0 114.0 101.0 111.0 112.0 110.0 16:11:15 INFO - PROCESS | 12720 | 16:11:15 INFO - PROCESS | 12720 | [#1] audio-beat-detection Cycles:10 Average:150.90 Median:156.50 stddev:21.34 (13.6%) stddev-sans-first:22.56 16:11:15 INFO - PROCESS | 12720 | Values: 156.0 126.0 156.0 178.0 127.0 157.0 159.0 126.0 186.0 138.0 16:11:15 INFO - PROCESS | 12720 | 16:11:15 INFO - PROCESS | 12720 | [#2] audio-dft Cycles:10 Average:163.00 Median:162.00 stddev:2.54 (1.6%) stddev-sans-first:2.67 16:11:15 INFO - PROCESS | 12720 | Values: 162.0 167.0 164.0 168.0 161.0 162.0 162.0 162.0 161.0 161.0 16:11:15 INFO - PROCESS | 12720 | 16:11:15 INFO - PROCESS | 12720 | [#3] audio-fft Cycles:10 Average:93.50 Median:75.00 stddev:39.82 (53.1%) stddev-sans-first:41.73 16:11:15 INFO - PROCESS | 12720 | Values: 76.0 72.0 76.0 168.0 74.0 74.0 76.0 73.0 170.0 76.0 16:11:15 INFO - PROCESS | 12720 | 16:11:15 INFO - PROCESS | 12720 | [#4] audio-oscillator Cycles:10 Average:110.20 Median:93.00 stddev:25.19 (27.1%) stddev-sans-first:25.93 16:11:15 INFO - PROCESS | 12720 | Values: 93.0 95.0 155.0 103.0 94.0 93.0 139.0 94.0 92.0 144.0 16:11:15 INFO - PROCESS | 12720 | 16:11:15 INFO - PROCESS | 12720 | [#5] imaging-gaussian-blur Cycles:10 Average:117.40 Median:117.50 stddev:0.52 (0.4%) stddev-sans-first:0.50 16:11:15 INFO - PROCESS | 12720 | Values: 118.0 117.0 117.0 118.0 117.0 117.0 118.0 117.0 117.0 118.0 16:11:15 INFO - PROCESS | 12720 | 16:11:15 INFO - PROCESS | 12720 | [#6] imaging-darkroom Cycles:10 Average:147.20 Median:147.50 stddev:1.03 (0.7%) stddev-sans-first:1.00 16:11:15 INFO - PROCESS | 12720 | Values: 146.0 147.0 148.0 146.0 146.0 147.0 147.0 148.0 149.0 148.0 16:11:15 INFO - PROCESS | 12720 | 16:11:15 INFO - PROCESS | 12720 | [#7] imaging-desaturate Cycles:10 Average:94.70 Median:95.00 stddev:0.48 (0.5%) stddev-sans-first:0.44 16:11:15 INFO - PROCESS | 12720 | Values: 94.0 95.0 95.0 95.0 95.0 95.0 95.0 94.0 95.0 94.0 16:11:15 INFO - PROCESS | 12720 | 16:11:15 INFO - PROCESS | 12720 | [#8] json-parse-financial Cycles:10 Average:56.90 Median:56.00 stddev:5.53 (9.9%) stddev-sans-first:5.57 16:11:15 INFO - PROCESS | 12720 | Values: 52.0 56.0 55.0 56.0 57.0 56.0 57.0 72.0 54.0 54.0 16:11:15 INFO - PROCESS | 12720 | 16:11:15 INFO - PROCESS | 12720 | [#9] json-stringify-tinderbox Cycles:10 Average:57.10 Median:57.00 stddev:0.57 (1.0%) stddev-sans-first:0.44 16:11:15 INFO - PROCESS | 12720 | Values: 56.0 57.0 57.0 58.0 58.0 57.0 57.0 57.0 57.0 57.0 16:11:15 INFO - PROCESS | 12720 | 16:11:15 INFO - PROCESS | 12720 | [#10] stanford-crypto-aes Cycles:10 Average:75.30 Median:75.00 stddev:2.00 (2.7%) stddev-sans-first:2.12 16:11:15 INFO - PROCESS | 12720 | Values: 75.0 80.0 73.0 74.0 75.0 75.0 76.0 74.0 77.0 74.0 16:11:15 INFO - PROCESS | 12720 | 16:11:15 INFO - PROCESS | 12720 | [#11] stanford-crypto-ccm Cycles:10 Average:120.40 Median:123.00 stddev:8.96 (7.3%) stddev-sans-first:9.27 16:11:15 INFO - PROCESS | 12720 | Values: 126.0 120.0 113.0 118.0 129.0 112.0 109.0 113.0 128.0 136.0 16:11:15 INFO - PROCESS | 12720 | 16:11:15 INFO - PROCESS | 12720 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:159.70 Median:160.00 stddev:1.89 (1.2%) stddev-sans-first:1.99 16:11:15 INFO - PROCESS | 12720 | Values: 159.0 161.0 159.0 163.0 159.0 156.0 161.0 159.0 161.0 159.0 16:11:15 INFO - PROCESS | 12720 | 16:11:15 INFO - PROCESS | 12720 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:65.40 Median:65.00 stddev:2.50 (3.9%) stddev-sans-first:2.50 16:11:15 INFO - PROCESS | 12720 | Values: 63.0 72.0 66.0 66.0 65.0 65.0 64.0 64.0 65.0 64.0 16:11:15 INFO - PROCESS | 12720 | -------- Summary: end -------- 16:11:15 INFO - PROCESS | 12720 | 16:11:16 INFO - TEST-INFO | 12720: exit 0 16:11:16 INFO - TEST-OK | kraken | took 60726ms 16:11:16 INFO - SUITE-END | took 1170s 16:11:16 INFO - Completed test suite (00:19:30) 16:11:16 INFO - javascript benchmark 16:11:16 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3374.4938259261116, 3435.5877294724637, 3436.6047904490993, 3486.2678837444137, 3492.5459690240264, 5669.773209071632, 5680.0, 5693.202951586776, 5694.829155125348, 5698.401667824881, 5650.463205995434, 5693.03218452863, 5708.8858222835515, 5710.229119068925, 5754.1944127822135, 5087.567556757671, 5151.356080489939, 5190.974045129769, 5215.947840521584, 5219.608529360295, 4989.052080104769, 5262.0, 5319.468053194669, 5319.574434045287, 5324.7071411072375, 5114.335136432259, 5125.103106956286, 5167.095758242312, 5210.687358758487, 5265.76304066318, 5157.432682404932, 5178.093833579109, 5179.818706345279, 5190.792368305263, 5210.166373380279, 5130.410002849682, 5152.072626927152, 5184.300119483859, 5209.1404918188455, 5249.055170069386, 5464.972675136639, 5485.177223416479, 5493.972530137364, 5522.088855338904, 5570.470805273492, 6012.6392416455155, 6035.155078289043, 6089.969550152266, 6099.847503812396, 6109.327973922865, 6085.756569737206, 6105.481034112106, 6137.447629713302, 6147.415995480422, 6155.846103847395, 5523.7790488380415, 5716.314042314907, 5719.170720245583, 5752.28096487939, 5773.162891380768, 6164.845878853064, 6184.721687524072, 6189.473894718909, 6193.163922870445, 6199.101130336076, 5914.4381283777975, 5951.375105613848, 5969.194158788508, 5982.820515384546, 6025.427584379477, 6039.275286965504, 6050.818475445743, 6055.909161362583, 6068.6358818471035, 6070.362611925772, 5989.101634754822, 5998.880022399615, 6004.099385092184, 6012.909806352908, 6014.909776353358, 5844.035734103911, 5938.138969849348, 6014.578979471395, 6023.5181185505935, 6125.357545073132, 4574.5882870541145, 4579.610733087658, 4587.174308624413, 4610.9308360374625, 4613.238815595456, 4093.099518106012, 4117.382392641128, 4129.752214867118, 4130.648894843972, 4153.792310384469, 5851.180834683148, 5885.529157667376, 5979.342272350038, 6007.609505382136, 6041.879162416727, 5949.434803693643, 6139.614800607407, 6221.751129954841, 6240.438360547572, 6245.6252624842655, 5893.263342082239, 5904.498117659961, 5905.970470147622, 5907.7046147692445, 5918.171455996164, 5090.338256026767, 5242.816501422508, 5269.947300527022, 5283.894322113536, 5308.893822123536, 6416.647084410402, 6441.0, 6451.419372256426, 6481.416672499403, 6501.47988160946, 6051.304100028553, 6180.905523574123, 6206.317305096436, 6235.314115447207, 6254.21822272216, 6251.218597675291, 6328.968355158195, 6353.0152826312, 6361.681915904093, 6385.233771947396, 6027.336992930686, 6030.276366836008, 6030.517558595214, 6041.879162416815, 6047.727852246748, 5974.4324289192455, 6111.113888486056, 6115.5719099664375, 6126.264848218064, 6148.538859585638, 5893.499052580579, 5905.793297234576, 5923.170756094237, 5923.703814809329, 5954.374790647093, 5839.620424672383, 5872.236609240942, 5905.498032667271, 5921.230240068936, 5926.585139040226, 5701.771929122954, 5753.539716822561, 5765.884682306414, 5832.475077243069, 5846.093855452412, 5950.315713692808, 5993.6104153231645, 6059.272887253558, 6064.0, 6098.817035488943, 5889.734961926638, 5906.350301466749, 5909.202257695156, 5915.0, 5918.437748413894], "value": 5625.462697745475, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [672.7914346552568, 682.9043933849259, 685.6366125953243, 687.4843867099676, 744.4863044499299, 31906.361872762533, 40547.0, 41122.0, 41265.58734412659, 41292.17415651685, 43038.784806076, 43664.0, 43746.0, 43968.34047489282, 44016.3397549037, 8734.170253825892, 8941.329400294971, 8952.283817294634, 8995.14546118121, 9012.639494420215, 8841.73474795754, 8865.290776737878, 8904.51025193614, 8926.642934282621, 8941.50821704806, 9105.226055785266, 9203.493807840567, 9272.814543709123, 9283.025282345325, 9284.72145835626, 9142.63429462824, 9197.356185067049, 9213.63145474187, 9221.077892210726, 9244.907550924505, 9061.456312621263, 9149.725508234764, 9158.084191580856, 9163.587638556215, 9164.95417522908, 43251.0, 43689.126217475794, 43806.34290485645, 43899.34150987738, 43978.56021439777, 3800.20195758891, 3822.7515211511163, 3842.3660096084113, 3843.7693738375788, 4033.4756481657196, 33448.0, 33725.325493489996, 34275.65724342749, 34600.65399346025, 34715.826420867736, 4069.206504731549, 4085.4484644573195, 4139.337705967061, 4170.791460426966, 4176.686748493845, 229318.0, 230165.0, 230474.8476257625, 231472.0, 232093.0, 39868.401973970416, 62253.06620400697, 65092.34907650958, 65169.34830651728, 65345.67327163429, 37997.81001094977, 38131.618683812805, 38219.61780382161, 38225.23549528994, 38271.234575308335, 15553.688926221412, 15689.68620627581, 15712.371505139667, 15716.764248536281, 15769.68460630781, 12577.182483138567, 12610.558630447891, 12659.936700316439, 12660.936695316464, 12737.681557961125, 9188.90811091894, 9245.0, 9355.391899526508, 9407.388519746195, 9434.0, 3598.8560457581925, 3608.242269123461, 3640.9453858192146, 3642.5264715586804, 3683.208110256308, 1152.291340825403, 1158.1314014489133, 1191.5472120594118, 1244.9190802597802, 1282.602393258093, 32831.50752738711, 33223.66776332254, 33588.3282334352, 33682.326353472796, 33851.661483385345, 1247.9891288056704, 1266.7276535544718, 1286.292539103508, 1308.941097650589, 1319.3139567424885, 17289.308427663003, 17393.565160870825, 17485.0, 17498.56253593645, 17618.559536011704, 501762.0, 508219.0, 529176.0, 532555.0, 535518.0, 54429.183562246595, 55788.72105639446, 55945.720271398386, 56433.435665643636, 56675.43324566784, 1479.201231335067, 1557.8520040596125, 1565.223471359992, 1577.1798664694525, 1580.2730743857953, 31079.689203108584, 31556.526652100696, 31839.88560400375, 32277.35445291128, 32864.50703239405, 54004.72997635144, 54371.0, 54646.453535464134, 54646.726766365915, 54765.726171368886, 439741.0, 444817.0, 445460.0, 446288.0, 446447.0, 31420.52869206918, 31542.211444714067, 31685.0, 31750.523742143425, 31787.6821231794, 51359.74320128375, 51671.741641291555, 52209.21686174635, 52874.2068868975, 52903.20645190248, 41555.79222103991, 42815.14369712526, 42872.78563607162, 42951.57048429476, 43656.0, 42765.5723442774, 42946.0, 42974.78512607542, 43687.0, 43863.56136438595, 43114.353284701385, 43200.56799431965, 43499.34750978675, 43735.12529749451, 44514.55485445104, 37541.061473463385, 37766.43350349802, 37861.81069094637, 38011.0, 38372.23255534929, 29539.55690664685, 29724.0, 29801.10596682103, 30151.849240753654, 30239.244018899702], "value": 19537.61546692174, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [415.0950926979188, 422.4782393743728, 426.6565414841053, 428.0753572283866, 433.43003949806, 18754.2498300068, 19395.903020484897, 19399.321023764172, 19829.504262393446, 20953.790462095374, 12501.874981250185, 12794.360281985886, 12877.162984406006, 20213.59572808543, 20225.797742022576, 5270.92093618596, 5367.221752845835, 5408.378036525811, 5411.648242864221, 5418.9458105419035, 5377.623566350357, 5767.33675627304, 5770.278715160605, 5771.942280577204, 5772.971135144318, 5633.239512665799, 5642.830715078554, 5667.5749318801045, 5681.403452637475, 5700.201971723941, 5415.0, 5898.793542226002, 5900.64596124234, 5901.026330655458, 5903.79336723217, 5332.440093790135, 5333.2266821310695, 5358.33020872391, 5358.517733404013, 5366.758495867695, 14876.851231487655, 14879.776803347959, 14884.479043233543, 14960.551183464513, 16551.586210344718, 2469.172827102923, 2500.7999360051335, 2561.4492884030024, 2727.699953005168, 2948.82307061577, 10492.317999330018, 10573.365598064063, 10595.682129536126, 10673.306235094695, 10774.622888198875, 2061.402193363923, 2127.4468638154035, 2129.33990462957, 2132.605467988427, 2149.6453085240914, 76591.0, 79009.0, 79334.99999999942, 80054.599727001, 80764.59617701932, 11526.250793698382, 11746.76506469883, 11829.467673954692, 11866.228695134789, 11894.286342819285, 16579.91710041442, 16719.247633856507, 16743.0, 16770.74843877343, 16874.831251687327, 8495.872561911576, 8577.699780507652, 8594.183552562497, 8900.42147260426, 8925.33060020501, 8685.43544669607, 8704.956475217583, 8733.912660873437, 8810.471371717718, 8849.89376327959, 4921.87695307613, 5005.0, 5058.696478211245, 5215.374155101412, 5228.241904923765, 1896.9620607587772, 2075.886170743884, 2117.7458704955197, 2164.729408823897, 2170.24041585447, 1009.1724785675822, 1108.257467496779, 1117.1286396610656, 1162.7035106047904, 1226.4603574427224, 18979.525511862037, 19016.714749278774, 19202.423927282205, 19290.22839086449, 19524.51188720265, 1110.8064315094105, 1111.4664960818852, 1113.5434471866495, 1173.7828501727208, 1203.6629743671785, 10799.0, 10955.50700218492, 11024.338539687644, 11073.224874258725, 11088.390138542296, 489537.0, 496132.0, 496350.0, 498100.0, 508530.0, 90719.54640226888, 92620.0, 93984.53007735054, 94213.0, 95388.0, 1117.3072694929197, 1119.1997721628911, 1119.731264496515, 1122.5846436818267, 1169.0997931592626, 17140.485785426456, 17190.570235744206, 17200.741988869926, 17376.82623173752, 17557.82442175562, 39433.40849887311, 40108.79945600253, 40403.0, 41045.38431923583, 41882.1623567533, 53937.73031134819, 55658.44341556533, 55976.0, 56587.43412565822, 56629.43370566241, 8919.643214271617, 9038.347376245249, 9123.0, 9176.623506474083, 9404.059594040542, 12877.871221288042, 12998.415071322002, 13089.0, 13256.270905100311, 13385.263810490516, 11550.249233799776, 11680.70798230051, 11736.589219377282, 11929.0, 12040.578579749666, 11146.609868654557, 11176.16178786578, 11265.436728163722, 11347.0, 11462.94268528652, 11885.94057029744, 11892.0, 11935.403229838299, 12093.879061209627, 12249.081318901297, 8798.296136309207, 8808.735737927873, 9139.954300228455, 9191.080891910755, 9213.0, 11692.298462092302, 12055.698607534881, 12168.0, 12171.14801963854, 12244.3475524791], "value": 9365.090439930298, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1624.6263359427328, 1628.430049482681, 1818.5817262029732, 1909.284018493065, 1946.182603306611, 7613.314801667849, 8010.759677209686, 8259.545724985132, 8307.376946728997, 8422.83154336913, 8520.403571749965, 8575.442596231256, 8598.570071496431, 8690.782730431742, 8692.043875173726, 2398.4963157736897, 2424.1273141668985, 2443.376938880583, 2450.7059152901675, 2453.4479742057983, 2399.796017338528, 2413.6862207913036, 2419.2742177346813, 2442.829001969863, 2450.779429851313, 2428.3322086426197, 2436.792872605831, 2456.078970386105, 2465.938351541208, 2470.777630013298, 2424.6363045543135, 2437.573424650679, 2446.620773780076, 2447.0823441209545, 2457.054034196838, 2287.9199228026937, 2299.6895419118373, 2300.723913130418, 2300.9309720708407, 2311.4914718761847, 8780.736577902673, 8843.646254149826, 8854.734357969272, 8889.111088891124, 8925.866112008325, 5357.544608708265, 5400.486953739389, 5411.0, 5414.945850541483, 5440.972795135999, 3362.2266878618057, 3418.538497302882, 3458.3774920514297, 3481.442969124928, 3483.878064267764, 1028.7428142964259, 1082.5832054659013, 1083.0739717541467, 1083.9295445796, 1087.423665457301, 12567.057470689735, 12570.057245706608, 12587.244765314019, 12603.873961260453, 12613.180143290656, 4624.861254162381, 4658.720476771405, 4707.152712511713, 4738.241881298975, 4803.063402636522, 10552.050315471644, 10553.947230263799, 10642.042216200425, 10679.78640427187, 10705.197110216764, 5265.236540701577, 5308.097623404031, 5343.278657381282, 5371.113766228528, 5372.650777699437, 4211.642010429086, 4877.487863774323, 4883.780229889663, 4993.500649934977, 5005.649604527721, 4237.957620423818, 4258.6380157686945, 4293.742375457483, 4308.46144231971, 4348.34774783785, 1355.1327150623608, 1422.2035660030417, 1432.133559196671, 1442.2067862675697, 1454.665426951807, 956.4596003258137, 1078.1698092468755, 1096.5887792077972, 1117.3240189685287, 1127.9943600281947, 5613.298337707786, 5936.892403196889, 6031.276246850318, 6106.053561697944, 6112.17485639433, 989.3964681544396, 995.9194274212416, 1034.4362322534237, 1056.1234175634206, 1060.7401186709305, 4228.302330115496, 4248.74507529543, 4258.8296468140925, 4261.275583150872, 4281.207976524291, 10529.578816847394, 10808.675739727822, 10891.074258687942, 10933.453327333602, 10978.451077446096, 9745.220382369393, 10859.83710244347, 10860.348379097279, 10870.565177392815, 10872.238943274053, 8234.752957411287, 8303.418760686814, 8317.95841020779, 8357.623906924204, 8374.2881855043, 6011.879762404815, 6144.969275153596, 6157.507399408126, 6246.718897649707, 6253.1245625613365, 9089.363744537819, 9089.727308180765, 9164.404313719588, 9241.907580924373, 9309.20871725911, 9265.490398027903, 9400.623975041195, 9997.900020999698, 10041.899581004389, 10172.186225101826, 6785.5250132490255, 7542.6605802740105, 7551.773446796605, 7558.659860306189, 7604.315611594983, 8389.538575378412, 8419.8737018946, 8429.4942303462, 8438.746837594881, 8466.872996905175, 7465.514741541782, 7734.8839767402405, 7788.260115289038, 7790.337821285254, 7798.571078590732, 7583.9620801895635, 7610.543367397974, 7662.425318101276, 7736.651850666621, 7751.0, 7118.786436406916, 7147.463940204401, 7151.8569628608175, 7181.281871812777, 7197.280271972761, 5128.769205385841, 5186.455422180617, 5286.709230992333, 5300.575953923754, 5308.495692909168, 5282.718079011638, 5296.470352964673, 5347.919781203363, 5485.6982865942755, 5511.5039646432015], "value": 4729.126789338741, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [337.4656330954532, 342.2299825392867, 342.53073289593254, 356.8491614543097, 357.8693776771476, 6480.351964803517, 6536.575122617039, 6675.732970681173, 6733.898991515125, 6757.966210168955, 6596.505262105337, 6614.437772789307, 6630.767923122692, 6646.634435106067, 6650.933490665092, 4957.0, 4957.206846904496, 4964.205727083668, 4968.180250258703, 4992.051510213066, 4994.400671919375, 4998.7250701211415, 5004.949950500503, 5011.899762004758, 5016.548510634042, 4951.133551628469, 4958.752062396884, 4960.355153829997, 4962.528559786814, 4974.204127339626, 4723.055388922229, 4898.338724272213, 4946.431160416562, 4964.578010869062, 4969.726665033421, 4218.641415479688, 4222.0, 4233.111046680201, 4234.9364759528635, 4238.131183107455, 6295.307516173218, 6303.432691057827, 6308.526860485436, 6312.116303717483, 6314.579219675582, 5695.373508914016, 5696.430356964312, 5696.601237913348, 5699.8005069822775, 5725.055365864628, 6934.2719014503255, 6964.338387853146, 6965.407940325078, 6968.895466568006, 6969.930300697029, 4645.558671926162, 4662.230731929228, 4665.393498845162, 4713.363695901078, 4826.372571565709, 7217.242189570072, 7248.238934911811, 7335.48651594394, 7371.37343325818, 7390.5196162249285, 4936.703797772145, 4945.184044632667, 4945.23348880924, 4948.455669876311, 4957.405111386656, 5009.799608015712, 5023.447420783711, 5026.572741317029, 5028.673136246132, 5032.521910418504, 5759.712014399263, 5780.132980052942, 5788.594798364158, 5801.390853960358, 5807.0, 6854.760083397057, 6951.756688515878, 7005.369516743517, 7070.292970702992, 7082.575045497184, 1772.087375001875, 1796.362291386539, 1797.2361746257789, 1801.0814484612943, 1805.5666640006305, 1117.3296022386503, 1158.7914175448332, 1163.8428812110258, 1187.7743228786676, 1192.0761409907218, 6763.458923286125, 6895.931040689529, 6900.102986611809, 6917.619530925847, 6944.409725173316, 7290.4167666586545, 7333.449991250677, 7349.412047036224, 7351.669174887036, 7355.742549010759, 6831.555948863308, 6855.314468553105, 6873.037774711544, 6873.175218973755, 6881.552699074544, 3875.4380614810693, 3940.0543869471694, 3961.069148750041, 3963.207358528306, 3979.1643754811234, 7583.696652133964, 7612.733554325683, 7619.390448764197, 7630.046244219473, 7637.885431718529, 7349.4855360124275, 7391.593462359622, 7445.739399121005, 7458.0, 7469.141048779351, 7613.238676132342, 7623.809404764926, 7640.426967977424, 7646.65590048438, 7650.4644674872225, 7114.079198616241, 7315.524490908287, 7316.268373162641, 7318.487705860752, 7320.341169294789, 7152.0, 7171.533850299714, 7183.245759195209, 7210.315020073084, 7216.097987751531, 7580.62096895142, 7586.734464293723, 7612.0, 7613.428992825449, 7617.314441700273, 4983.401991761012, 4997.275395067768, 5001.64988450805, 5008.1235783736975, 5009.023240468219, 7128.750493732695, 7294.562326260441, 7303.780886573411, 7306.96346518264, 7341.15576708664, 7009.1939426966555, 7062.940558916203, 7068.222495525385, 7072.752453664303, 7074.292570742885, 7047.295270472911, 7055.259197784364, 7058.682359293947, 7062.788116356517, 7080.822979425349, 6868.622225777431, 6875.243723190545, 6889.689963951734, 6914.308569143045, 6928.099347085048, 6886.621235831877, 7112.50212485121, 7138.928610713826, 7188.38898693596, 7190.101237345332, 6591.373819487141, 6761.357671021246, 6947.722091116501, 6955.756548520778, 6983.895241571279], "value": 5276.55525834436, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [849.3205435651478, 911.9316051296155, 931.8974912759595, 934.4725946029238, 961.2742379503474, 15169.469068582603, 15218.467353642625, 15232.0, 15235.238238088094, 15255.0, 15685.686286274296, 15770.053796772201, 15787.28957196926, 15801.525954221363, 15832.129232892186, 886.7871710789397, 910.599336292031, 917.3670167584379, 924.9213816825578, 927.0868194828089, 922.8154369126169, 929.2705226397279, 930.483581612205, 930.5486838883136, 933.1508327422048, 961.4952150121172, 962.8266911955845, 969.2294625772528, 970.6166064404556, 973.1873885305743, 960.5437417226831, 964.4117088575963, 965.020504188253, 965.7199412170462, 966.1642679082613, 700.6951975890504, 701.7649087555675, 704.7568588836895, 705.1115594351154, 707.2114592229627, 15833.52499425019, 15858.048517088897, 15868.285927133307, 15906.920465397714, 15926.522204333889, 14077.296135193199, 14267.429302827979, 14367.137971721626, 14506.1296322221, 14518.927405362905, 12076.879231207664, 12092.818607720803, 12176.878231217752, 12393.132480726354, 12458.252504849737, 3940.5271367435803, 4023.1752490739327, 4026.57720939303, 4033.657139143176, 4069.3895915612893, 57060.0, 57582.424175758126, 57588.13617795694, 57699.0, 58227.41772582305, 11191.552337906556, 11200.21598488098, 11232.0, 11474.77050459003, 11715.4142292885, 20117.798822011886, 20170.798292017185, 20194.09126589307, 20438.386848394573, 20502.0, 8296.70961516344, 8323.209295116954, 8476.915230847613, 8486.19381158789, 8634.525101119372, 4973.452920178777, 5014.17266151081, 5027.874303142377, 5079.796808127633, 5210.583153347723, 3660.2313514162324, 3687.354712925281, 3691.593924668284, 3709.4621279914263, 3709.6104908984707, 664.6643445060214, 667.7095463473307, 676.2223443040542, 687.4328678839977, 696.084648686975, 771.7491815159983, 778.8559116563454, 779.6530543907907, 780.6994307191773, 789.676232744572, 10257.33327333721, 10379.896201038044, 10441.216908731723, 10499.94750026245, 10584.100351470057, 644.9548531602836, 759.3279947246726, 781.6560713286136, 788.9053313602404, 807.9474834135763, 4820.878149182468, 4844.346013288232, 4888.706677599355, 4957.157283261782, 4989.800407983713, 64101.35898641047, 64962.0, 65311.0, 65524.0, 65538.34461655418, 56486.0, 56830.43169568334, 57789.71105144447, 57850.42149578535, 58445.70777146087, 51870.22194667083, 51937.48062519327, 52329.0, 53010.0, 53124.0, 9671.758206044906, 9732.367396119229, 9774.80450390974, 9830.508474576385, 9852.310338276251, 36449.271014579026, 37597.0, 38219.72088675776, 39087.21825563416, 39526.60473395229, 49034.26448603202, 49330.75334623304, 49873.0, 49944.50055499398, 50573.0, 11906.0, 11999.0, 12040.277583345027, 12124.333161676192, 12162.635120946386, 13755.931220344235, 14273.357698903366, 14701.779473308123, 14727.0, 15618.9219053904, 13751.113751113671, 13948.372323245681, 14000.369983350978, 14180.432782688576, 14757.114573125647, 13129.0, 13380.933095334462, 13437.462501499831, 13644.65888352799, 13788.0, 11715.1799374043, 11966.46150923193, 12080.21478603888, 12952.611421657366, 13445.260510672008, 11038.613648522263, 11359.091272697999, 11444.94277528607, 11458.885411145782, 11824.822627660764, 10785.568577256821, 11023.779524409627, 11207.271527351022, 11417.657470275904, 11475.426228688699], "value": 7291.967708346115, "unit": "score"}], "name": "dromaeo_css", "value": 7564.127289303749, "alertThreshold": 5.0}, {"lowerIsBetter": true, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [108.0, 112.0, 103.0, 109.0, 112.0, 114.0, 101.0, 111.0, 112.0, 110.0], "value": 109.2, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [156.0, 126.0, 156.0, 178.0, 127.0, 157.0, 159.0, 126.0, 186.0, 138.0], "value": 150.9, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [162.0, 167.0, 164.0, 168.0, 161.0, 162.0, 162.0, 162.0, 161.0, 161.0], "value": 163.0, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [76.0, 72.0, 76.0, 168.0, 74.0, 74.0, 76.0, 73.0, 170.0, 76.0], "value": 93.5, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [93.0, 95.0, 155.0, 103.0, 94.0, 93.0, 139.0, 94.0, 92.0, 144.0], "value": 110.2, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [118.0, 117.0, 117.0, 118.0, 117.0, 117.0, 118.0, 117.0, 117.0, 118.0], "value": 117.4, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [146.0, 147.0, 148.0, 146.0, 146.0, 147.0, 147.0, 148.0, 149.0, 148.0], "value": 147.2, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [94.0, 95.0, 95.0, 95.0, 95.0, 95.0, 95.0, 94.0, 95.0, 94.0], "value": 94.7, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [52.0, 56.0, 55.0, 56.0, 57.0, 56.0, 57.0, 72.0, 54.0, 54.0], "value": 56.9, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [56.0, 57.0, 57.0, 58.0, 58.0, 57.0, 57.0, 57.0, 57.0, 57.0], "value": 57.1, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [75.0, 80.0, 73.0, 74.0, 75.0, 75.0, 76.0, 74.0, 77.0, 74.0], "value": 75.3, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [126.0, 120.0, 113.0, 118.0, 129.0, 112.0, 109.0, 113.0, 128.0, 136.0], "value": 120.4, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [159.0, 161.0, 159.0, 163.0, 159.0, 156.0, 161.0, 159.0, 161.0, 159.0], "value": 159.7, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [63.0, 72.0, 66.0, 66.0, 65.0, 65.0, 64.0, 64.0, 65.0, 64.0], "value": 65.4, "unit": "score"}], "name": "kraken", "value": 1520.9000000000003, "alertThreshold": 2.0}]} 16:11:16 INFO - Return code: 0 16:11:16 INFO - Validating PERFHERDER_DATA against /builds/slave/test/build/tests/talos/treeherder-schemas/performance-artifact.json 16:11:16 ERROR - # TBPL SUCCESS # 16:11:16 INFO - Running post-action listener: _resource_record_post_action 16:11:16 INFO - Running post-run listener: _resource_record_post_run 16:11:17 INFO - Total resource usage - Wall time: 1187s; CPU: 13.0%; Read bytes: 0; Write bytes: 499060736; Read time: 0; Write time: 588140 16:11:17 INFO - install - Wall time: 16s; CPU: 15.0%; Read bytes: 0; Write bytes: 249335808; Read time: 0; Write time: 390288 16:11:17 INFO - run-tests - Wall time: 1172s; CPU: 13.0%; Read bytes: 0; Write bytes: 249724928; Read time: 0; Write time: 197852 16:11:17 INFO - Running post-run listener: _upload_blobber_files 16:11:17 INFO - Blob upload gear active. 16:11:17 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 16:11:17 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 16:11:17 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', 'Mozilla-Aurora', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 16:11:17 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 Mozilla-Aurora -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 16:11:18 INFO - (blobuploader) - INFO - Open directory for files ... 16:11:18 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 16:11:18 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 16:11:18 INFO - (blobuploader) - INFO - Uploading, attempt #1. 16:11:18 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 16:11:18 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 16:11:18 INFO - (blobuploader) - INFO - Done attempting. 16:11:18 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 16:11:18 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 16:11:18 INFO - (blobuploader) - INFO - Uploading, attempt #1. 16:11:19 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 16:11:19 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 16:11:19 INFO - (blobuploader) - INFO - Done attempting. 16:11:19 INFO - (blobuploader) - INFO - Iteration through files over. 16:11:19 INFO - Return code: 0 16:11:19 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 16:11:19 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 16:11:19 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/bb4eff6bf1586db19d05d5f61fa6de07374238a38c7bea6eef2739b72fa829af05577a49ee104a297bda1788e51ffb50fd21c81be1346a04d5b96c0fc4cbef10", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/e7cf34c6ad38d9f6381600be1032e6817b9ee8f7f16c57f82a90c99602281ec7685de0fad579369eca84087c5b247cfbba5da81141a8d20e077343ffd2e97617"} 16:11:19 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 16:11:19 INFO - Writing to file /builds/slave/test/properties/blobber_files 16:11:19 INFO - Contents: 16:11:19 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/bb4eff6bf1586db19d05d5f61fa6de07374238a38c7bea6eef2739b72fa829af05577a49ee104a297bda1788e51ffb50fd21c81be1346a04d5b96c0fc4cbef10", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/e7cf34c6ad38d9f6381600be1032e6817b9ee8f7f16c57f82a90c99602281ec7685de0fad579369eca84087c5b247cfbba5da81141a8d20e077343ffd2e97617"} 16:11:19 INFO - Running post-run listener: copy_logs_to_upload_dir 16:11:19 INFO - Copying logs to upload dir... 16:11:19 INFO - mkdir: /builds/slave/test/build/upload/logs 16:11:19 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1230.310124 ========= master_lag: 0.69 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 31 secs) (at 2016-05-30 16:11:20.468392) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-05-30 16:11:20.474288) ========= 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=d2a8c569965ab8367867b893000001a1-1464647802.778318-1934851532 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/Mozilla-Aurora/sha512/bb4eff6bf1586db19d05d5f61fa6de07374238a38c7bea6eef2739b72fa829af05577a49ee104a297bda1788e51ffb50fd21c81be1346a04d5b96c0fc4cbef10", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/e7cf34c6ad38d9f6381600be1032e6817b9ee8f7f16c57f82a90c99602281ec7685de0fad579369eca84087c5b247cfbba5da81141a8d20e077343ffd2e97617"} build_url:https://queue.taskcluster.net/v1/task/PFkRtY74QaCv8vwtlU479g/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.009632 build_url: 'https://queue.taskcluster.net/v1/task/PFkRtY74QaCv8vwtlU479g/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/bb4eff6bf1586db19d05d5f61fa6de07374238a38c7bea6eef2739b72fa829af05577a49ee104a297bda1788e51ffb50fd21c81be1346a04d5b96c0fc4cbef10", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/e7cf34c6ad38d9f6381600be1032e6817b9ee8f7f16c57f82a90c99602281ec7685de0fad579369eca84087c5b247cfbba5da81141a8d20e077343ffd2e97617"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-05-30 16:11:20.504954) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-05-30 16:11:20.505291) ========= 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=d2a8c569965ab8367867b893000001a1-1464647802.778318-1934851532 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004635 ========= master_lag: 0.05 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-05-30 16:11:20.556368) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-05-30 16:11:20.556792) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-05-30 16:11:20.557727) ========= ========= Total master_lag: 0.84 =========