builder: mozilla-beta_ubuntu64_hw_test-dromaeojs-pgo slave: talos-linux64-ix-068 starttime: 1464652349.42 results: success (0) buildid: 20160526112438 builduid: 7b7803f5dee74ad79ba6e8f098a8fa00 revision: 417e1ec42d8f68c55e52c336cdf81e83323db88c ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-05-30 16:52:29.420785) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-05-30 16:52:29.421952) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-05-30 16:52:29.422622) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-05-30 16:52:29.439115) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-05-30 16:52:29.439421) ========= 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=97facb8ba2ac28944cc45e6b000001d4-1464652350.110445-327964771 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-05-30 16:52:30-- 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% 88.9M=0s 2016-05-30 16:52:30 (88.9 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.119182 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-05-30 16:52:29.576735) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-05-30 16:52:29.577503) ========= 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=97facb8ba2ac28944cc45e6b000001d4-1464652350.110445-327964771 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.014132 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-05-30 16:52:29.631514) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-05-30 16:52:29.632355) ========= bash -c 'python archiver_client.py mozharness --repo releases/mozilla-beta --rev 417e1ec42d8f68c55e52c336cdf81e83323db88c --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-beta --rev 417e1ec42d8f68c55e52c336cdf81e83323db88c --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=97facb8ba2ac28944cc45e6b000001d4-1464652350.110445-327964771 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-05-30 16:52:31,074 truncating revision to first 12 chars 2016-05-30 16:52:31,074 Setting DEBUG logging. 2016-05-30 16:52:31,074 attempt 1/10 2016-05-30 16:52:31,074 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/releases/mozilla-beta/417e1ec42d8f?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-05-30 16:52:32,085 unpacking tar archive at: mozilla-beta-417e1ec42d8f/testing/mozharness/ program finished with exit code 0 elapsedTime=1.343831 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-05-30 16:52:30.995615) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-05-30 16:52:30.996643) ========= script_repo_revision: 417e1ec42d8f68c55e52c336cdf81e83323db88c ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-05-30 16:52:30.998012) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-05-30 16:52:30.998729) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-05-30 16:52:31.010304) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 23 secs) (at 2016-05-30 16:52:31.010628) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Beta --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Beta in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs', '--add-option', '--webServer,localhost', '--branch-name', 'Mozilla-Beta', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-Beta'] 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=97facb8ba2ac28944cc45e6b000001d4-1464652350.110445-327964771 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 16:52:32 INFO - MultiFileLogger online at 20160530 16:52:32 in /builds/slave/test 16:52:32 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Beta --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Beta 16:52:32 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 16:52:32 INFO - {'append_to_log': False, 16:52:32 INFO - 'base_work_dir': '/builds/slave/test', 16:52:32 INFO - 'blob_upload_branch': 'Mozilla-Beta', 16:52:32 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 16:52:32 INFO - 'branch': 'Mozilla-Beta', 16:52:32 INFO - 'buildbot_json_path': 'buildprops.json', 16:52:32 INFO - 'config_files': ('talos/linux_config.py',), 16:52:32 INFO - 'default_actions': ('clobber', 16:52:32 INFO - 'read-buildbot-config', 16:52:32 INFO - 'download-and-extract', 16:52:32 INFO - 'populate-webroot', 16:52:32 INFO - 'create-virtualenv', 16:52:32 INFO - 'install', 16:52:32 INFO - 'run-tests'), 16:52:32 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 16:52:32 INFO - 'download_minidump_stackwalk': True, 16:52:32 INFO - 'download_symbols': 'ondemand', 16:52:32 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 16:52:32 INFO - 'tooltool.py': '/tools/tooltool.py', 16:52:32 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 16:52:32 INFO - '/tools/misc-python/virtualenv.py')}, 16:52:32 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 16:52:32 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 16:52:32 INFO - 'installer_path': 'installer.exe', 16:52:32 INFO - 'log_level': 'info', 16:52:32 INFO - 'log_name': 'talos', 16:52:32 INFO - 'log_to_console': True, 16:52:32 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 16:52:32 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 16:52:32 INFO - 'opt_config_files': (), 16:52:32 INFO - 'pip_index': False, 16:52:32 INFO - 'sps_profile': False, 16:52:32 INFO - 'sps_profile_interval': 0, 16:52:32 INFO - 'suite': 'dromaeojs', 16:52:32 INFO - 'system_bits': '32', 16:52:32 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 16:52:32 INFO - 'title': 'talos-linux64-ix-068', 16:52:32 INFO - 'tooltool_cache': '/builds/tooltool_cache', 16:52:32 INFO - 'use_talos_json': True, 16:52:32 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 16:52:32 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 16:52:32 INFO - 'work_dir': 'build'} 16:52:32 INFO - ##### 16:52:32 INFO - ##### Running clobber step. 16:52:32 INFO - ##### 16:52:32 INFO - Running pre-action listener: _resource_record_pre_action 16:52:32 INFO - Running main action method: clobber 16:52:32 INFO - rmtree: /builds/slave/test/build 16:52:32 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 16:52:33 INFO - Running post-action listener: _resource_record_post_action 16:52:33 INFO - ##### 16:52:33 INFO - ##### Running read-buildbot-config step. 16:52:33 INFO - ##### 16:52:33 INFO - Running pre-action listener: _resource_record_pre_action 16:52:33 INFO - Running main action method: read_buildbot_config 16:52:33 INFO - Using buildbot properties: 16:52:33 INFO - { 16:52:33 INFO - "project": "", 16:52:33 INFO - "product": "firefox", 16:52:33 INFO - "script_repo_revision": "production", 16:52:33 INFO - "builddir": "mozilla-beta_ubuntu64_hw_test-dromaeojs", 16:52:33 INFO - "repository": "", 16:52:33 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-beta pgo talos dromaeojs", 16:52:33 INFO - "buildid": "20160526112438", 16:52:33 INFO - "pgo_build": "True", 16:52:33 INFO - "basedir": "/builds/slave/test", 16:52:33 INFO - "buildnumber": 255, 16:52:33 INFO - "slavename": "talos-linux64-ix-068", 16:52:33 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 16:52:33 INFO - "platform": "ubuntu64_hw", 16:52:33 INFO - "scheduler": "tests-mozilla-beta-linux64-pgo-talos", 16:52:33 INFO - "branch": "mozilla-beta", 16:52:33 INFO - "repo_path": "releases/mozilla-beta", 16:52:33 INFO - "revision": "417e1ec42d8f68c55e52c336cdf81e83323db88c", 16:52:33 INFO - "stage_platform": "linux64-pgo", 16:52:33 INFO - "builduid": "7b7803f5dee74ad79ba6e8f098a8fa00", 16:52:33 INFO - "slavebuilddir": "test" 16:52:33 INFO - } 16:52:33 INFO - Found installer url https://queue.taskcluster.net/v1/task/f4GDJdCZR7SnRBdlkgdboQ/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.tar.bz2. 16:52:33 INFO - Running post-action listener: _resource_record_post_action 16:52:33 INFO - ##### 16:52:33 INFO - ##### Running download-and-extract step. 16:52:33 INFO - ##### 16:52:33 INFO - Running pre-action listener: _resource_record_pre_action 16:52:33 INFO - Running main action method: download_and_extract 16:52:33 INFO - mkdir: /builds/slave/test/build/tests 16:52:33 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:52:33 INFO - https://queue.taskcluster.net/v1/task/f4GDJdCZR7SnRBdlkgdboQ/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 16:52:33 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/f4GDJdCZR7SnRBdlkgdboQ/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.test_packages.json 16:52:33 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/f4GDJdCZR7SnRBdlkgdboQ/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.test_packages.json 16:52:33 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/f4GDJdCZR7SnRBdlkgdboQ/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-47.0.en-US.linux-x86_64.test_packages.json 16:52:33 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/f4GDJdCZR7SnRBdlkgdboQ/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-47.0.en-US.linux-x86_64.test_packages.json'}, attempt #1 16:52:34 INFO - Downloaded 1412 bytes. 16:52:34 INFO - Reading from file /builds/slave/test/build/firefox-47.0.en-US.linux-x86_64.test_packages.json 16:52:34 INFO - Using the following test package requirements: 16:52:34 INFO - {u'common': [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip'], 16:52:34 INFO - u'cppunittest': [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip', 16:52:34 INFO - u'firefox-47.0.en-US.linux-x86_64.cppunittest.tests.zip'], 16:52:34 INFO - u'gtest': [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip', 16:52:34 INFO - u'firefox-47.0.en-US.linux-x86_64.gtest.tests.zip'], 16:52:34 INFO - u'jittest': [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip', 16:52:34 INFO - u'jsshell-linux-x86_64.zip'], 16:52:34 INFO - u'mochitest': [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip', 16:52:34 INFO - u'firefox-47.0.en-US.linux-x86_64.mochitest.tests.zip'], 16:52:34 INFO - u'mozbase': [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip'], 16:52:34 INFO - u'reftest': [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip', 16:52:34 INFO - u'firefox-47.0.en-US.linux-x86_64.reftest.tests.zip'], 16:52:34 INFO - u'talos': [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip', 16:52:34 INFO - u'firefox-47.0.en-US.linux-x86_64.talos.tests.zip'], 16:52:34 INFO - u'web-platform': [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip', 16:52:34 INFO - u'firefox-47.0.en-US.linux-x86_64.web-platform.tests.zip'], 16:52:34 INFO - u'webapprt': [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip'], 16:52:34 INFO - u'xpcshell': [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip', 16:52:34 INFO - u'firefox-47.0.en-US.linux-x86_64.xpcshell.tests.zip']} 16:52:34 INFO - Downloading packages: [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 16:52:34 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')]} 16:52:34 INFO - https://queue.taskcluster.net/v1/task/f4GDJdCZR7SnRBdlkgdboQ/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 16:52:34 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/f4GDJdCZR7SnRBdlkgdboQ/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.common.tests.zip 16:52:34 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/f4GDJdCZR7SnRBdlkgdboQ/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.common.tests.zip 16:52:34 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/f4GDJdCZR7SnRBdlkgdboQ/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-47.0.en-US.linux-x86_64.common.tests.zip 16:52:34 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/f4GDJdCZR7SnRBdlkgdboQ/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-47.0.en-US.linux-x86_64.common.tests.zip'}, attempt #1 16:52:35 INFO - Downloaded 23434090 bytes. 16:52:35 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-47.0.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 16:52:35 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-47.0.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 16:52:36 INFO - Return code: 0 16:52:36 INFO - Downloading packages: [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip', u'firefox-47.0.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 16:52:36 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')]} 16:52:36 INFO - https://queue.taskcluster.net/v1/task/f4GDJdCZR7SnRBdlkgdboQ/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 16:52:36 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/f4GDJdCZR7SnRBdlkgdboQ/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.common.tests.zip 16:52:36 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/f4GDJdCZR7SnRBdlkgdboQ/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.common.tests.zip 16:52:36 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/f4GDJdCZR7SnRBdlkgdboQ/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-47.0.en-US.linux-x86_64.common.tests.zip 16:52:36 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/f4GDJdCZR7SnRBdlkgdboQ/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-47.0.en-US.linux-x86_64.common.tests.zip'}, attempt #1 16:52:37 INFO - Downloaded 23434090 bytes. 16:52:37 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-47.0.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 16:52:37 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-47.0.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 16:52:39 INFO - Return code: 0 16:52:39 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')]} 16:52:39 INFO - https://queue.taskcluster.net/v1/task/f4GDJdCZR7SnRBdlkgdboQ/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 16:52:39 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/f4GDJdCZR7SnRBdlkgdboQ/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.talos.tests.zip 16:52:39 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/f4GDJdCZR7SnRBdlkgdboQ/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.talos.tests.zip 16:52:39 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/f4GDJdCZR7SnRBdlkgdboQ/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-47.0.en-US.linux-x86_64.talos.tests.zip 16:52:39 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/f4GDJdCZR7SnRBdlkgdboQ/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-47.0.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 16:52:40 INFO - Downloaded 10845194 bytes. 16:52:40 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-47.0.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test/build/tests'] 16:52:40 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-47.0.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test/build/tests 16:52:40 INFO - Return code: 0 16:52:40 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:52:40 INFO - https://queue.taskcluster.net/v1/task/f4GDJdCZR7SnRBdlkgdboQ/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 16:52:40 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/f4GDJdCZR7SnRBdlkgdboQ/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.tar.bz2 16:52:40 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/f4GDJdCZR7SnRBdlkgdboQ/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.tar.bz2 16:52:40 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/f4GDJdCZR7SnRBdlkgdboQ/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-47.0.en-US.linux-x86_64.tar.bz2 16:52:40 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/f4GDJdCZR7SnRBdlkgdboQ/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-47.0.en-US.linux-x86_64.tar.bz2'}, attempt #1 16:52:41 INFO - Downloaded 53852157 bytes. 16:52:41 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/f4GDJdCZR7SnRBdlkgdboQ/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.tar.bz2 16:52:41 INFO - mkdir: /builds/slave/test/properties 16:52:41 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 16:52:41 INFO - Writing to file /builds/slave/test/properties/build_url 16:52:41 INFO - Contents: 16:52:41 INFO - build_url:https://queue.taskcluster.net/v1/task/f4GDJdCZR7SnRBdlkgdboQ/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.tar.bz2 16:52:42 INFO - Running post-action listener: _resource_record_post_action 16:52:42 INFO - Running post-action listener: set_extra_try_arguments 16:52:42 INFO - ##### 16:52:42 INFO - ##### Running populate-webroot step. 16:52:42 INFO - ##### 16:52:42 INFO - Running pre-action listener: _resource_record_pre_action 16:52:42 INFO - Running main action method: populate_webroot 16:52:42 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 16:52:42 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 16:52:42 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 16:52:42 INFO - '--tppagecycles', 16:52:42 INFO - '7'], 16:52:42 INFO - 'tests': ['tsvgm']}}, 16:52:42 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 16:52:42 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 16:52:42 INFO - 'tests': ['tresize', 'tcanvasmark']}, 16:52:42 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken']}, 16:52:42 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 16:52:42 INFO - 'tests': ['dromaeo_css', 'kraken']}, 16:52:42 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:52:42 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 16:52:42 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:52:42 INFO - 'talos_options': ['--e10s'], 16:52:42 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 16:52:42 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:52:42 INFO - 'tests': ['damp', 'tps']}, 16:52:42 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:52:42 INFO - 'talos_options': ['--e10s'], 16:52:42 INFO - 'tests': ['damp', 'tps']}, 16:52:42 INFO - 'g3': {'tests': ['dromaeo_dom']}, 16:52:42 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 16:52:42 INFO - 'other': {'tests': ['a11yr', 16:52:42 INFO - 'ts_paint', 16:52:42 INFO - 'tpaint', 16:52:42 INFO - 'sessionrestore', 16:52:42 INFO - 'sessionrestore_no_auto_restore', 16:52:42 INFO - 'tabpaint']}, 16:52:42 INFO - 'other-e10s': {'talos_options': ['--e10s'], 16:52:42 INFO - 'tests': ['a11yr', 16:52:42 INFO - 'ts_paint', 16:52:42 INFO - 'tpaint', 16:52:42 INFO - 'sessionrestore', 16:52:42 INFO - 'sessionrestore_no_auto_restore', 16:52:42 INFO - 'tabpaint']}, 16:52:42 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 16:52:42 INFO - 'tests': ['a11yr', 16:52:42 INFO - 'ts_paint', 16:52:42 INFO - 'tpaint', 16:52:42 INFO - 'sessionrestore', 16:52:42 INFO - 'sessionrestore_no_auto_restore', 16:52:42 INFO - 'tabpaint']}, 16:52:42 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 16:52:42 INFO - 'tests': ['a11yr', 16:52:42 INFO - 'ts_paint', 16:52:42 INFO - 'tpaint', 16:52:42 INFO - 'sessionrestore', 16:52:42 INFO - 'sessionrestore_no_auto_restore', 16:52:42 INFO - 'tabpaint']}, 16:52:42 INFO - 'other_l64': {'tests': ['a11yr', 16:52:42 INFO - 'ts_paint', 16:52:42 INFO - 'tpaint', 16:52:42 INFO - 'sessionrestore', 16:52:42 INFO - 'sessionrestore_no_auto_restore', 16:52:42 INFO - 'tabpaint']}, 16:52:42 INFO - 'other_nol64': {'tests': ['a11yr', 16:52:42 INFO - 'ts_paint', 16:52:42 INFO - 'tpaint', 16:52:42 INFO - 'sessionrestore', 16:52:42 INFO - 'sessionrestore_no_auto_restore', 16:52:42 INFO - 'tabpaint']}, 16:52:42 INFO - 'svgr': {'tests': ['tsvgx', 16:52:42 INFO - 'tsvgr_opacity', 16:52:42 INFO - 'tart', 16:52:42 INFO - 'tscrollx', 16:52:42 INFO - 'cart']}, 16:52:42 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 16:52:42 INFO - 'tests': ['tsvgx', 16:52:42 INFO - 'tsvgr_opacity', 16:52:42 INFO - 'tart', 16:52:42 INFO - 'tscrollx', 16:52:42 INFO - 'cart']}, 16:52:42 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:52:42 INFO - 'tests': ['tp5o']}, 16:52:42 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:52:42 INFO - 'talos_options': ['--e10s'], 16:52:42 INFO - 'tests': ['tp5o']}, 16:52:42 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:52:42 INFO - 'talos_options': ['--xperf_path', 16:52:42 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 16:52:42 INFO - 'tests': ['tp5n']}, 16:52:42 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:52:42 INFO - 'talos_options': ['--e10s', 16:52:42 INFO - '--xperf_path', 16:52:42 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 16:52:42 INFO - 'tests': ['tp5n']}}, 16:52:42 INFO - 'talos.zip': {'path': '', 16:52:42 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 16:52:42 INFO - Running post-action listener: _resource_record_post_action 16:52:42 INFO - ##### 16:52:42 INFO - ##### Running create-virtualenv step. 16:52:42 INFO - ##### 16:52:42 INFO - Running pre-action listener: _resource_record_pre_action 16:52:42 INFO - Running main action method: create_virtualenv 16:52:42 INFO - Creating virtualenv /builds/slave/test/build/venv 16:52:42 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 16:52:42 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 16:52:42 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 16:52:42 INFO - Using real prefix '/usr' 16:52:42 INFO - New python executable in /builds/slave/test/build/venv/bin/python 16:52:43 INFO - Installing distribute.............................................................................................................................................................................................done. 16:52:45 INFO - Installing pip.................done. 16:52:45 INFO - Return code: 0 16:52:45 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 16:52: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')]} 16:52:45 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:52:45 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:52: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')]} 16:52:45 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:52:45 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:52:45 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 0x7f8da5792f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ce38a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1db0410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e3f160>, '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 0x1e40060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1e404f0>, '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': '97facb8ba2ac28944cc45e6b000001d4-1464652350.110445-327964771', '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 16:52:45 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 16:52:45 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 16:52:45 INFO - Using env: {'DISPLAY': ':0', 16:52:45 INFO - 'HOME': '/home/cltbld', 16:52:45 INFO - 'LANG': 'en_US.UTF-8', 16:52:45 INFO - 'LANGUAGE': 'en_US:en', 16:52:45 INFO - 'LOGNAME': 'cltbld', 16:52:45 INFO - 'MAIL': '/var/mail/cltbld', 16:52:45 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:52:45 INFO - 'MOZ_NO_REMOTE': '1', 16:52:45 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:52:45 INFO - 'NO_EM_RESTART': '1', 16:52:45 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:52:45 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:52:45 INFO - 'PWD': '/builds/slave/test', 16:52:45 INFO - 'SHELL': '/bin/bash', 16:52:45 INFO - 'SHLVL': '1', 16:52:45 INFO - 'TERM': 'linux', 16:52:45 INFO - 'TMOUT': '86400', 16:52:45 INFO - 'USER': 'cltbld', 16:52:45 INFO - 'XDG_SESSION_COOKIE': '97facb8ba2ac28944cc45e6b000001d4-1464652350.110445-327964771', 16:52:45 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:52:45 INFO - '_': '/tools/buildbot/bin/python'} 16:52:45 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:52:45 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 16:52:45 INFO - Cleaning up... 16:52:45 INFO - Return code: 0 16:52:45 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 16:52: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')]} 16:52:45 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:52:45 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:52: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')]} 16:52:45 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:52:45 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:52:45 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 0x7f8da5792f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ce38a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1db0410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e3f160>, '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 0x1e40060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1e404f0>, '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': '97facb8ba2ac28944cc45e6b000001d4-1464652350.110445-327964771', '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 16:52:45 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 16:52:45 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 16:52:45 INFO - Using env: {'DISPLAY': ':0', 16:52:45 INFO - 'HOME': '/home/cltbld', 16:52:45 INFO - 'LANG': 'en_US.UTF-8', 16:52:45 INFO - 'LANGUAGE': 'en_US:en', 16:52:45 INFO - 'LOGNAME': 'cltbld', 16:52:45 INFO - 'MAIL': '/var/mail/cltbld', 16:52:45 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:52:45 INFO - 'MOZ_NO_REMOTE': '1', 16:52:45 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:52:45 INFO - 'NO_EM_RESTART': '1', 16:52:45 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:52:45 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:52:45 INFO - 'PWD': '/builds/slave/test', 16:52:45 INFO - 'SHELL': '/bin/bash', 16:52:45 INFO - 'SHLVL': '1', 16:52:45 INFO - 'TERM': 'linux', 16:52:45 INFO - 'TMOUT': '86400', 16:52:45 INFO - 'USER': 'cltbld', 16:52:45 INFO - 'XDG_SESSION_COOKIE': '97facb8ba2ac28944cc45e6b000001d4-1464652350.110445-327964771', 16:52:45 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:52:45 INFO - '_': '/tools/buildbot/bin/python'} 16:52:45 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:52:45 INFO - Downloading/unpacking psutil>=0.7.1 16:52:45 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:52:45 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:52:45 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:52:45 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:52:45 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:52:45 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:52:47 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 16:52:47 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 16:52:47 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 16:52:47 INFO - Installing collected packages: psutil 16:52:47 INFO - Running setup.py install for psutil 16:52:47 INFO - building 'psutil._psutil_linux' extension 16:52:47 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 16:52:47 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 16:52:47 INFO - building 'psutil._psutil_posix' extension 16:52:47 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 16:52:47 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 16:52:48 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 16:52:48 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 16:52:48 INFO - Successfully installed psutil 16:52:48 INFO - Cleaning up... 16:52:48 INFO - Return code: 0 16:52:48 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 16:52:48 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:52:48 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:52:48 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:52:48 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:52:48 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:52:48 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:52:48 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x7f8da5792f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ce38a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1db0410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e3f160>, '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 0x1e40060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1e404f0>, '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': '97facb8ba2ac28944cc45e6b000001d4-1464652350.110445-327964771', '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 16:52:48 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0'] in /builds/slave/test/build 16:52:48 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.0.0 16:52:48 INFO - Using env: {'DISPLAY': ':0', 16:52:48 INFO - 'HOME': '/home/cltbld', 16:52:48 INFO - 'LANG': 'en_US.UTF-8', 16:52:48 INFO - 'LANGUAGE': 'en_US:en', 16:52:48 INFO - 'LOGNAME': 'cltbld', 16:52:48 INFO - 'MAIL': '/var/mail/cltbld', 16:52:48 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:52:48 INFO - 'MOZ_NO_REMOTE': '1', 16:52:48 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:52:48 INFO - 'NO_EM_RESTART': '1', 16:52:48 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:52:48 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:52:48 INFO - 'PWD': '/builds/slave/test', 16:52:48 INFO - 'SHELL': '/bin/bash', 16:52:48 INFO - 'SHLVL': '1', 16:52:48 INFO - 'TERM': 'linux', 16:52:48 INFO - 'TMOUT': '86400', 16:52:48 INFO - 'USER': 'cltbld', 16:52:48 INFO - 'XDG_SESSION_COOKIE': '97facb8ba2ac28944cc45e6b000001d4-1464652350.110445-327964771', 16:52:48 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:52:48 INFO - '_': '/tools/buildbot/bin/python'} 16:52:48 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:52:48 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 16:52:48 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:52:48 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:52:48 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:52:48 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:52:48 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:52:48 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:52:50 INFO - Downloading mozsystemmonitor-0.0.tar.gz 16:52:50 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 16:52:50 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 16:52:50 INFO - Installing collected packages: mozsystemmonitor 16:52:50 INFO - Running setup.py install for mozsystemmonitor 16:52:50 INFO - Successfully installed mozsystemmonitor 16:52:50 INFO - Cleaning up... 16:52:50 INFO - Return code: 0 16:52:50 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 16:52: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')]} 16:52:50 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:52:50 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:52: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')]} 16:52:50 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:52:50 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:52:50 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 0x7f8da5792f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ce38a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1db0410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e3f160>, '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 0x1e40060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1e404f0>, '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': '97facb8ba2ac28944cc45e6b000001d4-1464652350.110445-327964771', '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 16:52:50 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 16:52:50 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 16:52:50 INFO - Using env: {'DISPLAY': ':0', 16:52:50 INFO - 'HOME': '/home/cltbld', 16:52:50 INFO - 'LANG': 'en_US.UTF-8', 16:52:50 INFO - 'LANGUAGE': 'en_US:en', 16:52:50 INFO - 'LOGNAME': 'cltbld', 16:52:50 INFO - 'MAIL': '/var/mail/cltbld', 16:52:50 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:52:50 INFO - 'MOZ_NO_REMOTE': '1', 16:52:50 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:52:50 INFO - 'NO_EM_RESTART': '1', 16:52:50 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:52:50 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:52:50 INFO - 'PWD': '/builds/slave/test', 16:52:50 INFO - 'SHELL': '/bin/bash', 16:52:50 INFO - 'SHLVL': '1', 16:52:50 INFO - 'TERM': 'linux', 16:52:50 INFO - 'TMOUT': '86400', 16:52:50 INFO - 'USER': 'cltbld', 16:52:50 INFO - 'XDG_SESSION_COOKIE': '97facb8ba2ac28944cc45e6b000001d4-1464652350.110445-327964771', 16:52:50 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:52:50 INFO - '_': '/tools/buildbot/bin/python'} 16:52:50 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:52:50 INFO - Downloading/unpacking blobuploader==1.2.4 16:52:50 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:52:50 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:52:50 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:52:50 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:52:50 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:52:50 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:52:52 INFO - Downloading blobuploader-1.2.4.tar.gz 16:52:52 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 16:52:52 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 16:52:52 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 16:52:52 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 16:52:52 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 16:52:52 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 16:52:52 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 16:52:52 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 16:52:52 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 16:52:53 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 16:52:53 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:52:53 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:52:53 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:52:53 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:52:53 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:52:53 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:52:53 INFO - Downloading docopt-0.6.1.tar.gz 16:52:53 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 16:52:53 INFO - Installing collected packages: blobuploader, requests, docopt 16:52:53 INFO - Running setup.py install for blobuploader 16:52:53 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 16:52:53 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 16:52:53 INFO - Running setup.py install for requests 16:52:53 INFO - Running setup.py install for docopt 16:52:53 INFO - Successfully installed blobuploader requests docopt 16:52:53 INFO - Cleaning up... 16:52:53 INFO - Return code: 0 16:52:53 INFO - Installing None into virtualenv /builds/slave/test/build/venv 16:52:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:52:53 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:52:53 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:52:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:52:53 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:52:53 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:52:53 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 0x7f8da5792f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ce38a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1db0410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e3f160>, '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 0x1e40060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1e404f0>, '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': '97facb8ba2ac28944cc45e6b000001d4-1464652350.110445-327964771', '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 16:52:53 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 16:52:53 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 16:52:53 INFO - Using env: {'DISPLAY': ':0', 16:52:53 INFO - 'HOME': '/home/cltbld', 16:52:53 INFO - 'LANG': 'en_US.UTF-8', 16:52:53 INFO - 'LANGUAGE': 'en_US:en', 16:52:53 INFO - 'LOGNAME': 'cltbld', 16:52:53 INFO - 'MAIL': '/var/mail/cltbld', 16:52:53 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:52:53 INFO - 'MOZ_NO_REMOTE': '1', 16:52:53 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:52:53 INFO - 'NO_EM_RESTART': '1', 16:52:53 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:52:53 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:52:53 INFO - 'PWD': '/builds/slave/test', 16:52:53 INFO - 'SHELL': '/bin/bash', 16:52:53 INFO - 'SHLVL': '1', 16:52:53 INFO - 'TERM': 'linux', 16:52:53 INFO - 'TMOUT': '86400', 16:52:53 INFO - 'USER': 'cltbld', 16:52:53 INFO - 'XDG_SESSION_COOKIE': '97facb8ba2ac28944cc45e6b000001d4-1464652350.110445-327964771', 16:52:53 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:52:53 INFO - '_': '/tools/buildbot/bin/python'} 16:52:54 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:52:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 16:52:54 INFO - Running setup.py (path:/tmp/pip-Bcq1sZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 16:52:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 16:52:54 INFO - Running setup.py (path:/tmp/pip-ILT1UB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 16:52:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 16:52:54 INFO - Running setup.py (path:/tmp/pip-iwNNRa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 16:52:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 16:52:54 INFO - Running setup.py (path:/tmp/pip-vnlvxv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 16:52:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 16:52:54 INFO - Running setup.py (path:/tmp/pip-UdoVKU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 16:52:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 16:52:54 INFO - Running setup.py (path:/tmp/pip-KiYufk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 16:52:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 16:52:54 INFO - Running setup.py (path:/tmp/pip-w6DvAJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 16:52:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 16:52:54 INFO - Running setup.py (path:/tmp/pip-Rpf_ps-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 16:52:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 16:52:54 INFO - Running setup.py (path:/tmp/pip-CY5R0h-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 16:52:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 16:52:54 INFO - Running setup.py (path:/tmp/pip-cuONwg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 16:52:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 16:52:54 INFO - Running setup.py (path:/tmp/pip-axTco3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 16:52:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 16:52:54 INFO - Running setup.py (path:/tmp/pip-_AYRHb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 16:52:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 16:52:54 INFO - Running setup.py (path:/tmp/pip-GPKwWg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 16:52:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 16:52:55 INFO - Running setup.py (path:/tmp/pip-G6lx7O-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 16:52:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 16:52:55 INFO - Running setup.py (path:/tmp/pip-c57W4y-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 16:52:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 16:52:55 INFO - Running setup.py (path:/tmp/pip-uR79ZL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 16:52:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 16:52:55 INFO - Running setup.py (path:/tmp/pip-6Hmiy9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 16:52:55 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 16:52:55 INFO - Running setup.py install for manifestparser 16:52:55 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 16:52:55 INFO - Running setup.py install for mozcrash 16:52:55 INFO - Running setup.py install for mozdebug 16:52:55 INFO - Running setup.py install for mozdevice 16:52:55 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 16:52:55 INFO - Installing dm script to /builds/slave/test/build/venv/bin 16:52:55 INFO - Running setup.py install for mozfile 16:52:55 INFO - Running setup.py install for mozhttpd 16:52:55 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 16:52:55 INFO - Running setup.py install for mozinfo 16:52:56 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 16:52:56 INFO - Running setup.py install for mozInstall 16:52:56 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 16:52:56 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 16:52:56 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 16:52:56 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 16:52:56 INFO - Running setup.py install for mozleak 16:52:56 INFO - Running setup.py install for mozlog 16:52:56 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 16:52:56 INFO - Running setup.py install for moznetwork 16:52:56 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 16:52:56 INFO - Running setup.py install for mozprocess 16:52:56 INFO - Running setup.py install for mozprofile 16:52:56 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 16:52:56 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 16:52:56 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 16:52:56 INFO - Running setup.py install for mozrunner 16:52:56 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 16:52:56 INFO - Running setup.py install for mozscreenshot 16:52:56 INFO - Running setup.py install for moztest 16:52:57 INFO - Running setup.py install for mozversion 16:52:57 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 16:52:57 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 16:52:57 INFO - Cleaning up... 16:52:57 INFO - Return code: 0 16:52:57 INFO - Installing None into virtualenv /builds/slave/test/build/venv 16:52:57 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')]} 16:52:57 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:52:57 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:52:57 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')]} 16:52:57 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:52:57 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:52:57 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 0x7f8da5792f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ce38a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1db0410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e3f160>, '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 0x1e40060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1e404f0>, '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': '97facb8ba2ac28944cc45e6b000001d4-1464652350.110445-327964771', '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 16:52:57 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 16:52:57 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 16:52:57 INFO - Using env: {'DISPLAY': ':0', 16:52:57 INFO - 'HOME': '/home/cltbld', 16:52:57 INFO - 'LANG': 'en_US.UTF-8', 16:52:57 INFO - 'LANGUAGE': 'en_US:en', 16:52:57 INFO - 'LOGNAME': 'cltbld', 16:52:57 INFO - 'MAIL': '/var/mail/cltbld', 16:52:57 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:52:57 INFO - 'MOZ_NO_REMOTE': '1', 16:52:57 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:52:57 INFO - 'NO_EM_RESTART': '1', 16:52:57 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:52:57 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:52:57 INFO - 'PWD': '/builds/slave/test', 16:52:57 INFO - 'SHELL': '/bin/bash', 16:52:57 INFO - 'SHLVL': '1', 16:52:57 INFO - 'TERM': 'linux', 16:52:57 INFO - 'TMOUT': '86400', 16:52:57 INFO - 'USER': 'cltbld', 16:52:57 INFO - 'XDG_SESSION_COOKIE': '97facb8ba2ac28944cc45e6b000001d4-1464652350.110445-327964771', 16:52:57 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:52:57 INFO - '_': '/tools/buildbot/bin/python'} 16:52:57 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:52:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 16:52:57 INFO - Running setup.py (path:/tmp/pip-9qTQ45-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 16:52:57 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)) 16:52:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 16:52:57 INFO - Running setup.py (path:/tmp/pip-OSr4ym-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 16:52:57 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)) 16:52:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 16:52:57 INFO - Running setup.py (path:/tmp/pip-slNa7F-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 16:52:57 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)) 16:52:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 16:52:57 INFO - Running setup.py (path:/tmp/pip-4sO9I3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 16:52:57 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)) 16:52:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 16:52:57 INFO - Running setup.py (path:/tmp/pip-fqMb_B-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 16:52:57 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)) 16:52:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 16:52:57 INFO - Running setup.py (path:/tmp/pip-JVpeAP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 16:52:57 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)) 16:52:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 16:52:57 INFO - Running setup.py (path:/tmp/pip-lmn0Nq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 16:52:57 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)) 16:52:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 16:52:57 INFO - Running setup.py (path:/tmp/pip-ZgXfg4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 16:52:57 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)) 16:52:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 16:52:57 INFO - Running setup.py (path:/tmp/pip-Np6KSb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 16:52:58 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)) 16:52:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 16:52:58 INFO - Running setup.py (path:/tmp/pip-IHKQof-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 16:52:58 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)) 16:52:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 16:52:58 INFO - Running setup.py (path:/tmp/pip-7XOJyT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 16:52:58 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)) 16:52:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 16:52:58 INFO - Running setup.py (path:/tmp/pip-AvoWQE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 16:52:58 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)) 16:52:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 16:52:58 INFO - Running setup.py (path:/tmp/pip-CcwDFE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 16:52:58 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)) 16:52:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 16:52:58 INFO - Running setup.py (path:/tmp/pip-zORAEs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 16:52:58 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)) 16:52:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 16:52:58 INFO - Running setup.py (path:/tmp/pip-p5Q5Dy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 16:52:58 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)) 16:52:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 16:52:58 INFO - Running setup.py (path:/tmp/pip-kKYVa7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 16:52:58 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)) 16:52:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 16:52:58 INFO - Running setup.py (path:/tmp/pip-ZUtPsi-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 16:52:58 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)) 16:52:58 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)) 16:52:58 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)) 16:52:58 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)) 16:52:58 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)) 16:52:58 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)) 16:52:58 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 16:52:58 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:52:58 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:52:58 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:52:58 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:52:58 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:52:58 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:53:00 INFO - Downloading blessings-1.6.tar.gz 16:53:00 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 16:53:00 INFO - Installing collected packages: blessings 16:53:00 INFO - Running setup.py install for blessings 16:53:00 INFO - Successfully installed blessings 16:53:00 INFO - Cleaning up... 16:53:00 INFO - Return code: 0 16:53:00 INFO - Done creating virtualenv /builds/slave/test/build/venv. 16:53:00 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 16:53:00 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 16:53:00 INFO - Reading from file tmpfile_stdout 16:53:00 INFO - Current package versions: 16:53:00 INFO - argparse == 1.2.1 16:53:00 INFO - blessings == 1.6 16:53:00 INFO - blobuploader == 1.2.4 16:53:00 INFO - docopt == 0.6.1 16:53:00 INFO - manifestparser == 1.1 16:53:00 INFO - mozInstall == 1.12 16:53:00 INFO - mozcrash == 0.17 16:53:00 INFO - mozdebug == 0.1 16:53:00 INFO - mozdevice == 0.48 16:53:00 INFO - mozfile == 1.2 16:53:00 INFO - mozhttpd == 0.7 16:53:00 INFO - mozinfo == 0.9 16:53:00 INFO - mozleak == 0.1 16:53:00 INFO - mozlog == 3.1 16:53:00 INFO - moznetwork == 0.27 16:53:00 INFO - mozprocess == 0.22 16:53:00 INFO - mozprofile == 0.28 16:53:00 INFO - mozrunner == 6.11 16:53:00 INFO - mozscreenshot == 0.1 16:53:00 INFO - mozsystemmonitor == 0.0 16:53:00 INFO - moztest == 0.7 16:53:00 INFO - mozversion == 1.4 16:53:00 INFO - psutil == 3.1.1 16:53:00 INFO - requests == 1.2.3 16:53:00 INFO - wsgiref == 0.1.2 16:53:00 INFO - Installing None into virtualenv /builds/slave/test/build/venv 16:53:00 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:53:00 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:53:00 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:53:00 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:53:00 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:53:00 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:53:00 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 0x7f8da5792f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ce38a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1db0410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e3f160>, '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 0x1e40060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1e404f0>, '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': '97facb8ba2ac28944cc45e6b000001d4-1464652350.110445-327964771', '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 16:53:00 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 16:53:00 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 16:53:00 INFO - Using env: {'DISPLAY': ':0', 16:53:00 INFO - 'HOME': '/home/cltbld', 16:53:00 INFO - 'LANG': 'en_US.UTF-8', 16:53:00 INFO - 'LANGUAGE': 'en_US:en', 16:53:00 INFO - 'LOGNAME': 'cltbld', 16:53:00 INFO - 'MAIL': '/var/mail/cltbld', 16:53:00 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:53:00 INFO - 'MOZ_NO_REMOTE': '1', 16:53:00 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:53:00 INFO - 'NO_EM_RESTART': '1', 16:53:00 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:53:00 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:53:00 INFO - 'PWD': '/builds/slave/test', 16:53:00 INFO - 'SHELL': '/bin/bash', 16:53:00 INFO - 'SHLVL': '1', 16:53:00 INFO - 'TERM': 'linux', 16:53:00 INFO - 'TMOUT': '86400', 16:53:00 INFO - 'USER': 'cltbld', 16:53:00 INFO - 'XDG_SESSION_COOKIE': '97facb8ba2ac28944cc45e6b000001d4-1464652350.110445-327964771', 16:53:00 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:53:00 INFO - '_': '/tools/buildbot/bin/python'} 16:53:01 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:53:01 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)) 16:53:01 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)) 16:53:01 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)) 16:53:01 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)) 16:53:01 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)) 16:53:01 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)) 16:53:01 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)) 16:53:01 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)) 16:53:01 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)) 16:53:01 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)) 16:53:01 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)) 16:53:01 INFO - Cleaning up... 16:53:01 INFO - Return code: 0 16:53:01 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 16:53: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')]} 16:53:01 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:53:01 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:53: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')]} 16:53:01 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:53:01 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:53:01 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 0x7f8da5792f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ce38a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1db0410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e3f160>, '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 0x1e40060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1e404f0>, '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': '97facb8ba2ac28944cc45e6b000001d4-1464652350.110445-327964771', '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 16:53:01 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 16:53:01 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 16:53:01 INFO - Using env: {'DISPLAY': ':0', 16:53:01 INFO - 'HOME': '/home/cltbld', 16:53:01 INFO - 'LANG': 'en_US.UTF-8', 16:53:01 INFO - 'LANGUAGE': 'en_US:en', 16:53:01 INFO - 'LOGNAME': 'cltbld', 16:53:01 INFO - 'MAIL': '/var/mail/cltbld', 16:53:01 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:53:01 INFO - 'MOZ_NO_REMOTE': '1', 16:53:01 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:53:01 INFO - 'NO_EM_RESTART': '1', 16:53:01 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:53:01 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:53:01 INFO - 'PWD': '/builds/slave/test', 16:53:01 INFO - 'SHELL': '/bin/bash', 16:53:01 INFO - 'SHLVL': '1', 16:53:01 INFO - 'TERM': 'linux', 16:53:01 INFO - 'TMOUT': '86400', 16:53:01 INFO - 'USER': 'cltbld', 16:53:01 INFO - 'XDG_SESSION_COOKIE': '97facb8ba2ac28944cc45e6b000001d4-1464652350.110445-327964771', 16:53:01 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:53:01 INFO - '_': '/tools/buildbot/bin/python'} 16:53:01 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:53:01 INFO - Downloading/unpacking jsonschema 16:53:01 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 16:53:01 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 16:53:01 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 16:53:01 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 16:53:01 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 16:53:01 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 16:53:03 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 16:53:03 INFO - Downloading/unpacking functools32 (from jsonschema) 16:53:03 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:53:03 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:53:03 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:53:03 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:53:03 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:53:03 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:53:03 INFO - Downloading functools32-3.2.3-2.tar.gz 16:53:03 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 16:53:03 INFO - warning: no files found matching '*.txt' 16:53:03 INFO - no previously-included directories found matching 'build' 16:53:03 INFO - no previously-included directories found matching 'dist' 16:53:03 INFO - no previously-included directories found matching '.git*' 16:53:03 INFO - Installing collected packages: jsonschema, functools32 16:53:03 INFO - Running setup.py install for functools32 16:53:03 INFO - warning: no files found matching '*.txt' 16:53:03 INFO - no previously-included directories found matching 'build' 16:53:03 INFO - no previously-included directories found matching 'dist' 16:53:03 INFO - no previously-included directories found matching '.git*' 16:53:03 INFO - Successfully installed jsonschema functools32 16:53:03 INFO - Cleaning up... 16:53:03 INFO - Return code: 0 16:53:03 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 16:53:03 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')]} 16:53:03 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:53:03 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:53:03 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')]} 16:53:03 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:53:03 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:53:03 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 0x7f8da5792f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ce38a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1db0410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e3f160>, '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 0x1e40060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1e404f0>, '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': '97facb8ba2ac28944cc45e6b000001d4-1464652350.110445-327964771', '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 16:53:03 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 16:53:03 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 16:53:03 INFO - Using env: {'DISPLAY': ':0', 16:53:03 INFO - 'HOME': '/home/cltbld', 16:53:03 INFO - 'LANG': 'en_US.UTF-8', 16:53:03 INFO - 'LANGUAGE': 'en_US:en', 16:53:03 INFO - 'LOGNAME': 'cltbld', 16:53:03 INFO - 'MAIL': '/var/mail/cltbld', 16:53:03 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:53:03 INFO - 'MOZ_NO_REMOTE': '1', 16:53:03 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:53:03 INFO - 'NO_EM_RESTART': '1', 16:53:03 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:53:03 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:53:03 INFO - 'PWD': '/builds/slave/test', 16:53:03 INFO - 'SHELL': '/bin/bash', 16:53:03 INFO - 'SHLVL': '1', 16:53:03 INFO - 'TERM': 'linux', 16:53:03 INFO - 'TMOUT': '86400', 16:53:03 INFO - 'USER': 'cltbld', 16:53:03 INFO - 'XDG_SESSION_COOKIE': '97facb8ba2ac28944cc45e6b000001d4-1464652350.110445-327964771', 16:53:03 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:53:03 INFO - '_': '/tools/buildbot/bin/python'} 16:53:03 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:53:03 INFO - Downloading/unpacking flake8 16:53:03 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:53:03 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:53:03 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:53:03 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:53:03 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:53:03 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:53:05 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 16:53:05 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 16:53:05 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:53:05 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:53:05 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:53:05 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:53:05 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:53:05 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:53:06 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 16:53:06 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 16:53:06 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:53:06 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:53:06 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:53:06 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:53:06 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:53:06 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:53:06 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 16:53:06 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:53:06 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:53:06 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:53:06 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:53:06 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:53:06 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:53:06 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 16:53:06 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 16:53:06 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 16:53:06 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 16:53:06 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 16:53:06 INFO - no previously-included directories found matching 'docs/_build' 16:53:06 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 16:53:06 INFO - Running setup.py install for pep8 16:53:06 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 16:53:06 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 16:53:06 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 16:53:06 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 16:53:06 INFO - no previously-included directories found matching 'docs/_build' 16:53:06 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 16:53:06 INFO - Successfully installed flake8 mccabe pyflakes pep8 16:53:06 INFO - Cleaning up... 16:53:06 INFO - Return code: 0 16:53:06 INFO - Running post-action listener: _resource_record_post_action 16:53:06 INFO - Running post-action listener: _start_resource_monitoring 16:53:06 INFO - Starting resource monitoring. 16:53:06 INFO - ##### 16:53:06 INFO - ##### Running install step. 16:53:06 INFO - ##### 16:53:06 INFO - Running pre-action listener: _resource_record_pre_action 16:53:06 INFO - Running main action method: install 16:53:06 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 16:53:06 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 16:53:07 INFO - Reading from file tmpfile_stdout 16:53:07 INFO - Detecting whether we're running mozinstall >=1.0... 16:53:07 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 16:53:07 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 16:53:07 INFO - Reading from file tmpfile_stdout 16:53:07 INFO - Output received: 16:53:07 INFO - Usage: mozinstall [options] installer 16:53:07 INFO - Options: 16:53:07 INFO - -h, --help show this help message and exit 16:53:07 INFO - -d DEST, --destination=DEST 16:53:07 INFO - Directory to install application into. [default: 16:53:07 INFO - "/builds/slave/test"] 16:53:07 INFO - --app=APP Application being installed. [default: firefox] 16:53:07 INFO - mkdir: /builds/slave/test/build/application 16:53:07 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-47.0.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 16:53:07 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-47.0.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 16:53:19 INFO - Reading from file tmpfile_stdout 16:53:19 INFO - Output received: 16:53:19 INFO - /builds/slave/test/build/application/firefox/firefox 16:53:19 INFO - Running post-action listener: _resource_record_post_action 16:53:19 INFO - ##### 16:53:19 INFO - ##### Running run-tests step. 16:53:19 INFO - ##### 16:53:19 INFO - Running pre-action listener: _resource_record_pre_action 16:53:19 INFO - Running main action method: run_tests 16:53:19 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 16:53:19 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 16:53:19 INFO - Python 2.7.3 16:53:19 INFO - Return code: 0 16:53:19 INFO - grabbing minidump binary from tooltool 16:53: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')]} 16:53:19 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 0x1e3f160>, '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 0x1e40060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1e404f0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 16:53:19 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 16:53:19 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 16:53:19 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 16:53:19 INFO - Return code: 0 16:53:19 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 16:53:19 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 16:53:19 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 16:53:19 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 16:53:19 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 16:53:19 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 16:53:19 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 16:53:20 INFO - Return code: 0 16:53:20 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Beta', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/f4GDJdCZR7SnRBdlkgdboQ/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-068', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] in /builds/slave/test/build 16:53:20 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Mozilla-Beta --suite dromaeojs --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/f4GDJdCZR7SnRBdlkgdboQ/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-068 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log 16:53:20 INFO - Using env: {'DISPLAY': ':0', 16:53:20 INFO - 'HOME': '/home/cltbld', 16:53:20 INFO - 'LANG': 'en_US.UTF-8', 16:53:20 INFO - 'LANGUAGE': 'en_US:en', 16:53:20 INFO - 'LOGNAME': 'cltbld', 16:53:20 INFO - 'MAIL': '/var/mail/cltbld', 16:53:20 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 16:53:20 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 16:53:20 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:53:20 INFO - 'MOZ_NO_REMOTE': '1', 16:53:20 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 16:53:20 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:53:20 INFO - 'NO_EM_RESTART': '1', 16:53:20 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:53:20 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:53:20 INFO - 'PWD': '/builds/slave/test', 16:53:20 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 16:53:20 INFO - 'SHELL': '/bin/bash', 16:53:20 INFO - 'SHLVL': '1', 16:53:20 INFO - 'TERM': 'linux', 16:53:20 INFO - 'TMOUT': '86400', 16:53:20 INFO - 'USER': 'cltbld', 16:53:20 INFO - 'XDG_SESSION_COOKIE': '97facb8ba2ac28944cc45e6b000001d4-1464652350.110445-327964771', 16:53:20 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:53:20 INFO - '_': '/tools/buildbot/bin/python'} 16:53:20 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Beta', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/f4GDJdCZR7SnRBdlkgdboQ/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-068', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] with output_timeout 3600 16:53:21 INFO - mozversion application_buildid: 20160526112438 16:53:21 INFO - mozversion application_changeset: 417e1ec42d8f68c55e52c336cdf81e83323db88c 16:53:21 INFO - mozversion application_display_name: Firefox 16:53:21 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 16:53:21 INFO - mozversion application_name: Firefox 16:53:21 INFO - mozversion application_remotingname: firefox 16:53:21 INFO - mozversion application_repository: https://hg.mozilla.org/releases/mozilla-beta 16:53:21 INFO - mozversion application_vendor: Mozilla 16:53:21 INFO - mozversion application_version: 47.0 16:53:21 INFO - mozversion platform_buildid: 20160526112438 16:53:21 INFO - mozversion platform_changeset: 417e1ec42d8f68c55e52c336cdf81e83323db88c 16:53:21 INFO - mozversion platform_repository: https://hg.mozilla.org/releases/mozilla-beta 16:53:21 INFO - mozversion platform_version: 47.0 16:53:21 INFO - using testdate: 1464652401 16:53:21 INFO - actual date: 1464652401 16:53:21 INFO - starting webserver on 'localhost:60338' 16:53:21 INFO - SUITE-START | Running 2 tests 16:53:21 INFO - TEST-START | dromaeo_css 16:53:21 INFO - operating with platform_type : linux_ 16:53:21 INFO - Initialising browser for dromaeo_css test... 16:53:21 INFO - TEST-INFO | started process 4001 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpB8pprx/profile http://localhost:60338/getInfo.html) 16:53:25 INFO - PROCESS | 4001 | __metrics Screen width/height:1600/1200 16:53:25 INFO - PROCESS | 4001 | colorDepth:24 16:53:25 INFO - PROCESS | 4001 | Browser inner width/height: 1024/697 16:53:25 INFO - PROCESS | 4001 | __metrics 16:53:26 INFO - PROCESS | 4001 | JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 16:53:27 INFO - TEST-INFO | 4001: exit 0 16:53:27 INFO - Browser initialized. 16:53:27 INFO - Running cycle 1/1 for dromaeo_css test... 16:53:27 INFO - TEST-INFO | started process 4097 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpB8pprx/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 16:53:39 INFO - PROCESS | 4097 | RSS: Main: 138813440 16:53:39 INFO - PROCESS | 4097 | 16:54:30 INFO - PROCESS | 4097 | 1464652470254 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] 16:56:37 INFO - PROCESS | 4097 | Cycle 1(1): loaded http://localhost:60338/tests/dromaeo/cssquery-dojo.html (next: http://localhost:60338/tests/dromaeo/cssquery-ext.html) 16:56:38 INFO - PROCESS | 4097 | RSS: Main: 257032192 16:56:38 INFO - PROCESS | 4097 | 16:59:41 INFO - PROCESS | 4097 | Cycle 1(1): loaded http://localhost:60338/tests/dromaeo/cssquery-ext.html (next: http://localhost:60338/tests/dromaeo/cssquery-jquery.html) 16:59:41 INFO - PROCESS | 4097 | RSS: Main: 227889152 16:59:41 INFO - PROCESS | 4097 | 17:02:43 INFO - PROCESS | 4097 | Cycle 1(1): loaded http://localhost:60338/tests/dromaeo/cssquery-jquery.html (next: http://localhost:60338/tests/dromaeo/cssquery-mootools.html) 17:02:44 INFO - PROCESS | 4097 | RSS: Main: 233193472 17:02:44 INFO - PROCESS | 4097 | 17:05:45 INFO - PROCESS | 4097 | Cycle 1(1): loaded http://localhost:60338/tests/dromaeo/cssquery-mootools.html (next: http://localhost:60338/tests/dromaeo/cssquery-prototype.html) 17:05:46 INFO - PROCESS | 4097 | RSS: Main: 207499264 17:05:46 INFO - PROCESS | 4097 | 17:08:48 INFO - PROCESS | 4097 | Cycle 1(1): loaded http://localhost:60338/tests/dromaeo/cssquery-prototype.html (next: http://localhost:60338/tests/dromaeo/cssquery-yui.html) 17:08:49 INFO - PROCESS | 4097 | RSS: Main: 207773696 17:08:49 INFO - PROCESS | 4097 | 17:11:51 INFO - PROCESS | 4097 | Cycle 1(1): loaded http://localhost:60338/tests/dromaeo/cssquery-yui.html (next: http://localhost:60338/tests/dromaeo/cssquery-dojo.html) 17:11:51 INFO - PROCESS | 4097 | RSS: Main: 257691648 17:11:51 INFO - PROCESS | 4097 | 17:11:51 INFO - PROCESS | 4097 | __start_tp_report 17:11:51 INFO - PROCESS | 4097 | _x_x_mozilla_page_load 17:11:51 INFO - PROCESS | 4097 | _x_x_mozilla_page_load_details 17:11:51 INFO - PROCESS | 4097 | |i|pagename|runs| 17:11:51 INFO - PROCESS | 4097 | |0;dojo.html;3232.51512273159;3304.1244070321354;3306.90079297621;3332.8166950817695;3341.181410554413;5311.362636483623;5319.6808191508535;5321.840344789658;5327.094393953028;5328.866778330534;5319.760610772515;5328.573714102872;5347.919781203285;5347.973260133704;5358.196270559418;4651.255799072149;4811.8075276988875;4885.926711099336;4943.23379876118;4957.157283261854;4736.644751643623;4805.9279110813195;4864.78108485119;4907.460179380265;4974.676646017997;4934.333864928225;4944.728039957801;4955.405351357842;4957.876053098666;4976.178930476485;4738.786754596052;4879.926416188433;4897.559219670246;4929.457759646436;4947.851564453073;4725.2675835245245;4773.4510531289;4791.544803243686;4800.663953523254;4833.540813622701;5136.8202112925865;5160.0969830279555;5178.533931946143;5183.45573714762;5189.844304670866;5491.670499769986;5676.403977582336;5694.430556944314;5695.971520142414;5696.1740547620775;5702.942970570282;5707.1724599933195;5711.657300561979;5718.942810571924;5747.827565173052;5322.866928326784;5337.439568845254;5337.626366154371;5338;5339.385970613391;5622.240997465372;5787.363390027093;5799.710014499343;5812.651240925558;5895.233619629421;5638.887222255532;5653.152027195872;5655.095184770417;5658.122990936411;5670.744816483269;5695.743691533891;5722.284714410699;5733.77064917407;5733.77064917407;5753.683547404933;5459.672419654833;5651.406602306699;5663.32040155184;5724.685142317129;5747.109198074305;5610.523105535994;5614.606977511535;5622.353429355677;5626.662400255997;5628.155776633455;4307.913841723148;4345.000649850489;4368.628666563378;4370.8907277317685;4378.474583050054;3848.3073046851837;3933.056066544009;3956.0703234739813;3974.7217694761666;3993.3011722948368;5297.920531192035;5330.093884039723;5330.840074797762;5334.199870019451;5335.119705248668;5488.259085023471;5670.064439367458;5696.629719068247;5699.287589051369;5707.143928410772;5323;5345;5362.785488580413;5375.5162035417;5382.73086345689;4924.43369012561;4945.901081978341;4948.8762780930765;4971.403431588233;4977.104121258209;5716.771329146787;5895.263092113486;5899.144624029492;5903.173555702205;5926.2295901532525;5708.600397972102;5722.313322401338;5726.770929162787;5729.828105156768;5732.16883551891;5866.765329386777;5868.794592189253;5874.03078492044;5881.38245484218;5887.264091988502;5480.671159730429;5622.690752008679;5645.096784514458;5725.2843394575675;5744.167095771173;5728.455796699307;5737.540996720169;5756.625819321731;5756.913646295226;5759.51044161251;5550.666959982253;5624.409437009055;5626.1842032905815;5627.296587926509;5628.127640215773;5357.651752636066;5488.067028605226;5560;5568.303962004749;5591.860203494945;5493.093639549589;5531.1426728857095;5536.4186760389575;5541.667499950016;5569.470900264469;5416.7020813855615;5631.7184140793615;5659.754853932129;5660.20757093999;5668.26312579362;5348.973255133699;5441.945580544302;5481.808136715196;5567.387587365306;5581.832545023493 17:11:51 INFO - PROCESS | 4097 | |1;ext.html;548.421415406746;558.8211772232886;577.2841676321358;577.6014549960527;631.3244828034;30887;31667.84166079169;38319;38634.42048369277;38780.612193878056;42444.15111697764;42956;42984.78507607465;43084.35373469401;43103.78448107755;8746.125387461267;8973.14755098268;8978.787863638423;8983.236424903858;8985.415947963362;8785.95607021964;8835.690750823722;8922.73231803047;8925.330600204978;8934.10658934108;9142.405743626676;9259.259259259277;9260.490673012982;9262.675806346779;9265.166135047844;8989.95505022474;9063.456192628397;9072.092790720908;9076.41003334781;9079.092090790935;8895.421797583136;9114.635414583408;9132.08679132088;9134.725958221265;9135.817283654356;43076.784616077035;43609.56390436119;43618;43630.90922726926;43692.3446148308;3902.4731661225655;4000.899977500557;4093.713440059197;4270.594293542109;4381.474223093217;32713;33089.6691033089;33417.83291083553;33431.6656833431;33468;4248.98024474127;4255.3829694694405;4290.2706539888295;4290.334998075272;4324.200022995756;276236;276425;278087;279727;279991;62247.51009959642;63101.684491577245;63139.6843015782;63225.68387158127;63230.36769632337;66731.66634166798;67107.66446167738;78891.60554197192;79495;79695;18851.90574047121;19049.7142542862;19085.61828763417;19086.61826763457;19102.140403681868;14588.270586470633;14657.486987955584;14659.780103298459;14666;14684.045537040272;22633.88683056574;22932.885335573217;22990.540189196458;22993.885030575075;23000.079996800276;8024.358051355995;8058.435909486397;8122.988988148727;8271.627776750061;8557.443766155304;1094.7536804219146;1123.9213255072066;1139.4758411130972;1150.9827352589718;1226.3745489800267;29948.700512995027;29969.550456743167;30236.84881575622;30664.540031899538;30833;1136.9545218191179;1155.3414553704308;1157.675850761788;1271.065766661503;1277.8658240884758;14646.560603181922;14842.777358339634;15101;16514.33942642305;16739.414120505724;292410;297360;297685;299471;299547;59055.70472147612;59553.70223148856;59598.70200648969;59670.70164649236;59720;1368.5346982026158;1501.5495351394538;1536.4852774320727;1548.1872017191065;1564.6948844975348;29705;30011.699883001766;30261;32213.838930805196;33180;47163.528364715916;47382.28926566173;47531.76234118807;47572.52427475681;47617.285740713225;252841;254476;254679;256911;257093;30134.698653014068;48861.2670809931;48970.755146224044;50541.241881372545;51530.742346288025;47080;47149.29276060931;47386;48162.75918620524;48434.515654843;38217.426738598384;38503;39030.2193956125;39305.803470982464;43265.7836710827;41320;42412.78793606012;42492.150156997304;43031;43051.138977219656;42465.575344246165;43331.35002974895;43659;43866;43881.78059109684;36848.81575592105;38264.42603361008;38618;39158;39257.803710981265;28216.576751349156;28711.856440717664;28913.7108628911;28948.27629309284;29019.709802902544 17:11:51 INFO - PROCESS | 4097 | |2;jquery.html;368.2212121363316;369.7836765492187;372.6310952157365;379.7057280607529;388.1906225519791;17142.142892855354;18603.441896743087;20058.49853753657;20100.798992010077;20103.296384626523;12093.818592721116;12516.749665006717;12536;12541.059420543474;12550;5018.34761481007;5137.871553211181;5260.073765123582;5794.623349482291;5802.883942321151;5673.517750991171;5737.856553586152;5742.54059675225;5755.136729490589;5777.306723193223;5134.358205224347;5344.412114667383;5352.946470535303;5650.011248031578;5714.885702285973;5316.415194328621;5336.412994570614;5339.9733001335135;5355.410904800468;5377.274068000828;5165.354330708661;5195.818146364897;5207.921881171786;5223.82463945613;5239.659422137549;14104.08323458972;14373.209473478955;14410.351534180882;14533.200673962929;19694.704579431178;2250.6551564667784;2274.613315736329;2359.5634807560486;2581.186926118267;3058.006148001908;9885.55662905011;10223.335483193569;10333.793324133476;10424.739381515523;13417;1847.8614103942123;1966.7246585478044;1968.812962768549;1998.9300374486822;2008.1465377214772;51282.48717512852;67602.66198669025;67648.6617566909;69706.30293697049;71734.28265717329;10351.792964140675;10418.739531511774;10802.837957430645;10849.186311026704;10912.618058368078;13675.452981880613;14504.927475362556;14970.700585988438;15430.842686798534;15458.5362439127;8146.918530814616;8326.5004099753;8600.924884389451;8609.397342186112;8645.438046526955;8488;8539.573021349031;8559.144085591392;8607.698730544402;8657.22085012352;4799.328094066834;4824.34871292378;4849.933014736752;4890;4910.8772280693265;1897.5540747924504;2036.093938197488;2057.0434747842323;2061.5773766378156;2093.3301343570215;1011.8886922438526;1015.720676813882;1031.5706511166245;1068.1476201789933;1079.1474734959295;16652.3339066436;17281.654366912593;17640.294388224585;17770.555736106442;18357.54106147357;995.1889210293588;1006.6929586476195;1021.1524434719165;1050.653284416156;1061.2253055269541;9987.350822196535;10256.538455769509;10271.281010329354;10425.843612345821;10502.842457363146;356117;359341;360001;364100;459056;78515.21484785194;82486.58756706178;83912;84030.57984710038;84541.57729211438;1052.8210204265292;1071.9464026798628;1083.8590983172294;1084.5173897615484;1089.6349722842779;16047.277872495531;16112.274947627151;16145.1927403627;16326.836731633006;16622.50132496027;24056.19578531582;33119.337613248084;35556.82221588876;37472.437913431866;37860.24279514339;53305.46694533005;53588.196177058155;53915.191272131735;53964.19053714276;54151;8463.322934165375;8504.53225072627;8583.957080214559;8665.480071195749;8722.563871806511;11814.586489472827;13118.75903093998;13358.398872050586;13742.312884355542;14020.789688154482;7780.84438311242;10238.846417303896;11739.11956603241;12082.637520874388;12248.69378265515;11878.287302761863;11889.405529723652;11981.880181198425;12153.696157595778;12543.749125017632;5784.623999440023;8762;9978.550965206729;12262.080343974416;12380.938095309466;8594.871076933976;8937.419067760575;8947.686830960885;9059.36584439083;9090.954545227232;11768.52925882955;12015.639530814089;12025.819612705991;12053.18460236058;12062.336571488653 17:11:51 INFO - PROCESS | 4097 | |3;mootools.html;1180.2151569206478;1555.673308605193;1584.9603759905997;1792.2651712797756;1892.858035647326;7520.097588289406;7663.8084047898765;7676.4242681798805;7765.301122898938;7769.533827970312;7611.391088712903;7791.415643826722;7797.376209903208;7802.336801371876;7810;2321.767823217682;2344.8593084414906;2348.095983046522;2354.3996280948336;2354.7409784923643;2332.2769941318247;2352.4236562042324;2371.027878569787;2372.406898275431;2374.287713685896;2352;2358.740538540759;2359.469119448119;2371.4071482129466;2382.737898831127;2372.7034120734907;2379.0127097254617;2394.4971555973266;2395.8921848516857;2411;2355.8939847706724;2418.8548687078833;2423.9515209695883;2430.793382562484;2431.9270421887195;7969.521828690239;7975.7607271781935;7995.360371170293;7996.760097197093;8000;4847.75761211938;4978.377702787152;4982.153033984231;4983;4987.925181122286;3105.7825952183357;3119.516474946387;3144.827034513101;3173.5557022016937;3184.060702092865;1057.0750593230923;1066.2642776484279;1069.1553672598639;1095.0691911874922;1097.4896673047072;10812.729681758019;10831.64604424447;10843.566257349696;10849.186311026626;10856.565737370574;4284.614384705392;4322.805473753689;4393.165298593257;4404.71369360997;4433.534478879671;9326.253899688008;9364;9364.110409511086;9370.29722770795;9376.671816486527;4978.4025916890205;4985.476524964826;4990.850274491699;4992.550670439678;4993.625478089158;3956.7823769692945;3996.1208534122447;4421.845235416809;4468.396766436489;4567.429071366079;3586.479960405779;3660.7254455915913;3663.3405986922608;3684.5394325709285;3685.8157092145284;1177.2759752752168;1191.0709646475764;1191.5055252070295;1193.0813273779142;1205.457544105156;1208.788462019143;1220.371508673034;1224.7121926347302;1480.1193289992436;1500.579837645461;7312.5246858954;7354.154272258758;7423.85152296951;7431.925680743123;7455.403567714569;542.4738004135982;550.9090999984958;553.7314402514777;569.6012791046202;573.1717667969743;5757.254735007878;5849.473547380756;5882.411758824169;5890.4698577128265;5940.198073260054;8959.820803583892;9092.8636070459;9231.953840230755;9302.069793020644;9305.441673499612;9008.234300084436;9051.411658242194;9121.589528471102;9174.357794954423;9188.678396256098;6991.685374158175;7309.634518274172;7369.6315184240575;7372.483926125227;7382.704691812375;6872.656367181721;6886.208086069965;6949.7567585134275;6970.989206565121;6976.511644184859;8010.719624813103;8062.677492900219;8189.385796065199;8325.95837020811;8376.83246335082;8328.917240758663;8356.373272004503;8363.330933525182;8533.274671652978;8540.487570745776;6186.505079593531;6719.798406047827;6844.247132815486;7178.892316615151;7359.300866417681;7192.532485388642;7247.383972362198;7254.96372518134;7278.199398066315;7288.08898887639;6550.541462097607;6639.4688424924925;6662.600243985376;6686.097376854257;6828.487863410165;6586.1438013058;6667.599944003376;6702.664866756741;6713.697883595152;6855.760048398282;7133.85732285341;7180.712771489082;7189.424846012411;7216.494845360984;7219.639018049182;6785.796426107225;6814.93185068143;6817.488688348294;6831.146106736658;6843.931560684329;6382.712777924911;6443.130177425987;6446.4520515756685;6459.806205813645;6460.547761656639 17:11:51 INFO - PROCESS | 4097 | |4;prototype.html;340.55557497465827;346.3575068248399;348.9948947032548;350.0129634430904;350.6318365715998;5883.6763977981245;5893.793717219898;5907.61600495968;5916.970415147929;5924.022536281508;5855.941440585593;5861.17943487912;5865.736041878115;5867.207926929863;5882.764689412418;4424.2921132618785;4489.955100448987;4570.702904311217;4585.28928016158;4649.279361698942;4596.885077873047;4612.285095810138;4613.6539759518;4632.2819962905805;4635.258358662614;4584.151931892594;4589.449266088058;4594.805350608849;4595.977020114911;4606.6314694824505;4385.101054283864;4472.709273897219;4541.568550987651;4544.8863778405475;4568.2462393705;4046.7976601169826;4057.0668746188544;4060.9187816243807;4081.0409553754844;4083.060895993938;5598.58010649203;5599.524040456566;5606.579506537026;5611.523020543259;5621.437856214387;5321.042212401766;5322.733863306819;5333.759980800874;5334.67991920486;5337.386200586943;6194.752209911598;6198.039303907902;6198.690065496708;6198.752049917998;6219.346968568326;4236.385724069993;4392.450943632046;4402.977985110054;4515.61617262533;4516.661250406232;6443.387878151568;6474.737426201893;6498.090267362526;6507.4794016479045;6520.967395163041;4470.262406702923;4497.168023915586;4499.3251012347755;4499.797509112098;4500.617447516932;4489.236829738887;4552.567506086916;4552.704074235164;4560.293154561048;4560.361549383089;5236.816711415082;5246.947530524646;5247.921281180786;5257.868553286122;5260.263563101169;6224.906626400608;6275.560710750204;6292.056191571301;6294.842628934313;6298.433141017331;1570.599497128225;1570.9528714138594;1572.316042521507;1586.0166696648153;1591.9761203581957;1002.3033991376069;1034.9223808214415;1046.2780681329857;1047.9371237725761;1080.8216644253766;5945;5948.851278718067;5961.552883533753;6042.154098426224;6045.848853778691;6360.14138091361;6361.681915904279;6361.968190159112;6367.140436041075;6381.202349706286;5954.8809023819285;5957;5958.1062840573395;5964.970175149097;5967.075103358986;3418.0942050356675;3453.153977275533;3454.5336379588935;3456.3778519866164;3457.429524128491;6410.967945160244;6572.14562106923;6573.244076931214;6575.046618240328;6575.046618240424;6480.51396145291;6486.708098135595;6522.673866306665;6526.347365263436;6527;6510.283868774431;6527.086207930894;6535.901961470582;6551.475881929434;6556.016597510316;6304.968475157595;6342.334054924351;6344.206974128234;6353.777617783356;6362.172917520693;6134.079888016833;6262.906056409249;6270.843228919131;6273.623582584877;6281.71732272058;6475.481961443167;6502.122213501117;6534.052562378523;6534.542582019213;6548.148740663683;4470;4471.150481408522;4480.39514665516;4483.7982290797645;4485.394471746273;6353.618782873043;6356.618602883842;6363.3636636336;6365.395287447685;6371.299157092809;6174.289956655042;6175.5677102602385;6183.659898705614;6185.536084793748;6188.535859810622;6123.601965872204;6194.659293738708;6315.842103947254;6327.3988971047675;6336.746530138743;6180.258368995569;6199.969000154971;6204.317525072148;6206.131141640084;6214.098955651496;6319.862424763587;6344.873102538016;6347.873042539216;6354.301026887131;6356.396142366468;5986.88026239464;6100.725467353891;6206.131141640084;6211.596246243979;6213.161223234805 17:11:51 INFO - PROCESS | 4097 | |5;yui.html;780.5121798875703;827.9710210142646;849.3460035772455;861.6768711733104;954.30335854826;15020.77468837967;15106;15127.773083403757;15244.84755152448;15257.465988690397;15722.449714260003;16084.276207570658;16105.03369797813;16114.516564503054;16129;910.1171863292612;925.0379605210572;925.7546750111226;927.350854401918;928.6935311347273;785.9449838511277;934.0799312677008;950.8954015058338;953.6662168241095;954.4607296877277;993.101243374747;993.2997236947971;994.8358520844052;1000.2448151645534;1003.2776400991274;834.1950018232375;980.3382716666257;987.6543209876558;989.43602146776;989.8614194012844;715.8174665460326;719.4100837313405;720.2833180984901;725.2602345607451;725.521156037013;14294.356753946098;14346.641333966734;14348.139111653334;14424.855751442456;14452.349644265929;13667.248301343423;13868;13925.860741392658;14044.297785110704;14141.787873181911;11582;11674.824877626843;11811.704707382385;11927.94036029823;12169.330686812222;3831.4635950966886;3837.2517359114986;3902.7463214891227;3923.803809809498;3959.2675355059405;52163.478365216244;52975;52981.470185298036;53008.73495632536;53392;10561.313514621525;10945.945270273756;11067.557297708163;11068.059214966657;11168.329900206014;19430;19594.51013724668;19610.70583941242;19630.116644751022;19651;7696.999390079254;8006.599670016476;8328.70849520276;8466.534340611326;8537.402381833212;4605.930911036337;4784.856454306377;4795.280707893774;4802;4925.335079764258;3315.834208289576;3336;3341.883034093844;3349.949750753741;3351.1957130289043;555.5638823523515;559.4601209832531;560.7812952948353;567.9119835364882;588.4556784973882;594.6461855196152;610.0270069239556;652.438902543812;664.1996394344803;683.9760608378683;8883;9050;9080.22818060459;9135.132162444557;9231.584578693975;631.4537924695197;675.3853992866468;706.7031846624327;727.8617062758059;732.6410059071017;4121.258173528734;4254.212970600449;4374.300111982067;4395.077033822933;4477.283634618446;61707;62119.68940155361;62511.68744156341;62542.374576254566;62571;53065.73467132717;54625.72687136539;55224;55650.16524752132;55723.44276557264;47185.52814471811;47282.05435891263;49065.264021039715;49913;51729.741351293;8486.236238738544;8540.615672294638;8749.693760718344;8953.462792232487;9025.41334813235;37331.06672333214;37815.62184378121;38731.41902871516;38899.416508752955;39030.80484597559;47724.761376192895;48591.757041214565;49042.75478622584;49442.25836612526;49704.75147624239;10343.172546196136;10500.159987200852;10527.842082368617;10731.785364292826;10764.40795756241;11894.345810980132;12135.878641213474;12252.754944900873;12500.687482813002;12546.87453125457;11266.324020558794;11364.142787112;11461.6287630077;11516.712082198012;11669.708257293636;11447.198696091195;11661.125415594033;11725.179237453296;11752.353620550952;11842.230255033395;11180.440977951233;11225.550977960791;11271.323720576791;11382.94308528452;11449.942750286194;9623.807523849624;10497.895021049691;10556.366618002945;10620.09729172998;10699.14406847466;10022.699319020441;10171.64399246023;10199.184065274909;10207.489625518545;10282 17:11:51 INFO - PROCESS | 4097 | __end_tp_report 17:11:51 INFO - PROCESS | 4097 | __start_cc_report 17:11:51 INFO - PROCESS | 4097 | _x_x_mozilla_cycle_collect,884 17:11:51 INFO - PROCESS | 4097 | __end_cc_report 17:11:51 INFO - PROCESS | 4097 | __startTimestamp1464653511787__endTimestamp 17:11:51 INFO - PROCESS | 4097 | 17:11:51 INFO - PROCESS | 4097 | ------- Summary: start ------- 17:11:51 INFO - PROCESS | 4097 | Number of tests: 6 17:11:51 INFO - PROCESS | 4097 | 17:11:51 INFO - PROCESS | 4097 | [#0] dojo.html Cycles:165 Average:5296.81 Median:5488.07 stddev:568.60 (10.4%) stddev-sans-first:546.80 17:11:51 INFO - PROCESS | 4097 | Values: 3232.5 3304.1 3306.9 3332.8 3341.2 5311.4 5319.7 5321.8 5327.1 5328.9 5319.8 5328.6 5347.9 5348.0 5358.2 4651.3 4811.8 4885.9 4943.2 4957.2 4736.6 4805.9 4864.8 4907.5 4974.7 4934.3 4944.7 4955.4 4957.9 4976.2 4738.8 4879.9 4897.6 4929.5 4947.9 4725.3 4773.5 4791.5 4800.7 4833.5 5136.8 5160.1 5178.5 5183.5 5189.8 5491.7 5676.4 5694.4 5696.0 5696.2 5702.9 5707.2 5711.7 5718.9 5747.8 5322.9 5337.4 5337.6 5338.0 5339.4 5622.2 5787.4 5799.7 5812.7 5895.2 5638.9 5653.2 5655.1 5658.1 5670.7 5695.7 5722.3 5733.8 5733.8 5753.7 5459.7 5651.4 5663.3 5724.7 5747.1 5610.5 5614.6 5622.4 5626.7 5628.2 4307.9 4345.0 4368.6 4370.9 4378.5 3848.3 3933.1 3956.1 3974.7 3993.3 5297.9 5330.1 5330.8 5334.2 5335.1 5488.3 5670.1 5696.6 5699.3 5707.1 5323.0 5345.0 5362.8 5375.5 5382.7 4924.4 4945.9 4948.9 4971.4 4977.1 5716.8 5895.3 5899.1 5903.2 5926.2 5708.6 5722.3 5726.8 5729.8 5732.2 5866.8 5868.8 5874.0 5881.4 5887.3 5480.7 5622.7 5645.1 5725.3 5744.2 5728.5 5737.5 5756.6 5756.9 5759.5 5550.7 5624.4 5626.2 5627.3 5628.1 5357.7 5488.1 5560.0 5568.3 5591.9 5493.1 5531.1 5536.4 5541.7 5569.5 5416.7 5631.7 5659.8 5660.2 5668.3 5349.0 5441.9 5481.8 5567.4 5581.8 17:11:51 INFO - PROCESS | 4097 | 17:11:51 INFO - PROCESS | 4097 | [#1] ext.html Cycles:180 Average:47679.82 Median:42454.86 stddev:72127.90 (169.9%) stddev-sans-first:72243.42 17:11:51 INFO - PROCESS | 4097 | Values: 548.4 558.8 577.3 577.6 631.3 30887.0 31667.8 38319.0 38634.4 38780.6 42444.2 42956.0 42984.8 43084.4 43103.8 8746.1 8973.1 8978.8 8983.2 8985.4 8786.0 8835.7 8922.7 8925.3 8934.1 9142.4 9259.3 9260.5 9262.7 9265.2 8990.0 9063.5 9072.1 9076.4 9079.1 8895.4 9114.6 9132.1 9134.7 9135.8 43076.8 43609.6 43618.0 43630.9 43692.3 3902.5 4000.9 4093.7 4270.6 4381.5 32713.0 33089.7 33417.8 33431.7 33468.0 4249.0 4255.4 4290.3 4290.3 4324.2 276236.0 276425.0 278087.0 279727.0 279991.0 62247.5 63101.7 63139.7 63225.7 63230.4 66731.7 67107.7 78891.6 79495.0 79695.0 18851.9 19049.7 19085.6 19086.6 19102.1 14588.3 14657.5 14659.8 14666.0 14684.0 22633.9 22932.9 22990.5 22993.9 23000.1 8024.4 8058.4 8123.0 8271.6 8557.4 1094.8 1123.9 1139.5 1151.0 1226.4 29948.7 29969.6 30236.8 30664.5 30833.0 1137.0 1155.3 1157.7 1271.1 1277.9 14646.6 14842.8 15101.0 16514.3 16739.4 292410.0 297360.0 297685.0 299471.0 299547.0 59055.7 59553.7 59598.7 59670.7 59720.0 1368.5 1501.5 1536.5 1548.2 1564.7 29705.0 30011.7 30261.0 32213.8 33180.0 47163.5 47382.3 47531.8 47572.5 47617.3 252841.0 254476.0 254679.0 256911.0 257093.0 30134.7 48861.3 48970.8 50541.2 51530.7 47080.0 47149.3 47386.0 48162.8 48434.5 38217.4 38503.0 39030.2 39305.8 43265.8 41320.0 42412.8 42492.2 43031.0 43051.1 42465.6 43331.4 43659.0 43866.0 43881.8 36848.8 38264.4 38618.0 39158.0 39257.8 28216.6 28711.9 28913.7 28948.3 29019.7 17:11:51 INFO - PROCESS | 4097 | 17:11:51 INFO - PROCESS | 4097 | [#2] jquery.html Cycles:180 Average:24371.75 Median:13207.88 stddev:63136.81 (478.0%) stddev-sans-first:63288.20 17:11:51 INFO - PROCESS | 4097 | Values: 368.2 369.8 372.6 379.7 388.2 17142.1 18603.4 20058.5 20100.8 20103.3 12093.8 12516.7 12536.0 12541.1 12550.0 5018.3 5137.9 5260.1 5794.6 5802.9 5673.5 5737.9 5742.5 5755.1 5777.3 5134.4 5344.4 5352.9 5650.0 5714.9 5316.4 5336.4 5340.0 5355.4 5377.3 5165.4 5195.8 5207.9 5223.8 5239.7 14104.1 14373.2 14410.4 14533.2 19694.7 2250.7 2274.6 2359.6 2581.2 3058.0 9885.6 10223.3 10333.8 10424.7 13417.0 1847.9 1966.7 1968.8 1998.9 2008.1 51282.5 67602.7 67648.7 69706.3 71734.3 10351.8 10418.7 10802.8 10849.2 10912.6 13675.5 14504.9 14970.7 15430.8 15458.5 8146.9 8326.5 8600.9 8609.4 8645.4 8488.0 8539.6 8559.1 8607.7 8657.2 4799.3 4824.3 4849.9 4890.0 4910.9 1897.6 2036.1 2057.0 2061.6 2093.3 1011.9 1015.7 1031.6 1068.1 1079.1 16652.3 17281.7 17640.3 17770.6 18357.5 995.2 1006.7 1021.2 1050.7 1061.2 9987.4 10256.5 10271.3 10425.8 10502.8 356117.0 359341.0 360001.0 364100.0 459056.0 78515.2 82486.6 83912.0 84030.6 84541.6 1052.8 1071.9 1083.9 1084.5 1089.6 16047.3 16112.3 16145.2 16326.8 16622.5 24056.2 33119.3 35556.8 37472.4 37860.2 53305.5 53588.2 53915.2 53964.2 54151.0 8463.3 8504.5 8584.0 8665.5 8722.6 11814.6 13118.8 13358.4 13742.3 14020.8 7780.8 10238.8 11739.1 12082.6 12248.7 11878.3 11889.4 11981.9 12153.7 12543.7 5784.6 8762.0 9978.6 12262.1 12380.9 8594.9 8937.4 8947.7 9059.4 9091.0 11768.5 12015.6 12025.8 12053.2 12062.3 17:11:51 INFO - PROCESS | 4097 | 17:11:51 INFO - PROCESS | 4097 | [#3] mootools.html Cycles:180 Average:5471.28 Median:6284.61 stddev:2799.99 (44.6%) stddev-sans-first:2789.26 17:11:51 INFO - PROCESS | 4097 | Values: 1180.2 1555.7 1585.0 1792.3 1892.9 7520.1 7663.8 7676.4 7765.3 7769.5 7611.4 7791.4 7797.4 7802.3 7810.0 2321.8 2344.9 2348.1 2354.4 2354.7 2332.3 2352.4 2371.0 2372.4 2374.3 2352.0 2358.7 2359.5 2371.4 2382.7 2372.7 2379.0 2394.5 2395.9 2411.0 2355.9 2418.9 2424.0 2430.8 2431.9 7969.5 7975.8 7995.4 7996.8 8000.0 4847.8 4978.4 4982.2 4983.0 4987.9 3105.8 3119.5 3144.8 3173.6 3184.1 1057.1 1066.3 1069.2 1095.1 1097.5 10812.7 10831.6 10843.6 10849.2 10856.6 4284.6 4322.8 4393.2 4404.7 4433.5 9326.3 9364.0 9364.1 9370.3 9376.7 4978.4 4985.5 4990.9 4992.6 4993.6 3956.8 3996.1 4421.8 4468.4 4567.4 3586.5 3660.7 3663.3 3684.5 3685.8 1177.3 1191.1 1191.5 1193.1 1205.5 1208.8 1220.4 1224.7 1480.1 1500.6 7312.5 7354.2 7423.9 7431.9 7455.4 542.5 550.9 553.7 569.6 573.2 5757.3 5849.5 5882.4 5890.5 5940.2 8959.8 9092.9 9232.0 9302.1 9305.4 9008.2 9051.4 9121.6 9174.4 9188.7 6991.7 7309.6 7369.6 7372.5 7382.7 6872.7 6886.2 6949.8 6971.0 6976.5 8010.7 8062.7 8189.4 8326.0 8376.8 8328.9 8356.4 8363.3 8533.3 8540.5 6186.5 6719.8 6844.2 7178.9 7359.3 7192.5 7247.4 7255.0 7278.2 7288.1 6550.5 6639.5 6662.6 6686.1 6828.5 6586.1 6667.6 6702.7 6713.7 6855.8 7133.9 7180.7 7189.4 7216.5 7219.6 6785.8 6814.9 6817.5 6831.1 6843.9 6382.7 6443.1 6446.5 6459.8 6460.5 17:11:51 INFO - PROCESS | 4097 | 17:11:51 INFO - PROCESS | 4097 | [#4] prototype.html Cycles:180 Average:5224.84 Median:5946.93 stddev:1546.43 (26.0%) stddev-sans-first:1506.69 17:11:51 INFO - PROCESS | 4097 | Values: 340.6 346.4 349.0 350.0 350.6 5883.7 5893.8 5907.6 5917.0 5924.0 5855.9 5861.2 5865.7 5867.2 5882.8 4424.3 4490.0 4570.7 4585.3 4649.3 4596.9 4612.3 4613.7 4632.3 4635.3 4584.2 4589.4 4594.8 4596.0 4606.6 4385.1 4472.7 4541.6 4544.9 4568.2 4046.8 4057.1 4060.9 4081.0 4083.1 5598.6 5599.5 5606.6 5611.5 5621.4 5321.0 5322.7 5333.8 5334.7 5337.4 6194.8 6198.0 6198.7 6198.8 6219.3 4236.4 4392.5 4403.0 4515.6 4516.7 6443.4 6474.7 6498.1 6507.5 6521.0 4470.3 4497.2 4499.3 4499.8 4500.6 4489.2 4552.6 4552.7 4560.3 4560.4 5236.8 5246.9 5247.9 5257.9 5260.3 6224.9 6275.6 6292.1 6294.8 6298.4 1570.6 1571.0 1572.3 1586.0 1592.0 1002.3 1034.9 1046.3 1047.9 1080.8 5945.0 5948.9 5961.6 6042.2 6045.8 6360.1 6361.7 6362.0 6367.1 6381.2 5954.9 5957.0 5958.1 5965.0 5967.1 3418.1 3453.2 3454.5 3456.4 3457.4 6411.0 6572.1 6573.2 6575.0 6575.0 6480.5 6486.7 6522.7 6526.3 6527.0 6510.3 6527.1 6535.9 6551.5 6556.0 6305.0 6342.3 6344.2 6353.8 6362.2 6134.1 6262.9 6270.8 6273.6 6281.7 6475.5 6502.1 6534.1 6534.5 6548.1 4470.0 4471.2 4480.4 4483.8 4485.4 6353.6 6356.6 6363.4 6365.4 6371.3 6174.3 6175.6 6183.7 6185.5 6188.5 6123.6 6194.7 6315.8 6327.4 6336.7 6180.3 6200.0 6204.3 6206.1 6214.1 6319.9 6344.9 6347.9 6354.3 6356.4 5986.9 6100.7 6206.1 6211.6 6213.2 17:11:51 INFO - PROCESS | 4097 | 17:11:51 INFO - PROCESS | 4097 | [#5] yui.html Cycles:180 Average:14880.98 Median:4541.61 stddev:17280.20 (380.5%) stddev-sans-first:17296.23 17:11:51 INFO - PROCESS | 4097 | Values: 780.5 828.0 849.3 861.7 954.3 15020.8 15106.0 15127.8 15244.8 15257.5 15722.4 16084.3 16105.0 16114.5 16129.0 910.1 925.0 925.8 927.4 928.7 785.9 934.1 950.9 953.7 954.5 993.1 993.3 994.8 1000.2 1003.3 834.2 980.3 987.7 989.4 989.9 715.8 719.4 720.3 725.3 725.5 14294.4 14346.6 14348.1 14424.9 14452.3 13667.2 13868.0 13925.9 14044.3 14141.8 11582.0 11674.8 11811.7 11927.9 12169.3 3831.5 3837.3 3902.7 3923.8 3959.3 52163.5 52975.0 52981.5 53008.7 53392.0 10561.3 10945.9 11067.6 11068.1 11168.3 19430.0 19594.5 19610.7 19630.1 19651.0 7697.0 8006.6 8328.7 8466.5 8537.4 4605.9 4784.9 4795.3 4802.0 4925.3 3315.8 3336.0 3341.9 3349.9 3351.2 555.6 559.5 560.8 567.9 588.5 594.6 610.0 652.4 664.2 684.0 8883.0 9050.0 9080.2 9135.1 9231.6 631.5 675.4 706.7 727.9 732.6 4121.3 4254.2 4374.3 4395.1 4477.3 61707.0 62119.7 62511.7 62542.4 62571.0 53065.7 54625.7 55224.0 55650.2 55723.4 47185.5 47282.1 49065.3 49913.0 51729.7 8486.2 8540.6 8749.7 8953.5 9025.4 37331.1 37815.6 38731.4 38899.4 39030.8 47724.8 48591.8 49042.8 49442.3 49704.8 10343.2 10500.2 10527.8 10731.8 10764.4 11894.3 12135.9 12252.8 12500.7 12546.9 11266.3 11364.1 11461.6 11516.7 11669.7 11447.2 11661.1 11725.2 11752.4 11842.2 11180.4 11225.6 11271.3 11382.9 11449.9 9623.8 10497.9 10556.4 10620.1 10699.1 10022.7 10171.6 10199.2 10207.5 10282.0 17:11:51 INFO - PROCESS | 4097 | -------- Summary: end -------- 17:11:51 INFO - PROCESS | 4097 | 17:11:52 INFO - TEST-INFO | 4097: exit 0 17:11:52 INFO - TEST-OK | dromaeo_css | took 1111299ms 17:11:52 INFO - TEST-START | kraken 17:11:52 INFO - operating with platform_type : linux_ 17:11:52 INFO - Initialising browser for kraken test... 17:11:52 INFO - TEST-INFO | started process 4297 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpJUPfue/profile http://localhost:60338/getInfo.html) 17:11:56 INFO - PROCESS | 4297 | __metrics Screen width/height:1600/1200 17:11:56 INFO - PROCESS | 4297 | colorDepth:24 17:11:56 INFO - PROCESS | 4297 | Browser inner width/height: 1024/697 17:11:56 INFO - PROCESS | 4297 | __metrics 17:11:57 INFO - PROCESS | 4297 | JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 17:11:58 INFO - TEST-INFO | 4297: exit 0 17:11:58 INFO - Browser initialized. 17:11:58 INFO - Running cycle 1/1 for kraken test... 17:11:58 INFO - TEST-INFO | started process 4388 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpJUPfue/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 17:12:10 INFO - PROCESS | 4388 | RSS: Main: 139100160 17:12:10 INFO - PROCESS | 4388 | 17:12:13 INFO - PROCESS | 4388 | Cycle 1(1): loaded http://localhost:60338/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:60338/tests/kraken/driver.html?testName=audio-beat-detection) 17:12:13 INFO - PROCESS | 4388 | RSS: Main: 183824384 17:12:13 INFO - PROCESS | 4388 | 17:12:16 INFO - PROCESS | 4388 | Cycle 1(1): loaded http://localhost:60338/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:60338/tests/kraken/driver.html?testName=audio-dft) 17:12:16 INFO - PROCESS | 4388 | RSS: Main: 174604288 17:12:16 INFO - PROCESS | 4388 | 17:12:19 INFO - PROCESS | 4388 | Cycle 1(1): loaded http://localhost:60338/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:60338/tests/kraken/driver.html?testName=audio-fft) 17:12:20 INFO - PROCESS | 4388 | RSS: Main: 174612480 17:12:20 INFO - PROCESS | 4388 | 17:12:22 INFO - PROCESS | 4388 | Cycle 1(1): loaded http://localhost:60338/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:60338/tests/kraken/driver.html?testName=audio-oscillator) 17:12:22 INFO - PROCESS | 4388 | RSS: Main: 175878144 17:12:22 INFO - PROCESS | 4388 | 17:12:25 INFO - PROCESS | 4388 | Cycle 1(1): loaded http://localhost:60338/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:60338/tests/kraken/driver.html?testName=imaging-gaussian-blur) 17:12:25 INFO - PROCESS | 4388 | RSS: Main: 174956544 17:12:25 INFO - PROCESS | 4388 | 17:12:28 INFO - PROCESS | 4388 | Cycle 1(1): loaded http://localhost:60338/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:60338/tests/kraken/driver.html?testName=imaging-darkroom) 17:12:29 INFO - PROCESS | 4388 | RSS: Main: 174157824 17:12:29 INFO - PROCESS | 4388 | 17:12:32 INFO - PROCESS | 4388 | Cycle 1(1): loaded http://localhost:60338/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:60338/tests/kraken/driver.html?testName=imaging-desaturate) 17:12:33 INFO - PROCESS | 4388 | RSS: Main: 174317568 17:12:33 INFO - PROCESS | 4388 | 17:12:35 INFO - PROCESS | 4388 | Cycle 1(1): loaded http://localhost:60338/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:60338/tests/kraken/driver.html?testName=json-parse-financial) 17:12:36 INFO - PROCESS | 4388 | RSS: Main: 174768128 17:12:36 INFO - PROCESS | 4388 | 17:12:38 INFO - PROCESS | 4388 | Cycle 1(1): loaded http://localhost:60338/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:60338/tests/kraken/driver.html?testName=json-stringify-tinderbox) 17:12:38 INFO - PROCESS | 4388 | RSS: Main: 183291904 17:12:38 INFO - PROCESS | 4388 | 17:12:40 INFO - PROCESS | 4388 | Cycle 1(1): loaded http://localhost:60338/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:60338/tests/kraken/driver.html?testName=stanford-crypto-aes) 17:12:40 INFO - PROCESS | 4388 | RSS: Main: 181608448 17:12:40 INFO - PROCESS | 4388 | 17:12:42 INFO - PROCESS | 4388 | Cycle 1(1): loaded http://localhost:60338/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:60338/tests/kraken/driver.html?testName=stanford-crypto-ccm) 17:12:43 INFO - PROCESS | 4388 | RSS: Main: 184000512 17:12:43 INFO - PROCESS | 4388 | 17:12:45 INFO - PROCESS | 4388 | Cycle 1(1): loaded http://localhost:60338/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:60338/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 17:12:46 INFO - PROCESS | 4388 | RSS: Main: 187654144 17:12:46 INFO - PROCESS | 4388 | 17:12:48 INFO - PROCESS | 4388 | Cycle 1(1): loaded http://localhost:60338/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:60338/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 17:12:49 INFO - PROCESS | 4388 | RSS: Main: 187236352 17:12:49 INFO - PROCESS | 4388 | 17:12:51 INFO - PROCESS | 4388 | Cycle 1(1): loaded http://localhost:60338/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:60338/tests/kraken/driver.html?testName=ai-astar) 17:12:51 INFO - PROCESS | 4388 | RSS: Main: 248532992 17:12:51 INFO - PROCESS | 4388 | 17:12:51 INFO - PROCESS | 4388 | __start_tp_report 17:12:51 INFO - PROCESS | 4388 | _x_x_mozilla_page_load 17:12:51 INFO - PROCESS | 4388 | _x_x_mozilla_page_load_details 17:12:51 INFO - PROCESS | 4388 | |i|pagename|runs| 17:12:51 INFO - PROCESS | 4388 | |0;ai-astar;111;114;114;112;110;115;113;110;111;126 17:12:51 INFO - PROCESS | 4388 | |1;audio-beat-detection;151;130;154;165;127;155;154;128;179;134 17:12:51 INFO - PROCESS | 4388 | |2;audio-dft;161;160;165;160;160;161;161;160;160;160 17:12:51 INFO - PROCESS | 4388 | |3;audio-fft;77;75;77;162;77;76;77;78;170;77 17:12:51 INFO - PROCESS | 4388 | |4;audio-oscillator;94;93;153;93;94;93;146;94;93;147 17:12:51 INFO - PROCESS | 4388 | |5;imaging-gaussian-blur;117;118;117;116;116;117;118;117;116;117 17:12:51 INFO - PROCESS | 4388 | |6;imaging-darkroom;146;146;146;146;146;146;145;147;145;146 17:12:51 INFO - PROCESS | 4388 | |7;imaging-desaturate;95;96;96;95;96;97;95;96;96;96 17:12:51 INFO - PROCESS | 4388 | |8;json-parse-financial;55;62;56;56;56;58;59;57;66;55 17:12:51 INFO - PROCESS | 4388 | |9;json-stringify-tinderbox;64;64;65;64;65;64;64;63;65;65 17:12:51 INFO - PROCESS | 4388 | |10;stanford-crypto-aes;85;78;77;79;77;77;79;78;78;85 17:12:51 INFO - PROCESS | 4388 | |11;stanford-crypto-ccm;115;124;112;115;114;113;116;119;124;114 17:12:51 INFO - PROCESS | 4388 | |12;stanford-crypto-pbkdf2;146;134;147;144;144;134;148;143;148;146 17:12:51 INFO - PROCESS | 4388 | |13;stanford-crypto-sha256-iterative;70;68;69;66;66;65;65;67;65;67 17:12:51 INFO - PROCESS | 4388 | __end_tp_report 17:12:51 INFO - PROCESS | 4388 | __start_cc_report 17:12:51 INFO - PROCESS | 4388 | _x_x_mozilla_cycle_collect,1038 17:12:51 INFO - PROCESS | 4388 | __end_cc_report 17:12:51 INFO - PROCESS | 4388 | __startTimestamp1464653571486__endTimestamp 17:12:51 INFO - PROCESS | 4388 | 17:12:51 INFO - PROCESS | 4388 | ------- Summary: start ------- 17:12:51 INFO - PROCESS | 4388 | Number of tests: 14 17:12:51 INFO - PROCESS | 4388 | 17:12:51 INFO - PROCESS | 4388 | [#0] ai-astar Cycles:10 Average:113.60 Median:113.50 stddev:4.70 (4.1%) stddev-sans-first:4.88 17:12:51 INFO - PROCESS | 4388 | Values: 111.0 114.0 114.0 112.0 110.0 115.0 113.0 110.0 111.0 126.0 17:12:51 INFO - PROCESS | 4388 | 17:12:51 INFO - PROCESS | 4388 | [#1] audio-beat-detection Cycles:10 Average:147.70 Median:154.00 stddev:17.45 (11.3%) stddev-sans-first:18.47 17:12:51 INFO - PROCESS | 4388 | Values: 151.0 130.0 154.0 165.0 127.0 155.0 154.0 128.0 179.0 134.0 17:12:51 INFO - PROCESS | 4388 | 17:12:51 INFO - PROCESS | 4388 | [#2] audio-dft Cycles:10 Average:160.80 Median:160.50 stddev:1.55 (1.0%) stddev-sans-first:1.64 17:12:51 INFO - PROCESS | 4388 | Values: 161.0 160.0 165.0 160.0 160.0 161.0 161.0 160.0 160.0 160.0 17:12:51 INFO - PROCESS | 4388 | 17:12:51 INFO - PROCESS | 4388 | [#3] audio-fft Cycles:10 Average:94.60 Median:77.00 stddev:37.69 (48.9%) stddev-sans-first:39.43 17:12:51 INFO - PROCESS | 4388 | Values: 77.0 75.0 77.0 162.0 77.0 76.0 77.0 78.0 170.0 77.0 17:12:51 INFO - PROCESS | 4388 | 17:12:51 INFO - PROCESS | 4388 | [#4] audio-oscillator Cycles:10 Average:110.00 Median:93.00 stddev:26.75 (28.8%) stddev-sans-first:27.73 17:12:51 INFO - PROCESS | 4388 | Values: 94.0 93.0 153.0 93.0 94.0 93.0 146.0 94.0 93.0 147.0 17:12:51 INFO - PROCESS | 4388 | 17:12:51 INFO - PROCESS | 4388 | [#5] imaging-gaussian-blur Cycles:10 Average:116.90 Median:117.00 stddev:0.74 (0.6%) stddev-sans-first:0.78 17:12:51 INFO - PROCESS | 4388 | Values: 117.0 118.0 117.0 116.0 116.0 117.0 118.0 117.0 116.0 117.0 17:12:51 INFO - PROCESS | 4388 | 17:12:51 INFO - PROCESS | 4388 | [#6] imaging-darkroom Cycles:10 Average:145.90 Median:146.00 stddev:0.57 (0.4%) stddev-sans-first:0.60 17:12:51 INFO - PROCESS | 4388 | Values: 146.0 146.0 146.0 146.0 146.0 146.0 145.0 147.0 145.0 146.0 17:12:51 INFO - PROCESS | 4388 | 17:12:51 INFO - PROCESS | 4388 | [#7] imaging-desaturate Cycles:10 Average:95.80 Median:96.00 stddev:0.63 (0.7%) stddev-sans-first:0.60 17:12:51 INFO - PROCESS | 4388 | Values: 95.0 96.0 96.0 95.0 96.0 97.0 95.0 96.0 96.0 96.0 17:12:51 INFO - PROCESS | 4388 | 17:12:51 INFO - PROCESS | 4388 | [#8] json-parse-financial Cycles:10 Average:58.00 Median:57.50 stddev:3.53 (6.1%) stddev-sans-first:3.57 17:12:51 INFO - PROCESS | 4388 | Values: 55.0 62.0 56.0 56.0 56.0 58.0 59.0 57.0 66.0 55.0 17:12:51 INFO - PROCESS | 4388 | 17:12:51 INFO - PROCESS | 4388 | [#9] json-stringify-tinderbox Cycles:10 Average:64.30 Median:64.50 stddev:0.67 (1.0%) stddev-sans-first:0.71 17:12:51 INFO - PROCESS | 4388 | Values: 64.0 64.0 65.0 64.0 65.0 64.0 64.0 63.0 65.0 65.0 17:12:51 INFO - PROCESS | 4388 | 17:12:51 INFO - PROCESS | 4388 | [#10] stanford-crypto-aes Cycles:10 Average:79.30 Median:78.50 stddev:3.09 (3.9%) stddev-sans-first:2.50 17:12:51 INFO - PROCESS | 4388 | Values: 85.0 78.0 77.0 79.0 77.0 77.0 79.0 78.0 78.0 85.0 17:12:51 INFO - PROCESS | 4388 | 17:12:51 INFO - PROCESS | 4388 | [#11] stanford-crypto-ccm Cycles:10 Average:116.60 Median:115.50 stddev:4.33 (3.7%) stddev-sans-first:4.55 17:12:51 INFO - PROCESS | 4388 | Values: 115.0 124.0 112.0 115.0 114.0 113.0 116.0 119.0 124.0 114.0 17:12:51 INFO - PROCESS | 4388 | 17:12:51 INFO - PROCESS | 4388 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:143.40 Median:146.00 stddev:5.23 (3.6%) stddev-sans-first:5.46 17:12:51 INFO - PROCESS | 4388 | Values: 146.0 134.0 147.0 144.0 144.0 134.0 148.0 143.0 148.0 146.0 17:12:51 INFO - PROCESS | 4388 | 17:12:51 INFO - PROCESS | 4388 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:66.80 Median:67.00 stddev:1.75 (2.6%) stddev-sans-first:1.42 17:12:51 INFO - PROCESS | 4388 | Values: 70.0 68.0 69.0 66.0 66.0 65.0 65.0 67.0 65.0 67.0 17:12:51 INFO - PROCESS | 4388 | -------- Summary: end -------- 17:12:51 INFO - PROCESS | 4388 | 17:12:52 INFO - TEST-INFO | 4388: exit 0 17:12:52 INFO - TEST-OK | kraken | took 60071ms 17:12:52 INFO - SUITE-END | took 1171s 17:12:52 INFO - Completed test suite (00:19:31) 17:12:52 INFO - javascript benchmark 17:12:52 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [3232.51512273159, 3304.1244070321354, 3306.90079297621, 3332.8166950817695, 3341.181410554413, 5311.362636483623, 5319.6808191508535, 5321.840344789658, 5327.094393953028, 5328.866778330534, 5319.760610772515, 5328.573714102872, 5347.919781203285, 5347.973260133704, 5358.196270559418, 4651.255799072149, 4811.8075276988875, 4885.926711099336, 4943.23379876118, 4957.157283261854, 4736.644751643623, 4805.9279110813195, 4864.78108485119, 4907.460179380265, 4974.676646017997, 4934.333864928225, 4944.728039957801, 4955.405351357842, 4957.876053098666, 4976.178930476485, 4738.786754596052, 4879.926416188433, 4897.559219670246, 4929.457759646436, 4947.851564453073, 4725.2675835245245, 4773.4510531289, 4791.544803243686, 4800.663953523254, 4833.540813622701, 5136.8202112925865, 5160.0969830279555, 5178.533931946143, 5183.45573714762, 5189.844304670866, 5491.670499769986, 5676.403977582336, 5694.430556944314, 5695.971520142414, 5696.1740547620775, 5702.942970570282, 5707.1724599933195, 5711.657300561979, 5718.942810571924, 5747.827565173052, 5322.866928326784, 5337.439568845254, 5337.626366154371, 5338.0, 5339.385970613391, 5622.240997465372, 5787.363390027093, 5799.710014499343, 5812.651240925558, 5895.233619629421, 5638.887222255532, 5653.152027195872, 5655.095184770417, 5658.122990936411, 5670.744816483269, 5695.743691533891, 5722.284714410699, 5733.77064917407, 5733.77064917407, 5753.683547404933, 5459.672419654833, 5651.406602306699, 5663.32040155184, 5724.685142317129, 5747.109198074305, 5610.523105535994, 5614.606977511535, 5622.353429355677, 5626.662400255997, 5628.155776633455, 4307.913841723148, 4345.000649850489, 4368.628666563378, 4370.8907277317685, 4378.474583050054, 3848.3073046851837, 3933.056066544009, 3956.0703234739813, 3974.7217694761666, 3993.3011722948368, 5297.920531192035, 5330.093884039723, 5330.840074797762, 5334.199870019451, 5335.119705248668, 5488.259085023471, 5670.064439367458, 5696.629719068247, 5699.287589051369, 5707.143928410772, 5323.0, 5345.0, 5362.785488580413, 5375.5162035417, 5382.73086345689, 4924.43369012561, 4945.901081978341, 4948.8762780930765, 4971.403431588233, 4977.104121258209, 5716.771329146787, 5895.263092113486, 5899.144624029492, 5903.173555702205, 5926.2295901532525, 5708.600397972102, 5722.313322401338, 5726.770929162787, 5729.828105156768, 5732.16883551891, 5866.765329386777, 5868.794592189253, 5874.03078492044, 5881.38245484218, 5887.264091988502, 5480.671159730429, 5622.690752008679, 5645.096784514458, 5725.2843394575675, 5744.167095771173, 5728.455796699307, 5737.540996720169, 5756.625819321731, 5756.913646295226, 5759.51044161251, 5550.666959982253, 5624.409437009055, 5626.1842032905815, 5627.296587926509, 5628.127640215773, 5357.651752636066, 5488.067028605226, 5560.0, 5568.303962004749, 5591.860203494945, 5493.093639549589, 5531.1426728857095, 5536.4186760389575, 5541.667499950016, 5569.470900264469, 5416.7020813855615, 5631.7184140793615, 5659.754853932129, 5660.20757093999, 5668.26312579362, 5348.973255133699, 5441.945580544302, 5481.808136715196, 5567.387587365306, 5581.832545023493], "unit": "score", "name": "dojo.html", "value": 5261.6434868095275}, {"lowerIsBetter": false, "replicates": [548.421415406746, 558.8211772232886, 577.2841676321358, 577.6014549960527, 631.3244828034, 30887.0, 31667.84166079169, 38319.0, 38634.42048369277, 38780.612193878056, 42444.15111697764, 42956.0, 42984.78507607465, 43084.35373469401, 43103.78448107755, 8746.125387461267, 8973.14755098268, 8978.787863638423, 8983.236424903858, 8985.415947963362, 8785.95607021964, 8835.690750823722, 8922.73231803047, 8925.330600204978, 8934.10658934108, 9142.405743626676, 9259.259259259277, 9260.490673012982, 9262.675806346779, 9265.166135047844, 8989.95505022474, 9063.456192628397, 9072.092790720908, 9076.41003334781, 9079.092090790935, 8895.421797583136, 9114.635414583408, 9132.08679132088, 9134.725958221265, 9135.817283654356, 43076.784616077035, 43609.56390436119, 43618.0, 43630.90922726926, 43692.3446148308, 3902.4731661225655, 4000.899977500557, 4093.713440059197, 4270.594293542109, 4381.474223093217, 32713.0, 33089.6691033089, 33417.83291083553, 33431.6656833431, 33468.0, 4248.98024474127, 4255.3829694694405, 4290.2706539888295, 4290.334998075272, 4324.200022995756, 276236.0, 276425.0, 278087.0, 279727.0, 279991.0, 62247.51009959642, 63101.684491577245, 63139.6843015782, 63225.68387158127, 63230.36769632337, 66731.66634166798, 67107.66446167738, 78891.60554197192, 79495.0, 79695.0, 18851.90574047121, 19049.7142542862, 19085.61828763417, 19086.61826763457, 19102.140403681868, 14588.270586470633, 14657.486987955584, 14659.780103298459, 14666.0, 14684.045537040272, 22633.88683056574, 22932.885335573217, 22990.540189196458, 22993.885030575075, 23000.079996800276, 8024.358051355995, 8058.435909486397, 8122.988988148727, 8271.627776750061, 8557.443766155304, 1094.7536804219146, 1123.9213255072066, 1139.4758411130972, 1150.9827352589718, 1226.3745489800267, 29948.700512995027, 29969.550456743167, 30236.84881575622, 30664.540031899538, 30833.0, 1136.9545218191179, 1155.3414553704308, 1157.675850761788, 1271.065766661503, 1277.8658240884758, 14646.560603181922, 14842.777358339634, 15101.0, 16514.33942642305, 16739.414120505724, 292410.0, 297360.0, 297685.0, 299471.0, 299547.0, 59055.70472147612, 59553.70223148856, 59598.70200648969, 59670.70164649236, 59720.0, 1368.5346982026158, 1501.5495351394538, 1536.4852774320727, 1548.1872017191065, 1564.6948844975348, 29705.0, 30011.699883001766, 30261.0, 32213.838930805196, 33180.0, 47163.528364715916, 47382.28926566173, 47531.76234118807, 47572.52427475681, 47617.285740713225, 252841.0, 254476.0, 254679.0, 256911.0, 257093.0, 30134.698653014068, 48861.2670809931, 48970.755146224044, 50541.241881372545, 51530.742346288025, 47080.0, 47149.29276060931, 47386.0, 48162.75918620524, 48434.515654843, 38217.426738598384, 38503.0, 39030.2193956125, 39305.803470982464, 43265.7836710827, 41320.0, 42412.78793606012, 42492.150156997304, 43031.0, 43051.138977219656, 42465.575344246165, 43331.35002974895, 43659.0, 43866.0, 43881.78059109684, 36848.81575592105, 38264.42603361008, 38618.0, 39158.0, 39257.803710981265, 28216.576751349156, 28711.856440717664, 28913.7108628911, 28948.27629309284, 29019.709802902544], "unit": "score", "name": "ext.html", "value": 20252.95419331987}, {"lowerIsBetter": false, "replicates": [368.2212121363316, 369.7836765492187, 372.6310952157365, 379.7057280607529, 388.1906225519791, 17142.142892855354, 18603.441896743087, 20058.49853753657, 20100.798992010077, 20103.296384626523, 12093.818592721116, 12516.749665006717, 12536.0, 12541.059420543474, 12550.0, 5018.34761481007, 5137.871553211181, 5260.073765123582, 5794.623349482291, 5802.883942321151, 5673.517750991171, 5737.856553586152, 5742.54059675225, 5755.136729490589, 5777.306723193223, 5134.358205224347, 5344.412114667383, 5352.946470535303, 5650.011248031578, 5714.885702285973, 5316.415194328621, 5336.412994570614, 5339.9733001335135, 5355.410904800468, 5377.274068000828, 5165.354330708661, 5195.818146364897, 5207.921881171786, 5223.82463945613, 5239.659422137549, 14104.08323458972, 14373.209473478955, 14410.351534180882, 14533.200673962929, 19694.704579431178, 2250.6551564667784, 2274.613315736329, 2359.5634807560486, 2581.186926118267, 3058.006148001908, 9885.55662905011, 10223.335483193569, 10333.793324133476, 10424.739381515523, 13417.0, 1847.8614103942123, 1966.7246585478044, 1968.812962768549, 1998.9300374486822, 2008.1465377214772, 51282.48717512852, 67602.66198669025, 67648.6617566909, 69706.30293697049, 71734.28265717329, 10351.792964140675, 10418.739531511774, 10802.837957430645, 10849.186311026704, 10912.618058368078, 13675.452981880613, 14504.927475362556, 14970.700585988438, 15430.842686798534, 15458.5362439127, 8146.918530814616, 8326.5004099753, 8600.924884389451, 8609.397342186112, 8645.438046526955, 8488.0, 8539.573021349031, 8559.144085591392, 8607.698730544402, 8657.22085012352, 4799.328094066834, 4824.34871292378, 4849.933014736752, 4890.0, 4910.8772280693265, 1897.5540747924504, 2036.093938197488, 2057.0434747842323, 2061.5773766378156, 2093.3301343570215, 1011.8886922438526, 1015.720676813882, 1031.5706511166245, 1068.1476201789933, 1079.1474734959295, 16652.3339066436, 17281.654366912593, 17640.294388224585, 17770.555736106442, 18357.54106147357, 995.1889210293588, 1006.6929586476195, 1021.1524434719165, 1050.653284416156, 1061.2253055269541, 9987.350822196535, 10256.538455769509, 10271.281010329354, 10425.843612345821, 10502.842457363146, 356117.0, 359341.0, 360001.0, 364100.0, 459056.0, 78515.21484785194, 82486.58756706178, 83912.0, 84030.57984710038, 84541.57729211438, 1052.8210204265292, 1071.9464026798628, 1083.8590983172294, 1084.5173897615484, 1089.6349722842779, 16047.277872495531, 16112.274947627151, 16145.1927403627, 16326.836731633006, 16622.50132496027, 24056.19578531582, 33119.337613248084, 35556.82221588876, 37472.437913431866, 37860.24279514339, 53305.46694533005, 53588.196177058155, 53915.191272131735, 53964.19053714276, 54151.0, 8463.322934165375, 8504.53225072627, 8583.957080214559, 8665.480071195749, 8722.563871806511, 11814.586489472827, 13118.75903093998, 13358.398872050586, 13742.312884355542, 14020.789688154482, 7780.84438311242, 10238.846417303896, 11739.11956603241, 12082.637520874388, 12248.69378265515, 11878.287302761863, 11889.405529723652, 11981.880181198425, 12153.696157595778, 12543.749125017632, 5784.623999440023, 8762.0, 9978.550965206729, 12262.080343974416, 12380.938095309466, 8594.871076933976, 8937.419067760575, 8947.686830960885, 9059.36584439083, 9090.954545227232, 11768.52925882955, 12015.639530814089, 12025.819612705991, 12053.18460236058, 12062.336571488653], "unit": "score", "name": "jquery.html", "value": 8735.90474639252}, {"lowerIsBetter": false, "replicates": [1180.2151569206478, 1555.673308605193, 1584.9603759905997, 1792.2651712797756, 1892.858035647326, 7520.097588289406, 7663.8084047898765, 7676.4242681798805, 7765.301122898938, 7769.533827970312, 7611.391088712903, 7791.415643826722, 7797.376209903208, 7802.336801371876, 7810.0, 2321.767823217682, 2344.8593084414906, 2348.095983046522, 2354.3996280948336, 2354.7409784923643, 2332.2769941318247, 2352.4236562042324, 2371.027878569787, 2372.406898275431, 2374.287713685896, 2352.0, 2358.740538540759, 2359.469119448119, 2371.4071482129466, 2382.737898831127, 2372.7034120734907, 2379.0127097254617, 2394.4971555973266, 2395.8921848516857, 2411.0, 2355.8939847706724, 2418.8548687078833, 2423.9515209695883, 2430.793382562484, 2431.9270421887195, 7969.521828690239, 7975.7607271781935, 7995.360371170293, 7996.760097197093, 8000.0, 4847.75761211938, 4978.377702787152, 4982.153033984231, 4983.0, 4987.925181122286, 3105.7825952183357, 3119.516474946387, 3144.827034513101, 3173.5557022016937, 3184.060702092865, 1057.0750593230923, 1066.2642776484279, 1069.1553672598639, 1095.0691911874922, 1097.4896673047072, 10812.729681758019, 10831.64604424447, 10843.566257349696, 10849.186311026626, 10856.565737370574, 4284.614384705392, 4322.805473753689, 4393.165298593257, 4404.71369360997, 4433.534478879671, 9326.253899688008, 9364.0, 9364.110409511086, 9370.29722770795, 9376.671816486527, 4978.4025916890205, 4985.476524964826, 4990.850274491699, 4992.550670439678, 4993.625478089158, 3956.7823769692945, 3996.1208534122447, 4421.845235416809, 4468.396766436489, 4567.429071366079, 3586.479960405779, 3660.7254455915913, 3663.3405986922608, 3684.5394325709285, 3685.8157092145284, 1177.2759752752168, 1191.0709646475764, 1191.5055252070295, 1193.0813273779142, 1205.457544105156, 1208.788462019143, 1220.371508673034, 1224.7121926347302, 1480.1193289992436, 1500.579837645461, 7312.5246858954, 7354.154272258758, 7423.85152296951, 7431.925680743123, 7455.403567714569, 542.4738004135982, 550.9090999984958, 553.7314402514777, 569.6012791046202, 573.1717667969743, 5757.254735007878, 5849.473547380756, 5882.411758824169, 5890.4698577128265, 5940.198073260054, 8959.820803583892, 9092.8636070459, 9231.953840230755, 9302.069793020644, 9305.441673499612, 9008.234300084436, 9051.411658242194, 9121.589528471102, 9174.357794954423, 9188.678396256098, 6991.685374158175, 7309.634518274172, 7369.6315184240575, 7372.483926125227, 7382.704691812375, 6872.656367181721, 6886.208086069965, 6949.7567585134275, 6970.989206565121, 6976.511644184859, 8010.719624813103, 8062.677492900219, 8189.385796065199, 8325.95837020811, 8376.83246335082, 8328.917240758663, 8356.373272004503, 8363.330933525182, 8533.274671652978, 8540.487570745776, 6186.505079593531, 6719.798406047827, 6844.247132815486, 7178.892316615151, 7359.300866417681, 7192.532485388642, 7247.383972362198, 7254.96372518134, 7278.199398066315, 7288.08898887639, 6550.541462097607, 6639.4688424924925, 6662.600243985376, 6686.097376854257, 6828.487863410165, 6586.1438013058, 6667.599944003376, 6702.664866756741, 6713.697883595152, 6855.760048398282, 7133.85732285341, 7180.712771489082, 7189.424846012411, 7216.494845360984, 7219.639018049182, 6785.796426107225, 6814.93185068143, 6817.488688348294, 6831.146106736658, 6843.931560684329, 6382.712777924911, 6443.130177425987, 6446.4520515756685, 6459.806205813645, 6460.547761656639], "unit": "score", "name": "mootools.html", "value": 4472.357199225783}, {"lowerIsBetter": false, "replicates": [340.55557497465827, 346.3575068248399, 348.9948947032548, 350.0129634430904, 350.6318365715998, 5883.6763977981245, 5893.793717219898, 5907.61600495968, 5916.970415147929, 5924.022536281508, 5855.941440585593, 5861.17943487912, 5865.736041878115, 5867.207926929863, 5882.764689412418, 4424.2921132618785, 4489.955100448987, 4570.702904311217, 4585.28928016158, 4649.279361698942, 4596.885077873047, 4612.285095810138, 4613.6539759518, 4632.2819962905805, 4635.258358662614, 4584.151931892594, 4589.449266088058, 4594.805350608849, 4595.977020114911, 4606.6314694824505, 4385.101054283864, 4472.709273897219, 4541.568550987651, 4544.8863778405475, 4568.2462393705, 4046.7976601169826, 4057.0668746188544, 4060.9187816243807, 4081.0409553754844, 4083.060895993938, 5598.58010649203, 5599.524040456566, 5606.579506537026, 5611.523020543259, 5621.437856214387, 5321.042212401766, 5322.733863306819, 5333.759980800874, 5334.67991920486, 5337.386200586943, 6194.752209911598, 6198.039303907902, 6198.690065496708, 6198.752049917998, 6219.346968568326, 4236.385724069993, 4392.450943632046, 4402.977985110054, 4515.61617262533, 4516.661250406232, 6443.387878151568, 6474.737426201893, 6498.090267362526, 6507.4794016479045, 6520.967395163041, 4470.262406702923, 4497.168023915586, 4499.3251012347755, 4499.797509112098, 4500.617447516932, 4489.236829738887, 4552.567506086916, 4552.704074235164, 4560.293154561048, 4560.361549383089, 5236.816711415082, 5246.947530524646, 5247.921281180786, 5257.868553286122, 5260.263563101169, 6224.906626400608, 6275.560710750204, 6292.056191571301, 6294.842628934313, 6298.433141017331, 1570.599497128225, 1570.9528714138594, 1572.316042521507, 1586.0166696648153, 1591.9761203581957, 1002.3033991376069, 1034.9223808214415, 1046.2780681329857, 1047.9371237725761, 1080.8216644253766, 5945.0, 5948.851278718067, 5961.552883533753, 6042.154098426224, 6045.848853778691, 6360.14138091361, 6361.681915904279, 6361.968190159112, 6367.140436041075, 6381.202349706286, 5954.8809023819285, 5957.0, 5958.1062840573395, 5964.970175149097, 5967.075103358986, 3418.0942050356675, 3453.153977275533, 3454.5336379588935, 3456.3778519866164, 3457.429524128491, 6410.967945160244, 6572.14562106923, 6573.244076931214, 6575.046618240328, 6575.046618240424, 6480.51396145291, 6486.708098135595, 6522.673866306665, 6526.347365263436, 6527.0, 6510.283868774431, 6527.086207930894, 6535.901961470582, 6551.475881929434, 6556.016597510316, 6304.968475157595, 6342.334054924351, 6344.206974128234, 6353.777617783356, 6362.172917520693, 6134.079888016833, 6262.906056409249, 6270.843228919131, 6273.623582584877, 6281.71732272058, 6475.481961443167, 6502.122213501117, 6534.052562378523, 6534.542582019213, 6548.148740663683, 4470.0, 4471.150481408522, 4480.39514665516, 4483.7982290797645, 4485.394471746273, 6353.618782873043, 6356.618602883842, 6363.3636636336, 6365.395287447685, 6371.299157092809, 6174.289956655042, 6175.5677102602385, 6183.659898705614, 6185.536084793748, 6188.535859810622, 6123.601965872204, 6194.659293738708, 6315.842103947254, 6327.3988971047675, 6336.746530138743, 6180.258368995569, 6199.969000154971, 6204.317525072148, 6206.131141640084, 6214.098955651496, 6319.862424763587, 6344.873102538016, 6347.873042539216, 6354.301026887131, 6356.396142366468, 5986.88026239464, 6100.725467353891, 6206.131141640084, 6211.596246243979, 6213.161223234805], "unit": "score", "name": "prototype.html", "value": 4723.457018476209}, {"lowerIsBetter": false, "replicates": [780.5121798875703, 827.9710210142646, 849.3460035772455, 861.6768711733104, 954.30335854826, 15020.77468837967, 15106.0, 15127.773083403757, 15244.84755152448, 15257.465988690397, 15722.449714260003, 16084.276207570658, 16105.03369797813, 16114.516564503054, 16129.0, 910.1171863292612, 925.0379605210572, 925.7546750111226, 927.350854401918, 928.6935311347273, 785.9449838511277, 934.0799312677008, 950.8954015058338, 953.6662168241095, 954.4607296877277, 993.101243374747, 993.2997236947971, 994.8358520844052, 1000.2448151645534, 1003.2776400991274, 834.1950018232375, 980.3382716666257, 987.6543209876558, 989.43602146776, 989.8614194012844, 715.8174665460326, 719.4100837313405, 720.2833180984901, 725.2602345607451, 725.521156037013, 14294.356753946098, 14346.641333966734, 14348.139111653334, 14424.855751442456, 14452.349644265929, 13667.248301343423, 13868.0, 13925.860741392658, 14044.297785110704, 14141.787873181911, 11582.0, 11674.824877626843, 11811.704707382385, 11927.94036029823, 12169.330686812222, 3831.4635950966886, 3837.2517359114986, 3902.7463214891227, 3923.803809809498, 3959.2675355059405, 52163.478365216244, 52975.0, 52981.470185298036, 53008.73495632536, 53392.0, 10561.313514621525, 10945.945270273756, 11067.557297708163, 11068.059214966657, 11168.329900206014, 19430.0, 19594.51013724668, 19610.70583941242, 19630.116644751022, 19651.0, 7696.999390079254, 8006.599670016476, 8328.70849520276, 8466.534340611326, 8537.402381833212, 4605.930911036337, 4784.856454306377, 4795.280707893774, 4802.0, 4925.335079764258, 3315.834208289576, 3336.0, 3341.883034093844, 3349.949750753741, 3351.1957130289043, 555.5638823523515, 559.4601209832531, 560.7812952948353, 567.9119835364882, 588.4556784973882, 594.6461855196152, 610.0270069239556, 652.438902543812, 664.1996394344803, 683.9760608378683, 8883.0, 9050.0, 9080.22818060459, 9135.132162444557, 9231.584578693975, 631.4537924695197, 675.3853992866468, 706.7031846624327, 727.8617062758059, 732.6410059071017, 4121.258173528734, 4254.212970600449, 4374.300111982067, 4395.077033822933, 4477.283634618446, 61707.0, 62119.68940155361, 62511.68744156341, 62542.374576254566, 62571.0, 53065.73467132717, 54625.72687136539, 55224.0, 55650.16524752132, 55723.44276557264, 47185.52814471811, 47282.05435891263, 49065.264021039715, 49913.0, 51729.741351293, 8486.236238738544, 8540.615672294638, 8749.693760718344, 8953.462792232487, 9025.41334813235, 37331.06672333214, 37815.62184378121, 38731.41902871516, 38899.416508752955, 39030.80484597559, 47724.761376192895, 48591.757041214565, 49042.75478622584, 49442.25836612526, 49704.75147624239, 10343.172546196136, 10500.159987200852, 10527.842082368617, 10731.785364292826, 10764.40795756241, 11894.345810980132, 12135.878641213474, 12252.754944900873, 12500.687482813002, 12546.87453125457, 11266.324020558794, 11364.142787112, 11461.6287630077, 11516.712082198012, 11669.708257293636, 11447.198696091195, 11661.125415594033, 11725.179237453296, 11752.353620550952, 11842.230255033395, 11180.440977951233, 11225.550977960791, 11271.323720576791, 11382.94308528452, 11449.942750286194, 9623.807523849624, 10497.895021049691, 10556.366618002945, 10620.09729172998, 10699.14406847466, 10022.699319020441, 10171.64399246023, 10199.184065274909, 10207.489625518545, 10282.0], "unit": "score", "name": "yui.html", "value": 6802.292590238875}], "name": "dromaeo_css", "value": 7151.5790667711035}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [111.0, 114.0, 114.0, 112.0, 110.0, 115.0, 113.0, 110.0, 111.0, 126.0], "unit": "score", "name": "ai-astar", "value": 113.6}, {"lowerIsBetter": true, "replicates": [151.0, 130.0, 154.0, 165.0, 127.0, 155.0, 154.0, 128.0, 179.0, 134.0], "unit": "score", "name": "audio-beat-detection", "value": 147.7}, {"lowerIsBetter": true, "replicates": [161.0, 160.0, 165.0, 160.0, 160.0, 161.0, 161.0, 160.0, 160.0, 160.0], "unit": "score", "name": "audio-dft", "value": 160.8}, {"lowerIsBetter": true, "replicates": [77.0, 75.0, 77.0, 162.0, 77.0, 76.0, 77.0, 78.0, 170.0, 77.0], "unit": "score", "name": "audio-fft", "value": 94.6}, {"lowerIsBetter": true, "replicates": [94.0, 93.0, 153.0, 93.0, 94.0, 93.0, 146.0, 94.0, 93.0, 147.0], "unit": "score", "name": "audio-oscillator", "value": 110.0}, {"lowerIsBetter": true, "replicates": [117.0, 118.0, 117.0, 116.0, 116.0, 117.0, 118.0, 117.0, 116.0, 117.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 116.9}, {"lowerIsBetter": true, "replicates": [146.0, 146.0, 146.0, 146.0, 146.0, 146.0, 145.0, 147.0, 145.0, 146.0], "unit": "score", "name": "imaging-darkroom", "value": 145.9}, {"lowerIsBetter": true, "replicates": [95.0, 96.0, 96.0, 95.0, 96.0, 97.0, 95.0, 96.0, 96.0, 96.0], "unit": "score", "name": "imaging-desaturate", "value": 95.8}, {"lowerIsBetter": true, "replicates": [55.0, 62.0, 56.0, 56.0, 56.0, 58.0, 59.0, 57.0, 66.0, 55.0], "unit": "score", "name": "json-parse-financial", "value": 58.0}, {"lowerIsBetter": true, "replicates": [64.0, 64.0, 65.0, 64.0, 65.0, 64.0, 64.0, 63.0, 65.0, 65.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 64.3}, {"lowerIsBetter": true, "replicates": [85.0, 78.0, 77.0, 79.0, 77.0, 77.0, 79.0, 78.0, 78.0, 85.0], "unit": "score", "name": "stanford-crypto-aes", "value": 79.3}, {"lowerIsBetter": true, "replicates": [115.0, 124.0, 112.0, 115.0, 114.0, 113.0, 116.0, 119.0, 124.0, 114.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 116.6}, {"lowerIsBetter": true, "replicates": [146.0, 134.0, 147.0, 144.0, 144.0, 134.0, 148.0, 143.0, 148.0, 146.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 143.4}, {"lowerIsBetter": true, "replicates": [70.0, 68.0, 69.0, 66.0, 66.0, 65.0, 65.0, 67.0, 65.0, 67.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 66.8}], "name": "kraken", "value": 1513.6999999999996}]} 17:12:52 INFO - Return code: 0 17:12:52 INFO - Validating PERFHERDER_DATA against /builds/slave/test/build/tests/talos/treeherder-schemas/performance-artifact.json 17:12:52 INFO - # TBPL SUCCESS # 17:12:52 INFO - Running post-action listener: _resource_record_post_action 17:12:52 INFO - Running post-run listener: _resource_record_post_run 17:12:53 INFO - Total resource usage - Wall time: 1185s; CPU: 13.0%; Read bytes: 8192; Write bytes: 460300288; Read time: 32; Write time: 456020 17:12:53 INFO - install - Wall time: 13s; CPU: 15.0%; Read bytes: 0; Write bytes: 237805568; Read time: 0; Write time: 343656 17:12:53 INFO - run-tests - Wall time: 1173s; CPU: 13.0%; Read bytes: 8192; Write bytes: 222179328; Read time: 32; Write time: 112336 17:12:53 INFO - Running post-run listener: _upload_blobber_files 17:12:53 INFO - Blob upload gear active. 17:12:53 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 17:12:53 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 17:12:53 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-Beta', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 17:12:53 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-Beta -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 17:12:54 INFO - (blobuploader) - INFO - Open directory for files ... 17:12:54 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 17:12:54 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 17:12:54 INFO - (blobuploader) - INFO - Uploading, attempt #1. 17:12:54 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 17:12:54 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 17:12:54 INFO - (blobuploader) - INFO - Done attempting. 17:12:54 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 17:12:54 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 17:12:54 INFO - (blobuploader) - INFO - Uploading, attempt #1. 17:12:55 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 17:12:55 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 17:12:55 INFO - (blobuploader) - INFO - Done attempting. 17:12:55 INFO - (blobuploader) - INFO - Iteration through files over. 17:12:55 INFO - Return code: 0 17:12:55 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 17:12:55 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 17:12:55 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/9647c8719a5b5927ae5578a60ccd21bbf2fbe7307339c28ec1183c9e7b9196888a02ee1744aac4e5b2491cca7f376c4efbadd274037b6099150ecba1d6245bb8", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/b7bf07170031913463c4549bbcf961d418112a6019dbcc0d18b61beba060778c7afefd5256f250ca35653d46142c6902816d78302d4465837a32cb98a481315e"} 17:12:55 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 17:12:55 INFO - Writing to file /builds/slave/test/properties/blobber_files 17:12:55 INFO - Contents: 17:12:55 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/9647c8719a5b5927ae5578a60ccd21bbf2fbe7307339c28ec1183c9e7b9196888a02ee1744aac4e5b2491cca7f376c4efbadd274037b6099150ecba1d6245bb8", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/b7bf07170031913463c4549bbcf961d418112a6019dbcc0d18b61beba060778c7afefd5256f250ca35653d46142c6902816d78302d4465837a32cb98a481315e"} 17:12:55 INFO - Running post-run listener: copy_logs_to_upload_dir 17:12:55 INFO - Copying logs to upload dir... 17:12:55 INFO - mkdir: /builds/slave/test/build/upload/logs 17:12:55 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1223.546408 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 23 secs) (at 2016-05-30 17:12:54.563713) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-05-30 17:12:54.567161) ========= 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=97facb8ba2ac28944cc45e6b000001d4-1464652350.110445-327964771 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/9647c8719a5b5927ae5578a60ccd21bbf2fbe7307339c28ec1183c9e7b9196888a02ee1744aac4e5b2491cca7f376c4efbadd274037b6099150ecba1d6245bb8", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/b7bf07170031913463c4549bbcf961d418112a6019dbcc0d18b61beba060778c7afefd5256f250ca35653d46142c6902816d78302d4465837a32cb98a481315e"} build_url:https://queue.taskcluster.net/v1/task/f4GDJdCZR7SnRBdlkgdboQ/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011559 build_url: 'https://queue.taskcluster.net/v1/task/f4GDJdCZR7SnRBdlkgdboQ/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/9647c8719a5b5927ae5578a60ccd21bbf2fbe7307339c28ec1183c9e7b9196888a02ee1744aac4e5b2491cca7f376c4efbadd274037b6099150ecba1d6245bb8", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/b7bf07170031913463c4549bbcf961d418112a6019dbcc0d18b61beba060778c7afefd5256f250ca35653d46142c6902816d78302d4465837a32cb98a481315e"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-05-30 17:12:54.598808) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-05-30 17:12:54.599650) ========= 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=97facb8ba2ac28944cc45e6b000001d4-1464652350.110445-327964771 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004421 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-05-30 17:12:54.683667) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-05-30 17:12:54.684411) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-05-30 17:12:54.685121) ========= ========= Total master_lag: 0.18 =========