builder: mozilla-aurora_ubuntu64_hw_test-dromaeojs-pgo slave: talos-linux64-ix-012 starttime: 1490284597.23 results: success (0) revision: 786d0d85a2c3df3348cf7deaf6d2e69e8e52c9d7 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2017-03-23 08:56:37.230429) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2017-03-23 08:56:37.230861) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-03-23 08:56:37.231126) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-03-23 08:56:37.245782) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-03-23 08:56:37.246060) ========= 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=2c5dd2b0a310ecf02fd87158000001b4-1490284596.745172-725811385 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2017-03-23 08:56:37-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12179 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 222M=0s 2017-03-23 08:56:37 (222 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.123376 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-03-23 08:56:37.382934) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-03-23 08:56:37.383239) ========= 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=2c5dd2b0a310ecf02fd87158000001b4-1490284596.745172-725811385 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.019244 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-03-23 08:56:37.431885) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-03-23 08:56:37.432211) ========= bash -c 'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev 786d0d85a2c3df3348cf7deaf6d2e69e8e52c9d7 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev 786d0d85a2c3df3348cf7deaf6d2e69e8e52c9d7 --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=2c5dd2b0a310ecf02fd87158000001b4-1490284596.745172-725811385 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2017-03-23 08:56:37,620 truncating revision to first 12 chars 2017-03-23 08:56:37,621 Setting DEBUG logging. 2017-03-23 08:56:37,621 attempt 1/10 2017-03-23 08:56:37,621 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/releases/mozilla-aurora/786d0d85a2c3?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2017-03-23 08:56:37,983 unpacking tar archive at: mozilla-aurora-786d0d85a2c3/testing/mozharness/ program finished with exit code 0 elapsedTime=0.676128 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-03-23 08:56:38.122976) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-03-23 08:56:38.123410) ========= script_repo_revision: 786d0d85a2c3df3348cf7deaf6d2e69e8e52c9d7 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-03-23 08:56:38.123768) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-03-23 08:56:38.124141) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-03-23 08:56:38.134498) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 53 secs) (at 2017-03-23 08:56:38.134778) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Aurora --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs', '--add-option', '--webServer,localhost', '--branch-name', 'Mozilla-Aurora', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-Aurora'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=2c5dd2b0a310ecf02fd87158000001b4-1490284596.745172-725811385 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 08:56:38 INFO - MultiFileLogger online at 20170323 08:56:38 in /builds/slave/test 08:56:38 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Aurora --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora 08:56:38 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 08:56:38 INFO - {'append_to_log': False, 08:56:38 INFO - 'base_work_dir': '/builds/slave/test', 08:56:38 INFO - 'blob_upload_branch': 'Mozilla-Aurora', 08:56:38 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 08:56:38 INFO - 'branch': 'Mozilla-Aurora', 08:56:38 INFO - 'buildbot_json_path': 'buildprops.json', 08:56:38 INFO - 'config_files': ('talos/linux_config.py',), 08:56:38 INFO - 'default_actions': ('clobber', 08:56:38 INFO - 'read-buildbot-config', 08:56:38 INFO - 'download-and-extract', 08:56:38 INFO - 'populate-webroot', 08:56:38 INFO - 'create-virtualenv', 08:56:38 INFO - 'install', 08:56:38 INFO - 'run-tests'), 08:56:38 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 08:56:38 INFO - 'download_minidump_stackwalk': True, 08:56:38 INFO - 'download_symbols': 'ondemand', 08:56:38 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 08:56:38 INFO - 'tooltool.py': '/tools/tooltool.py', 08:56:38 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 08:56:38 INFO - '/tools/misc-python/virtualenv.py')}, 08:56:38 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 08:56:38 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 08:56:38 INFO - 'gecko_profile': False, 08:56:38 INFO - 'gecko_profile_interval': 0, 08:56:38 INFO - 'installer_path': 'installer.exe', 08:56:38 INFO - 'log_level': 'info', 08:56:38 INFO - 'log_name': 'talos', 08:56:38 INFO - 'log_to_console': True, 08:56:38 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 08:56:38 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 08:56:38 INFO - 'opt_config_files': (), 08:56:38 INFO - 'pip_index': False, 08:56:38 INFO - 'suite': 'dromaeojs', 08:56:38 INFO - 'system_bits': '32', 08:56:38 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 08:56:38 INFO - 'title': 'talos-linux64-ix-012', 08:56:38 INFO - 'tooltool_cache': '/builds/tooltool_cache', 08:56:38 INFO - 'use_talos_json': True, 08:56:38 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 08:56:38 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 08:56:38 INFO - 'work_dir': 'build'} 08:56:38 INFO - [mozharness: 2017-03-23 15:56:38.428534Z] Running clobber step. 08:56:38 INFO - Running pre-action listener: _resource_record_pre_action 08:56:38 INFO - Running main action method: clobber 08:56:38 INFO - rmtree: /builds/slave/test/build 08:56:38 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 08:56:39 INFO - Running post-action listener: _resource_record_post_action 08:56:39 INFO - [mozharness: 2017-03-23 15:56:39.369256Z] Finished clobber step (success) 08:56:39 INFO - [mozharness: 2017-03-23 15:56:39.369355Z] Running read-buildbot-config step. 08:56:39 INFO - Running pre-action listener: _resource_record_pre_action 08:56:39 INFO - Running main action method: read_buildbot_config 08:56:39 INFO - Using buildbot properties: 08:56:39 INFO - { 08:56:39 INFO - "project": "", 08:56:39 INFO - "product": "firefox", 08:56:39 INFO - "who": "cbook@mozilla.com", 08:56:39 INFO - "installer_path": "public/build/target.tar.bz2", 08:56:39 INFO - "builddir": "mozilla-aurora_ubuntu64_hw_test-dromaeojs", 08:56:39 INFO - "repository": "https://hg.mozilla.org/releases/mozilla-aurora/", 08:56:39 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-aurora pgo talos dromaeojs", 08:56:39 INFO - "stage_platform": "linux64-pgo", 08:56:39 INFO - "basedir": "/builds/slave/test", 08:56:39 INFO - "buildnumber": 846, 08:56:39 INFO - "platform": "ubuntu64_hw", 08:56:39 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 08:56:39 INFO - "slavebuilddir": "test", 08:56:39 INFO - "taskId": "fouUbsxXQmqeIUS0xg3xPw", 08:56:39 INFO - "branch": "mozilla-aurora", 08:56:39 INFO - "script_repo_revision": "production", 08:56:39 INFO - "revision": "786d0d85a2c3df3348cf7deaf6d2e69e8e52c9d7", 08:56:39 INFO - "slavename": "talos-linux64-ix-012", 08:56:39 INFO - "repo_path": "releases/mozilla-aurora" 08:56:39 INFO - } 08:56:39 INFO - Finding installer, test and symbols from parent task. 08:56:39 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/fouUbsxXQmqeIUS0xg3xPw'}, attempt #1 08:56:39 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/fouUbsxXQmqeIUS0xg3xPw'}, attempt #1 08:56:40 INFO - Task dependencies: dywW6IdcSMqTUQR9vFXpeQ 08:56:40 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/dywW6IdcSMqTUQR9vFXpeQ'}, attempt #1 08:56:40 INFO - Set installer_url: https://queue.taskcluster.net/v1/task/dywW6IdcSMqTUQR9vFXpeQ/artifacts/public/build/target.tar.bz2 08:56:40 INFO - Set test_url: https://queue.taskcluster.net/v1/task/dywW6IdcSMqTUQR9vFXpeQ/artifacts/public/build/test_packages.json 08:56:40 INFO - Set symbols_url: https://queue.taskcluster.net/v1/task/dywW6IdcSMqTUQR9vFXpeQ/artifacts/public/build/target.crashreporter-symbols.zip 08:56:40 INFO - Running post-action listener: _resource_record_post_action 08:56:40 INFO - [mozharness: 2017-03-23 15:56:40.861591Z] Finished read-buildbot-config step (success) 08:56:40 INFO - [mozharness: 2017-03-23 15:56:40.861812Z] Running download-and-extract step. 08:56:40 INFO - Running pre-action listener: _resource_record_pre_action 08:56:40 INFO - Running main action method: download_and_extract 08:56:40 INFO - mkdir: /builds/slave/test/build/tests 08:56: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:56:40 INFO - trying https://queue.taskcluster.net/v1/task/dywW6IdcSMqTUQR9vFXpeQ/artifacts/public/build/target.test_packages.json 08:56:40 INFO - Downloading https://queue.taskcluster.net/v1/task/dywW6IdcSMqTUQR9vFXpeQ/artifacts/public/build/target.test_packages.json to /builds/slave/test/build/target.test_packages.json 08:56:40 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/dywW6IdcSMqTUQR9vFXpeQ/artifacts/public/build/target.test_packages.json', 'file_name': '/builds/slave/test/build/target.test_packages.json'}, attempt #1 08:56:41 INFO - Downloaded 896 bytes. 08:56:41 INFO - Reading from file /builds/slave/test/build/target.test_packages.json 08:56:41 INFO - Using the following test package requirements: 08:56:41 INFO - {u'common': [u'target.common.tests.zip'], 08:56:41 INFO - u'cppunittest': [u'target.common.tests.zip', u'target.cppunittest.tests.zip'], 08:56:41 INFO - u'gtest': [u'target.common.tests.zip', u'target.gtest.tests.zip'], 08:56:41 INFO - u'jittest': [u'target.common.tests.zip', u'target.jsshell.zip'], 08:56:41 INFO - u'mochitest': [u'target.common.tests.zip', u'target.mochitest.tests.zip'], 08:56:41 INFO - u'mozbase': [u'target.common.tests.zip'], 08:56:41 INFO - u'reftest': [u'target.common.tests.zip', u'target.reftest.tests.zip'], 08:56:41 INFO - u'talos': [u'target.common.tests.zip', u'target.talos.tests.zip'], 08:56:41 INFO - u'web-platform': [u'target.common.tests.zip', 08:56:41 INFO - u'target.web-platform.tests.zip'], 08:56:41 INFO - u'xpcshell': [u'target.common.tests.zip', u'target.xpcshell.tests.zip']} 08:56:41 INFO - Downloading packages: [u'target.common.tests.zip'] for test suite category: common 08:56:41 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/dywW6IdcSMqTUQR9vFXpeQ/artifacts/public/build/target.common.tests.zip 08:56:41 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/dywW6IdcSMqTUQR9vFXpeQ/artifacts/public/build/target.common.tests.zip'}, attempt #1 08:56:41 INFO - Fetch https://queue.taskcluster.net/v1/task/dywW6IdcSMqTUQR9vFXpeQ/artifacts/public/build/target.common.tests.zip into memory 08:56:43 INFO - Expected file size: 59531987 08:56:43 INFO - Obtained file size: 59531987 08:56:53 INFO - Downloading packages: [u'target.common.tests.zip', u'target.talos.tests.zip'] for test suite category: talos 08:56:53 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/dywW6IdcSMqTUQR9vFXpeQ/artifacts/public/build/target.common.tests.zip 08:56:53 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/dywW6IdcSMqTUQR9vFXpeQ/artifacts/public/build/target.common.tests.zip'}, attempt #1 08:56:53 INFO - Fetch https://queue.taskcluster.net/v1/task/dywW6IdcSMqTUQR9vFXpeQ/artifacts/public/build/target.common.tests.zip into memory 08:56:54 INFO - Expected file size: 59531987 08:56:54 INFO - Obtained file size: 59531987 08:57:05 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/dywW6IdcSMqTUQR9vFXpeQ/artifacts/public/build/target.talos.tests.zip 08:57:05 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/dywW6IdcSMqTUQR9vFXpeQ/artifacts/public/build/target.talos.tests.zip'}, attempt #1 08:57:05 INFO - Fetch https://queue.taskcluster.net/v1/task/dywW6IdcSMqTUQR9vFXpeQ/artifacts/public/build/target.talos.tests.zip into memory 08:57:07 INFO - Expected file size: 14404438 08:57:07 INFO - Obtained file size: 14404438 08:57:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:57:07 INFO - trying https://queue.taskcluster.net/v1/task/dywW6IdcSMqTUQR9vFXpeQ/artifacts/public/build/target.tar.bz2 08:57:07 INFO - Downloading https://queue.taskcluster.net/v1/task/dywW6IdcSMqTUQR9vFXpeQ/artifacts/public/build/target.tar.bz2 to /builds/slave/test/build/target.tar.bz2 08:57:07 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/dywW6IdcSMqTUQR9vFXpeQ/artifacts/public/build/target.tar.bz2', 'file_name': '/builds/slave/test/build/target.tar.bz2'}, attempt #1 08:57:10 INFO - Downloaded 66762446 bytes. 08:57:10 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/dywW6IdcSMqTUQR9vFXpeQ/artifacts/public/build/target.tar.bz2 08:57:10 INFO - mkdir: /builds/slave/test/properties 08:57:10 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 08:57:10 INFO - Writing to file /builds/slave/test/properties/build_url 08:57:10 INFO - Contents: 08:57:10 INFO - build_url:https://queue.taskcluster.net/v1/task/dywW6IdcSMqTUQR9vFXpeQ/artifacts/public/build/target.tar.bz2 08:57:10 INFO - Running post-action listener: _resource_record_post_action 08:57:10 INFO - Running post-action listener: set_extra_try_arguments 08:57:10 INFO - [mozharness: 2017-03-23 15:57:10.305802Z] Finished download-and-extract step (success) 08:57:10 INFO - [mozharness: 2017-03-23 15:57:10.305953Z] Running populate-webroot step. 08:57:10 INFO - Running pre-action listener: _resource_record_pre_action 08:57:10 INFO - Running main action method: populate_webroot 08:57:10 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 08:57:10 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 08:57:10 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 08:57:10 INFO - '--tppagecycles', 08:57:10 INFO - '7'], 08:57:10 INFO - 'tests': ['tsvgm']}}, 08:57:10 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 08:57:10 INFO - 'tests': ['tresize', 'tcanvasmark']}, 08:57:10 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 08:57:10 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 08:57:10 INFO - 'tests': ['dromaeo_css', 'kraken']}, 08:57:10 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 08:57:10 INFO - 'g1': {'pagesets_name': 'tp5n.zip', 08:57:10 INFO - 'talos_options': ['--disable-e10s'], 08:57:10 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 08:57:10 INFO - 'g1-e10s': {'pagesets_name': 'tp5n.zip', 08:57:10 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 08:57:10 INFO - 'g2': {'pagesets_name': 'tp5n.zip', 08:57:10 INFO - 'talos_options': ['--disable-e10s'], 08:57:10 INFO - 'tests': ['damp', 'tps']}, 08:57:10 INFO - 'g2-e10s': {'pagesets_name': 'tp5n.zip', 08:57:10 INFO - 'tests': ['damp', 'tps']}, 08:57:10 INFO - 'g3': {'talos_options': ['--disable-e10s'], 08:57:10 INFO - 'tests': ['dromaeo_dom']}, 08:57:10 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 08:57:10 INFO - 'g4': {'talos_options': ['--disable-e10s'], 08:57:10 INFO - 'tests': ['basic_compositor_video']}, 08:57:10 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 08:57:10 INFO - 'other': {'talos_options': ['--disable-e10s'], 08:57:10 INFO - 'tests': ['a11yr', 08:57:10 INFO - 'ts_paint', 08:57:10 INFO - 'tpaint', 08:57:10 INFO - 'sessionrestore', 08:57:10 INFO - 'sessionrestore_no_auto_restore', 08:57:10 INFO - 'tabpaint']}, 08:57:10 INFO - 'other-e10s': {'tests': ['a11yr', 08:57:10 INFO - 'ts_paint', 08:57:10 INFO - 'tpaint', 08:57:10 INFO - 'sessionrestore', 08:57:10 INFO - 'sessionrestore_no_auto_restore', 08:57:10 INFO - 'tabpaint']}, 08:57:10 INFO - 'other-e10s_l64': {'tests': ['a11yr', 08:57:10 INFO - 'ts_paint', 08:57:10 INFO - 'tpaint', 08:57:10 INFO - 'sessionrestore', 08:57:10 INFO - 'sessionrestore_no_auto_restore', 08:57:10 INFO - 'tabpaint']}, 08:57:10 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 08:57:10 INFO - 'ts_paint', 08:57:10 INFO - 'tpaint', 08:57:10 INFO - 'sessionrestore', 08:57:10 INFO - 'sessionrestore_no_auto_restore', 08:57:10 INFO - 'tabpaint']}, 08:57:10 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 08:57:10 INFO - 'tests': ['a11yr', 08:57:10 INFO - 'ts_paint', 08:57:10 INFO - 'tpaint', 08:57:10 INFO - 'sessionrestore', 08:57:10 INFO - 'sessionrestore_no_auto_restore', 08:57:10 INFO - 'tabpaint']}, 08:57:10 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 08:57:10 INFO - 'tests': ['a11yr', 08:57:10 INFO - 'ts_paint', 08:57:10 INFO - 'tpaint', 08:57:10 INFO - 'sessionrestore', 08:57:10 INFO - 'sessionrestore_no_auto_restore', 08:57:10 INFO - 'tabpaint']}, 08:57:10 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 08:57:10 INFO - 'tests': ['tsvgx', 08:57:10 INFO - 'tsvgr_opacity', 08:57:10 INFO - 'tart', 08:57:10 INFO - 'tscrollx', 08:57:10 INFO - 'cart', 08:57:10 INFO - 'tsvg_static']}, 08:57:10 INFO - 'svgr-e10s': {'tests': ['tsvgx', 08:57:10 INFO - 'tsvgr_opacity', 08:57:10 INFO - 'tart', 08:57:10 INFO - 'tscrollx', 08:57:10 INFO - 'cart', 08:57:10 INFO - 'tsvg_static']}, 08:57:10 INFO - 'tp5o': {'pagesets_name': 'tp5n.zip', 08:57:10 INFO - 'talos_options': ['--disable-e10s'], 08:57:10 INFO - 'tests': ['tp5o']}, 08:57:10 INFO - 'tp5o-e10s': {'pagesets_name': 'tp5n.zip', 'tests': ['tp5o']}, 08:57:10 INFO - 'xperf': {'pagesets_name': 'tp5n.zip', 08:57:10 INFO - 'talos_options': ['--disable-e10s', 08:57:10 INFO - '--xperf_path', 08:57:10 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 08:57:10 INFO - 'tests': ['tp5n']}, 08:57:10 INFO - 'xperf-e10s': {'pagesets_name': 'tp5n.zip', 08:57:10 INFO - 'talos_options': ['--xperf_path', 08:57:10 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 08:57:10 INFO - 'tests': ['tp5n']}}, 08:57:10 INFO - 'talos.zip': {'path': '', 08:57:10 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 08:57:10 INFO - Running post-action listener: _resource_record_post_action 08:57:10 INFO - [mozharness: 2017-03-23 15:57:10.325327Z] Finished populate-webroot step (success) 08:57:10 INFO - [mozharness: 2017-03-23 15:57:10.325500Z] Running create-virtualenv step. 08:57:10 INFO - Running pre-action listener: _resource_record_pre_action 08:57:10 INFO - Running main action method: create_virtualenv 08:57:10 INFO - Creating virtualenv /builds/slave/test/build/venv 08:57:10 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 08:57:10 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 08:57:10 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 08:57:10 INFO - Using real prefix '/usr' 08:57:10 INFO - New python executable in /builds/slave/test/build/venv/bin/python 08:57:10 INFO - Installing distribute.............................................................................................................................................................................................done. 08:57:12 INFO - Installing pip.................done. 08:57:12 INFO - Return code: 0 08:57:12 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 08:57:12 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 08:57:13 INFO - Reading from file tmpfile_stdout 08:57:13 INFO - Output received: 08:57:13 INFO - pip 1.5.5 from /builds/slave/test/build/venv/local/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg (python 2.7) 08:57:13 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 08:57:13 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:57:13 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:57:13 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:57:13 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:57:13 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:57:13 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:57:13 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 0x1a331f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b2ba80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1cd0b10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1cce290>, '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 0x1cceb90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1ccf040>, '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': '2c5dd2b0a310ecf02fd87158000001b4-1490284596.745172-725811385', '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 08:57:13 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 08:57:13 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 08:57:13 INFO - Using env: {'DISPLAY': ':0', 08:57:13 INFO - 'HOME': '/home/cltbld', 08:57:13 INFO - 'LANG': 'en_US.UTF-8', 08:57:13 INFO - 'LANGUAGE': 'en_US:en', 08:57:13 INFO - 'LOGNAME': 'cltbld', 08:57:13 INFO - 'MAIL': '/var/mail/cltbld', 08:57:13 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:57:13 INFO - 'MOZ_NO_REMOTE': '1', 08:57:13 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:57:13 INFO - 'NO_EM_RESTART': '1', 08:57:13 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:57:13 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:57:13 INFO - 'PWD': '/builds/slave/test', 08:57:13 INFO - 'SHELL': '/bin/bash', 08:57:13 INFO - 'SHLVL': '1', 08:57:13 INFO - 'TERM': 'linux', 08:57:13 INFO - 'TMOUT': '86400', 08:57:13 INFO - 'USER': 'cltbld', 08:57:13 INFO - 'XDG_SESSION_COOKIE': '2c5dd2b0a310ecf02fd87158000001b4-1490284596.745172-725811385', 08:57:13 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:57:13 INFO - '_': '/tools/buildbot/bin/python'} 08:57:13 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:57:13 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 08:57:13 INFO - Cleaning up... 08:57:13 INFO - Return code: 0 08:57:13 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 08:57:13 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:57:13 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:57:13 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:57:13 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:57:13 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:57:13 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:57:13 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1a331f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b2ba80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1cd0b10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1cce290>, '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 0x1cceb90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1ccf040>, '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': '2c5dd2b0a310ecf02fd87158000001b4-1490284596.745172-725811385', '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 08:57:13 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1'] in /builds/slave/test/build 08:57:13 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 08:57:13 INFO - Using env: {'DISPLAY': ':0', 08:57:13 INFO - 'HOME': '/home/cltbld', 08:57:13 INFO - 'LANG': 'en_US.UTF-8', 08:57:13 INFO - 'LANGUAGE': 'en_US:en', 08:57:13 INFO - 'LOGNAME': 'cltbld', 08:57:13 INFO - 'MAIL': '/var/mail/cltbld', 08:57:13 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:57:13 INFO - 'MOZ_NO_REMOTE': '1', 08:57:13 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:57:13 INFO - 'NO_EM_RESTART': '1', 08:57:13 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:57:13 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:57:13 INFO - 'PWD': '/builds/slave/test', 08:57:13 INFO - 'SHELL': '/bin/bash', 08:57:13 INFO - 'SHLVL': '1', 08:57:13 INFO - 'TERM': 'linux', 08:57:13 INFO - 'TMOUT': '86400', 08:57:13 INFO - 'USER': 'cltbld', 08:57:13 INFO - 'XDG_SESSION_COOKIE': '2c5dd2b0a310ecf02fd87158000001b4-1490284596.745172-725811385', 08:57:13 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:57:13 INFO - '_': '/tools/buildbot/bin/python'} 08:57:13 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:57:13 INFO - Downloading/unpacking psutil>=3.1.1 08:57:13 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:57:13 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:57:13 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:57:13 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:57:13 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:57:13 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:57:15 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 08:57:15 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 08:57:15 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 08:57:15 INFO - Installing collected packages: psutil 08:57:15 INFO - Running setup.py install for psutil 08:57:15 INFO - building 'psutil._psutil_linux' extension 08:57:15 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 08:57:15 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 08:57:15 INFO - building 'psutil._psutil_posix' extension 08:57:15 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 08:57:16 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 08:57:16 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 08:57:16 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 08:57:16 INFO - Successfully installed psutil 08:57:16 INFO - Cleaning up... 08:57:16 INFO - Return code: 0 08:57:16 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 08:57:16 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:57:16 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:57:16 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:57:16 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:57:16 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:57:16 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:57:16 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1a331f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b2ba80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1cd0b10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1cce290>, '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 0x1cceb90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1ccf040>, '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': '2c5dd2b0a310ecf02fd87158000001b4-1490284596.745172-725811385', '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 08:57:16 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3'] in /builds/slave/test/build 08:57:16 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.3 08:57:16 INFO - Using env: {'DISPLAY': ':0', 08:57:16 INFO - 'HOME': '/home/cltbld', 08:57:16 INFO - 'LANG': 'en_US.UTF-8', 08:57:16 INFO - 'LANGUAGE': 'en_US:en', 08:57:16 INFO - 'LOGNAME': 'cltbld', 08:57:16 INFO - 'MAIL': '/var/mail/cltbld', 08:57:16 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:57:16 INFO - 'MOZ_NO_REMOTE': '1', 08:57:16 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:57:16 INFO - 'NO_EM_RESTART': '1', 08:57:16 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:57:16 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:57:16 INFO - 'PWD': '/builds/slave/test', 08:57:16 INFO - 'SHELL': '/bin/bash', 08:57:16 INFO - 'SHLVL': '1', 08:57:16 INFO - 'TERM': 'linux', 08:57:16 INFO - 'TMOUT': '86400', 08:57:16 INFO - 'USER': 'cltbld', 08:57:16 INFO - 'XDG_SESSION_COOKIE': '2c5dd2b0a310ecf02fd87158000001b4-1490284596.745172-725811385', 08:57:16 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:57:16 INFO - '_': '/tools/buildbot/bin/python'} 08:57:16 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:57:16 INFO - Downloading/unpacking mozsystemmonitor==0.3 08:57:16 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 08:57:16 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 08:57:16 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 08:57:16 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 08:57:16 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 08:57:16 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 08:57:18 INFO - Downloading mozsystemmonitor-0.3.tar.gz 08:57:18 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 08:57:18 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 08:57:18 INFO - Installing collected packages: mozsystemmonitor 08:57:18 INFO - Running setup.py install for mozsystemmonitor 08:57:18 INFO - Successfully installed mozsystemmonitor 08:57:18 INFO - Cleaning up... 08:57:18 INFO - Return code: 0 08:57:18 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 08:57:18 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:57:18 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:57:18 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:57:18 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:57:18 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:57:18 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:57:18 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1a331f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b2ba80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1cd0b10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1cce290>, '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 0x1cceb90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1ccf040>, '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': '2c5dd2b0a310ecf02fd87158000001b4-1490284596.745172-725811385', '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 08:57:18 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1'] in /builds/slave/test/build 08:57:18 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema==2.5.1 08:57:18 INFO - Using env: {'DISPLAY': ':0', 08:57:18 INFO - 'HOME': '/home/cltbld', 08:57:18 INFO - 'LANG': 'en_US.UTF-8', 08:57:18 INFO - 'LANGUAGE': 'en_US:en', 08:57:18 INFO - 'LOGNAME': 'cltbld', 08:57:18 INFO - 'MAIL': '/var/mail/cltbld', 08:57:18 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:57:18 INFO - 'MOZ_NO_REMOTE': '1', 08:57:18 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:57:18 INFO - 'NO_EM_RESTART': '1', 08:57:18 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:57:18 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:57:18 INFO - 'PWD': '/builds/slave/test', 08:57:18 INFO - 'SHELL': '/bin/bash', 08:57:18 INFO - 'SHLVL': '1', 08:57:18 INFO - 'TERM': 'linux', 08:57:18 INFO - 'TMOUT': '86400', 08:57:18 INFO - 'USER': 'cltbld', 08:57:18 INFO - 'XDG_SESSION_COOKIE': '2c5dd2b0a310ecf02fd87158000001b4-1490284596.745172-725811385', 08:57:18 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:57:18 INFO - '_': '/tools/buildbot/bin/python'} 08:57:18 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:57:18 INFO - Downloading/unpacking jsonschema==2.5.1 08:57:18 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 08:57:18 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 08:57:18 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 08:57:18 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 08:57:18 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 08:57:18 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 08:57:20 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 08:57:20 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 08:57:20 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:57:20 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:57:20 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:57:20 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:57:20 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:57:20 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:57:21 INFO - Downloading functools32-3.2.3-2.tar.gz 08:57:21 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 08:57:21 INFO - warning: no files found matching '*.txt' 08:57:21 INFO - no previously-included directories found matching 'build' 08:57:21 INFO - no previously-included directories found matching 'dist' 08:57:21 INFO - no previously-included directories found matching '.git*' 08:57:21 INFO - Installing collected packages: jsonschema, functools32 08:57:21 INFO - Running setup.py install for functools32 08:57:21 INFO - warning: no files found matching '*.txt' 08:57:21 INFO - no previously-included directories found matching 'build' 08:57:21 INFO - no previously-included directories found matching 'dist' 08:57:21 INFO - no previously-included directories found matching '.git*' 08:57:21 INFO - Successfully installed jsonschema functools32 08:57:21 INFO - Cleaning up... 08:57:21 INFO - Return code: 0 08:57:21 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 08:57:21 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:57:21 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:57:21 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:57:21 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:57:21 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:57:21 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:57:21 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1a331f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b2ba80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1cd0b10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1cce290>, '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 0x1cceb90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1ccf040>, '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': '2c5dd2b0a310ecf02fd87158000001b4-1490284596.745172-725811385', '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 08:57:21 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2'] in /builds/slave/test/build 08:57:21 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub functools32==3.2.3-2 08:57:21 INFO - Using env: {'DISPLAY': ':0', 08:57:21 INFO - 'HOME': '/home/cltbld', 08:57:21 INFO - 'LANG': 'en_US.UTF-8', 08:57:21 INFO - 'LANGUAGE': 'en_US:en', 08:57:21 INFO - 'LOGNAME': 'cltbld', 08:57:21 INFO - 'MAIL': '/var/mail/cltbld', 08:57:21 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:57:21 INFO - 'MOZ_NO_REMOTE': '1', 08:57:21 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:57:21 INFO - 'NO_EM_RESTART': '1', 08:57:21 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:57:21 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:57:21 INFO - 'PWD': '/builds/slave/test', 08:57:21 INFO - 'SHELL': '/bin/bash', 08:57:21 INFO - 'SHLVL': '1', 08:57:21 INFO - 'TERM': 'linux', 08:57:21 INFO - 'TMOUT': '86400', 08:57:21 INFO - 'USER': 'cltbld', 08:57:21 INFO - 'XDG_SESSION_COOKIE': '2c5dd2b0a310ecf02fd87158000001b4-1490284596.745172-725811385', 08:57:21 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:57:21 INFO - '_': '/tools/buildbot/bin/python'} 08:57:21 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:57:21 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 08:57:21 INFO - Cleaning up... 08:57:21 INFO - Return code: 0 08:57:21 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 08:57:21 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:57:21 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:57:21 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:57:21 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:57:21 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:57:21 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:57:21 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x1a331f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b2ba80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1cd0b10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1cce290>, '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 0x1cceb90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1ccf040>, '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': '2c5dd2b0a310ecf02fd87158000001b4-1490284596.745172-725811385', '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 08:57:21 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 08:57:21 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 08:57:21 INFO - Using env: {'DISPLAY': ':0', 08:57:21 INFO - 'HOME': '/home/cltbld', 08:57:21 INFO - 'LANG': 'en_US.UTF-8', 08:57:21 INFO - 'LANGUAGE': 'en_US:en', 08:57:21 INFO - 'LOGNAME': 'cltbld', 08:57:21 INFO - 'MAIL': '/var/mail/cltbld', 08:57:21 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:57:21 INFO - 'MOZ_NO_REMOTE': '1', 08:57:21 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:57:21 INFO - 'NO_EM_RESTART': '1', 08:57:21 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:57:21 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:57:21 INFO - 'PWD': '/builds/slave/test', 08:57:21 INFO - 'SHELL': '/bin/bash', 08:57:21 INFO - 'SHLVL': '1', 08:57:21 INFO - 'TERM': 'linux', 08:57:21 INFO - 'TMOUT': '86400', 08:57:21 INFO - 'USER': 'cltbld', 08:57:21 INFO - 'XDG_SESSION_COOKIE': '2c5dd2b0a310ecf02fd87158000001b4-1490284596.745172-725811385', 08:57:21 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:57:21 INFO - '_': '/tools/buildbot/bin/python'} 08:57:21 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:57:21 INFO - Downloading/unpacking blobuploader==1.2.4 08:57:21 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 08:57:21 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 08:57:21 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 08:57:21 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 08:57:21 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 08:57:21 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 08:57:23 INFO - Downloading blobuploader-1.2.4.tar.gz 08:57:23 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 08:57:23 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 08:57:23 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:57:23 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:57:23 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:57:23 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:57:23 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:57:23 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:57:24 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 08:57:24 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 08:57:24 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:57:24 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:57:24 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:57:24 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:57:24 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:57:24 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:57:24 INFO - Downloading docopt-0.6.1.tar.gz 08:57:24 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 08:57:24 INFO - Installing collected packages: blobuploader, requests, docopt 08:57:24 INFO - Running setup.py install for blobuploader 08:57:24 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 08:57:24 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 08:57:24 INFO - Running setup.py install for requests 08:57:25 INFO - Running setup.py install for docopt 08:57:25 INFO - Successfully installed blobuploader requests docopt 08:57:25 INFO - Cleaning up... 08:57:25 INFO - Return code: 0 08:57:25 INFO - Installing None into virtualenv /builds/slave/test/build/venv 08:57:25 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:57:25 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:57:25 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:57:25 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:57:25 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:57:25 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:57:25 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 0x1a331f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b2ba80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1cd0b10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1cce290>, '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 0x1cceb90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1ccf040>, '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': '2c5dd2b0a310ecf02fd87158000001b4-1490284596.745172-725811385', '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 08:57:25 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 08:57:25 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 08:57:25 INFO - Using env: {'DISPLAY': ':0', 08:57:25 INFO - 'HOME': '/home/cltbld', 08:57:25 INFO - 'LANG': 'en_US.UTF-8', 08:57:25 INFO - 'LANGUAGE': 'en_US:en', 08:57:25 INFO - 'LOGNAME': 'cltbld', 08:57:25 INFO - 'MAIL': '/var/mail/cltbld', 08:57:25 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:57:25 INFO - 'MOZ_NO_REMOTE': '1', 08:57:25 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:57:25 INFO - 'NO_EM_RESTART': '1', 08:57:25 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:57:25 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:57:25 INFO - 'PWD': '/builds/slave/test', 08:57:25 INFO - 'SHELL': '/bin/bash', 08:57:25 INFO - 'SHLVL': '1', 08:57:25 INFO - 'TERM': 'linux', 08:57:25 INFO - 'TMOUT': '86400', 08:57:25 INFO - 'USER': 'cltbld', 08:57:25 INFO - 'XDG_SESSION_COOKIE': '2c5dd2b0a310ecf02fd87158000001b4-1490284596.745172-725811385', 08:57:25 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:57:25 INFO - '_': '/tools/buildbot/bin/python'} 08:57:25 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:57:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 08:57:25 INFO - Running setup.py (path:/tmp/pip-XfkS0C-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 08:57:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 08:57:25 INFO - Running setup.py (path:/tmp/pip-wMUefB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 08:57:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 08:57:25 INFO - Running setup.py (path:/tmp/pip-lY2sd8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 08:57:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 08:57:25 INFO - Running setup.py (path:/tmp/pip-zmQbfH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 08:57:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 08:57:25 INFO - Running setup.py (path:/tmp/pip-e8LE7m-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 08:57:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 08:57:25 INFO - Running setup.py (path:/tmp/pip-w0K0ap-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 08:57:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 08:57:25 INFO - Running setup.py (path:/tmp/pip-LMfNuR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 08:57:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 08:57:25 INFO - Running setup.py (path:/tmp/pip-CL3eIb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 08:57:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 08:57:26 INFO - Running setup.py (path:/tmp/pip-vabYH1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 08:57:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 08:57:26 INFO - Running setup.py (path:/tmp/pip-lHIz3b-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 08:57:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 08:57:26 INFO - Running setup.py (path:/tmp/pip-23C5h7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 08:57:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 08:57:26 INFO - Running setup.py (path:/tmp/pip-tybR1f-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 08:57:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 08:57:26 INFO - Running setup.py (path:/tmp/pip-Af2quH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 08:57:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 08:57:26 INFO - Running setup.py (path:/tmp/pip-RwT5mM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 08:57:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 08:57:26 INFO - Running setup.py (path:/tmp/pip-uIJlWi-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 08:57:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 08:57:26 INFO - Running setup.py (path:/tmp/pip-2Xwp_5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 08:57:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 08:57:26 INFO - Running setup.py (path:/tmp/pip-N2Udfi-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 08:57:26 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 08:57:26 INFO - Running setup.py install for manifestparser 08:57:26 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 08:57:26 INFO - Running setup.py install for mozcrash 08:57:26 INFO - Running setup.py install for mozdebug 08:57:26 INFO - Running setup.py install for mozdevice 08:57:27 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 08:57:27 INFO - Installing dm script to /builds/slave/test/build/venv/bin 08:57:27 INFO - Running setup.py install for mozfile 08:57:27 INFO - Running setup.py install for mozhttpd 08:57:27 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 08:57:27 INFO - Running setup.py install for mozinfo 08:57:27 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 08:57:27 INFO - Running setup.py install for mozInstall 08:57:27 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 08:57:27 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 08:57:27 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 08:57:27 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 08:57:27 INFO - Running setup.py install for mozleak 08:57:27 INFO - Running setup.py install for mozlog 08:57:27 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 08:57:27 INFO - Running setup.py install for moznetwork 08:57:27 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 08:57:27 INFO - Running setup.py install for mozprocess 08:57:27 INFO - Running setup.py install for mozprofile 08:57:28 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 08:57:28 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 08:57:28 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 08:57:28 INFO - Running setup.py install for mozrunner 08:57:28 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 08:57:28 INFO - Running setup.py install for mozscreenshot 08:57:28 INFO - Running setup.py install for moztest 08:57:28 INFO - Running setup.py install for mozversion 08:57:28 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 08:57:28 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 08:57:28 INFO - Cleaning up... 08:57:28 INFO - Return code: 0 08:57:28 INFO - Installing None into virtualenv /builds/slave/test/build/venv 08:57:28 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:57:28 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:57:28 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:57:28 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:57:28 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:57:28 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:57:28 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 0x1a331f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b2ba80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1cd0b10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1cce290>, '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 0x1cceb90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1ccf040>, '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': '2c5dd2b0a310ecf02fd87158000001b4-1490284596.745172-725811385', '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 08:57:28 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 08:57:28 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 08:57:28 INFO - Using env: {'DISPLAY': ':0', 08:57:28 INFO - 'HOME': '/home/cltbld', 08:57:28 INFO - 'LANG': 'en_US.UTF-8', 08:57:28 INFO - 'LANGUAGE': 'en_US:en', 08:57:28 INFO - 'LOGNAME': 'cltbld', 08:57:28 INFO - 'MAIL': '/var/mail/cltbld', 08:57:28 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:57:28 INFO - 'MOZ_NO_REMOTE': '1', 08:57:28 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:57:28 INFO - 'NO_EM_RESTART': '1', 08:57:28 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:57:28 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:57:28 INFO - 'PWD': '/builds/slave/test', 08:57:28 INFO - 'SHELL': '/bin/bash', 08:57:28 INFO - 'SHLVL': '1', 08:57:28 INFO - 'TERM': 'linux', 08:57:28 INFO - 'TMOUT': '86400', 08:57:28 INFO - 'USER': 'cltbld', 08:57:28 INFO - 'XDG_SESSION_COOKIE': '2c5dd2b0a310ecf02fd87158000001b4-1490284596.745172-725811385', 08:57:28 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:57:28 INFO - '_': '/tools/buildbot/bin/python'} 08:57:28 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:57:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 08:57:28 INFO - Running setup.py (path:/tmp/pip-cjevTp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 08:57:28 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)) 08:57:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 08:57:28 INFO - Running setup.py (path:/tmp/pip-ApE4aN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 08:57:28 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==1.0 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)) 08:57:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 08:57:28 INFO - Running setup.py (path:/tmp/pip-bxvHAP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 08:57:28 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)) 08:57:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 08:57:28 INFO - Running setup.py (path:/tmp/pip-irrnqw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 08:57:29 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.49 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)) 08:57:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 08:57:29 INFO - Running setup.py (path:/tmp/pip-HGT6bX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 08:57:29 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)) 08:57:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 08:57:29 INFO - Running setup.py (path:/tmp/pip-51d1LV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 08:57:29 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)) 08:57:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 08:57:29 INFO - Running setup.py (path:/tmp/pip-JCBeXX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 08:57:29 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)) 08:57:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 08:57:29 INFO - Running setup.py (path:/tmp/pip-fM8rSP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 08:57:29 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)) 08:57:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 08:57:29 INFO - Running setup.py (path:/tmp/pip-uyVyqQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 08:57:29 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)) 08:57:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 08:57:29 INFO - Running setup.py (path:/tmp/pip-FJyCgZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 08:57:29 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.4 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)) 08:57:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 08:57:29 INFO - Running setup.py (path:/tmp/pip-0Rbpxk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 08:57:29 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)) 08:57:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 08:57:29 INFO - Running setup.py (path:/tmp/pip-6jq298-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 08:57:29 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.25 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)) 08:57:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 08:57:29 INFO - Running setup.py (path:/tmp/pip-NFoIe4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 08:57:29 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)) 08:57:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 08:57:29 INFO - Running setup.py (path:/tmp/pip-nAR9FV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 08:57:29 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.13 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)) 08:57:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 08:57:29 INFO - Running setup.py (path:/tmp/pip-9eSixo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 08:57:29 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)) 08:57:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 08:57:29 INFO - Running setup.py (path:/tmp/pip-3_yA9c-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 08:57:29 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.8 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)) 08:57:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 08:57:29 INFO - Running setup.py (path:/tmp/pip-44xqwY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 08:57:29 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)) 08:57:29 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 08:57:29 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 08:57:30 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)) 08:57:30 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.49->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 08:57:30 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.49->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 08:57:30 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 08:57:30 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 08:57:30 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 08:57:30 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 08:57:30 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 08:57:30 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 08:57:30 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 08:57:32 INFO - Downloading blessings-1.6.tar.gz 08:57:32 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 08:57:32 INFO - Installing collected packages: blessings 08:57:32 INFO - Running setup.py install for blessings 08:57:32 INFO - Successfully installed blessings 08:57:32 INFO - Cleaning up... 08:57:32 INFO - Return code: 0 08:57:32 INFO - Done creating virtualenv /builds/slave/test/build/venv. 08:57:32 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 08:57:32 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 08:57:32 INFO - Reading from file tmpfile_stdout 08:57:32 INFO - Current package versions: 08:57:32 INFO - argparse == 1.2.1 08:57:32 INFO - blessings == 1.6 08:57:32 INFO - blobuploader == 1.2.4 08:57:32 INFO - docopt == 0.6.1 08:57:32 INFO - functools32 == 3.2.3-2 08:57:32 INFO - jsonschema == 2.5.1 08:57:32 INFO - manifestparser == 1.1 08:57:32 INFO - mozInstall == 1.12 08:57:32 INFO - mozcrash == 1.0 08:57:32 INFO - mozdebug == 0.1 08:57:32 INFO - mozdevice == 0.49 08:57:32 INFO - mozfile == 1.2 08:57:32 INFO - mozhttpd == 0.7 08:57:32 INFO - mozinfo == 0.9 08:57:32 INFO - mozleak == 0.1 08:57:32 INFO - mozlog == 3.4 08:57:32 INFO - moznetwork == 0.27 08:57:32 INFO - mozprocess == 0.25 08:57:32 INFO - mozprofile == 0.28 08:57:32 INFO - mozrunner == 6.13 08:57:32 INFO - mozscreenshot == 0.1 08:57:32 INFO - mozsystemmonitor == 0.3 08:57:32 INFO - moztest == 0.8 08:57:32 INFO - mozversion == 1.4 08:57:32 INFO - psutil == 3.1.1 08:57:32 INFO - requests == 1.2.3 08:57:32 INFO - wsgiref == 0.1.2 08:57:32 INFO - Installing None into virtualenv /builds/slave/test/build/venv 08:57:32 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:57:32 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:57:32 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:57:32 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:57:32 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:57:32 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:57:32 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 0x1a331f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b2ba80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1cd0b10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1cce290>, '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 0x1cceb90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1ccf040>, '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': '2c5dd2b0a310ecf02fd87158000001b4-1490284596.745172-725811385', '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 08:57:32 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 08:57:32 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 08:57:32 INFO - Using env: {'DISPLAY': ':0', 08:57:32 INFO - 'HOME': '/home/cltbld', 08:57:32 INFO - 'LANG': 'en_US.UTF-8', 08:57:32 INFO - 'LANGUAGE': 'en_US:en', 08:57:32 INFO - 'LOGNAME': 'cltbld', 08:57:32 INFO - 'MAIL': '/var/mail/cltbld', 08:57:32 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:57:32 INFO - 'MOZ_NO_REMOTE': '1', 08:57:32 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:57:32 INFO - 'NO_EM_RESTART': '1', 08:57:32 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:57:32 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:57:32 INFO - 'PWD': '/builds/slave/test', 08:57:32 INFO - 'SHELL': '/bin/bash', 08:57:32 INFO - 'SHLVL': '1', 08:57:32 INFO - 'TERM': 'linux', 08:57:32 INFO - 'TMOUT': '86400', 08:57:32 INFO - 'USER': 'cltbld', 08:57:32 INFO - 'XDG_SESSION_COOKIE': '2c5dd2b0a310ecf02fd87158000001b4-1490284596.745172-725811385', 08:57:32 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:57:32 INFO - '_': '/tools/buildbot/bin/python'} 08:57:32 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:57:32 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)) 08:57:32 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)) 08:57:32 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)) 08:57:32 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)) 08:57:32 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)) 08:57:32 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)) 08:57:32 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)) 08:57:32 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)) 08:57:32 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)) 08:57:32 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)) 08:57:32 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)) 08:57:32 INFO - Cleaning up... 08:57:32 INFO - Return code: 0 08:57:32 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 08:57:32 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:57:32 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:57:32 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:57:32 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:57:32 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:57:32 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:57:32 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 0x1a331f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b2ba80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1cd0b10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1cce290>, '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 0x1cceb90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1ccf040>, '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': '2c5dd2b0a310ecf02fd87158000001b4-1490284596.745172-725811385', '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 08:57:32 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 08:57:32 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 08:57:32 INFO - Using env: {'DISPLAY': ':0', 08:57:32 INFO - 'HOME': '/home/cltbld', 08:57:32 INFO - 'LANG': 'en_US.UTF-8', 08:57:32 INFO - 'LANGUAGE': 'en_US:en', 08:57:32 INFO - 'LOGNAME': 'cltbld', 08:57:32 INFO - 'MAIL': '/var/mail/cltbld', 08:57:32 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:57:32 INFO - 'MOZ_NO_REMOTE': '1', 08:57:32 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:57:32 INFO - 'NO_EM_RESTART': '1', 08:57:32 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:57:32 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:57:32 INFO - 'PWD': '/builds/slave/test', 08:57:32 INFO - 'SHELL': '/bin/bash', 08:57:32 INFO - 'SHLVL': '1', 08:57:32 INFO - 'TERM': 'linux', 08:57:32 INFO - 'TMOUT': '86400', 08:57:32 INFO - 'USER': 'cltbld', 08:57:32 INFO - 'XDG_SESSION_COOKIE': '2c5dd2b0a310ecf02fd87158000001b4-1490284596.745172-725811385', 08:57:32 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:57:32 INFO - '_': '/tools/buildbot/bin/python'} 08:57:32 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:57:32 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 08:57:32 INFO - Cleaning up... 08:57:32 INFO - Return code: 0 08:57:32 INFO - Running post-action listener: _resource_record_post_action 08:57:32 INFO - Running post-action listener: _start_resource_monitoring 08:57:32 INFO - Starting resource monitoring. 08:57:32 INFO - [mozharness: 2017-03-23 15:57:32.991317Z] Finished create-virtualenv step (success) 08:57:32 INFO - [mozharness: 2017-03-23 15:57:32.991782Z] Running install step. 08:57:32 INFO - Running pre-action listener: _resource_record_pre_action 08:57:32 INFO - Running main action method: install 08:57:32 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 08:57:32 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 08:57:33 INFO - Reading from file tmpfile_stdout 08:57:33 INFO - Detecting whether we're running mozinstall >=1.0... 08:57:33 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 08:57:33 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 08:57:33 INFO - Reading from file tmpfile_stdout 08:57:33 INFO - Output received: 08:57:33 INFO - Usage: mozinstall [options] installer 08:57:33 INFO - Options: 08:57:33 INFO - -h, --help show this help message and exit 08:57:33 INFO - -d DEST, --destination=DEST 08:57:33 INFO - Directory to install application into. [default: 08:57:33 INFO - "/builds/slave/test"] 08:57:33 INFO - --app=APP Application being installed. [default: firefox] 08:57:33 INFO - mkdir: /builds/slave/test/build/application 08:57:33 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/target.tar.bz2', '--destination', '/builds/slave/test/build/application'] 08:57:33 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/target.tar.bz2 --destination /builds/slave/test/build/application 08:57:49 INFO - Reading from file tmpfile_stdout 08:57:49 INFO - Output received: 08:57:49 INFO - /builds/slave/test/build/application/firefox/firefox 08:57:49 INFO - Running post-action listener: _resource_record_post_action 08:57:49 INFO - [mozharness: 2017-03-23 15:57:49.971134Z] Finished install step (success) 08:57:49 INFO - [mozharness: 2017-03-23 15:57:49.971409Z] Running run-tests step. 08:57:49 INFO - Running pre-action listener: _resource_record_pre_action 08:57:49 INFO - Running main action method: run_tests 08:57:49 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 08:57:49 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 08:57:49 INFO - Python 2.7.3 08:57:49 INFO - Return code: 0 08:57:49 INFO - grabbing minidump binary from tooltool 08:57:49 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:57:49 INFO - retry: Calling run_command with args: (['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'],), kwargs: {'output_timeout': 600, 'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1cce290>, '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 0x1cceb90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1ccf040>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 08:57:49 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 08:57:49 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 08:57:49 INFO - Calling ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] with output_timeout 600 08:57:50 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 08:57:50 INFO - Return code: 0 08:57:50 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 08:57:50 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 08:57:50 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 08:57:50 INFO - ENV: RUST_BACKTRACE is now 1 08:57:50 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 08:57:50 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 08:57:50 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Aurora', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/dywW6IdcSMqTUQR9vFXpeQ/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-012', '--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 08:57:50 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Mozilla-Aurora --suite dromaeojs --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/dywW6IdcSMqTUQR9vFXpeQ/artifacts/public/build/target.crashreporter-symbols.zip --title talos-linux64-ix-012 --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 08:57:50 INFO - Using env: {'DISPLAY': ':0', 08:57:50 INFO - 'HOME': '/home/cltbld', 08:57:50 INFO - 'LANG': 'en_US.UTF-8', 08:57:50 INFO - 'LANGUAGE': 'en_US:en', 08:57:50 INFO - 'LOGNAME': 'cltbld', 08:57:50 INFO - 'MAIL': '/var/mail/cltbld', 08:57:50 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 08:57:50 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 08:57:50 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:57:50 INFO - 'MOZ_NO_REMOTE': '1', 08:57:50 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 08:57:50 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:57:50 INFO - 'NO_EM_RESTART': '1', 08:57:50 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:57:50 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:57:50 INFO - 'PWD': '/builds/slave/test', 08:57:50 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 08:57:50 INFO - 'RUST_BACKTRACE': '1', 08:57:50 INFO - 'SHELL': '/bin/bash', 08:57:50 INFO - 'SHLVL': '1', 08:57:50 INFO - 'TERM': 'linux', 08:57:50 INFO - 'TMOUT': '86400', 08:57:50 INFO - 'USER': 'cltbld', 08:57:50 INFO - 'XDG_SESSION_COOKIE': '2c5dd2b0a310ecf02fd87158000001b4-1490284596.745172-725811385', 08:57:50 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:57:50 INFO - '_': '/tools/buildbot/bin/python'} 08:57:50 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Aurora', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/dywW6IdcSMqTUQR9vFXpeQ/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-012', '--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 08:57:50 INFO - mozversion application_buildid: 20170323150154 08:57:50 INFO - mozversion application_changeset: 786d0d85a2c3df3348cf7deaf6d2e69e8e52c9d7 08:57:50 INFO - mozversion application_display_name: FirefoxDeveloperEdition 08:57:50 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 08:57:50 INFO - mozversion application_name: Firefox 08:57:50 INFO - mozversion application_remotingname: firefox-dev 08:57:50 INFO - mozversion application_repository: https://hg.mozilla.org/releases/mozilla-aurora 08:57:50 INFO - mozversion application_vendor: Mozilla 08:57:50 INFO - mozversion application_version: 54.0a2 08:57:50 INFO - mozversion platform_buildid: 20170323150154 08:57:50 INFO - mozversion platform_changeset: 786d0d85a2c3df3348cf7deaf6d2e69e8e52c9d7 08:57:50 INFO - mozversion platform_repository: https://hg.mozilla.org/releases/mozilla-aurora 08:57:50 INFO - mozversion platform_version: 54.0a2 08:57:50 INFO - using testdate: 1490284670 08:57:50 INFO - actual date: 1490284670 08:57:50 INFO - starting webserver on 'localhost:54257' 08:57:50 INFO - SUITE-START | Running 2 tests 08:57:50 INFO - TEST-START | dromaeo_css 08:57:50 INFO - operating with platform_type : linux_ 08:57:50 INFO - Initialising browser for dromaeo_css test... 08:57:50 INFO - TEST-INFO | started process 26287 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpFllJaZ/profile http://localhost:54257/getInfo.html) 08:57:53 INFO - PROCESS | 26287 | __metrics Screen width/height:1600/1200 08:57:53 INFO - PROCESS | 26287 | colorDepth:24 08:57:53 INFO - PROCESS | 26287 | Browser inner width/height: 1024/697 08:57:53 INFO - PROCESS | 26287 | __metrics 08:57:54 INFO - PROCESS | 26287 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 692: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 08:57:54 INFO - PROCESS | 26287 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 303: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 08:57:55 INFO - TEST-INFO | 26287: exit 0 08:57:55 INFO - Browser initialized. 08:57:55 INFO - Running cycle 1/1 for dromaeo_css test... 08:57:55 INFO - TEST-INFO | started process 26376 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpFllJaZ/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 08:58:07 INFO - PROCESS | 26376 | RSS: Main: 139276288 08:58:07 INFO - PROCESS | 26376 | 09:01:08 INFO - PROCESS | 26376 | Cycle 1(1): loaded http://localhost:54257/tests/dromaeo/cssquery-dojo.html (next: http://localhost:54257/tests/dromaeo/cssquery-ext.html) 09:01:10 INFO - PROCESS | 26376 | RSS: Main: 280289280 09:01:10 INFO - PROCESS | 26376 | 09:02:57 INFO - PROCESS | 26376 | ************************* 09:02:57 INFO - PROCESS | 26376 | A coding exception was thrown and uncaught in a Task. 09:02:57 INFO - PROCESS | 26376 | 09:02:57 ERROR - PROCESS | 26376 | Full message: TypeError: NetworkError when attempting to fetch resource. 09:02:57 INFO - PROCESS | 26376 | Full stack: 09:02:57 INFO - PROCESS | 26376 | ************************* 09:04:12 INFO - PROCESS | 26376 | Cycle 1(1): loaded http://localhost:54257/tests/dromaeo/cssquery-ext.html (next: http://localhost:54257/tests/dromaeo/cssquery-jquery.html) 09:04:12 INFO - PROCESS | 26376 | RSS: Main: 231747584 09:04:12 INFO - PROCESS | 26376 | 09:07:14 INFO - PROCESS | 26376 | Cycle 1(1): loaded http://localhost:54257/tests/dromaeo/cssquery-jquery.html (next: http://localhost:54257/tests/dromaeo/cssquery-mootools.html) 09:07:15 INFO - PROCESS | 26376 | RSS: Main: 191287296 09:07:15 INFO - PROCESS | 26376 | 09:10:17 INFO - PROCESS | 26376 | Cycle 1(1): loaded http://localhost:54257/tests/dromaeo/cssquery-mootools.html (next: http://localhost:54257/tests/dromaeo/cssquery-prototype.html) 09:10:17 INFO - PROCESS | 26376 | RSS: Main: 171073536 09:10:17 INFO - PROCESS | 26376 | 09:13:20 INFO - PROCESS | 26376 | Cycle 1(1): loaded http://localhost:54257/tests/dromaeo/cssquery-prototype.html (next: http://localhost:54257/tests/dromaeo/cssquery-yui.html) 09:13:21 INFO - PROCESS | 26376 | RSS: Main: 177766400 09:13:21 INFO - PROCESS | 26376 | 09:16:23 INFO - PROCESS | 26376 | Cycle 1(1): loaded http://localhost:54257/tests/dromaeo/cssquery-yui.html (next: http://localhost:54257/tests/dromaeo/cssquery-dojo.html) 09:16:24 INFO - PROCESS | 26376 | RSS: Main: 263094272 09:16:24 INFO - PROCESS | 26376 | 09:16:24 INFO - PROCESS | 26376 | __start_tp_report 09:16:24 INFO - PROCESS | 26376 | _x_x_mozilla_page_load 09:16:24 INFO - PROCESS | 26376 | _x_x_mozilla_page_load_details 09:16:24 INFO - PROCESS | 26376 | |i|pagename|runs| 09:16:24 INFO - PROCESS | 26376 | |0;dojo.html;3374.2576633140707;3400.67693569111;3413.300273443944;3419.487076938459;3424.8184376390136;5746.913796293059;5785.710714464281;5787.305523337205;5820.767169313228;5835.153902684114;5797.4202579742005;5846.386129456409;5850.970745146279;5853.5317174625925;5860.941390586093;5253.8949221015555;5261.973690131544;5274.868128296785;5347.839564813062;5356.116240820279;5215.687058776467;5375.6774593524315;5377.677339359651;5383.084875571162;5391.703456309901;5243.056249875021;5264.8157314494;5301.20481927712;5378.946210537903;5384.246205531209;5365.543928766059;5399.919001214985;5400.270963419947;5400.945990540084;5404.891902161935;5323.866903327409;5330.973345133289;5334.27987221724;5375.6774593524515;5400.135978243462;5652.802151924663;5691.886162276773;5713.14302854571;5793.681347525884;5806.709664516799;6319.74721011159;6323.114763933053;6327.145835312266;6329.556931014831;6338.556301058928;6338.239411270677;6348.746050157988;6350.872982540323;6362.0774987627;6362.395572420613;5697.886042279131;5735.4551317624755;5835.737391817378;5850.882982340329;5874.383189765099;6298.086777417248;6330.556861019776;6335.1447554579545;6354.110424540568;6356.078368636522;6175.96912015446;6208.81373558794;6230.532710046674;6232.220972378453;6247.219097612799;6016.488598469092;6062.302835173923;6111.387369467926;6242.563020588606;6252.062190671345;6142.232220972379;6157.384261573897;6237.157983672237;6239.500839932794;6245.156903817927;6055.818325450244;6103.450689437972;6116.204893363834;6236.532260080512;6243.687815609202;4708.552687494683;4712.52874712526;4730.5032971538185;4737.478877323491;4797.208460603962;4165.854195103157;4273.444452221192;4282.443282373271;4292.957070429318;4328.935065974013;5903.409659034062;5982.670953097621;6030;6050.606710563799;6113.388661133851;6276.623402595859;6359.904601430982;6361.427471527585;6366.649834259068;6369.108324834527;6067.969660151671;6072.332043475214;6084.056971169476;6087.604305720114;6091.451769340781;5171.818986335536;5212.087884620177;5217.034848553029;5247.134222853263;5255.605829562798;6454;6460.612363258314;6461.61230326182;6464.418202361716;6474.320196379406;6193.81418557444;6234.189555357956;6258.311585725658;6280.246370435577;6281.340459251713;6161.260648722182;6229.470495007975;6392.616443013434;6437.742490300336;6459.418652321314;6257.186565746424;6263.498920086473;6267.498600111889;6270.623762574261;6272.686365681607;6274.874502509833;6281.152044473937;6283.497320214463;6284.277308109626;6291.528135389773;5852.882942341214;5932.2584676915385;6069.696515174312;6133.89589873827;6188.659623720739;6122.825106970275;6123.295820980644;6148.200733904564;6149.600275982047;6156.045812899008;6147.508199344131;6148.016317389196;6151.507879369729;6158.3841615838055;6159.784407545714;5940.732667029907;5946.524278057658;6008.87982240344;6085.3306136325855;6179.412955769195;6037.728302226498;6040.305364883095;6040.6677632730625;6072.605280656743;6073.028315469681 09:16:24 INFO - PROCESS | 26376 | |1;ext.html;696.6133795743364;751.2975368030892;770.5684816502759;840.7687885831399;849.4139044059602;31916.99999999997;43551.346729799036;44109.558904410944;44170;44219.3367099493;46872.765636171855;47073.764631176884;47196.528034719646;47234;47246.291305630446;7777.611119444005;7944.523328600274;9242.075792420772;9386.718398448058;9390.812183756321;10605.045545900868;10833.783324333508;10833.970772776613;10837.458127093652;10841.783164336708;10938.56245750169;10982.450877456135;10984.176186786022;10987.121030317556;10994.065504432092;10841.945790271076;10921.563137474492;10923.836142457869;10940.945295273512;10955.780884382348;10616.203784716177;10665.253432259746;10666.36001839892;10676.359418434919;10678.412687302196;43060.13879722388;43096;43177.56822431767;43336;43343;4094.754314741125;4111.054457474767;4145.709800313979;4219.578042195756;4267.210566045292;29881.70118298811;30039.249018774488;30334.848325758452;30680.69319306823;31353.216169595715;4358.150160718661;4433.911321773547;4441.133978874121;4453.309736990772;4534.478534968488;229144;230920;231618;232340;232347.8382608093;54996.175057374174;55047.72476137674;55050.44949550533;55052.72473637686;55094.449055509736;56129.43870561242;56451;56484;56604;56668.14997775036;16492.83507164913;16730.49808505747;16738.74891876623;16741.49775506737;16774.83225167757;12962.092653514352;13200.933995329962;14884.10695358282;14924;14926.552203433914;13118.672033199246;13444.663883402993;13847.653808654864;13851.792223116661;13895.305234738222;5298;5373;5378.112611419072;5387.427338646845;5416.187571864173;1023.8668973033607;1024.08856118055;1031.8761748590218;1034.798214348195;1038.3717850700218;29426.852865735535;29670.258243543652;29689.703102969124;29758.85120574383;30028.69971300303;1085.267444474992;1089.553283153919;1112.866456025282;1115.4367044642404;1130.9434528273553;14461.349239284258;15497.690046199014;15568.532944011698;15571.299291531908;15711;292929;293607;294177;294330;295767;57968;58047;58149.4185058144;58166.12750808741;58350;1504.0900255345578;1522.1628104542458;1539.8999065060734;1546.9458568950033;1554.2228885557222;26347.604785927844;26731.732682672926;27866;27932.301692457037;28026.719732802412;41787;42005.36991945062;42009.78995105005;42060;42063;261856;261919;262457;262528;264579;35280.29439411249;35475.64524354723;35667.46498802572;35891.820540897126;36007.63992360043;43771.56228437675;44416.333754994346;44501;45422.31866522071;45457.77271113623;36860;36920.63079369172;36978.63021369752;37122.07194820151;37152.25695486021;36614;36867;37042;37056.814715926244;37823.62176378201;38540;39066.609333907436;39124.217515650096;39429.408558872216;39969.60030399659;31158.22104447407;32722.181945451553;32791;32877;33261.50107748337;25385.365365866;25557.23328300154;25756.87121564455;25858.87070564635;26240 09:16:24 INFO - PROCESS | 26376 | |2;jquery.html;425.25367979196506;471.97404142772155;485.9562639362459;488.1920421702082;496.0921513630057;17790;18723.71914421283;19793.60412791743;20722.585548289026;20796;14863.405463781435;20486.975651217417;22175.223867164652;22183.334499965025;22670.43323916903;6691.3308669133185;6940.097787287646;6953.096097507317;6955.513114082017;7264.38252748517;7512.43656725745;7571.432142589328;7582.090149182106;7594.5822979736095;7624.885626715603;7441.962790186041;7574.621268936558;7578.393728501735;7598.962005189994;7599.278068583476;7446.7765967020805;7587.393008559302;7617.5810330431805;7632.580208088553;7649.732259370923;7238.203797582261;7430.442716796208;7441.55350678961;7443.2556744325675;7449.627518624101;25410.618840717405;25441.363965900815;25937.092201772848;26024.479510409874;26096.217113486626;3147.1817327494787;3198.632157301917;3240.0279916025097;3303.933921321584;3461.7922924624604;15413.614659633487;15869.127198004106;16198.271077801528;16593.253303601366;16634;2135.882526461044;2229.955400891973;2249.955000899989;2295.5867943770113;2308.0652335804025;105785.99999999923;126031;129542;130465;131795.34102329522;17198.82801171972;18021.7296740549;18318.816811831977;18568.25726970933;18810.435686929413;31492.842535787633;31730.524042138924;31784.523232151536;31805.840970794998;32068.518972215435;8934.106589341014;9392.29557783169;10085.949570252102;10410.271281010257;10504.527296271686;8854.911450885409;8876;8890.86663700045;9091.863622045674;9094;9053.411528250774;9211.124943130391;9275.67535136267;9337.159655631025;9428.481433521085;3423.8288085595623;3547.0954906498678;3688.723345749026;3726.6832319252626;3823.655870971626;970.1801977329145;971.9514024298757;974.878140232471;981.2787601113176;1000.049952545085;20784.792152078284;20968.370948871558;21146.47133821636;21167.470813229484;21365.893170534047;981.5779214937503;986.4032260482448;986.5659109991581;992.3301771304341;996.6013594562088;10594.4702764863;11383.772324553462;11447.656570302905;11490.368029758443;11547.191696581158;635078;635502;637767;681328;685450;78029.6098519515;81535.73857045652;96155.51922240344;113236;115200;1281.6988007818156;1299.564645843634;1328.926874076444;1332.5336132353793;1334.4928927007868;17865.821341786417;18175.18211680451;18437.455134139873;18513.35203267879;18587.34944276944;37060.44409333808;44004.559954401324;50894.745526272134;51294.48705512897;51331;62059.6897015512;67138.66430667815;70913;71580.64209679127;72298;11184.328940263611;11549.595764148215;11659.533618655498;11724.593048834195;11819.822702659296;12980.415881285177;13005.349732513525;13052.5431609897;13053.608391748263;13132.540361087316;11411.486483108114;11585.6524304271;11689.657922015802;11890.881091188978;11925;11050.447477626247;11158.665240042812;11251.606193783178;11352.659420217407;11398.487068082122;11621.883781162418;11724.941375293069;11987.100967427652;12131.878681213075;12643.431045602785;11875.049996000127;12078;12317.876821231674;12433.502659893504;12681.23912565249;11763.764724705628;11929.463174157358;11983.700407489883;12008.219465734699;12201.08491863096 09:16:24 INFO - PROCESS | 26376 | |3;mootools.html;1564.8904576679622;1569.152657564915;1589.8251192368841;1592.4904030710177;1604.895681780684;10911.618093366733;11651.533938642444;11664.183507154492;11684.240524365921;11699.239549429281;11269.26749761265;11494.252873563213;11496.540138394454;11505.137114716408;11505.654830355083;2395.9760402396014;2427.927162185137;2428.2472433545568;2432.501337225873;2433.6836211292507;2327.522857814144;2352.329586067971;2360.657704632827;2361.4332560185603;2363.3737059679197;2229.9108035678555;2242.125571027301;2251.0545570860277;2259.7401298850596;2262.6266666000174;2217.9556408871895;2241;2245.7529671736097;2246.86518808872;2248.921287754929;2234.65362868754;2318.9796489544715;2318.988405057981;2319.7216334039854;2321.2339927823778;11448.198626096177;11506.712332191679;11519.827202591969;11530.250533715282;11533.826992595117;5708.628939118986;5852.180694702745;5867.471927526543;5867.677277749722;5867.882642347129;3187.5218717192374;3384.2554637979606;3413.74396920232;3432.5880894292595;3437.1922598189403;1303.8109474126293;1321.914075585084;1346;1399.132537826554;1407.7466056109897;15210.923945380313;15559.766603500957;16496.7525487119;17734.55663608407;17899.19453624577;4623.190941585209;4701.670883038223;4723.126221649006;4735.384400027974;4756.548127927841;12788.808167877489;12812.42344094518;12847.100702950704;12858;12876.098673092982;4920.163572192736;5033.421156567042;5826.737796799154;5827.475527202488;5831.912521312183;5349.144136938071;5514.61397702157;5518.365387980433;5542.889142217133;5543.556515478752;4216.515100763451;4278.935815962763;4337.089211265669;4338.9349159762;4364.825406983685;1125.060574420368;1128.6444769897455;1131.8358837968613;1147.3574798113084;1149.2759561476385;1085.3216739537788;1097.1599402092675;1127.177160672697;1131.2081542919989;1140.9771804564027;6963.860722785617;7014.403775679022;7196.568205907663;7360.300771426706;7487.550746955091;1049.2078480746986;1052.153016821466;1073.6671631794168;1087.1465899269035;1098.9340639561651;4520.88697782558;4611.2852507861335;4631.397918270603;4671.369365135731;4672.345871577982;13921.468638449762;14103.858961410255;14134.151950882775;14289.928550357181;14338.283085845665;14076.366563504667;14208.289585520683;14215.644608884653;14446.855531444551;14635.85364146345;10693.465326733633;10748.247622666495;10913.672589822318;10968.341899485897;10986.176036797273;6956.756513522205;7104.751333703295;7305.707771689073;7333.523320984119;7360.411167106511;13124.671883202996;13341.599752007456;13631.79552306736;13637.045406821824;13681;11583.247088939192;11697.941510292394;13063.889569386329;13387;13978.161310321413;10007.799844003224;10246.846297305397;10337.224708147069;10347.793044138925;10371.636992705218;10538.051575358255;10660.520276587416;10675.839862402225;10754.408507531847;10818.56725730962;9318;9796.216302695624;9804.1666458349;9961.40231586107;10012.949935250277;9439.764005899908;9511.952440237754;9591.040895910353;9655.517224138905;9779.951100244452;8840.425372350777;8932.642694292155;8995.23540499065;9022.14289642483;9101.08989101111;6364.172657554488;6524.902126468011;6608.4052435281055;6701.229358623821;6786.626735529593;6690.096836926952;6727.360900714424;6906.930930690629;6931.549449285982;6970.721171153097 09:16:24 INFO - PROCESS | 26376 | |4;prototype.html;431.60508135056426;433.67691070152733;447.228530784397;448.6545360072746;449.8965237995261;5304.416514183436;5316.9734151329285;5353.73231338433;5354.678719276846;5355.464453554648;5229.60777941654;5243.318368612085;5246.213068039796;5270.446603106676;5288.99509093272;4333.2416827055295;4340.327249276367;4470.597646211841;4493.415855938723;4499.977500112511;4465.82136714531;4473.2395492766145;4491;4492.39352687388;4507.909841803162;4491.505934347219;4511;4527.275635898257;4542.704724192933;4559.498455169929;4334.891627709301;4441;4483.50681425043;4489.73061616304;4561.221123761736;4186.162767446523;4187.309093999486;4189.4344263524645;4196.853110141131;4212.726172798758;5120.974395128038;5149.3305870237;5158.432572417031;5165.7158856262895;5168.819091331786;5023.899522009539;5097.592192624581;5139.038330552901;5183.3002544656365;5205.219217117425;5456.135528847347;5498.780048798043;5513.173024046385;5521.668699878021;5532.901575117907;4616.792244348979;4637.675362724577;4661.370714953472;4662.650301227422;4664.300354946751;5457.536109430703;5526.309211348582;5625.80309689163;5749.913751293734;5768.615532272266;4706.2822069944905;4728.574428301469;4762.714237145713;4764.499727528629;4825.9758701206265;4826.903461930741;4836.395450568679;4856.543037088859;4873.658843880894;4880.755962201875;5035.874103147451;5129;5170.6380553360905;5191.6884986900905;5198.532132108128;5476.507114359727;5487.07952216721;5500.367457742411;5513.448655134454;5586.469285417878;1646.9094199819126;1658.2620733773597;1663.8003439587328;1668.357682292302;1669.732842745155;1233.0967807297172;1285.13895689888;1294.825198598196;1299.4867027524076;1306.4447609765812;5293.258943747878;5441.347038355423;5453;5477.260569823103;5491.846712190405;5663.886722265532;5710.543156547466;5721.5136713379825;5777.653340799566;5795.710694275822;5473.616846820684;5505.614606977553;5515.586331025189;5532.225488431623;5574;2909.8254104753782;2977;2992.8750587082977;2999.0702882106616;3019.7282244597654;5727.656340619576;5741.679413734864;5784.305883294031;5857.70711464425;5859.912101318484;5488.368837583649;5728.226689396878;5760.279965004374;5760.6255593386295;5848.181254624356;5829.621074630136;5849.630899485715;5862.941370586324;5864.501517370986;5887.38097023322;5685.521764341218;5693.686847223443;5701.771929122789;5715.31416230055;5719.7426115824055;5447.155690867922;5505.825199046274;5559.694216817952;5564.499195072301;5640.915386269291;5534.916976245279;5655.604107712586;5681.2330335404195;5839.474447299764;5850.561207909509;4727.692699974491;4736.431628204499;4751.861662252069;4756.908009793662;4759.809607615795;5387.892242155057;5666.773329066791;5687.379096957347;5764;5774.23885714861;5519.537322609592;5532.087205611029;5538.196961440649;5544.085225937675;5561.777528898799;5522.392536820867;5529.751161197675;5550;5606.710456595088;5633.408492108433;5232.319798426332;5454.400015998316;5517;5523.8895222096135;5535.844568595861;5466.753996070107;5545.445455454423;5564.638298510584;5570.777168913198;5579.525740312119;5187.507186817246;5406.810241852057;5460.890782184413;5464.977958155349;5515.338159420895 09:16:24 INFO - PROCESS | 26376 | |5;yui.html;794.7337641889967;810.7486679129466;838.3209600223819;849.3163003781953;877.127258377914;17086.14569271536;17324.393646222386;18043.188056537456;18057.367992120264;18105.909470452647;15173.468928587501;15346.462873799419;15398.230088495586;15411.92294038531;15421.614459638487;873.9563021848913;884.8672699095139;895.3911340288602;915.4827522449827;918.4994178172878;903.9593218305159;906.4244204929884;908.5321059654283;910.2172131966504;910.8223896340216;931.4039015030386;935.4714586258776;938.5025936253796;939.3049143633696;939.4034787909658;932.659579253571;933.0995589256332;933.1554942776764;933.6825479337058;933.6965486216973;687.069021475898;687.4225650453643;687.7455341523619;687.8349196192928;688.1638808847274;17650.823491765175;17659.29362825498;17687.646247075114;18221.54446138844;18436.354727584603;15940.442084526985;16052.188594234669;16082.356705731756;16193.838061619352;16402.83597164037;13257.337133143401;13263.071584989055;13564.93217533916;13608.523701670492;13681.521146759816;3961.2473630010495;3974.7813870237123;4025.4163146343617;4053.1691003344245;4097.97951010246;90370;91071.54464227703;91524.54237728835;92779.53610231906;93755;11245.775084498264;11472;12272.447739851728;12273.631791046282;12466.626001219978;19477.12352944121;19845.206191752455;19909.800901991086;22717.88641056784;23196.18813341525;8328.33373330132;8526.488410695378;8729.345299102593;8788.384813063152;8947.776305592282;4850.587700045536;4904.313396124546;4945.035718034948;4946.629002824802;5003.54968052877;3727.7949712765517;3828.3683192272965;3840.0399900024995;3840.2895464338626;3840.731148819612;646.1309538670481;653.0726368556661;653.539254825347;664.6078813500059;671.1409395973162;818.2226884459787;826.9173082691683;828.1676914700687;860.7073594977612;861.8664107063415;11403.543858245743;11442.485088171052;11712.004479619158;11807.940960295144;11820;836.7698882807276;843.371688092375;843.8776377425239;849.227203245044;851.9957400213083;5476.645319660726;5511.118221084687;5603.831885043455;5613.915791263134;5668.801591944262;66122.33877661258;72055;81281.26827366577;83839.5808020956;85276;74718;74895;77007.61496192595;78428;79587.60206198932;53847.73076134673;54721;64583.67708161429;66325.00512492316;66859.66570167216;11458.885411145782;12256.325902075472;12275.693107672023;12369.93815030919;12641.2415255085;37678.62321376751;41375.79312103541;41589.58410415978;42156;42943.7852810734;53702.731486342316;54976.35070947878;55944;56440;57768.422315777985;13890.513832015831;14073.507427239998;14112.50606228777;14217.431302747775;14363.138211707332;16516;16822.915885420494;17098.145092745064;17135.05757183367;18096.819031809515;15397;16012.199390030684;16337.428190013292;16413.753793693344;16614;15082.396704131712;15640.374385024927;15672.373105075669;15986.680266394374;16186.67626647484;15295.77056344178;15831.525054248392;16139.435119770751;16313;16328.428505002268;12443.315617640754;12706.87293127057;13093.541726039542;13236;13451.730965380833;12816.55142070023;12841.871581284442;13028.739425211632;13108;13290.269035203157 09:16:24 INFO - PROCESS | 26376 | __end_tp_report 09:16:24 INFO - PROCESS | 26376 | __start_cc_report 09:16:24 INFO - PROCESS | 26376 | _x_x_mozilla_cycle_collect,1367 09:16:24 INFO - PROCESS | 26376 | __end_cc_report 09:16:24 INFO - PROCESS | 26376 | __startTimestamp1490285784032__endTimestamp 09:16:24 INFO - PROCESS | 26376 | 09:16:24 INFO - PROCESS | 26376 | ------- Summary: start ------- 09:16:24 INFO - PROCESS | 26376 | Number of tests: 6 09:16:24 INFO - PROCESS | 26376 | 09:16:24 INFO - PROCESS | 26376 | [#0] dojo.html Cycles:165 Average:5808.83 Median:6072.33 stddev:661.44 (10.9%) stddev-sans-first:635.30 09:16:24 INFO - PROCESS | 26376 | Values: 3374.3 3400.7 3413.3 3419.5 3424.8 5746.9 5785.7 5787.3 5820.8 5835.2 5797.4 5846.4 5851.0 5853.5 5860.9 5253.9 5262.0 5274.9 5347.8 5356.1 5215.7 5375.7 5377.7 5383.1 5391.7 5243.1 5264.8 5301.2 5378.9 5384.2 5365.5 5399.9 5400.3 5400.9 5404.9 5323.9 5331.0 5334.3 5375.7 5400.1 5652.8 5691.9 5713.1 5793.7 5806.7 6319.7 6323.1 6327.1 6329.6 6338.6 6338.2 6348.7 6350.9 6362.1 6362.4 5697.9 5735.5 5835.7 5850.9 5874.4 6298.1 6330.6 6335.1 6354.1 6356.1 6176.0 6208.8 6230.5 6232.2 6247.2 6016.5 6062.3 6111.4 6242.6 6252.1 6142.2 6157.4 6237.2 6239.5 6245.2 6055.8 6103.5 6116.2 6236.5 6243.7 4708.6 4712.5 4730.5 4737.5 4797.2 4165.9 4273.4 4282.4 4293.0 4328.9 5903.4 5982.7 6030.0 6050.6 6113.4 6276.6 6359.9 6361.4 6366.6 6369.1 6068.0 6072.3 6084.1 6087.6 6091.5 5171.8 5212.1 5217.0 5247.1 5255.6 6454.0 6460.6 6461.6 6464.4 6474.3 6193.8 6234.2 6258.3 6280.2 6281.3 6161.3 6229.5 6392.6 6437.7 6459.4 6257.2 6263.5 6267.5 6270.6 6272.7 6274.9 6281.2 6283.5 6284.3 6291.5 5852.9 5932.3 6069.7 6133.9 6188.7 6122.8 6123.3 6148.2 6149.6 6156.0 6147.5 6148.0 6151.5 6158.4 6159.8 5940.7 5946.5 6008.9 6085.3 6179.4 6037.7 6040.3 6040.7 6072.6 6073.0 09:16:24 INFO - PROCESS | 26376 | 09:16:24 INFO - PROCESS | 26376 | [#1] ext.html Cycles:180 Average:44489.60 Median:31635.11 stddev:68569.76 (216.8%) stddev-sans-first:68683.27 09:16:24 INFO - PROCESS | 26376 | Values: 696.6 751.3 770.6 840.8 849.4 31917.0 43551.3 44109.6 44170.0 44219.3 46872.8 47073.8 47196.5 47234.0 47246.3 7777.6 7944.5 9242.1 9386.7 9390.8 10605.0 10833.8 10834.0 10837.5 10841.8 10938.6 10982.5 10984.2 10987.1 10994.1 10841.9 10921.6 10923.8 10940.9 10955.8 10616.2 10665.3 10666.4 10676.4 10678.4 43060.1 43096.0 43177.6 43336.0 43343.0 4094.8 4111.1 4145.7 4219.6 4267.2 29881.7 30039.2 30334.8 30680.7 31353.2 4358.2 4433.9 4441.1 4453.3 4534.5 229144.0 230920.0 231618.0 232340.0 232347.8 54996.2 55047.7 55050.4 55052.7 55094.4 56129.4 56451.0 56484.0 56604.0 56668.1 16492.8 16730.5 16738.7 16741.5 16774.8 12962.1 13200.9 14884.1 14924.0 14926.6 13118.7 13444.7 13847.7 13851.8 13895.3 5298.0 5373.0 5378.1 5387.4 5416.2 1023.9 1024.1 1031.9 1034.8 1038.4 29426.9 29670.3 29689.7 29758.9 30028.7 1085.3 1089.6 1112.9 1115.4 1130.9 14461.3 15497.7 15568.5 15571.3 15711.0 292929.0 293607.0 294177.0 294330.0 295767.0 57968.0 58047.0 58149.4 58166.1 58350.0 1504.1 1522.2 1539.9 1546.9 1554.2 26347.6 26731.7 27866.0 27932.3 28026.7 41787.0 42005.4 42009.8 42060.0 42063.0 261856.0 261919.0 262457.0 262528.0 264579.0 35280.3 35475.6 35667.5 35891.8 36007.6 43771.6 44416.3 44501.0 45422.3 45457.8 36860.0 36920.6 36978.6 37122.1 37152.3 36614.0 36867.0 37042.0 37056.8 37823.6 38540.0 39066.6 39124.2 39429.4 39969.6 31158.2 32722.2 32791.0 32877.0 33261.5 25385.4 25557.2 25756.9 25858.9 26240.0 09:16:24 INFO - PROCESS | 26376 | 09:16:24 INFO - PROCESS | 26376 | [#2] jquery.html Cycles:180 Average:37134.79 Median:13859.34 stddev:108024.83 (779.4%) stddev-sans-first:108292.70 09:16:24 INFO - PROCESS | 26376 | Values: 425.3 472.0 486.0 488.2 496.1 17790.0 18723.7 19793.6 20722.6 20796.0 14863.4 20487.0 22175.2 22183.3 22670.4 6691.3 6940.1 6953.1 6955.5 7264.4 7512.4 7571.4 7582.1 7594.6 7624.9 7442.0 7574.6 7578.4 7599.0 7599.3 7446.8 7587.4 7617.6 7632.6 7649.7 7238.2 7430.4 7441.6 7443.3 7449.6 25410.6 25441.4 25937.1 26024.5 26096.2 3147.2 3198.6 3240.0 3303.9 3461.8 15413.6 15869.1 16198.3 16593.3 16634.0 2135.9 2230.0 2250.0 2295.6 2308.1 105786.0 126031.0 129542.0 130465.0 131795.3 17198.8 18021.7 18318.8 18568.3 18810.4 31492.8 31730.5 31784.5 31805.8 32068.5 8934.1 9392.3 10085.9 10410.3 10504.5 8854.9 8876.0 8890.9 9091.9 9094.0 9053.4 9211.1 9275.7 9337.2 9428.5 3423.8 3547.1 3688.7 3726.7 3823.7 970.2 972.0 974.9 981.3 1000.0 20784.8 20968.4 21146.5 21167.5 21365.9 981.6 986.4 986.6 992.3 996.6 10594.5 11383.8 11447.7 11490.4 11547.2 635078.0 635502.0 637767.0 681328.0 685450.0 78029.6 81535.7 96155.5 113236.0 115200.0 1281.7 1299.6 1328.9 1332.5 1334.5 17865.8 18175.2 18437.5 18513.4 18587.3 37060.4 44004.6 50894.7 51294.5 51331.0 62059.7 67138.7 70913.0 71580.6 72298.0 11184.3 11549.6 11659.5 11724.6 11819.8 12980.4 13005.3 13052.5 13053.6 13132.5 11411.5 11585.7 11689.7 11890.9 11925.0 11050.4 11158.7 11251.6 11352.7 11398.5 11621.9 11724.9 11987.1 12131.9 12643.4 11875.0 12078.0 12317.9 12433.5 12681.2 11763.8 11929.5 11983.7 12008.2 12201.1 09:16:24 INFO - PROCESS | 26376 | 09:16:24 INFO - PROCESS | 26376 | [#3] mootools.html Cycles:180 Average:7174.48 Median:2243.94 stddev:4540.56 (202.3%) stddev-sans-first:4533.73 09:16:24 INFO - PROCESS | 26376 | Values: 1564.9 1569.2 1589.8 1592.5 1604.9 10911.6 11651.5 11664.2 11684.2 11699.2 11269.3 11494.3 11496.5 11505.1 11505.7 2396.0 2427.9 2428.2 2432.5 2433.7 2327.5 2352.3 2360.7 2361.4 2363.4 2229.9 2242.1 2251.1 2259.7 2262.6 2218.0 2241.0 2245.8 2246.9 2248.9 2234.7 2319.0 2319.0 2319.7 2321.2 11448.2 11506.7 11519.8 11530.3 11533.8 5708.6 5852.2 5867.5 5867.7 5867.9 3187.5 3384.3 3413.7 3432.6 3437.2 1303.8 1321.9 1346.0 1399.1 1407.7 15210.9 15559.8 16496.8 17734.6 17899.2 4623.2 4701.7 4723.1 4735.4 4756.5 12788.8 12812.4 12847.1 12858.0 12876.1 4920.2 5033.4 5826.7 5827.5 5831.9 5349.1 5514.6 5518.4 5542.9 5543.6 4216.5 4278.9 4337.1 4338.9 4364.8 1125.1 1128.6 1131.8 1147.4 1149.3 1085.3 1097.2 1127.2 1131.2 1141.0 6963.9 7014.4 7196.6 7360.3 7487.6 1049.2 1052.2 1073.7 1087.1 1098.9 4520.9 4611.3 4631.4 4671.4 4672.3 13921.5 14103.9 14134.2 14289.9 14338.3 14076.4 14208.3 14215.6 14446.9 14635.9 10693.5 10748.2 10913.7 10968.3 10986.2 6956.8 7104.8 7305.7 7333.5 7360.4 13124.7 13341.6 13631.8 13637.0 13681.0 11583.2 11697.9 13063.9 13387.0 13978.2 10007.8 10246.8 10337.2 10347.8 10371.6 10538.1 10660.5 10675.8 10754.4 10818.6 9318.0 9796.2 9804.2 9961.4 10012.9 9439.8 9512.0 9591.0 9655.5 9780.0 8840.4 8932.6 8995.2 9022.1 9101.1 6364.2 6524.9 6608.4 6701.2 6786.6 6690.1 6727.4 6906.9 6931.5 6970.7 09:16:24 INFO - PROCESS | 26376 | 09:16:24 INFO - PROCESS | 26376 | [#4] prototype.html Cycles:180 Average:4842.17 Median:5354.21 stddev:1274.05 (23.8%) stddev-sans-first:1233.87 09:16:24 INFO - PROCESS | 26376 | Values: 431.6 433.7 447.2 448.7 449.9 5304.4 5317.0 5353.7 5354.7 5355.5 5229.6 5243.3 5246.2 5270.4 5289.0 4333.2 4340.3 4470.6 4493.4 4500.0 4465.8 4473.2 4491.0 4492.4 4507.9 4491.5 4511.0 4527.3 4542.7 4559.5 4334.9 4441.0 4483.5 4489.7 4561.2 4186.2 4187.3 4189.4 4196.9 4212.7 5121.0 5149.3 5158.4 5165.7 5168.8 5023.9 5097.6 5139.0 5183.3 5205.2 5456.1 5498.8 5513.2 5521.7 5532.9 4616.8 4637.7 4661.4 4662.7 4664.3 5457.5 5526.3 5625.8 5749.9 5768.6 4706.3 4728.6 4762.7 4764.5 4826.0 4826.9 4836.4 4856.5 4873.7 4880.8 5035.9 5129.0 5170.6 5191.7 5198.5 5476.5 5487.1 5500.4 5513.4 5586.5 1646.9 1658.3 1663.8 1668.4 1669.7 1233.1 1285.1 1294.8 1299.5 1306.4 5293.3 5441.3 5453.0 5477.3 5491.8 5663.9 5710.5 5721.5 5777.7 5795.7 5473.6 5505.6 5515.6 5532.2 5574.0 2909.8 2977.0 2992.9 2999.1 3019.7 5727.7 5741.7 5784.3 5857.7 5859.9 5488.4 5728.2 5760.3 5760.6 5848.2 5829.6 5849.6 5862.9 5864.5 5887.4 5685.5 5693.7 5701.8 5715.3 5719.7 5447.2 5505.8 5559.7 5564.5 5640.9 5534.9 5655.6 5681.2 5839.5 5850.6 4727.7 4736.4 4751.9 4756.9 4759.8 5387.9 5666.8 5687.4 5764.0 5774.2 5519.5 5532.1 5538.2 5544.1 5561.8 5522.4 5529.8 5550.0 5606.7 5633.4 5232.3 5454.4 5517.0 5523.9 5535.8 5466.8 5545.4 5564.6 5570.8 5579.5 5187.5 5406.8 5460.9 5465.0 5515.3 09:16:24 INFO - PROCESS | 26376 | 09:16:24 INFO - PROCESS | 26376 | [#5] yui.html Cycles:180 Average:18939.36 Median:22736.89 stddev:23691.36 (104.2%) stddev-sans-first:23718.64 09:16:24 INFO - PROCESS | 26376 | Values: 794.7 810.7 838.3 849.3 877.1 17086.1 17324.4 18043.2 18057.4 18105.9 15173.5 15346.5 15398.2 15411.9 15421.6 874.0 884.9 895.4 915.5 918.5 904.0 906.4 908.5 910.2 910.8 931.4 935.5 938.5 939.3 939.4 932.7 933.1 933.2 933.7 933.7 687.1 687.4 687.7 687.8 688.2 17650.8 17659.3 17687.6 18221.5 18436.4 15940.4 16052.2 16082.4 16193.8 16402.8 13257.3 13263.1 13564.9 13608.5 13681.5 3961.2 3974.8 4025.4 4053.2 4098.0 90370.0 91071.5 91524.5 92779.5 93755.0 11245.8 11472.0 12272.4 12273.6 12466.6 19477.1 19845.2 19909.8 22717.9 23196.2 8328.3 8526.5 8729.3 8788.4 8947.8 4850.6 4904.3 4945.0 4946.6 5003.5 3727.8 3828.4 3840.0 3840.3 3840.7 646.1 653.1 653.5 664.6 671.1 818.2 826.9 828.2 860.7 861.9 11403.5 11442.5 11712.0 11807.9 11820.0 836.8 843.4 843.9 849.2 852.0 5476.6 5511.1 5603.8 5613.9 5668.8 66122.3 72055.0 81281.3 83839.6 85276.0 74718.0 74895.0 77007.6 78428.0 79587.6 53847.7 54721.0 64583.7 66325.0 66859.7 11458.9 12256.3 12275.7 12369.9 12641.2 37678.6 41375.8 41589.6 42156.0 42943.8 53702.7 54976.4 55944.0 56440.0 57768.4 13890.5 14073.5 14112.5 14217.4 14363.1 16516.0 16822.9 17098.1 17135.1 18096.8 15397.0 16012.2 16337.4 16413.8 16614.0 15082.4 15640.4 15672.4 15986.7 16186.7 15295.8 15831.5 16139.4 16313.0 16328.4 12443.3 12706.9 13093.5 13236.0 13451.7 12816.6 12841.9 13028.7 13108.0 13290.3 09:16:24 INFO - PROCESS | 26376 | -------- Summary: end -------- 09:16:24 INFO - PROCESS | 26376 | 09:16:24 INFO - TEST-INFO | 26376: exit 0 09:16:24 INFO - TEST-OK | dromaeo_css | took 1114567ms 09:16:24 INFO - TEST-START | kraken 09:16:24 INFO - operating with platform_type : linux_ 09:16:24 INFO - Initialising browser for kraken test... 09:16:24 INFO - TEST-INFO | started process 26703 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpKY98kH/profile http://localhost:54257/getInfo.html) 09:16:28 INFO - PROCESS | 26703 | __metrics Screen width/height:1600/1200 09:16:28 INFO - PROCESS | 26703 | colorDepth:24 09:16:28 INFO - PROCESS | 26703 | Browser inner width/height: 1024/697 09:16:28 INFO - PROCESS | 26703 | __metrics 09:16:28 INFO - PROCESS | 26703 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 692: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 09:16:28 INFO - PROCESS | 26703 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 303: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 09:16:29 INFO - TEST-INFO | 26703: exit 0 09:16:29 INFO - Browser initialized. 09:16:29 INFO - Running cycle 1/1 for kraken test... 09:16:29 INFO - TEST-INFO | started process 26795 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpKY98kH/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 09:16:41 INFO - PROCESS | 26795 | RSS: Main: 140587008 09:16:41 INFO - PROCESS | 26795 | 09:16:44 INFO - PROCESS | 26795 | Cycle 1(1): loaded http://localhost:54257/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:54257/tests/kraken/driver.html?testName=audio-beat-detection) 09:16:45 INFO - PROCESS | 26795 | RSS: Main: 183721984 09:16:45 INFO - PROCESS | 26795 | 09:16:47 INFO - PROCESS | 26795 | Cycle 1(1): loaded http://localhost:54257/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:54257/tests/kraken/driver.html?testName=audio-dft) 09:16:48 INFO - PROCESS | 26795 | RSS: Main: 174211072 09:16:48 INFO - PROCESS | 26795 | 09:16:51 INFO - PROCESS | 26795 | Cycle 1(1): loaded http://localhost:54257/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:54257/tests/kraken/driver.html?testName=audio-fft) 09:16:51 INFO - PROCESS | 26795 | RSS: Main: 265904128 09:16:51 INFO - PROCESS | 26795 | 09:16:53 INFO - PROCESS | 26795 | Cycle 1(1): loaded http://localhost:54257/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:54257/tests/kraken/driver.html?testName=audio-oscillator) 09:16:54 INFO - PROCESS | 26795 | RSS: Main: 172318720 09:16:54 INFO - PROCESS | 26795 | 09:16:56 INFO - PROCESS | 26795 | Cycle 1(1): loaded http://localhost:54257/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:54257/tests/kraken/driver.html?testName=imaging-gaussian-blur) 09:16:56 INFO - PROCESS | 26795 | RSS: Main: 174940160 09:16:56 INFO - PROCESS | 26795 | 09:16:59 INFO - PROCESS | 26795 | Cycle 1(1): loaded http://localhost:54257/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:54257/tests/kraken/driver.html?testName=imaging-darkroom) 09:17:00 INFO - PROCESS | 26795 | RSS: Main: 213499904 09:17:00 INFO - PROCESS | 26795 | 09:17:03 INFO - PROCESS | 26795 | Cycle 1(1): loaded http://localhost:54257/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:54257/tests/kraken/driver.html?testName=imaging-desaturate) 09:17:04 INFO - PROCESS | 26795 | RSS: Main: 212328448 09:17:04 INFO - PROCESS | 26795 | 09:17:07 INFO - PROCESS | 26795 | Cycle 1(1): loaded http://localhost:54257/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:54257/tests/kraken/driver.html?testName=json-parse-financial) 09:17:07 INFO - PROCESS | 26795 | RSS: Main: 211546112 09:17:07 INFO - PROCESS | 26795 | 09:17:09 INFO - PROCESS | 26795 | Cycle 1(1): loaded http://localhost:54257/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:54257/tests/kraken/driver.html?testName=json-stringify-tinderbox) 09:17:09 INFO - PROCESS | 26795 | RSS: Main: 173391872 09:17:09 INFO - PROCESS | 26795 | 09:17:11 INFO - PROCESS | 26795 | Cycle 1(1): loaded http://localhost:54257/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:54257/tests/kraken/driver.html?testName=stanford-crypto-aes) 09:17:12 INFO - PROCESS | 26795 | RSS: Main: 179798016 09:17:12 INFO - PROCESS | 26795 | 09:17:14 INFO - PROCESS | 26795 | Cycle 1(1): loaded http://localhost:54257/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:54257/tests/kraken/driver.html?testName=stanford-crypto-ccm) 09:17:14 INFO - PROCESS | 26795 | RSS: Main: 189919232 09:17:14 INFO - PROCESS | 26795 | 09:17:17 INFO - PROCESS | 26795 | Cycle 1(1): loaded http://localhost:54257/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:54257/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 09:17:17 INFO - PROCESS | 26795 | RSS: Main: 199880704 09:17:17 INFO - PROCESS | 26795 | 09:17:20 INFO - PROCESS | 26795 | Cycle 1(1): loaded http://localhost:54257/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:54257/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 09:17:21 INFO - PROCESS | 26795 | RSS: Main: 195956736 09:17:21 INFO - PROCESS | 26795 | 09:17:22 INFO - PROCESS | 26795 | Cycle 1(1): loaded http://localhost:54257/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:54257/tests/kraken/driver.html?testName=ai-astar) 09:17:23 INFO - PROCESS | 26795 | RSS: Main: 247500800 09:17:23 INFO - PROCESS | 26795 | 09:17:23 INFO - PROCESS | 26795 | __start_tp_report 09:17:23 INFO - PROCESS | 26795 | _x_x_mozilla_page_load 09:17:23 INFO - PROCESS | 26795 | _x_x_mozilla_page_load_details 09:17:23 INFO - PROCESS | 26795 | |i|pagename|runs| 09:17:23 INFO - PROCESS | 26795 | |0;ai-astar;103;113;114;112;114;114;113;113;111;115 09:17:23 INFO - PROCESS | 26795 | |1;audio-beat-detection;142;117;119;157;123;121;115;115;139;119 09:17:23 INFO - PROCESS | 26795 | |2;audio-dft;160;161;161;163;160;162;161;161;162;160 09:17:23 INFO - PROCESS | 26795 | |3;audio-fft;76;77;74;107;76;78;76;75;90;76 09:17:23 INFO - PROCESS | 26795 | |4;audio-oscillator;82;81;99;81;82;82;96;82;81;99 09:17:23 INFO - PROCESS | 26795 | |5;imaging-gaussian-blur;113;112;114;113;114;113;113;113;113;113 09:17:23 INFO - PROCESS | 26795 | |6;imaging-darkroom;146;149;148;147;147;146;148;146;146;146 09:17:23 INFO - PROCESS | 26795 | |7;imaging-desaturate;96;93;94;94;94;94;94;94;94;94 09:17:23 INFO - PROCESS | 26795 | |8;json-parse-financial;55;62;54;55;54;55;57;54;54;56 09:17:23 INFO - PROCESS | 26795 | |9;json-stringify-tinderbox;53;54;53;54;53;54;53;54;54;54 09:17:23 INFO - PROCESS | 26795 | |10;stanford-crypto-aes;81;75;75;87;75;79;78;78;80;79 09:17:23 INFO - PROCESS | 26795 | |11;stanford-crypto-ccm;121;130;122;125;128;119;119;121;161;121 09:17:23 INFO - PROCESS | 26795 | |12;stanford-crypto-pbkdf2;160;159;159;158;157;160;158;169;159;157 09:17:23 INFO - PROCESS | 26795 | |13;stanford-crypto-sha256-iterative;62;61;62;62;60;60;59;59;63;61 09:17:23 INFO - PROCESS | 26795 | __end_tp_report 09:17:23 INFO - PROCESS | 26795 | __start_cc_report 09:17:23 INFO - PROCESS | 26795 | _x_x_mozilla_cycle_collect,1727 09:17:23 INFO - PROCESS | 26795 | __end_cc_report 09:17:23 INFO - PROCESS | 26795 | __startTimestamp1490285843187__endTimestamp 09:17:23 INFO - PROCESS | 26795 | 09:17:23 INFO - PROCESS | 26795 | ------- Summary: start ------- 09:17:23 INFO - PROCESS | 26795 | Number of tests: 14 09:17:23 INFO - PROCESS | 26795 | 09:17:23 INFO - PROCESS | 26795 | [#0] ai-astar Cycles:10 Average:112.20 Median:113.50 stddev:3.43 (3.0%) stddev-sans-first:1.20 09:17:23 INFO - PROCESS | 26795 | Values: 103.0 113.0 114.0 112.0 114.0 114.0 113.0 113.0 111.0 115.0 09:17:23 INFO - PROCESS | 26795 | 09:17:23 INFO - PROCESS | 26795 | [#1] audio-beat-detection Cycles:10 Average:126.70 Median:122.00 stddev:14.28 (11.7%) stddev-sans-first:14.04 09:17:23 INFO - PROCESS | 26795 | Values: 142.0 117.0 119.0 157.0 123.0 121.0 115.0 115.0 139.0 119.0 09:17:23 INFO - PROCESS | 26795 | 09:17:23 INFO - PROCESS | 26795 | [#2] audio-dft Cycles:10 Average:161.10 Median:161.00 stddev:0.99 (0.6%) stddev-sans-first:0.97 09:17:23 INFO - PROCESS | 26795 | Values: 160.0 161.0 161.0 163.0 160.0 162.0 161.0 161.0 162.0 160.0 09:17:23 INFO - PROCESS | 26795 | 09:17:23 INFO - PROCESS | 26795 | [#3] audio-fft Cycles:10 Average:80.50 Median:76.00 stddev:10.35 (13.6%) stddev-sans-first:10.85 09:17:23 INFO - PROCESS | 26795 | Values: 76.0 77.0 74.0 107.0 76.0 78.0 76.0 75.0 90.0 76.0 09:17:23 INFO - PROCESS | 26795 | 09:17:23 INFO - PROCESS | 26795 | [#4] audio-oscillator Cycles:10 Average:86.50 Median:82.00 stddev:7.99 (9.7%) stddev-sans-first:8.31 09:17:23 INFO - PROCESS | 26795 | Values: 82.0 81.0 99.0 81.0 82.0 82.0 96.0 82.0 81.0 99.0 09:17:23 INFO - PROCESS | 26795 | 09:17:23 INFO - PROCESS | 26795 | [#5] imaging-gaussian-blur Cycles:10 Average:113.10 Median:113.00 stddev:0.57 (0.5%) stddev-sans-first:0.60 09:17:23 INFO - PROCESS | 26795 | Values: 113.0 112.0 114.0 113.0 114.0 113.0 113.0 113.0 113.0 113.0 09:17:23 INFO - PROCESS | 26795 | 09:17:23 INFO - PROCESS | 26795 | [#6] imaging-darkroom Cycles:10 Average:146.90 Median:147.00 stddev:1.10 (0.7%) stddev-sans-first:1.12 09:17:23 INFO - PROCESS | 26795 | Values: 146.0 149.0 148.0 147.0 147.0 146.0 148.0 146.0 146.0 146.0 09:17:23 INFO - PROCESS | 26795 | 09:17:23 INFO - PROCESS | 26795 | [#7] imaging-desaturate Cycles:10 Average:94.10 Median:94.00 stddev:0.74 (0.8%) stddev-sans-first:0.33 09:17:23 INFO - PROCESS | 26795 | Values: 96.0 93.0 94.0 94.0 94.0 94.0 94.0 94.0 94.0 94.0 09:17:23 INFO - PROCESS | 26795 | 09:17:23 INFO - PROCESS | 26795 | [#8] json-parse-financial Cycles:10 Average:55.60 Median:55.00 stddev:2.46 (4.5%) stddev-sans-first:2.60 09:17:23 INFO - PROCESS | 26795 | Values: 55.0 62.0 54.0 55.0 54.0 55.0 57.0 54.0 54.0 56.0 09:17:23 INFO - PROCESS | 26795 | 09:17:23 INFO - PROCESS | 26795 | [#9] json-stringify-tinderbox Cycles:10 Average:53.60 Median:54.00 stddev:0.52 (1.0%) stddev-sans-first:0.50 09:17:23 INFO - PROCESS | 26795 | Values: 53.0 54.0 53.0 54.0 53.0 54.0 53.0 54.0 54.0 54.0 09:17:23 INFO - PROCESS | 26795 | 09:17:23 INFO - PROCESS | 26795 | [#10] stanford-crypto-aes Cycles:10 Average:78.70 Median:79.00 stddev:3.62 (4.6%) stddev-sans-first:3.75 09:17:23 INFO - PROCESS | 26795 | Values: 81.0 75.0 75.0 87.0 75.0 79.0 78.0 78.0 80.0 79.0 09:17:23 INFO - PROCESS | 26795 | 09:17:23 INFO - PROCESS | 26795 | [#11] stanford-crypto-ccm Cycles:10 Average:126.70 Median:123.50 stddev:12.61 (10.2%) stddev-sans-first:13.20 09:17:23 INFO - PROCESS | 26795 | Values: 121.0 130.0 122.0 125.0 128.0 119.0 119.0 121.0 161.0 121.0 09:17:23 INFO - PROCESS | 26795 | 09:17:23 INFO - PROCESS | 26795 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:159.60 Median:159.00 stddev:3.47 (2.2%) stddev-sans-first:3.68 09:17:23 INFO - PROCESS | 26795 | Values: 160.0 159.0 159.0 158.0 157.0 160.0 158.0 169.0 159.0 157.0 09:17:23 INFO - PROCESS | 26795 | 09:17:23 INFO - PROCESS | 26795 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:60.90 Median:61.50 stddev:1.37 (2.2%) stddev-sans-first:1.39 09:17:23 INFO - PROCESS | 26795 | Values: 62.0 61.0 62.0 62.0 60.0 60.0 59.0 59.0 63.0 61.0 09:17:23 INFO - PROCESS | 26795 | -------- Summary: end -------- 09:17:23 INFO - PROCESS | 26795 | 09:17:24 INFO - TEST-INFO | 26795: exit 0 09:17:24 INFO - TEST-OK | kraken | took 59411ms 09:17:24 INFO - SUITE-END | took 1173s 09:17:24 INFO - Completed test suite (00:19:34) 09:17:24 INFO - javascript benchmark 09:17:24 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": [], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 7916.281536063824, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3374.2576633140707, 3400.67693569111, 3413.300273443944, 3419.487076938459, 3424.8184376390136, 5746.913796293059, 5785.710714464281, 5787.305523337205, 5820.767169313228, 5835.153902684114, 5797.4202579742005, 5846.386129456409, 5850.970745146279, 5853.5317174625925, 5860.941390586093, 5253.8949221015555, 5261.973690131544, 5274.868128296785, 5347.839564813062, 5356.116240820279, 5215.687058776467, 5375.6774593524315, 5377.677339359651, 5383.084875571162, 5391.703456309901, 5243.056249875021, 5264.8157314494, 5301.20481927712, 5378.946210537903, 5384.246205531209, 5365.543928766059, 5399.919001214985, 5400.270963419947, 5400.945990540084, 5404.891902161935, 5323.866903327409, 5330.973345133289, 5334.27987221724, 5375.6774593524515, 5400.135978243462, 5652.802151924663, 5691.886162276773, 5713.14302854571, 5793.681347525884, 5806.709664516799, 6319.74721011159, 6323.114763933053, 6327.145835312266, 6329.556931014831, 6338.556301058928, 6338.239411270677, 6348.746050157988, 6350.872982540323, 6362.0774987627, 6362.395572420613, 5697.886042279131, 5735.4551317624755, 5835.737391817378, 5850.882982340329, 5874.383189765099, 6298.086777417248, 6330.556861019776, 6335.1447554579545, 6354.110424540568, 6356.078368636522, 6175.96912015446, 6208.81373558794, 6230.532710046674, 6232.220972378453, 6247.219097612799, 6016.488598469092, 6062.302835173923, 6111.387369467926, 6242.563020588606, 6252.062190671345, 6142.232220972379, 6157.384261573897, 6237.157983672237, 6239.500839932794, 6245.156903817927, 6055.818325450244, 6103.450689437972, 6116.204893363834, 6236.532260080512, 6243.687815609202, 4708.552687494683, 4712.52874712526, 4730.5032971538185, 4737.478877323491, 4797.208460603962, 4165.854195103157, 4273.444452221192, 4282.443282373271, 4292.957070429318, 4328.935065974013, 5903.409659034062, 5982.670953097621, 6030.0, 6050.606710563799, 6113.388661133851, 6276.623402595859, 6359.904601430982, 6361.427471527585, 6366.649834259068, 6369.108324834527, 6067.969660151671, 6072.332043475214, 6084.056971169476, 6087.604305720114, 6091.451769340781, 5171.818986335536, 5212.087884620177, 5217.034848553029, 5247.134222853263, 5255.605829562798, 6454.0, 6460.612363258314, 6461.61230326182, 6464.418202361716, 6474.320196379406, 6193.81418557444, 6234.189555357956, 6258.311585725658, 6280.246370435577, 6281.340459251713, 6161.260648722182, 6229.470495007975, 6392.616443013434, 6437.742490300336, 6459.418652321314, 6257.186565746424, 6263.498920086473, 6267.498600111889, 6270.623762574261, 6272.686365681607, 6274.874502509833, 6281.152044473937, 6283.497320214463, 6284.277308109626, 6291.528135389773, 5852.882942341214, 5932.2584676915385, 6069.696515174312, 6133.89589873827, 6188.659623720739, 6122.825106970275, 6123.295820980644, 6148.200733904564, 6149.600275982047, 6156.045812899008, 6147.508199344131, 6148.016317389196, 6151.507879369729, 6158.3841615838055, 6159.784407545714, 5940.732667029907, 5946.524278057658, 6008.87982240344, 6085.3306136325855, 6179.412955769195, 6037.728302226498, 6040.305364883095, 6040.6677632730625, 6072.605280656743, 6073.028315469681], "value": 5764.165347845366, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [696.6133795743364, 751.2975368030892, 770.5684816502759, 840.7687885831399, 849.4139044059602, 31916.99999999997, 43551.346729799036, 44109.558904410944, 44170.0, 44219.3367099493, 46872.765636171855, 47073.764631176884, 47196.528034719646, 47234.0, 47246.291305630446, 7777.611119444005, 7944.523328600274, 9242.075792420772, 9386.718398448058, 9390.812183756321, 10605.045545900868, 10833.783324333508, 10833.970772776613, 10837.458127093652, 10841.783164336708, 10938.56245750169, 10982.450877456135, 10984.176186786022, 10987.121030317556, 10994.065504432092, 10841.945790271076, 10921.563137474492, 10923.836142457869, 10940.945295273512, 10955.780884382348, 10616.203784716177, 10665.253432259746, 10666.36001839892, 10676.359418434919, 10678.412687302196, 43060.13879722388, 43096.0, 43177.56822431767, 43336.0, 43343.0, 4094.754314741125, 4111.054457474767, 4145.709800313979, 4219.578042195756, 4267.210566045292, 29881.70118298811, 30039.249018774488, 30334.848325758452, 30680.69319306823, 31353.216169595715, 4358.150160718661, 4433.911321773547, 4441.133978874121, 4453.309736990772, 4534.478534968488, 229144.0, 230920.0, 231618.0, 232340.0, 232347.8382608093, 54996.175057374174, 55047.72476137674, 55050.44949550533, 55052.72473637686, 55094.449055509736, 56129.43870561242, 56451.0, 56484.0, 56604.0, 56668.14997775036, 16492.83507164913, 16730.49808505747, 16738.74891876623, 16741.49775506737, 16774.83225167757, 12962.092653514352, 13200.933995329962, 14884.10695358282, 14924.0, 14926.552203433914, 13118.672033199246, 13444.663883402993, 13847.653808654864, 13851.792223116661, 13895.305234738222, 5298.0, 5373.0, 5378.112611419072, 5387.427338646845, 5416.187571864173, 1023.8668973033607, 1024.08856118055, 1031.8761748590218, 1034.798214348195, 1038.3717850700218, 29426.852865735535, 29670.258243543652, 29689.703102969124, 29758.85120574383, 30028.69971300303, 1085.267444474992, 1089.553283153919, 1112.866456025282, 1115.4367044642404, 1130.9434528273553, 14461.349239284258, 15497.690046199014, 15568.532944011698, 15571.299291531908, 15711.0, 292929.0, 293607.0, 294177.0, 294330.0, 295767.0, 57968.0, 58047.0, 58149.4185058144, 58166.12750808741, 58350.0, 1504.0900255345578, 1522.1628104542458, 1539.8999065060734, 1546.9458568950033, 1554.2228885557222, 26347.604785927844, 26731.732682672926, 27866.0, 27932.301692457037, 28026.719732802412, 41787.0, 42005.36991945062, 42009.78995105005, 42060.0, 42063.0, 261856.0, 261919.0, 262457.0, 262528.0, 264579.0, 35280.29439411249, 35475.64524354723, 35667.46498802572, 35891.820540897126, 36007.63992360043, 43771.56228437675, 44416.333754994346, 44501.0, 45422.31866522071, 45457.77271113623, 36860.0, 36920.63079369172, 36978.63021369752, 37122.07194820151, 37152.25695486021, 36614.0, 36867.0, 37042.0, 37056.814715926244, 37823.62176378201, 38540.0, 39066.609333907436, 39124.217515650096, 39429.408558872216, 39969.60030399659, 31158.22104447407, 32722.181945451553, 32791.0, 32877.0, 33261.50107748337, 25385.365365866, 25557.23328300154, 25756.87121564455, 25858.87070564635, 26240.0], "value": 19230.030780511832, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [425.25367979196506, 471.97404142772155, 485.9562639362459, 488.1920421702082, 496.0921513630057, 17790.0, 18723.71914421283, 19793.60412791743, 20722.585548289026, 20796.0, 14863.405463781435, 20486.975651217417, 22175.223867164652, 22183.334499965025, 22670.43323916903, 6691.3308669133185, 6940.097787287646, 6953.096097507317, 6955.513114082017, 7264.38252748517, 7512.43656725745, 7571.432142589328, 7582.090149182106, 7594.5822979736095, 7624.885626715603, 7441.962790186041, 7574.621268936558, 7578.393728501735, 7598.962005189994, 7599.278068583476, 7446.7765967020805, 7587.393008559302, 7617.5810330431805, 7632.580208088553, 7649.732259370923, 7238.203797582261, 7430.442716796208, 7441.55350678961, 7443.2556744325675, 7449.627518624101, 25410.618840717405, 25441.363965900815, 25937.092201772848, 26024.479510409874, 26096.217113486626, 3147.1817327494787, 3198.632157301917, 3240.0279916025097, 3303.933921321584, 3461.7922924624604, 15413.614659633487, 15869.127198004106, 16198.271077801528, 16593.253303601366, 16634.0, 2135.882526461044, 2229.955400891973, 2249.955000899989, 2295.5867943770113, 2308.0652335804025, 105785.99999999923, 126031.0, 129542.0, 130465.0, 131795.34102329522, 17198.82801171972, 18021.7296740549, 18318.816811831977, 18568.25726970933, 18810.435686929413, 31492.842535787633, 31730.524042138924, 31784.523232151536, 31805.840970794998, 32068.518972215435, 8934.106589341014, 9392.29557783169, 10085.949570252102, 10410.271281010257, 10504.527296271686, 8854.911450885409, 8876.0, 8890.86663700045, 9091.863622045674, 9094.0, 9053.411528250774, 9211.124943130391, 9275.67535136267, 9337.159655631025, 9428.481433521085, 3423.8288085595623, 3547.0954906498678, 3688.723345749026, 3726.6832319252626, 3823.655870971626, 970.1801977329145, 971.9514024298757, 974.878140232471, 981.2787601113176, 1000.049952545085, 20784.792152078284, 20968.370948871558, 21146.47133821636, 21167.470813229484, 21365.893170534047, 981.5779214937503, 986.4032260482448, 986.5659109991581, 992.3301771304341, 996.6013594562088, 10594.4702764863, 11383.772324553462, 11447.656570302905, 11490.368029758443, 11547.191696581158, 635078.0, 635502.0, 637767.0, 681328.0, 685450.0, 78029.6098519515, 81535.73857045652, 96155.51922240344, 113236.0, 115200.0, 1281.6988007818156, 1299.564645843634, 1328.926874076444, 1332.5336132353793, 1334.4928927007868, 17865.821341786417, 18175.18211680451, 18437.455134139873, 18513.35203267879, 18587.34944276944, 37060.44409333808, 44004.559954401324, 50894.745526272134, 51294.48705512897, 51331.0, 62059.6897015512, 67138.66430667815, 70913.0, 71580.64209679127, 72298.0, 11184.328940263611, 11549.595764148215, 11659.533618655498, 11724.593048834195, 11819.822702659296, 12980.415881285177, 13005.349732513525, 13052.5431609897, 13053.608391748263, 13132.540361087316, 11411.486483108114, 11585.6524304271, 11689.657922015802, 11890.881091188978, 11925.0, 11050.447477626247, 11158.665240042812, 11251.606193783178, 11352.659420217407, 11398.487068082122, 11621.883781162418, 11724.941375293069, 11987.100967427652, 12131.878681213075, 12643.431045602785, 11875.049996000127, 12078.0, 12317.876821231674, 12433.502659893504, 12681.23912565249, 11763.764724705628, 11929.463174157358, 11983.700407489883, 12008.219465734699, 12201.08491863096], "value": 11400.411629221993, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1564.8904576679622, 1569.152657564915, 1589.8251192368841, 1592.4904030710177, 1604.895681780684, 10911.618093366733, 11651.533938642444, 11664.183507154492, 11684.240524365921, 11699.239549429281, 11269.26749761265, 11494.252873563213, 11496.540138394454, 11505.137114716408, 11505.654830355083, 2395.9760402396014, 2427.927162185137, 2428.2472433545568, 2432.501337225873, 2433.6836211292507, 2327.522857814144, 2352.329586067971, 2360.657704632827, 2361.4332560185603, 2363.3737059679197, 2229.9108035678555, 2242.125571027301, 2251.0545570860277, 2259.7401298850596, 2262.6266666000174, 2217.9556408871895, 2241.0, 2245.7529671736097, 2246.86518808872, 2248.921287754929, 2234.65362868754, 2318.9796489544715, 2318.988405057981, 2319.7216334039854, 2321.2339927823778, 11448.198626096177, 11506.712332191679, 11519.827202591969, 11530.250533715282, 11533.826992595117, 5708.628939118986, 5852.180694702745, 5867.471927526543, 5867.677277749722, 5867.882642347129, 3187.5218717192374, 3384.2554637979606, 3413.74396920232, 3432.5880894292595, 3437.1922598189403, 1303.8109474126293, 1321.914075585084, 1346.0, 1399.132537826554, 1407.7466056109897, 15210.923945380313, 15559.766603500957, 16496.7525487119, 17734.55663608407, 17899.19453624577, 4623.190941585209, 4701.670883038223, 4723.126221649006, 4735.384400027974, 4756.548127927841, 12788.808167877489, 12812.42344094518, 12847.100702950704, 12858.0, 12876.098673092982, 4920.163572192736, 5033.421156567042, 5826.737796799154, 5827.475527202488, 5831.912521312183, 5349.144136938071, 5514.61397702157, 5518.365387980433, 5542.889142217133, 5543.556515478752, 4216.515100763451, 4278.935815962763, 4337.089211265669, 4338.9349159762, 4364.825406983685, 1125.060574420368, 1128.6444769897455, 1131.8358837968613, 1147.3574798113084, 1149.2759561476385, 1085.3216739537788, 1097.1599402092675, 1127.177160672697, 1131.2081542919989, 1140.9771804564027, 6963.860722785617, 7014.403775679022, 7196.568205907663, 7360.300771426706, 7487.550746955091, 1049.2078480746986, 1052.153016821466, 1073.6671631794168, 1087.1465899269035, 1098.9340639561651, 4520.88697782558, 4611.2852507861335, 4631.397918270603, 4671.369365135731, 4672.345871577982, 13921.468638449762, 14103.858961410255, 14134.151950882775, 14289.928550357181, 14338.283085845665, 14076.366563504667, 14208.289585520683, 14215.644608884653, 14446.855531444551, 14635.85364146345, 10693.465326733633, 10748.247622666495, 10913.672589822318, 10968.341899485897, 10986.176036797273, 6956.756513522205, 7104.751333703295, 7305.707771689073, 7333.523320984119, 7360.411167106511, 13124.671883202996, 13341.599752007456, 13631.79552306736, 13637.045406821824, 13681.0, 11583.247088939192, 11697.941510292394, 13063.889569386329, 13387.0, 13978.161310321413, 10007.799844003224, 10246.846297305397, 10337.224708147069, 10347.793044138925, 10371.636992705218, 10538.051575358255, 10660.520276587416, 10675.839862402225, 10754.408507531847, 10818.56725730962, 9318.0, 9796.216302695624, 9804.1666458349, 9961.40231586107, 10012.949935250277, 9439.764005899908, 9511.952440237754, 9591.040895910353, 9655.517224138905, 9779.951100244452, 8840.425372350777, 8932.642694292155, 8995.23540499065, 9022.14289642483, 9101.08989101111, 6364.172657554488, 6524.902126468011, 6608.4052435281055, 6701.229358623821, 6786.626735529593, 6690.096836926952, 6727.360900714424, 6906.930930690629, 6931.549449285982, 6970.721171153097], "value": 5431.020960085227, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [431.60508135056426, 433.67691070152733, 447.228530784397, 448.6545360072746, 449.8965237995261, 5304.416514183436, 5316.9734151329285, 5353.73231338433, 5354.678719276846, 5355.464453554648, 5229.60777941654, 5243.318368612085, 5246.213068039796, 5270.446603106676, 5288.99509093272, 4333.2416827055295, 4340.327249276367, 4470.597646211841, 4493.415855938723, 4499.977500112511, 4465.82136714531, 4473.2395492766145, 4491.0, 4492.39352687388, 4507.909841803162, 4491.505934347219, 4511.0, 4527.275635898257, 4542.704724192933, 4559.498455169929, 4334.891627709301, 4441.0, 4483.50681425043, 4489.73061616304, 4561.221123761736, 4186.162767446523, 4187.309093999486, 4189.4344263524645, 4196.853110141131, 4212.726172798758, 5120.974395128038, 5149.3305870237, 5158.432572417031, 5165.7158856262895, 5168.819091331786, 5023.899522009539, 5097.592192624581, 5139.038330552901, 5183.3002544656365, 5205.219217117425, 5456.135528847347, 5498.780048798043, 5513.173024046385, 5521.668699878021, 5532.901575117907, 4616.792244348979, 4637.675362724577, 4661.370714953472, 4662.650301227422, 4664.300354946751, 5457.536109430703, 5526.309211348582, 5625.80309689163, 5749.913751293734, 5768.615532272266, 4706.2822069944905, 4728.574428301469, 4762.714237145713, 4764.499727528629, 4825.9758701206265, 4826.903461930741, 4836.395450568679, 4856.543037088859, 4873.658843880894, 4880.755962201875, 5035.874103147451, 5129.0, 5170.6380553360905, 5191.6884986900905, 5198.532132108128, 5476.507114359727, 5487.07952216721, 5500.367457742411, 5513.448655134454, 5586.469285417878, 1646.9094199819126, 1658.2620733773597, 1663.8003439587328, 1668.357682292302, 1669.732842745155, 1233.0967807297172, 1285.13895689888, 1294.825198598196, 1299.4867027524076, 1306.4447609765812, 5293.258943747878, 5441.347038355423, 5453.0, 5477.260569823103, 5491.846712190405, 5663.886722265532, 5710.543156547466, 5721.5136713379825, 5777.653340799566, 5795.710694275822, 5473.616846820684, 5505.614606977553, 5515.586331025189, 5532.225488431623, 5574.0, 2909.8254104753782, 2977.0, 2992.8750587082977, 2999.0702882106616, 3019.7282244597654, 5727.656340619576, 5741.679413734864, 5784.305883294031, 5857.70711464425, 5859.912101318484, 5488.368837583649, 5728.226689396878, 5760.279965004374, 5760.6255593386295, 5848.181254624356, 5829.621074630136, 5849.630899485715, 5862.941370586324, 5864.501517370986, 5887.38097023322, 5685.521764341218, 5693.686847223443, 5701.771929122789, 5715.31416230055, 5719.7426115824055, 5447.155690867922, 5505.825199046274, 5559.694216817952, 5564.499195072301, 5640.915386269291, 5534.916976245279, 5655.604107712586, 5681.2330335404195, 5839.474447299764, 5850.561207909509, 4727.692699974491, 4736.431628204499, 4751.861662252069, 4756.908009793662, 4759.809607615795, 5387.892242155057, 5666.773329066791, 5687.379096957347, 5764.0, 5774.23885714861, 5519.537322609592, 5532.087205611029, 5538.196961440649, 5544.085225937675, 5561.777528898799, 5522.392536820867, 5529.751161197675, 5550.0, 5606.710456595088, 5633.408492108433, 5232.319798426332, 5454.400015998316, 5517.0, 5523.8895222096135, 5535.844568595861, 5466.753996070107, 5545.445455454423, 5564.638298510584, 5570.777168913198, 5579.525740312119, 5187.507186817246, 5406.810241852057, 5460.890782184413, 5464.977958155349, 5515.338159420895], "value": 4475.955520679116, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [794.7337641889967, 810.7486679129466, 838.3209600223819, 849.3163003781953, 877.127258377914, 17086.14569271536, 17324.393646222386, 18043.188056537456, 18057.367992120264, 18105.909470452647, 15173.468928587501, 15346.462873799419, 15398.230088495586, 15411.92294038531, 15421.614459638487, 873.9563021848913, 884.8672699095139, 895.3911340288602, 915.4827522449827, 918.4994178172878, 903.9593218305159, 906.4244204929884, 908.5321059654283, 910.2172131966504, 910.8223896340216, 931.4039015030386, 935.4714586258776, 938.5025936253796, 939.3049143633696, 939.4034787909658, 932.659579253571, 933.0995589256332, 933.1554942776764, 933.6825479337058, 933.6965486216973, 687.069021475898, 687.4225650453643, 687.7455341523619, 687.8349196192928, 688.1638808847274, 17650.823491765175, 17659.29362825498, 17687.646247075114, 18221.54446138844, 18436.354727584603, 15940.442084526985, 16052.188594234669, 16082.356705731756, 16193.838061619352, 16402.83597164037, 13257.337133143401, 13263.071584989055, 13564.93217533916, 13608.523701670492, 13681.521146759816, 3961.2473630010495, 3974.7813870237123, 4025.4163146343617, 4053.1691003344245, 4097.97951010246, 90370.0, 91071.54464227703, 91524.54237728835, 92779.53610231906, 93755.0, 11245.775084498264, 11472.0, 12272.447739851728, 12273.631791046282, 12466.626001219978, 19477.12352944121, 19845.206191752455, 19909.800901991086, 22717.88641056784, 23196.18813341525, 8328.33373330132, 8526.488410695378, 8729.345299102593, 8788.384813063152, 8947.776305592282, 4850.587700045536, 4904.313396124546, 4945.035718034948, 4946.629002824802, 5003.54968052877, 3727.7949712765517, 3828.3683192272965, 3840.0399900024995, 3840.2895464338626, 3840.731148819612, 646.1309538670481, 653.0726368556661, 653.539254825347, 664.6078813500059, 671.1409395973162, 818.2226884459787, 826.9173082691683, 828.1676914700687, 860.7073594977612, 861.8664107063415, 11403.543858245743, 11442.485088171052, 11712.004479619158, 11807.940960295144, 11820.0, 836.7698882807276, 843.371688092375, 843.8776377425239, 849.227203245044, 851.9957400213083, 5476.645319660726, 5511.118221084687, 5603.831885043455, 5613.915791263134, 5668.801591944262, 66122.33877661258, 72055.0, 81281.26827366577, 83839.5808020956, 85276.0, 74718.0, 74895.0, 77007.61496192595, 78428.0, 79587.60206198932, 53847.73076134673, 54721.0, 64583.67708161429, 66325.00512492316, 66859.66570167216, 11458.885411145782, 12256.325902075472, 12275.693107672023, 12369.93815030919, 12641.2415255085, 37678.62321376751, 41375.79312103541, 41589.58410415978, 42156.0, 42943.7852810734, 53702.731486342316, 54976.35070947878, 55944.0, 56440.0, 57768.422315777985, 13890.513832015831, 14073.507427239998, 14112.50606228777, 14217.431302747775, 14363.138211707332, 16516.0, 16822.915885420494, 17098.145092745064, 17135.05757183367, 18096.819031809515, 15397.0, 16012.199390030684, 16337.428190013292, 16413.753793693344, 16614.0, 15082.396704131712, 15640.374385024927, 15672.373105075669, 15986.680266394374, 16186.67626647484, 15295.77056344178, 15831.525054248392, 16139.435119770751, 16313.0, 16328.428505002268, 12443.315617640754, 12706.87293127057, 13093.541726039542, 13236.0, 13451.730965380833, 12816.55142070023, 12841.871581284442, 13028.739425211632, 13108.0, 13290.269035203157], "value": 8010.970819138039, "unit": "score"}]}, {"extraOptions": [], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1456.2, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [103.0, 113.0, 114.0, 112.0, 114.0, 114.0, 113.0, 113.0, 111.0, 115.0], "value": 112.2, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [142.0, 117.0, 119.0, 157.0, 123.0, 121.0, 115.0, 115.0, 139.0, 119.0], "value": 126.7, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [160.0, 161.0, 161.0, 163.0, 160.0, 162.0, 161.0, 161.0, 162.0, 160.0], "value": 161.1, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [76.0, 77.0, 74.0, 107.0, 76.0, 78.0, 76.0, 75.0, 90.0, 76.0], "value": 80.5, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [82.0, 81.0, 99.0, 81.0, 82.0, 82.0, 96.0, 82.0, 81.0, 99.0], "value": 86.5, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [113.0, 112.0, 114.0, 113.0, 114.0, 113.0, 113.0, 113.0, 113.0, 113.0], "value": 113.1, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [146.0, 149.0, 148.0, 147.0, 147.0, 146.0, 148.0, 146.0, 146.0, 146.0], "value": 146.9, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [96.0, 93.0, 94.0, 94.0, 94.0, 94.0, 94.0, 94.0, 94.0, 94.0], "value": 94.1, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [55.0, 62.0, 54.0, 55.0, 54.0, 55.0, 57.0, 54.0, 54.0, 56.0], "value": 55.6, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [53.0, 54.0, 53.0, 54.0, 53.0, 54.0, 53.0, 54.0, 54.0, 54.0], "value": 53.6, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [81.0, 75.0, 75.0, 87.0, 75.0, 79.0, 78.0, 78.0, 80.0, 79.0], "value": 78.7, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [121.0, 130.0, 122.0, 125.0, 128.0, 119.0, 119.0, 121.0, 161.0, 121.0], "value": 126.7, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [160.0, 159.0, 159.0, 158.0, 157.0, 160.0, 158.0, 169.0, 159.0, 157.0], "value": 159.6, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [62.0, 61.0, 62.0, 62.0, 60.0, 60.0, 59.0, 59.0, 63.0, 61.0], "value": 60.9, "unit": "score"}]}]} 09:17:24 INFO - Return code: 0 09:17:24 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 09:17:24 ERROR - # TBPL SUCCESS # 09:17:24 INFO - Running post-action listener: _resource_record_post_action 09:17:24 INFO - [mozharness: 2017-03-23 16:17:24.518796Z] Finished run-tests step (success) 09:17:24 INFO - Running post-run listener: _resource_record_post_run 09:17:24 INFO - Total resource usage - Wall time: 1191s; CPU: 13.0%; Read bytes: 266240; Write bytes: 370204672; Read time: 28; Write time: 301564 09:17:24 INFO - TinderboxPrint: CPU usage
13.1% 09:17:24 INFO - TinderboxPrint: I/O read bytes / time
266,240 / 28 09:17:24 INFO - TinderboxPrint: I/O write bytes / time
370,204,672 / 301,564 09:17:24 INFO - TinderboxPrint: CPU idle
8,255.0 (86.8%) 09:17:24 INFO - TinderboxPrint: CPU user
1,205.4 (12.7%) 09:17:24 INFO - TinderboxPrint: Swap in / out
0 / 0 09:17:24 INFO - install - Wall time: 17s; CPU: 13.0%; Read bytes: 0; Write bytes: 112656384; Read time: 0; Write time: 117700 09:17:24 INFO - run-tests - Wall time: 1175s; CPU: 13.0%; Read bytes: 266240; Write bytes: 257548288; Read time: 28; Write time: 183864 09:17:25 INFO - Running post-run listener: _upload_blobber_files 09:17:25 INFO - Blob upload gear active. 09:17:25 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 09:17:25 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 09:17:25 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Mozilla-Aurora', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 09:17:25 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Mozilla-Aurora -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 09:17:25 INFO - (blobuploader) - INFO - Open directory for files ... 09:17:25 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 09:17:25 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 09:17:25 INFO - (blobuploader) - INFO - Uploading, attempt #1. 09:17:26 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 09:17:26 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 09:17:26 INFO - (blobuploader) - INFO - Done attempting. 09:17:26 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 09:17:26 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 09:17:26 INFO - (blobuploader) - INFO - Uploading, attempt #1. 09:17:29 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 09:17:29 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 09:17:29 INFO - (blobuploader) - INFO - Done attempting. 09:17:29 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/perfherder-data.json ... 09:17:29 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 09:17:29 INFO - (blobuploader) - INFO - Uploading, attempt #1. 09:17:30 INFO - (blobuploader) - INFO - TinderboxPrint: perfherder-data.json: uploaded 09:17:30 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 09:17:30 INFO - (blobuploader) - INFO - Done attempting. 09:17:30 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 09:17:30 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 09:17:30 INFO - (blobuploader) - INFO - Uploading, attempt #1. 09:17:31 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 09:17:31 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 09:17:31 INFO - (blobuploader) - INFO - Done attempting. 09:17:31 INFO - (blobuploader) - INFO - Iteration through files over. 09:17:31 INFO - Return code: 0 09:17:31 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 09:17:31 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 09:17:31 INFO - Setting buildbot property blobber_files to {"perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/ff9e434675131b16c5ae1a83356e2037a3ec0e428d32f5d9d3b9296b93fd70d50add1b2c63990b99b44971e9594180d3ec4080af8d4971e574e39e715d0938c9", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/847ebf26d4644c6219664ff937608f481dd28c90dceff4a4f971f13692a4785992aa394542d398b641afb2378814ea1140dd1b88c2b1700ae02f52c338861dc8", "dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/a6204b1b068a42f527927b2fd680ced89f71d2dd0f3bba196959df931d3ce4abff123bcd4e44fd27bf9ded39cf152ae3b737226cdf2e98d3c7d1034248896c61", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/3acbc78b0ab7987a08a3b1de29ae488eedcb26b034a1fbe3957fb4cf67279b86334e9f56eb0cc33246d8869446a068d80b6b619535eb5f8eee4c92443f9b97a2"} 09:17:31 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 09:17:31 INFO - Writing to file /builds/slave/test/properties/blobber_files 09:17:31 INFO - Contents: 09:17:31 INFO - blobber_files:{"perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/ff9e434675131b16c5ae1a83356e2037a3ec0e428d32f5d9d3b9296b93fd70d50add1b2c63990b99b44971e9594180d3ec4080af8d4971e574e39e715d0938c9", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/847ebf26d4644c6219664ff937608f481dd28c90dceff4a4f971f13692a4785992aa394542d398b641afb2378814ea1140dd1b88c2b1700ae02f52c338861dc8", "dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/a6204b1b068a42f527927b2fd680ced89f71d2dd0f3bba196959df931d3ce4abff123bcd4e44fd27bf9ded39cf152ae3b737226cdf2e98d3c7d1034248896c61", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/3acbc78b0ab7987a08a3b1de29ae488eedcb26b034a1fbe3957fb4cf67279b86334e9f56eb0cc33246d8869446a068d80b6b619535eb5f8eee4c92443f9b97a2"} 09:17:31 INFO - Running post-run listener: copy_logs_to_upload_dir 09:17:31 INFO - Copying logs to upload dir... 09:17:31 INFO - mkdir: /builds/slave/test/build/upload/logs 09:17:31 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1253.040827 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 53 secs) (at 2017-03-23 09:17:31.186991) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-03-23 09:17:31.190683) ========= 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=2c5dd2b0a310ecf02fd87158000001b4-1490284596.745172-725811385 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/ff9e434675131b16c5ae1a83356e2037a3ec0e428d32f5d9d3b9296b93fd70d50add1b2c63990b99b44971e9594180d3ec4080af8d4971e574e39e715d0938c9", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/847ebf26d4644c6219664ff937608f481dd28c90dceff4a4f971f13692a4785992aa394542d398b641afb2378814ea1140dd1b88c2b1700ae02f52c338861dc8", "dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/a6204b1b068a42f527927b2fd680ced89f71d2dd0f3bba196959df931d3ce4abff123bcd4e44fd27bf9ded39cf152ae3b737226cdf2e98d3c7d1034248896c61", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/3acbc78b0ab7987a08a3b1de29ae488eedcb26b034a1fbe3957fb4cf67279b86334e9f56eb0cc33246d8869446a068d80b6b619535eb5f8eee4c92443f9b97a2"} build_url:https://queue.taskcluster.net/v1/task/dywW6IdcSMqTUQR9vFXpeQ/artifacts/public/build/target.tar.bz2 program finished with exit code 0 elapsedTime=0.011289 build_url: 'https://queue.taskcluster.net/v1/task/dywW6IdcSMqTUQR9vFXpeQ/artifacts/public/build/target.tar.bz2' blobber_files: '{"perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/ff9e434675131b16c5ae1a83356e2037a3ec0e428d32f5d9d3b9296b93fd70d50add1b2c63990b99b44971e9594180d3ec4080af8d4971e574e39e715d0938c9", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/847ebf26d4644c6219664ff937608f481dd28c90dceff4a4f971f13692a4785992aa394542d398b641afb2378814ea1140dd1b88c2b1700ae02f52c338861dc8", "dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/a6204b1b068a42f527927b2fd680ced89f71d2dd0f3bba196959df931d3ce4abff123bcd4e44fd27bf9ded39cf152ae3b737226cdf2e98d3c7d1034248896c61", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/3acbc78b0ab7987a08a3b1de29ae488eedcb26b034a1fbe3957fb4cf67279b86334e9f56eb0cc33246d8869446a068d80b6b619535eb5f8eee4c92443f9b97a2"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-03-23 09:17:31.218796) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-03-23 09:17:31.219202) ========= 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=2c5dd2b0a310ecf02fd87158000001b4-1490284596.745172-725811385 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004459 ========= master_lag: 0.07 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-03-23 09:17:31.298081) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2017-03-23 09:17:31.298396) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2017-03-23 09:17:31.298682) ========= ========= Total master_lag: 0.16 =========